{"level":"warn","ts":"2026-06-15T13:55:11.733949Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-15T13:55:11.734071Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.169:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.169:2380","--initial-cluster=instance=https://199.204.45.169:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.169:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.169:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-06-15T13:55:11.734161Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-15T13:55:11.734184Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.169:2380"]} {"level":"info","ts":"2026-06-15T13:55:11.734209Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-06-15T13:55:11.735117Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.169:2379"]} {"level":"info","ts":"2026-06-15T13:55:11.735234Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.169:2380"],"listen-peer-urls":["https://199.204.45.169:2380"],"advertise-client-urls":["https://199.204.45.169:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.169:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.169:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-06-15T13:55:11.741693Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"6.156732ms"} {"level":"info","ts":"2026-06-15T13:55:11.750005Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"1c917701ce165bac","cluster-id":"bfb5247022b87cb1"} {"level":"info","ts":"2026-06-15T13:55:11.750113Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac switched to configuration voters=()"} {"level":"info","ts":"2026-06-15T13:55:11.750152Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac became follower at term 0"} {"level":"info","ts":"2026-06-15T13:55:11.750174Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 1c917701ce165bac [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-06-15T13:55:11.750198Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac became follower at term 1"} {"level":"info","ts":"2026-06-15T13:55:11.750254Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac switched to configuration voters=(2058557354321271724)"} {"level":"warn","ts":"2026-06-15T13:55:11.755808Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-06-15T13:55:11.757955Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-06-15T13:55:11.759096Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-06-15T13:55:11.761728Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"1c917701ce165bac","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-06-15T13:55:11.762206Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"1c917701ce165bac","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-06-15T13:55:11.76212Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-15T13:55:11.762453Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-15T13:55:11.762666Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-15T13:55:11.764118Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac switched to configuration voters=(2058557354321271724)"} {"level":"info","ts":"2026-06-15T13:55:11.764798Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"bfb5247022b87cb1","local-member-id":"1c917701ce165bac","added-peer-id":"1c917701ce165bac","added-peer-peer-urls":["https://199.204.45.169:2380"]} {"level":"info","ts":"2026-06-15T13:55:11.766538Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-06-15T13:55:11.766978Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"1c917701ce165bac","initial-advertise-peer-urls":["https://199.204.45.169:2380"],"listen-peer-urls":["https://199.204.45.169:2380"],"advertise-client-urls":["https://199.204.45.169:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.169:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-06-15T13:55:11.767015Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-06-15T13:55:11.768575Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.169:2380"} {"level":"info","ts":"2026-06-15T13:55:11.768617Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.169:2380"} {"level":"info","ts":"2026-06-15T13:55:12.151145Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac is starting a new election at term 1"} {"level":"info","ts":"2026-06-15T13:55:12.151223Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac became pre-candidate at term 1"} {"level":"info","ts":"2026-06-15T13:55:12.151246Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac received MsgPreVoteResp from 1c917701ce165bac at term 1"} {"level":"info","ts":"2026-06-15T13:55:12.151266Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac became candidate at term 2"} {"level":"info","ts":"2026-06-15T13:55:12.151277Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac received MsgVoteResp from 1c917701ce165bac at term 2"} {"level":"info","ts":"2026-06-15T13:55:12.151359Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1c917701ce165bac became leader at term 2"} {"level":"info","ts":"2026-06-15T13:55:12.151373Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 1c917701ce165bac elected leader 1c917701ce165bac at term 2"} {"level":"info","ts":"2026-06-15T13:55:12.152383Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"1c917701ce165bac","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.169:2379]}","request-path":"/0/members/1c917701ce165bac/attributes","cluster-id":"bfb5247022b87cb1","publish-timeout":"7s"} {"level":"info","ts":"2026-06-15T13:55:12.152413Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-06-15T13:55:12.152467Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-15T13:55:12.152751Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-06-15T13:55:12.152794Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-06-15T13:55:12.152587Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-15T13:55:12.154521Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"bfb5247022b87cb1","local-member-id":"1c917701ce165bac","cluster-version":"3.5"} {"level":"info","ts":"2026-06-15T13:55:12.154704Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-06-15T13:55:12.154803Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-06-15T13:55:12.157871Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-06-15T13:55:12.174656Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.169:2379"} {"level":"info","ts":"2026-06-15T13:55:30.054153Z","caller":"traceutil/trace.go:171","msg":"trace[453692786] transaction","detail":"{read_only:false; response_revision:417; number_of_response:1; }","duration":"115.411479ms","start":"2026-06-15T13:55:29.938697Z","end":"2026-06-15T13:55:30.054108Z","steps":["trace[453692786] 'process raft request' (duration: 115.269277ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:55:30.510984Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.764863ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"warn","ts":"2026-06-15T13:55:30.511462Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"209.541411ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-06-15T13:55:30.511513Z","caller":"traceutil/trace.go:171","msg":"trace[2008368482] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:417; }","duration":"209.640884ms","start":"2026-06-15T13:55:30.301859Z","end":"2026-06-15T13:55:30.5115Z","steps":["trace[2008368482] 'agreement among raft nodes before linearized reading' (duration: 209.519101ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:55:30.511329Z","caller":"traceutil/trace.go:171","msg":"trace[1478299090] linearizableReadLoop","detail":"{readStateIndex:433; appliedIndex:432; }","duration":"209.226766ms","start":"2026-06-15T13:55:30.301903Z","end":"2026-06-15T13:55:30.51113Z","steps":["trace[1478299090] 'read index received' (duration: 55.123176ms)","trace[1478299090] 'applied index is now lower than readState.Index' (duration: 154.1013ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T13:55:49.171218Z","caller":"traceutil/trace.go:171","msg":"trace[1898777918] transaction","detail":"{read_only:false; response_revision:546; number_of_response:1; }","duration":"112.351198ms","start":"2026-06-15T13:55:49.058841Z","end":"2026-06-15T13:55:49.171192Z","steps":["trace[1898777918] 'process raft request' (duration: 108.121548ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:55:49.18274Z","caller":"traceutil/trace.go:171","msg":"trace[248250698] transaction","detail":"{read_only:false; response_revision:547; number_of_response:1; }","duration":"123.066166ms","start":"2026-06-15T13:55:49.059651Z","end":"2026-06-15T13:55:49.182717Z","steps":["trace[248250698] 'process raft request' (duration: 119.614218ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:55:49.183133Z","caller":"traceutil/trace.go:171","msg":"trace[1610581782] transaction","detail":"{read_only:false; number_of_response:1; response_revision:547; }","duration":"114.548264ms","start":"2026-06-15T13:55:49.068572Z","end":"2026-06-15T13:55:49.18312Z","steps":["trace[1610581782] 'process raft request' (duration: 111.084646ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:55:49.184315Z","caller":"traceutil/trace.go:171","msg":"trace[1776705123] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"112.967508ms","start":"2026-06-15T13:55:49.070911Z","end":"2026-06-15T13:55:49.183879Z","steps":["trace[1776705123] 'process raft request' (duration: 111.541604ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:55:49.184819Z","caller":"traceutil/trace.go:171","msg":"trace[2112122514] linearizableReadLoop","detail":"{readStateIndex:571; appliedIndex:567; }","duration":"112.531341ms","start":"2026-06-15T13:55:49.072248Z","end":"2026-06-15T13:55:49.184779Z","steps":["trace[2112122514] 'read index received' (duration: 94.725946ms)","trace[2112122514] 'applied index is now lower than readState.Index' (duration: 17.804775ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T13:55:49.184986Z","caller":"traceutil/trace.go:171","msg":"trace[1387619468] transaction","detail":"{read_only:false; response_revision:549; number_of_response:1; }","duration":"112.374888ms","start":"2026-06-15T13:55:49.072558Z","end":"2026-06-15T13:55:49.184933Z","steps":["trace[1387619468] 'process raft request' (duration: 112.046912ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:55:49.185162Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.898836ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/tcproutes.gateway.networking.k8s.io\" ","response":"range_response_count:1 size:30408"} {"level":"info","ts":"2026-06-15T13:55:49.185477Z","caller":"traceutil/trace.go:171","msg":"trace[103493729] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/tcproutes.gateway.networking.k8s.io; range_end:; response_count:1; response_revision:550; }","duration":"113.222402ms","start":"2026-06-15T13:55:49.072214Z","end":"2026-06-15T13:55:49.185437Z","steps":["trace[103493729] 'agreement among raft nodes before linearized reading' (duration: 112.811745ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:55:54.872871Z","caller":"traceutil/trace.go:171","msg":"trace[1347319034] transaction","detail":"{read_only:false; response_revision:630; number_of_response:1; }","duration":"114.825445ms","start":"2026-06-15T13:55:54.758017Z","end":"2026-06-15T13:55:54.872842Z","steps":["trace[1347319034] 'process raft request' (duration: 79.698841ms)","trace[1347319034] 'compare' (duration: 34.983062ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T13:55:55.078188Z","caller":"traceutil/trace.go:171","msg":"trace[1817957462] transaction","detail":"{read_only:false; response_revision:631; number_of_response:1; }","duration":"183.679336ms","start":"2026-06-15T13:55:54.894486Z","end":"2026-06-15T13:55:55.078165Z","steps":["trace[1817957462] 'process raft request' (duration: 183.504103ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:55:55.301635Z","caller":"traceutil/trace.go:171","msg":"trace[210742349] linearizableReadLoop","detail":"{readStateIndex:656; appliedIndex:654; }","duration":"225.31529ms","start":"2026-06-15T13:55:55.076296Z","end":"2026-06-15T13:55:55.301611Z","steps":["trace[210742349] 'read index received' (duration: 1.760859ms)","trace[210742349] 'applied index is now lower than readState.Index' (duration: 223.553421ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T13:55:55.301769Z","caller":"traceutil/trace.go:171","msg":"trace[1047480080] transaction","detail":"{read_only:false; response_revision:632; number_of_response:1; }","duration":"364.345017ms","start":"2026-06-15T13:55:54.937412Z","end":"2026-06-15T13:55:55.301757Z","steps":["trace[1047480080] 'process raft request' (duration: 363.680846ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:55:55.301984Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.723133ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-15T13:55:55.302085Z","caller":"traceutil/trace.go:171","msg":"trace[177967813] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:632; }","duration":"129.859375ms","start":"2026-06-15T13:55:55.172201Z","end":"2026-06-15T13:55:55.302061Z","steps":["trace[177967813] 'agreement among raft nodes before linearized reading' (duration: 129.685532ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:55:55.30212Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"225.782988ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.169\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-06-15T13:55:55.302218Z","caller":"traceutil/trace.go:171","msg":"trace[1386524187] range","detail":"{range_begin:/registry/masterleases/199.204.45.169; range_end:; response_count:1; response_revision:632; }","duration":"225.93185ms","start":"2026-06-15T13:55:55.076258Z","end":"2026-06-15T13:55:55.30219Z","steps":["trace[1386524187] 'agreement among raft nodes before linearized reading' (duration: 225.724296ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:55:55.302363Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-15T13:55:54.937381Z","time spent":"364.421178ms","remote":"127.0.0.1:37838","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036285,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-15T13:55:55.907574Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.000657ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-06-15T13:55:55.907708Z","caller":"traceutil/trace.go:171","msg":"trace[785329462] linearizableReadLoop","detail":"{readStateIndex:659; appliedIndex:658; }","duration":"309.256716ms","start":"2026-06-15T13:55:55.598433Z","end":"2026-06-15T13:55:55.907689Z","steps":["trace[785329462] 'read index received' (duration: 97.907644ms)","trace[785329462] 'applied index is now lower than readState.Index' (duration: 211.347392ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T13:55:55.907746Z","caller":"traceutil/trace.go:171","msg":"trace[1317189881] transaction","detail":"{read_only:false; response_revision:634; number_of_response:1; }","duration":"549.822555ms","start":"2026-06-15T13:55:55.357882Z","end":"2026-06-15T13:55:55.907705Z","steps":["trace[1317189881] 'process raft request' (duration: 338.584265ms)","trace[1317189881] 'compare' (duration: 210.55356ms)"],"step_count":2} {"level":"warn","ts":"2026-06-15T13:55:55.907932Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"309.489951ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-15T13:55:55.907964Z","caller":"traceutil/trace.go:171","msg":"trace[1371417606] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:634; }","duration":"309.610913ms","start":"2026-06-15T13:55:55.598343Z","end":"2026-06-15T13:55:55.907954Z","steps":["trace[1371417606] 'agreement among raft nodes before linearized reading' (duration: 309.39042ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:55:55.907994Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-15T13:55:55.598318Z","time spent":"309.669613ms","remote":"127.0.0.1:38014","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-06-15T13:55:55.908183Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-15T13:55:55.357866Z","time spent":"549.975858ms","remote":"127.0.0.1:38262","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1627,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-15T13:57:11.469919Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.224085ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-15T13:57:11.470066Z","caller":"traceutil/trace.go:171","msg":"trace[2006109544] range","detail":"{range_begin:/registry/flowschemas/; range_end:/registry/flowschemas0; response_count:0; response_revision:1491; }","duration":"129.39676ms","start":"2026-06-15T13:57:11.340649Z","end":"2026-06-15T13:57:11.470046Z","steps":["trace[2006109544] 'count revisions from in-memory index tree' (duration: 129.081751ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:57:36.764982Z","caller":"traceutil/trace.go:171","msg":"trace[1696852374] linearizableReadLoop","detail":"{readStateIndex:1985; appliedIndex:1984; }","duration":"359.125354ms","start":"2026-06-15T13:57:36.405826Z","end":"2026-06-15T13:57:36.764951Z","steps":["trace[1696852374] 'read index received' (duration: 358.885137ms)","trace[1696852374] 'applied index is now lower than readState.Index' (duration: 238.766µs)"],"step_count":2} {"level":"info","ts":"2026-06-15T13:57:36.765143Z","caller":"traceutil/trace.go:171","msg":"trace[759820480] transaction","detail":"{read_only:false; response_revision:1909; number_of_response:1; }","duration":"388.065125ms","start":"2026-06-15T13:57:36.377066Z","end":"2026-06-15T13:57:36.765131Z","steps":["trace[759820480] 'process raft request' (duration: 387.704857ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:57:36.765263Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-15T13:57:36.377038Z","time spent":"388.143077ms","remote":"127.0.0.1:37934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":10967,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-15T13:57:36.76544Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.938418ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-15T13:57:36.765492Z","caller":"traceutil/trace.go:171","msg":"trace[1631584424] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:1909; }","duration":"131.032129ms","start":"2026-06-15T13:57:36.634447Z","end":"2026-06-15T13:57:36.765479Z","steps":["trace[1631584424] 'agreement among raft nodes before linearized reading' (duration: 130.931096ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:57:36.76557Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.231121ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-06-15T13:57:36.765666Z","caller":"traceutil/trace.go:171","msg":"trace[1176815037] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1909; }","duration":"114.380675ms","start":"2026-06-15T13:57:36.651265Z","end":"2026-06-15T13:57:36.765645Z","steps":["trace[1176815037] 'agreement among raft nodes before linearized reading' (duration: 114.073788ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:57:36.765666Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"359.821959ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-15T13:57:36.765786Z","caller":"traceutil/trace.go:171","msg":"trace[743499189] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1909; }","duration":"359.975853ms","start":"2026-06-15T13:57:36.405788Z","end":"2026-06-15T13:57:36.765764Z","steps":["trace[743499189] 'agreement among raft nodes before linearized reading' (duration: 359.650926ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:57:36.765841Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-15T13:57:36.405775Z","time spent":"360.057035ms","remote":"127.0.0.1:38014","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-06-15T13:57:36.766677Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"351.111303ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-a740c955-7ae8-40b9-a222-91fb15d1ff59\" ","response":"range_response_count:1 size:3627"} {"level":"info","ts":"2026-06-15T13:57:36.766773Z","caller":"traceutil/trace.go:171","msg":"trace[1184712009] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-a740c955-7ae8-40b9-a222-91fb15d1ff59; range_end:; response_count:1; response_revision:1909; }","duration":"351.254495ms","start":"2026-06-15T13:57:36.4155Z","end":"2026-06-15T13:57:36.766755Z","steps":["trace[1184712009] 'agreement among raft nodes before linearized reading' (duration: 349.979457ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:57:36.767076Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-15T13:57:36.41549Z","time spent":"351.566962ms","remote":"127.0.0.1:37934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":1,"response size":3650,"request content":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-a740c955-7ae8-40b9-a222-91fb15d1ff59\" "} {"level":"info","ts":"2026-06-15T13:57:36.90931Z","caller":"traceutil/trace.go:171","msg":"trace[45117859] transaction","detail":"{read_only:false; response_revision:1911; number_of_response:1; }","duration":"137.307261ms","start":"2026-06-15T13:57:36.771962Z","end":"2026-06-15T13:57:36.909269Z","steps":["trace[45117859] 'process raft request' (duration: 137.004604ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:57:36.9094Z","caller":"traceutil/trace.go:171","msg":"trace[1057509859] transaction","detail":"{read_only:false; response_revision:1914; number_of_response:1; }","duration":"136.143374ms","start":"2026-06-15T13:57:36.773248Z","end":"2026-06-15T13:57:36.909391Z","steps":["trace[1057509859] 'process raft request' (duration: 136.002841ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:57:36.909395Z","caller":"traceutil/trace.go:171","msg":"trace[893969869] transaction","detail":"{read_only:false; response_revision:1913; number_of_response:1; }","duration":"136.339509ms","start":"2026-06-15T13:57:36.773039Z","end":"2026-06-15T13:57:36.909379Z","steps":["trace[893969869] 'process raft request' (duration: 136.161765ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:57:36.909511Z","caller":"traceutil/trace.go:171","msg":"trace[699735240] transaction","detail":"{read_only:false; response_revision:1915; number_of_response:1; }","duration":"136.027592ms","start":"2026-06-15T13:57:36.773475Z","end":"2026-06-15T13:57:36.909503Z","steps":["trace[699735240] 'process raft request' (duration: 135.823197ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:57:36.909597Z","caller":"traceutil/trace.go:171","msg":"trace[484190974] transaction","detail":"{read_only:false; response_revision:1916; number_of_response:1; }","duration":"133.765201ms","start":"2026-06-15T13:57:36.775799Z","end":"2026-06-15T13:57:36.909564Z","steps":["trace[484190974] 'process raft request' (duration: 133.533376ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:57:36.909336Z","caller":"traceutil/trace.go:171","msg":"trace[328562641] transaction","detail":"{read_only:false; response_revision:1912; number_of_response:1; }","duration":"136.955203ms","start":"2026-06-15T13:57:36.772358Z","end":"2026-06-15T13:57:36.909313Z","steps":["trace[328562641] 'process raft request' (duration: 136.763409ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:57:37.035431Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.982248ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-a740c955-7ae8-40b9-a222-91fb15d1ff59\" ","response":"range_response_count:1 size:3747"} {"level":"info","ts":"2026-06-15T13:57:37.035562Z","caller":"traceutil/trace.go:171","msg":"trace[612479706] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-a740c955-7ae8-40b9-a222-91fb15d1ff59; range_end:; response_count:1; response_revision:1916; }","duration":"120.168722ms","start":"2026-06-15T13:57:36.915373Z","end":"2026-06-15T13:57:37.035542Z","steps":["trace[612479706] 'range keys from in-memory index tree' (duration: 119.849585ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:57:37.09901Z","caller":"traceutil/trace.go:171","msg":"trace[891003564] transaction","detail":"{read_only:false; response_revision:1917; number_of_response:1; }","duration":"158.151182ms","start":"2026-06-15T13:57:36.940833Z","end":"2026-06-15T13:57:37.098984Z","steps":["trace[891003564] 'process raft request' (duration: 157.954987ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:57:37.145223Z","caller":"traceutil/trace.go:171","msg":"trace[1620374520] transaction","detail":"{read_only:false; response_revision:1918; number_of_response:1; }","duration":"160.196374ms","start":"2026-06-15T13:57:36.984986Z","end":"2026-06-15T13:57:37.145182Z","steps":["trace[1620374520] 'process raft request' (duration: 151.459969ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:58:11.212791Z","caller":"traceutil/trace.go:171","msg":"trace[31408765] transaction","detail":"{read_only:false; response_revision:2153; number_of_response:1; }","duration":"154.512297ms","start":"2026-06-15T13:58:11.058252Z","end":"2026-06-15T13:58:11.212764Z","steps":["trace[31408765] 'process raft request' (duration: 145.187616ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:58:11.737359Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.734792ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-15T13:58:11.737607Z","caller":"traceutil/trace.go:171","msg":"trace[1958888356] linearizableReadLoop","detail":"{readStateIndex:2239; appliedIndex:2238; }","duration":"255.361787ms","start":"2026-06-15T13:58:11.482226Z","end":"2026-06-15T13:58:11.737588Z","steps":["trace[1958888356] 'read index received' (duration: 75.131044ms)","trace[1958888356] 'applied index is now lower than readState.Index' (duration: 180.229613ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T13:58:11.737587Z","caller":"traceutil/trace.go:171","msg":"trace[690507105] transaction","detail":"{read_only:false; response_revision:2156; number_of_response:1; }","duration":"265.30653ms","start":"2026-06-15T13:58:11.472221Z","end":"2026-06-15T13:58:11.737527Z","steps":["trace[690507105] 'process raft request' (duration: 85.105319ms)","trace[690507105] 'compare' (duration: 179.478117ms)"],"step_count":2} {"level":"warn","ts":"2026-06-15T13:58:11.737894Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"255.659843ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5412"} {"level":"info","ts":"2026-06-15T13:58:11.73794Z","caller":"traceutil/trace.go:171","msg":"trace[115256030] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2157; }","duration":"255.743895ms","start":"2026-06-15T13:58:11.482184Z","end":"2026-06-15T13:58:11.737927Z","steps":["trace[115256030] 'agreement among raft nodes before linearized reading' (duration: 255.477049ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:58:12.099485Z","caller":"traceutil/trace.go:171","msg":"trace[571055124] transaction","detail":"{read_only:false; response_revision:2158; number_of_response:1; }","duration":"263.664332ms","start":"2026-06-15T13:58:11.835795Z","end":"2026-06-15T13:58:12.09946Z","steps":["trace[571055124] 'process raft request' (duration: 263.484278ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:58:12.107107Z","caller":"traceutil/trace.go:171","msg":"trace[1167217698] linearizableReadLoop","detail":"{readStateIndex:2242; appliedIndex:2240; }","duration":"114.180507ms","start":"2026-06-15T13:58:11.992904Z","end":"2026-06-15T13:58:12.107084Z","steps":["trace[1167217698] 'read index received' (duration: 106.332487ms)","trace[1167217698] 'applied index is now lower than readState.Index' (duration: 7.84703ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T13:58:12.107182Z","caller":"traceutil/trace.go:171","msg":"trace[1566484556] transaction","detail":"{read_only:false; response_revision:2159; number_of_response:1; }","duration":"157.207237ms","start":"2026-06-15T13:58:11.949941Z","end":"2026-06-15T13:58:12.107148Z","steps":["trace[1566484556] 'process raft request' (duration: 157.019204ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:58:12.107462Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.538686ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-06-15T13:58:12.107515Z","caller":"traceutil/trace.go:171","msg":"trace[339097341] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2159; }","duration":"114.642718ms","start":"2026-06-15T13:58:11.992857Z","end":"2026-06-15T13:58:12.1075Z","steps":["trace[339097341] 'agreement among raft nodes before linearized reading' (duration: 114.311451ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:59:15.649101Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.61736ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/auth-system/keycloak-metrics\" ","response":"range_response_count:1 size:1447"} {"level":"info","ts":"2026-06-15T13:59:15.649151Z","caller":"traceutil/trace.go:171","msg":"trace[1316383256] range","detail":"{range_begin:/registry/services/specs/auth-system/keycloak-metrics; range_end:; response_count:1; response_revision:2601; }","duration":"229.70957ms","start":"2026-06-15T13:59:15.419432Z","end":"2026-06-15T13:59:15.649141Z","steps":["trace[1316383256] 'range keys from in-memory index tree' (duration: 229.472116ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T13:59:15.649914Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"152.277817ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-06-15T13:59:15.649988Z","caller":"traceutil/trace.go:171","msg":"trace[2020075681] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2601; }","duration":"152.389149ms","start":"2026-06-15T13:59:15.497583Z","end":"2026-06-15T13:59:15.649972Z","steps":["trace[2020075681] 'range keys from in-memory index tree' (duration: 152.198286ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T13:59:48.686468Z","caller":"traceutil/trace.go:171","msg":"trace[778008589] transaction","detail":"{read_only:false; response_revision:2786; number_of_response:1; }","duration":"253.55204ms","start":"2026-06-15T13:59:48.432897Z","end":"2026-06-15T13:59:48.68645Z","steps":["trace[778008589] 'process raft request' (duration: 245.477062ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:30.763963Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.179116ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/monitoring/\" range_end:\"/registry/configmaps/monitoring0\" ","response":"range_response_count:47 size:2206973"} {"level":"info","ts":"2026-06-15T14:03:30.764058Z","caller":"traceutil/trace.go:171","msg":"trace[261561508] range","detail":"{range_begin:/registry/configmaps/monitoring/; range_end:/registry/configmaps/monitoring0; response_count:47; response_revision:4578; }","duration":"119.32486ms","start":"2026-06-15T14:03:30.644715Z","end":"2026-06-15T14:03:30.76404Z","steps":["trace[261561508] 'range keys from in-memory index tree' (duration: 118.258632ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:03:32.380433Z","caller":"traceutil/trace.go:171","msg":"trace[256615875] linearizableReadLoop","detail":"{readStateIndex:4783; appliedIndex:4782; }","duration":"114.578946ms","start":"2026-06-15T14:03:32.265826Z","end":"2026-06-15T14:03:32.380405Z","steps":["trace[256615875] 'read index received' (duration: 114.360101ms)","trace[256615875] 'applied index is now lower than readState.Index' (duration: 217.205µs)"],"step_count":2} {"level":"info","ts":"2026-06-15T14:03:32.380539Z","caller":"traceutil/trace.go:171","msg":"trace[1980541995] transaction","detail":"{read_only:false; response_revision:4607; number_of_response:1; }","duration":"117.950395ms","start":"2026-06-15T14:03:32.262555Z","end":"2026-06-15T14:03:32.380506Z","steps":["trace[1980541995] 'process raft request' (duration: 117.725588ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:32.380632Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.788061ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-generated\" ","response":"range_response_count:1 size:1343"} {"level":"info","ts":"2026-06-15T14:03:32.380678Z","caller":"traceutil/trace.go:171","msg":"trace[118008336] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-generated; range_end:; response_count:1; response_revision:4607; }","duration":"114.881315ms","start":"2026-06-15T14:03:32.265786Z","end":"2026-06-15T14:03:32.380667Z","steps":["trace[118008336] 'agreement among raft nodes before linearized reading' (duration: 114.70612ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:33.687228Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.949509ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/monitoring/kube-prometheus-stack-kube-state-metrics-5c97764fc9-7trp2\" ","response":"range_response_count:1 size:5151"} {"level":"info","ts":"2026-06-15T14:03:33.687329Z","caller":"traceutil/trace.go:171","msg":"trace[1156823987] range","detail":"{range_begin:/registry/pods/monitoring/kube-prometheus-stack-kube-state-metrics-5c97764fc9-7trp2; range_end:; response_count:1; response_revision:4640; }","duration":"128.121354ms","start":"2026-06-15T14:03:33.559185Z","end":"2026-06-15T14:03:33.687306Z","steps":["trace[1156823987] 'range keys from in-memory index tree' (duration: 127.758504ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:33.687664Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"178.671574ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-15T14:03:33.687806Z","caller":"traceutil/trace.go:171","msg":"trace[1925199515] range","detail":"{range_begin:/registry/statefulsets/; range_end:/registry/statefulsets0; response_count:0; response_revision:4640; }","duration":"178.860418ms","start":"2026-06-15T14:03:33.50893Z","end":"2026-06-15T14:03:33.68779Z","steps":["trace[1925199515] 'count revisions from in-memory index tree' (duration: 178.594072ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:39.114617Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.494266ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-15T14:03:39.11511Z","caller":"traceutil/trace.go:171","msg":"trace[1669691187] transaction","detail":"{read_only:false; response_revision:4769; number_of_response:1; }","duration":"262.414537ms","start":"2026-06-15T14:03:38.852642Z","end":"2026-06-15T14:03:39.115056Z","steps":["trace[1669691187] 'process raft request' (duration: 134.345707ms)","trace[1669691187] 'compare' (duration: 127.318251ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T14:03:39.139123Z","caller":"traceutil/trace.go:171","msg":"trace[2007899034] linearizableReadLoop","detail":"{readStateIndex:4950; appliedIndex:4948; }","duration":"158.012851ms","start":"2026-06-15T14:03:38.981091Z","end":"2026-06-15T14:03:39.139104Z","steps":["trace[2007899034] 'read index received' (duration: 5.888421ms)","trace[2007899034] 'applied index is now lower than readState.Index' (duration: 152.12367ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T14:03:39.13917Z","caller":"traceutil/trace.go:171","msg":"trace[1122436776] transaction","detail":"{read_only:false; response_revision:4770; number_of_response:1; }","duration":"283.827137ms","start":"2026-06-15T14:03:38.85532Z","end":"2026-06-15T14:03:39.139147Z","steps":["trace[1122436776] 'process raft request' (duration: 283.699734ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:39.139286Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.217505ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"} {"level":"info","ts":"2026-06-15T14:03:39.139313Z","caller":"traceutil/trace.go:171","msg":"trace[2092007396] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4770; }","duration":"158.292017ms","start":"2026-06-15T14:03:38.981012Z","end":"2026-06-15T14:03:39.139304Z","steps":["trace[2092007396] 'agreement among raft nodes before linearized reading' (duration: 158.186214ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:39.139366Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.630731ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-06-15T14:03:39.139369Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.454126ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"info","ts":"2026-06-15T14:03:39.139401Z","caller":"traceutil/trace.go:171","msg":"trace[439388282] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4770; }","duration":"122.703451ms","start":"2026-06-15T14:03:39.016689Z","end":"2026-06-15T14:03:39.139392Z","steps":["trace[439388282] 'agreement among raft nodes before linearized reading' (duration: 122.595119ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:03:39.139683Z","caller":"traceutil/trace.go:171","msg":"trace[574348823] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4770; }","duration":"143.571378ms","start":"2026-06-15T14:03:38.995879Z","end":"2026-06-15T14:03:39.13945Z","steps":["trace[574348823] 'agreement among raft nodes before linearized reading' (duration: 143.388813ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:03:39.271868Z","caller":"traceutil/trace.go:171","msg":"trace[162922373] transaction","detail":"{read_only:false; response_revision:4772; number_of_response:1; }","duration":"128.417738ms","start":"2026-06-15T14:03:39.143435Z","end":"2026-06-15T14:03:39.271853Z","steps":["trace[162922373] 'process raft request' (duration: 119.576551ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:03:39.271968Z","caller":"traceutil/trace.go:171","msg":"trace[1052702510] linearizableReadLoop","detail":"{readStateIndex:4953; appliedIndex:4950; }","duration":"114.04503ms","start":"2026-06-15T14:03:39.157906Z","end":"2026-06-15T14:03:39.271951Z","steps":["trace[1052702510] 'read index received' (duration: 19.573183ms)","trace[1052702510] 'applied index is now lower than readState.Index' (duration: 94.471367ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T14:03:39.272086Z","caller":"traceutil/trace.go:171","msg":"trace[1983051145] transaction","detail":"{read_only:false; response_revision:4773; number_of_response:1; }","duration":"127.805404ms","start":"2026-06-15T14:03:39.144252Z","end":"2026-06-15T14:03:39.272058Z","steps":["trace[1983051145] 'process raft request' (duration: 127.548927ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:39.272155Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.240375ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-f4a48dd0-cd2f-4325-965f-bb03349137b6\" ","response":"range_response_count:1 size:3646"} {"level":"info","ts":"2026-06-15T14:03:39.272198Z","caller":"traceutil/trace.go:171","msg":"trace[65575586] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-f4a48dd0-cd2f-4325-965f-bb03349137b6; range_end:; response_count:1; response_revision:4773; }","duration":"114.321547ms","start":"2026-06-15T14:03:39.157862Z","end":"2026-06-15T14:03:39.272184Z","steps":["trace[65575586] 'agreement among raft nodes before linearized reading' (duration: 114.177433ms)"],"step_count":1} {"level":"warn","ts":"2026-06-15T14:03:39.28131Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.327153ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-15T14:03:39.281359Z","caller":"traceutil/trace.go:171","msg":"trace[1185457478] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4775; }","duration":"108.406964ms","start":"2026-06-15T14:03:39.17294Z","end":"2026-06-15T14:03:39.281347Z","steps":["trace[1185457478] 'agreement among raft nodes before linearized reading' (duration: 108.293831ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:03:39.549507Z","caller":"traceutil/trace.go:171","msg":"trace[1548502518] transaction","detail":"{read_only:false; response_revision:4783; number_of_response:1; }","duration":"100.470381ms","start":"2026-06-15T14:03:39.449012Z","end":"2026-06-15T14:03:39.549482Z","steps":["trace[1548502518] 'process raft request' (duration: 100.285316ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:03:52.84296Z","caller":"traceutil/trace.go:171","msg":"trace[1929891702] transaction","detail":"{read_only:false; response_revision:4949; number_of_response:1; }","duration":"124.678971ms","start":"2026-06-15T14:03:52.718262Z","end":"2026-06-15T14:03:52.842941Z","steps":["trace[1929891702] 'process raft request' (duration: 124.537917ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:03:53.528755Z","caller":"traceutil/trace.go:171","msg":"trace[616940649] transaction","detail":"{read_only:false; response_revision:4959; number_of_response:1; }","duration":"120.379698ms","start":"2026-06-15T14:03:53.408345Z","end":"2026-06-15T14:03:53.528724Z","steps":["trace[616940649] 'process raft request' (duration: 120.103141ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:05:12.18786Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2911} {"level":"info","ts":"2026-06-15T14:05:12.282897Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2911,"took":"93.791851ms","hash":4217434419,"current-db-size-bytes":54177792,"current-db-size":"54 MB","current-db-size-in-use-bytes":29454336,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-06-15T14:05:12.282968Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":4217434419,"revision":2911,"compact-revision":-1} {"level":"info","ts":"2026-06-15T14:07:56.324014Z","caller":"traceutil/trace.go:171","msg":"trace[1977654280] linearizableReadLoop","detail":"{readStateIndex:6972; appliedIndex:6971; }","duration":"151.368505ms","start":"2026-06-15T14:07:56.172625Z","end":"2026-06-15T14:07:56.323994Z","steps":["trace[1977654280] 'read index received' (duration: 62.269283ms)","trace[1977654280] 'applied index is now lower than readState.Index' (duration: 89.098392ms)"],"step_count":2} {"level":"warn","ts":"2026-06-15T14:07:56.324113Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.476587ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-15T14:07:56.324266Z","caller":"traceutil/trace.go:171","msg":"trace[962563271] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6727; }","duration":"151.670723ms","start":"2026-06-15T14:07:56.172586Z","end":"2026-06-15T14:07:56.324257Z","steps":["trace[962563271] 'agreement among raft nodes before linearized reading' (duration: 151.488269ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:07:56.324175Z","caller":"traceutil/trace.go:171","msg":"trace[886586523] transaction","detail":"{read_only:false; response_revision:6727; number_of_response:1; }","duration":"194.355709ms","start":"2026-06-15T14:07:56.12971Z","end":"2026-06-15T14:07:56.324066Z","steps":["trace[886586523] 'process raft request' (duration: 105.193915ms)","trace[886586523] 'compare' (duration: 88.770105ms)"],"step_count":2} {"level":"info","ts":"2026-06-15T14:07:56.327692Z","caller":"traceutil/trace.go:171","msg":"trace[873778079] transaction","detail":"{read_only:false; response_revision:6728; number_of_response:1; }","duration":"104.011789ms","start":"2026-06-15T14:07:56.223659Z","end":"2026-06-15T14:07:56.327671Z","steps":["trace[873778079] 'process raft request' (duration: 103.842316ms)"],"step_count":1} {"level":"info","ts":"2026-06-15T14:10:12.1953Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5613} {"level":"info","ts":"2026-06-15T14:10:12.27969Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5613,"took":"82.895046ms","hash":3790821538,"current-db-size-bytes":54177792,"current-db-size":"54 MB","current-db-size-in-use-bytes":18427904,"current-db-size-in-use":"18 MB"} {"level":"info","ts":"2026-06-15T14:10:12.279753Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3790821538,"revision":5613,"compact-revision":2911}