{"level":"warn","ts":"2026-03-02T15:54:19.867031Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-03-02T15:54:19.867123Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.200: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://162.253.55.200:2380","--initial-cluster=instance=https://162.253.55.200:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.200:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.200: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-03-02T15:54:19.867193Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-03-02T15:54:19.867207Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.200:2380"]} {"level":"info","ts":"2026-03-02T15:54:19.867317Z","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-03-02T15:54:19.86804Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.200:2379"]} {"level":"info","ts":"2026-03-02T15:54:19.868235Z","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://162.253.55.200:2380"],"listen-peer-urls":["https://162.253.55.200:2380"],"advertise-client-urls":["https://162.253.55.200:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.200:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.200: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-03-02T15:54:19.872286Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.782288ms"} {"level":"info","ts":"2026-03-02T15:54:19.879066Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"e10bb51ed7578852","cluster-id":"aa14459abd2161c3"} {"level":"info","ts":"2026-03-02T15:54:19.879219Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 switched to configuration voters=()"} {"level":"info","ts":"2026-03-02T15:54:19.879319Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 became follower at term 0"} {"level":"info","ts":"2026-03-02T15:54:19.879435Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft e10bb51ed7578852 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-03-02T15:54:19.879464Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 became follower at term 1"} {"level":"info","ts":"2026-03-02T15:54:19.879542Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 switched to configuration voters=(16216254027344087122)"} {"level":"warn","ts":"2026-03-02T15:54:19.885619Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-03-02T15:54:19.887178Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-03-02T15:54:19.888264Z","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-03-02T15:54:19.890475Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"e10bb51ed7578852","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-03-02T15:54:19.890594Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"e10bb51ed7578852","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-03-02T15:54:19.890673Z","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-03-02T15:54:19.890741Z","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-03-02T15:54:19.890756Z","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-03-02T15:54:19.891668Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 switched to configuration voters=(16216254027344087122)"} {"level":"info","ts":"2026-03-02T15:54:19.891874Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"aa14459abd2161c3","local-member-id":"e10bb51ed7578852","added-peer-id":"e10bb51ed7578852","added-peer-peer-urls":["https://162.253.55.200:2380"]} {"level":"info","ts":"2026-03-02T15:54:19.894845Z","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-03-02T15:54:19.894918Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.200:2380"} {"level":"info","ts":"2026-03-02T15:54:19.894939Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.200:2380"} {"level":"info","ts":"2026-03-02T15:54:19.89579Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"e10bb51ed7578852","initial-advertise-peer-urls":["https://162.253.55.200:2380"],"listen-peer-urls":["https://162.253.55.200:2380"],"advertise-client-urls":["https://162.253.55.200:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.200:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-03-02T15:54:19.895824Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-03-02T15:54:20.780635Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 is starting a new election at term 1"} {"level":"info","ts":"2026-03-02T15:54:20.780678Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 became pre-candidate at term 1"} {"level":"info","ts":"2026-03-02T15:54:20.780701Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 received MsgPreVoteResp from e10bb51ed7578852 at term 1"} {"level":"info","ts":"2026-03-02T15:54:20.780715Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 became candidate at term 2"} {"level":"info","ts":"2026-03-02T15:54:20.78072Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 received MsgVoteResp from e10bb51ed7578852 at term 2"} {"level":"info","ts":"2026-03-02T15:54:20.780806Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e10bb51ed7578852 became leader at term 2"} {"level":"info","ts":"2026-03-02T15:54:20.780813Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: e10bb51ed7578852 elected leader e10bb51ed7578852 at term 2"} {"level":"info","ts":"2026-03-02T15:54:21.025206Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"e10bb51ed7578852","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.200:2379]}","request-path":"/0/members/e10bb51ed7578852/attributes","cluster-id":"aa14459abd2161c3","publish-timeout":"7s"} {"level":"info","ts":"2026-03-02T15:54:21.02526Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-03-02T15:54:21.025365Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-03-02T15:54:21.02565Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-03-02T15:54:21.025702Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-03-02T15:54:21.025726Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-03-02T15:54:21.028554Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-03-02T15:54:21.028768Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.200:2379"} {"level":"warn","ts":"2026-03-02T15:54:21.320541Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.065776ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/\" range_end:\"/registry/serviceaccounts0\" count_only:true ","response":"","error":"context canceled"} {"level":"info","ts":"2026-03-02T15:54:21.320629Z","caller":"traceutil/trace.go:171","msg":"trace[1301285456] range","detail":"{range_begin:/registry/serviceaccounts/; range_end:/registry/serviceaccounts0; }","duration":"123.18912ms","start":"2026-03-02T15:54:21.197424Z","end":"2026-03-02T15:54:21.320613Z","steps":["trace[1301285456] 'agreement among raft nodes before linearized reading' (duration: 123.080247ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.320769Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.242151ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/\" range_end:\"/registry/serviceaccounts0\" limit:10000 ","response":"","error":"context canceled"} {"level":"info","ts":"2026-03-02T15:54:21.320843Z","caller":"traceutil/trace.go:171","msg":"trace[1474968201] range","detail":"{range_begin:/registry/serviceaccounts/; range_end:/registry/serviceaccounts0; }","duration":"123.330403ms","start":"2026-03-02T15:54:21.197475Z","end":"2026-03-02T15:54:21.320805Z","steps":["trace[1474968201] 'agreement among raft nodes before linearized reading' (duration: 123.268761ms)"],"step_count":1} 2026/03/02 15:54:21 WARNING: [core] [Server #7] grpc: Server.processUnaryRPC failed to write status: connection error: desc = "transport is closing" {"level":"info","ts":"2026-03-02T15:54:21.378674Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"aa14459abd2161c3","local-member-id":"e10bb51ed7578852","cluster-version":"3.5"} {"level":"info","ts":"2026-03-02T15:54:21.378835Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-03-02T15:54:21.378901Z","caller":"traceutil/trace.go:171","msg":"trace[1391616489] linearizableReadLoop","detail":"{readStateIndex:4; appliedIndex:3; }","duration":"288.594571ms","start":"2026-03-02T15:54:21.090286Z","end":"2026-03-02T15:54:21.378881Z","steps":["trace[1391616489] 'read index received' (duration: 288.280132ms)","trace[1391616489] 'applied index is now lower than readState.Index' (duration: 313.379µs)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:54:21.378911Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"warn","ts":"2026-03-02T15:54:21.379435Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"216.939786ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.379521Z","caller":"traceutil/trace.go:171","msg":"trace[509916531] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:1; }","duration":"217.064658ms","start":"2026-03-02T15:54:21.162431Z","end":"2026-03-02T15:54:21.379495Z","steps":["trace[509916531] 'agreement among raft nodes before linearized reading' (duration: 216.892394ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.379763Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.084783ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/\" range_end:\"/registry/namespaces0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:21.379759Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"289.114454ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/\" range_end:\"/registry/apiextensions.k8s.io/customresourcedefinitions0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.379841Z","caller":"traceutil/trace.go:171","msg":"trace[2023742490] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:1; }","duration":"192.554064ms","start":"2026-03-02T15:54:21.18727Z","end":"2026-03-02T15:54:21.379824Z","steps":["trace[2023742490] 'agreement among raft nodes before linearized reading' (duration: 191.99527ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:21.379863Z","caller":"traceutil/trace.go:171","msg":"trace[2112169258] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:1; }","duration":"289.555625ms","start":"2026-03-02T15:54:21.090281Z","end":"2026-03-02T15:54:21.379837Z","steps":["trace[2112169258] 'agreement among raft nodes before linearized reading' (duration: 288.655792ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.379881Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.281028ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:21.379997Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"170.118244ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/podtemplates/\" range_end:\"/registry/podtemplates0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:21.380262Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.914304ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/\" range_end:\"/registry/namespaces0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.380272Z","caller":"traceutil/trace.go:171","msg":"trace[1365353261] range","detail":"{range_begin:/registry/podtemplates/; range_end:/registry/podtemplates0; response_count:0; response_revision:1; }","duration":"170.495023ms","start":"2026-03-02T15:54:21.209759Z","end":"2026-03-02T15:54:21.380254Z","steps":["trace[1365353261] 'agreement among raft nodes before linearized reading' (duration: 170.184495ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:21.380362Z","caller":"traceutil/trace.go:171","msg":"trace[1253583152] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:1; }","duration":"143.753101ms","start":"2026-03-02T15:54:21.236535Z","end":"2026-03-02T15:54:21.380288Z","steps":["trace[1253583152] 'agreement among raft nodes before linearized reading' (duration: 142.755885ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.380383Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.904484ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/\" range_end:\"/registry/configmaps0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:21.380404Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"170.686449ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/podtemplates/\" range_end:\"/registry/podtemplates0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.380421Z","caller":"traceutil/trace.go:171","msg":"trace[578468416] range","detail":"{range_begin:/registry/configmaps/; range_end:/registry/configmaps0; response_count:0; response_revision:1; }","duration":"204.975906ms","start":"2026-03-02T15:54:21.175433Z","end":"2026-03-02T15:54:21.380409Z","steps":["trace[578468416] 'agreement among raft nodes before linearized reading' (duration: 204.917305ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:21.380448Z","caller":"traceutil/trace.go:171","msg":"trace[1923999925] range","detail":"{range_begin:/registry/podtemplates/; range_end:/registry/podtemplates0; response_count:0; response_revision:1; }","duration":"170.74892ms","start":"2026-03-02T15:54:21.209689Z","end":"2026-03-02T15:54:21.380438Z","steps":["trace[1923999925] 'agreement among raft nodes before linearized reading' (duration: 170.679278ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:21.380327Z","caller":"traceutil/trace.go:171","msg":"trace[1680142015] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:1; }","duration":"193.201081ms","start":"2026-03-02T15:54:21.187105Z","end":"2026-03-02T15:54:21.380306Z","steps":["trace[1680142015] 'agreement among raft nodes before linearized reading' (duration: 192.902474ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.380632Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.249564ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/\" range_end:\"/registry/configmaps0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:21.380667Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.605512ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/\" range_end:\"/registry/persistentvolumeclaims0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.380678Z","caller":"traceutil/trace.go:171","msg":"trace[1631388898] range","detail":"{range_begin:/registry/configmaps/; range_end:/registry/configmaps0; response_count:0; response_revision:1; }","duration":"205.296255ms","start":"2026-03-02T15:54:21.175369Z","end":"2026-03-02T15:54:21.380665Z","steps":["trace[1631388898] 'agreement among raft nodes before linearized reading' (duration: 205.229613ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:21.380716Z","caller":"traceutil/trace.go:171","msg":"trace[718372599] range","detail":"{range_begin:/registry/persistentvolumeclaims/; range_end:/registry/persistentvolumeclaims0; response_count:0; response_revision:1; }","duration":"132.706966ms","start":"2026-03-02T15:54:21.247992Z","end":"2026-03-02T15:54:21.380699Z","steps":["trace[718372599] 'agreement among raft nodes before linearized reading' (duration: 132.642644ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.380847Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.09294ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.381022Z","caller":"traceutil/trace.go:171","msg":"trace[2027992198] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:1; }","duration":"157.247991ms","start":"2026-03-02T15:54:21.223689Z","end":"2026-03-02T15:54:21.380937Z","steps":["trace[2027992198] 'agreement among raft nodes before linearized reading' (duration: 156.031639ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.381156Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.373484ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.381222Z","caller":"traceutil/trace.go:171","msg":"trace[131605277] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:1; }","duration":"157.455506ms","start":"2026-03-02T15:54:21.223744Z","end":"2026-03-02T15:54:21.381199Z","steps":["trace[131605277] 'agreement among raft nodes before linearized reading' (duration: 157.375784ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.381349Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.575063ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/\" range_end:\"/registry/resourcequotas0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:21.381514Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.769077ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/\" range_end:\"/registry/resourcequotas0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.381595Z","caller":"traceutil/trace.go:171","msg":"trace[1414320313] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:1; }","duration":"229.83499ms","start":"2026-03-02T15:54:21.15172Z","end":"2026-03-02T15:54:21.381554Z","steps":["trace[1414320313] 'agreement among raft nodes before linearized reading' (duration: 229.763548ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.381692Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"219.261256ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.381726Z","caller":"traceutil/trace.go:171","msg":"trace[1797772826] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:1; }","duration":"219.316427ms","start":"2026-03-02T15:54:21.162402Z","end":"2026-03-02T15:54:21.381718Z","steps":["trace[1797772826] 'agreement among raft nodes before linearized reading' (duration: 219.193704ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.381941Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"242.882508ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.381962Z","caller":"traceutil/trace.go:171","msg":"trace[1390169984] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:1; }","duration":"242.937748ms","start":"2026-03-02T15:54:21.139019Z","end":"2026-03-02T15:54:21.381957Z","steps":["trace[1390169984] 'agreement among raft nodes before linearized reading' (duration: 242.902687ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.382087Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.110514ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/\" range_end:\"/registry/minions0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.382129Z","caller":"traceutil/trace.go:171","msg":"trace[1101240938] range","detail":"{range_begin:/registry/minions/; range_end:/registry/minions0; response_count:0; response_revision:1; }","duration":"109.163045ms","start":"2026-03-02T15:54:21.272957Z","end":"2026-03-02T15:54:21.38212Z","steps":["trace[1101240938] 'agreement among raft nodes before linearized reading' (duration: 109.097844ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.382358Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.409622ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/\" range_end:\"/registry/minions0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:21.382361Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.752301ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/\" range_end:\"/registry/services/endpoints0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.382383Z","caller":"traceutil/trace.go:171","msg":"trace[1729264897] range","detail":"{range_begin:/registry/minions/; range_end:/registry/minions0; response_count:0; response_revision:1; }","duration":"109.457473ms","start":"2026-03-02T15:54:21.27292Z","end":"2026-03-02T15:54:21.382378Z","steps":["trace[1729264897] 'agreement among raft nodes before linearized reading' (duration: 109.410922ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:21.382406Z","caller":"traceutil/trace.go:171","msg":"trace[910635362] range","detail":"{range_begin:/registry/services/endpoints/; range_end:/registry/services/endpoints0; response_count:0; response_revision:1; }","duration":"121.787082ms","start":"2026-03-02T15:54:21.260598Z","end":"2026-03-02T15:54:21.382385Z","steps":["trace[910635362] 'agreement among raft nodes before linearized reading' (duration: 121.739451ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.382643Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.115001ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/\" range_end:\"/registry/services/endpoints0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.382681Z","caller":"traceutil/trace.go:171","msg":"trace[1120820057] range","detail":"{range_begin:/registry/services/endpoints/; range_end:/registry/services/endpoints0; response_count:0; response_revision:1; }","duration":"122.172453ms","start":"2026-03-02T15:54:21.260498Z","end":"2026-03-02T15:54:21.382671Z","steps":["trace[1120820057] 'agreement among raft nodes before linearized reading' (duration: 118.744124ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.38088Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.89194ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/\" range_end:\"/registry/persistentvolumeclaims0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.382817Z","caller":"traceutil/trace.go:171","msg":"trace[1539016364] range","detail":"{range_begin:/registry/persistentvolumeclaims/; range_end:/registry/persistentvolumeclaims0; response_count:0; response_revision:1; }","duration":"134.8506ms","start":"2026-03-02T15:54:21.247958Z","end":"2026-03-02T15:54:21.382809Z","steps":["trace[1539016364] 'agreement among raft nodes before linearized reading' (duration: 132.89718ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.380903Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.327836ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.382982Z","caller":"traceutil/trace.go:171","msg":"trace[18723196] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:1; }","duration":"146.42921ms","start":"2026-03-02T15:54:21.236545Z","end":"2026-03-02T15:54:21.382975Z","steps":["trace[18723196] 'agreement among raft nodes before linearized reading' (duration: 144.348597ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:21.383363Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"292.964874ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/\" range_end:\"/registry/apiextensions.k8s.io/customresourcedefinitions0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:21.383416Z","caller":"traceutil/trace.go:171","msg":"trace[27939904] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:1; }","duration":"293.057096ms","start":"2026-03-02T15:54:21.090343Z","end":"2026-03-02T15:54:21.3834Z","steps":["trace[27939904] 'agreement among raft nodes before linearized reading' (duration: 288.666362ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:21.381409Z","caller":"traceutil/trace.go:171","msg":"trace[1369298188] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:1; }","duration":"229.647755ms","start":"2026-03-02T15:54:21.15175Z","end":"2026-03-02T15:54:21.381397Z","steps":["trace[1369298188] 'agreement among raft nodes before linearized reading' (duration: 229.551352ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.310196Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"727.347208ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.31029Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"606.635523ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/\" range_end:\"/registry/deployments0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.310289Z","caller":"traceutil/trace.go:171","msg":"trace[1898622949] range","detail":"{range_begin:/registry/volumeattachments/; range_end:/registry/volumeattachments0; response_count:0; response_revision:1; }","duration":"727.42721ms","start":"2026-03-02T15:54:21.582838Z","end":"2026-03-02T15:54:22.310265Z","steps":["trace[1898622949] 'range keys from in-memory index tree' (duration: 727.308787ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:22.310334Z","caller":"traceutil/trace.go:171","msg":"trace[1108690577] range","detail":"{range_begin:/registry/deployments/; range_end:/registry/deployments0; response_count:0; response_revision:1; }","duration":"606.703485ms","start":"2026-03-02T15:54:21.703617Z","end":"2026-03-02T15:54:22.310321Z","steps":["trace[1108690577] 'range keys from in-memory index tree' (duration: 606.584882ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.310238Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"738.849265ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/storageclasses/\" range_end:\"/registry/storageclasses0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.310443Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"727.492221ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.310493Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"529.575619ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/validatingwebhookconfigurations/\" range_end:\"/registry/validatingwebhookconfigurations0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.310484Z","caller":"traceutil/trace.go:171","msg":"trace[412024060] range","detail":"{range_begin:/registry/storageclasses/; range_end:/registry/storageclasses0; response_count:0; response_revision:1; }","duration":"739.165604ms","start":"2026-03-02T15:54:21.571288Z","end":"2026-03-02T15:54:22.310454Z","steps":["trace[412024060] 'count revisions from in-memory index tree' (duration: 738.761224ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:22.310549Z","caller":"traceutil/trace.go:171","msg":"trace[1695056265] range","detail":"{range_begin:/registry/validatingwebhookconfigurations/; range_end:/registry/validatingwebhookconfigurations0; response_count:0; response_revision:1; }","duration":"529.64438ms","start":"2026-03-02T15:54:21.780887Z","end":"2026-03-02T15:54:22.310531Z","steps":["trace[1695056265] 'range keys from in-memory index tree' (duration: 529.532608ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.31058Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"717.603476ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.310601Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.780869Z","time spent":"529.719332ms","remote":"127.0.0.1:35948","response type":"/etcdserverpb.KV/Range","request count":0,"request size":91,"response count":0,"response size":28,"request content":"key:\"/registry/validatingwebhookconfigurations/\" range_end:\"/registry/validatingwebhookconfigurations0\" limit:10000 "} {"level":"info","ts":"2026-03-02T15:54:22.31063Z","caller":"traceutil/trace.go:171","msg":"trace[1849816621] range","detail":"{range_begin:/registry/csinodes/; range_end:/registry/csinodes0; response_count:0; response_revision:1; }","duration":"717.688928ms","start":"2026-03-02T15:54:21.592928Z","end":"2026-03-02T15:54:22.310617Z","steps":["trace[1849816621] 'count revisions from in-memory index tree' (duration: 717.455231ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.310642Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.571275Z","time spent":"739.348338ms","remote":"127.0.0.1:35828","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":0,"response size":28,"request content":"key:\"/registry/storageclasses/\" range_end:\"/registry/storageclasses0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.310711Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"606.934401ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/\" range_end:\"/registry/deployments0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.310759Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"516.647574ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.310732Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"841.881213ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.310816Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"595.151456ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.31082Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"702.903345ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csidrivers/\" range_end:\"/registry/csidrivers0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.310881Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"594.681574ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.31091Z","caller":"traceutil/trace.go:171","msg":"trace[1801884397] range","detail":"{range_begin:/registry/statefulsets/; range_end:/registry/statefulsets0; response_count:0; response_revision:1; }","duration":"595.050473ms","start":"2026-03-02T15:54:21.715855Z","end":"2026-03-02T15:54:22.310905Z","steps":["trace[1801884397] 'count revisions from in-memory index tree' (duration: 594.55058ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.310918Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"688.918864ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csistoragecapacities/\" range_end:\"/registry/csistoragecapacities0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.310812Z","caller":"traceutil/trace.go:171","msg":"trace[415977950] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/; range_end:/registry/mutatingwebhookconfigurations0; response_count:0; response_revision:1; }","duration":"516.710175ms","start":"2026-03-02T15:54:21.794088Z","end":"2026-03-02T15:54:22.310798Z","steps":["trace[415977950] 'range keys from in-memory index tree' (duration: 516.579801ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:22.310962Z","caller":"traceutil/trace.go:171","msg":"trace[1991568139] range","detail":"{range_begin:/registry/csistoragecapacities/; range_end:/registry/csistoragecapacities0; response_count:0; response_revision:1; }","duration":"688.987995ms","start":"2026-03-02T15:54:21.621963Z","end":"2026-03-02T15:54:22.310951Z","steps":["trace[1991568139] 'range keys from in-memory index tree' (duration: 688.855332ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.310961Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.715822Z","time spent":"595.116525ms","remote":"127.0.0.1:35914","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":0,"response size":28,"request content":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.311004Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.621952Z","time spent":"689.039596ms","remote":"127.0.0.1:35862","response type":"/etcdserverpb.KV/Range","request count":0,"request size":69,"response count":0,"response size":28,"request content":"key:\"/registry/csistoragecapacities/\" range_end:\"/registry/csistoragecapacities0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.311055Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"516.91564ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.311102Z","caller":"traceutil/trace.go:171","msg":"trace[594818450] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/; range_end:/registry/mutatingwebhookconfigurations0; response_count:0; response_revision:1; }","duration":"516.973302ms","start":"2026-03-02T15:54:21.794117Z","end":"2026-03-02T15:54:22.31109Z","steps":["trace[594818450] 'count revisions from in-memory index tree' (duration: 515.372981ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.311145Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.794108Z","time spent":"517.025464ms","remote":"127.0.0.1:35956","response type":"/etcdserverpb.KV/Range","request count":0,"request size":86,"response count":0,"response size":28,"request content":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.3113Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"580.836486ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/daemonsets/\" range_end:\"/registry/daemonsets0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.311339Z","caller":"traceutil/trace.go:171","msg":"trace[219369334] range","detail":"{range_begin:/registry/daemonsets/; range_end:/registry/daemonsets0; response_count:0; response_revision:1; }","duration":"580.920148ms","start":"2026-03-02T15:54:21.730413Z","end":"2026-03-02T15:54:22.311333Z","steps":["trace[219369334] 'count revisions from in-memory index tree' (duration: 580.722663ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.311335Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"689.297953ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csistoragecapacities/\" range_end:\"/registry/csistoragecapacities0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.311367Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.730385Z","time spent":"580.975699ms","remote":"127.0.0.1:35920","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":0,"response size":28,"request content":"key:\"/registry/daemonsets/\" range_end:\"/registry/daemonsets0\" count_only:true "} {"level":"info","ts":"2026-03-02T15:54:22.311398Z","caller":"traceutil/trace.go:171","msg":"trace[1038501189] range","detail":"{range_begin:/registry/csistoragecapacities/; range_end:/registry/csistoragecapacities0; response_count:0; response_revision:1; }","duration":"689.388675ms","start":"2026-03-02T15:54:21.621995Z","end":"2026-03-02T15:54:22.311384Z","steps":["trace[1038501189] 'count revisions from in-memory index tree' (duration: 689.246202ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.311389Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"830.772005ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/runtimeclasses/\" range_end:\"/registry/runtimeclasses0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.311425Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"412.92976ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.311465Z","caller":"traceutil/trace.go:171","msg":"trace[1935684128] range","detail":"{range_begin:/registry/apiregistration.k8s.io/apiservices/; range_end:/registry/apiregistration.k8s.io/apiservices0; response_count:0; response_revision:1; }","duration":"413.014531ms","start":"2026-03-02T15:54:21.898438Z","end":"2026-03-02T15:54:22.311453Z","steps":["trace[1935684128] 'count revisions from in-memory index tree' (duration: 412.863217ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:22.31148Z","caller":"traceutil/trace.go:171","msg":"trace[1565038592] range","detail":"{range_begin:/registry/runtimeclasses/; range_end:/registry/runtimeclasses0; response_count:0; response_revision:1; }","duration":"830.880638ms","start":"2026-03-02T15:54:21.480586Z","end":"2026-03-02T15:54:22.311466Z","steps":["trace[1565038592] 'count revisions from in-memory index tree' (duration: 830.722634ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.311518Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"655.149499ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.311528Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.898416Z","time spent":"413.090243ms","remote":"127.0.0.1:35980","response type":"/etcdserverpb.KV/Range","request count":0,"request size":96,"response count":0,"response size":28,"request content":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.311576Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"566.596877ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/replicasets/\" range_end:\"/registry/replicasets0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.31161Z","caller":"traceutil/trace.go:171","msg":"trace[1871243457] range","detail":"{range_begin:/registry/replicasets/; range_end:/registry/replicasets0; response_count:0; response_revision:1; }","duration":"566.648788ms","start":"2026-03-02T15:54:21.744949Z","end":"2026-03-02T15:54:22.311598Z","steps":["trace[1871243457] 'range keys from in-memory index tree' (duration: 566.489274ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.311608Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"655.134769ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.311638Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.744937Z","time spent":"566.695089ms","remote":"127.0.0.1:35936","response type":"/etcdserverpb.KV/Range","request count":0,"request size":51,"response count":0,"response size":28,"request content":"key:\"/registry/replicasets/\" range_end:\"/registry/replicasets0\" limit:10000 "} {"level":"info","ts":"2026-03-02T15:54:22.31166Z","caller":"traceutil/trace.go:171","msg":"trace[1731522902] range","detail":"{range_begin:/registry/flowschemas/; range_end:/registry/flowschemas0; response_count:0; response_revision:1; }","duration":"655.250472ms","start":"2026-03-02T15:54:21.656398Z","end":"2026-03-02T15:54:22.311649Z","steps":["trace[1731522902] 'range keys from in-memory index tree' (duration: 655.016545ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.311693Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"830.93762ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/runtimeclasses/\" range_end:\"/registry/runtimeclasses0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.311708Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.656367Z","time spent":"655.328174ms","remote":"127.0.0.1:35876","response type":"/etcdserverpb.KV/Range","request count":0,"request size":51,"response count":0,"response size":28,"request content":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" limit:10000 "} {"level":"info","ts":"2026-03-02T15:54:22.311738Z","caller":"traceutil/trace.go:171","msg":"trace[1182121208] range","detail":"{range_begin:/registry/runtimeclasses/; range_end:/registry/runtimeclasses0; response_count:0; response_revision:1; }","duration":"831.054892ms","start":"2026-03-02T15:54:21.480671Z","end":"2026-03-02T15:54:22.311726Z","steps":["trace[1182121208] 'range keys from in-memory index tree' (duration: 830.851137ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.31182Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"566.818753ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/replicasets/\" range_end:\"/registry/replicasets0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.311849Z","caller":"traceutil/trace.go:171","msg":"trace[871157354] range","detail":"{range_begin:/registry/replicasets/; range_end:/registry/replicasets0; response_count:0; response_revision:1; }","duration":"566.927245ms","start":"2026-03-02T15:54:21.744916Z","end":"2026-03-02T15:54:22.311844Z","steps":["trace[871157354] 'count revisions from in-memory index tree' (duration: 566.680788ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.31131Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"842.589471ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.311369Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"502.462666ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.31192Z","caller":"traceutil/trace.go:171","msg":"trace[791339902] range","detail":"{range_begin:/registry/ingressclasses/; range_end:/registry/ingressclasses0; response_count:0; response_revision:1; }","duration":"843.221197ms","start":"2026-03-02T15:54:21.468683Z","end":"2026-03-02T15:54:22.311904Z","steps":["trace[791339902] 'range keys from in-memory index tree' (duration: 842.489829ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.31189Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"816.341872ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/poddisruptionbudgets/\" range_end:\"/registry/poddisruptionbudgets0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.311953Z","caller":"traceutil/trace.go:171","msg":"trace[798027149] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:1; }","duration":"503.068483ms","start":"2026-03-02T15:54:21.808878Z","end":"2026-03-02T15:54:22.311946Z","steps":["trace[798027149] 'count revisions from in-memory index tree' (duration: 502.393775ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:22.311981Z","caller":"traceutil/trace.go:171","msg":"trace[2124403754] range","detail":"{range_begin:/registry/poddisruptionbudgets/; range_end:/registry/poddisruptionbudgets0; response_count:0; response_revision:1; }","duration":"816.450204ms","start":"2026-03-02T15:54:21.495516Z","end":"2026-03-02T15:54:22.311966Z","steps":["trace[2124403754] 'range keys from in-memory index tree' (duration: 816.285401ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.311997Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"630.364138ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.312004Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.808864Z","time spent":"503.126774ms","remote":"127.0.0.1:35972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":0,"response size":28,"request content":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true "} {"level":"info","ts":"2026-03-02T15:54:22.312037Z","caller":"traceutil/trace.go:171","msg":"trace[37095755] range","detail":"{range_begin:/registry/flowschemas/; range_end:/registry/flowschemas0; response_count:0; response_revision:1; }","duration":"630.401219ms","start":"2026-03-02T15:54:21.681623Z","end":"2026-03-02T15:54:22.312025Z","steps":["trace[37095755] 'count revisions from in-memory index tree' (duration: 630.328267ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.312074Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.495504Z","time spent":"816.533907ms","remote":"127.0.0.1:35766","response type":"/etcdserverpb.KV/Range","request count":0,"request size":69,"response count":0,"response size":28,"request content":"key:\"/registry/poddisruptionbudgets/\" range_end:\"/registry/poddisruptionbudgets0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.312094Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.681606Z","time spent":"630.47411ms","remote":"127.0.0.1:35900","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":0,"response size":28,"request content":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.31153Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"581.058622ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/daemonsets/\" range_end:\"/registry/daemonsets0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.3122Z","caller":"traceutil/trace.go:171","msg":"trace[180967912] range","detail":"{range_begin:/registry/daemonsets/; range_end:/registry/daemonsets0; response_count:0; response_revision:1; }","duration":"581.758099ms","start":"2026-03-02T15:54:21.730437Z","end":"2026-03-02T15:54:22.312195Z","steps":["trace[180967912] 'range keys from in-memory index tree' (duration: 580.937818ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.312231Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.730416Z","time spent":"581.807181ms","remote":"127.0.0.1:35920","response type":"/etcdserverpb.KV/Range","request count":0,"request size":49,"response count":0,"response size":28,"request content":"key:\"/registry/daemonsets/\" range_end:\"/registry/daemonsets0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.31155Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.480573Z","time spent":"830.940759ms","remote":"127.0.0.1:35764","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":0,"response size":28,"request content":"key:\"/registry/runtimeclasses/\" range_end:\"/registry/runtimeclasses0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.312333Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"618.164221ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.310709Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"529.667841ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/validatingwebhookconfigurations/\" range_end:\"/registry/validatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.312385Z","caller":"traceutil/trace.go:171","msg":"trace[135018274] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:1; }","duration":"618.242454ms","start":"2026-03-02T15:54:21.694129Z","end":"2026-03-02T15:54:22.312371Z","steps":["trace[135018274] 'range keys from in-memory index tree' (duration: 618.10448ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.312396Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"816.772333ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/poddisruptionbudgets/\" range_end:\"/registry/poddisruptionbudgets0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.311983Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.468669Z","time spent":"843.296649ms","remote":"127.0.0.1:35762","response type":"/etcdserverpb.KV/Range","request count":0,"request size":57,"response count":0,"response size":28,"request content":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" limit:10000 "} {"level":"info","ts":"2026-03-02T15:54:22.312496Z","caller":"traceutil/trace.go:171","msg":"trace[1338397717] range","detail":"{range_begin:/registry/poddisruptionbudgets/; range_end:/registry/poddisruptionbudgets0; response_count:0; response_revision:1; }","duration":"816.870736ms","start":"2026-03-02T15:54:21.495588Z","end":"2026-03-02T15:54:22.312459Z","steps":["trace[1338397717] 'count revisions from in-memory index tree' (duration: 816.691141ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.312543Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.495574Z","time spent":"816.956308ms","remote":"127.0.0.1:35766","response type":"/etcdserverpb.KV/Range","request count":0,"request size":68,"response count":0,"response size":28,"request content":"key:\"/registry/poddisruptionbudgets/\" range_end:\"/registry/poddisruptionbudgets0\" count_only:true "} {"level":"info","ts":"2026-03-02T15:54:22.311566Z","caller":"traceutil/trace.go:171","msg":"trace[1366766591] range","detail":"{range_begin:/registry/flowschemas/; range_end:/registry/flowschemas0; response_count:0; response_revision:1; }","duration":"655.308973ms","start":"2026-03-02T15:54:21.656245Z","end":"2026-03-02T15:54:22.311554Z","steps":["trace[1366766591] 'count revisions from in-memory index tree' (duration: 654.948394ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.311842Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.480655Z","time spent":"831.148395ms","remote":"127.0.0.1:35764","response type":"/etcdserverpb.KV/Range","request count":0,"request size":57,"response count":0,"response size":28,"request content":"key:\"/registry/runtimeclasses/\" range_end:\"/registry/runtimeclasses0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.311961Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"643.997931ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.31273Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"892.737209ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/\" range_end:\"/registry/leases0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.312754Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"806.168448ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.312765Z","caller":"traceutil/trace.go:171","msg":"trace[2002643053] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:1; }","duration":"644.802831ms","start":"2026-03-02T15:54:21.667952Z","end":"2026-03-02T15:54:22.312755Z","steps":["trace[2002643053] 'count revisions from in-memory index tree' (duration: 643.900988ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:22.312788Z","caller":"traceutil/trace.go:171","msg":"trace[1651663174] range","detail":"{range_begin:/registry/leases/; range_end:/registry/leases0; response_count:0; response_revision:1; }","duration":"892.811151ms","start":"2026-03-02T15:54:21.419963Z","end":"2026-03-02T15:54:22.312774Z","steps":["trace[1651663174] 'range keys from in-memory index tree' (duration: 892.626256ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.312835Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.667899Z","time spent":"644.908424ms","remote":"127.0.0.1:35892","response type":"/etcdserverpb.KV/Range","request count":0,"request size":82,"response count":0,"response size":28,"request content":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.312839Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"806.086636ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.310767Z","caller":"traceutil/trace.go:171","msg":"trace[1206876580] range","detail":"{range_begin:/registry/deployments/; range_end:/registry/deployments0; response_count:0; response_revision:1; }","duration":"607.044884ms","start":"2026-03-02T15:54:21.703708Z","end":"2026-03-02T15:54:22.310753Z","steps":["trace[1206876580] 'count revisions from in-memory index tree' (duration: 606.843159ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.312897Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.703686Z","time spent":"609.1997ms","remote":"127.0.0.1:35912","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":0,"response size":28,"request content":"key:\"/registry/deployments/\" range_end:\"/registry/deployments0\" count_only:true "} {"level":"info","ts":"2026-03-02T15:54:22.312959Z","caller":"traceutil/trace.go:171","msg":"trace[1592762797] range","detail":"{range_begin:/registry/roles/; range_end:/registry/roles0; response_count:0; response_revision:1; }","duration":"806.148918ms","start":"2026-03-02T15:54:21.506727Z","end":"2026-03-02T15:54:22.312876Z","steps":["trace[1592762797] 'count revisions from in-memory index tree' (duration: 806.051235ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.313003Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.506721Z","time spent":"806.269911ms","remote":"127.0.0.1:35770","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":0,"response size":28,"request content":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313032Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"741.71051ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/storageclasses/\" range_end:\"/registry/storageclasses0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.313111Z","caller":"traceutil/trace.go:171","msg":"trace[918292830] range","detail":"{range_begin:/registry/storageclasses/; range_end:/registry/storageclasses0; response_count:0; response_revision:1; }","duration":"741.798312ms","start":"2026-03-02T15:54:21.571277Z","end":"2026-03-02T15:54:22.313075Z","steps":["trace[918292830] 'range keys from in-memory index tree' (duration: 741.660418ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.313144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"793.154261ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rolebindings/\" range_end:\"/registry/rolebindings0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.310874Z","caller":"traceutil/trace.go:171","msg":"trace[1765144197] range","detail":"{range_begin:/registry/csidrivers/; range_end:/registry/csidrivers0; response_count:0; response_revision:1; }","duration":"702.982617ms","start":"2026-03-02T15:54:21.607876Z","end":"2026-03-02T15:54:22.310859Z","steps":["trace[1765144197] 'range keys from in-memory index tree' (duration: 702.797953ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.313188Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.571244Z","time spent":"741.904845ms","remote":"127.0.0.1:35828","response type":"/etcdserverpb.KV/Range","request count":0,"request size":57,"response count":0,"response size":28,"request content":"key:\"/registry/storageclasses/\" range_end:\"/registry/storageclasses0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.313228Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"793.236384ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rolebindings/\" range_end:\"/registry/rolebindings0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.313261Z","caller":"traceutil/trace.go:171","msg":"trace[737188722] range","detail":"{range_begin:/registry/rolebindings/; range_end:/registry/rolebindings0; response_count:0; response_revision:1; }","duration":"793.301495ms","start":"2026-03-02T15:54:21.519952Z","end":"2026-03-02T15:54:22.313254Z","steps":["trace[737188722] 'count revisions from in-memory index tree' (duration: 793.141171ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.313206Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.607845Z","time spent":"705.349919ms","remote":"127.0.0.1:35854","response type":"/etcdserverpb.KV/Range","request count":0,"request size":49,"response count":0,"response size":28,"request content":"key:\"/registry/csidrivers/\" range_end:\"/registry/csidrivers0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.313321Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"780.555725ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-03-02T15:54:22.313337Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"913.478596ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cronjobs/\" range_end:\"/registry/cronjobs0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.31335Z","caller":"traceutil/trace.go:171","msg":"trace[1335862252] range","detail":"{range_begin:/registry/clusterroles/; range_end:/registry/clusterroles0; response_count:0; response_revision:1; }","duration":"780.595516ms","start":"2026-03-02T15:54:21.532747Z","end":"2026-03-02T15:54:22.313343Z","steps":["trace[1335862252] 'range keys from in-memory index tree' (duration: 780.505654ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:22.313376Z","caller":"traceutil/trace.go:171","msg":"trace[402113474] range","detail":"{range_begin:/registry/cronjobs/; range_end:/registry/cronjobs0; response_count:0; response_revision:1; }","duration":"913.527237ms","start":"2026-03-02T15:54:21.39984Z","end":"2026-03-02T15:54:22.313367Z","steps":["trace[402113474] 'range keys from in-memory index tree' (duration: 913.444745ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.314578Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.399834Z","time spent":"914.728068ms","remote":"127.0.0.1:35718","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":0,"response size":28,"request content":"key:\"/registry/cronjobs/\" range_end:\"/registry/cronjobs0\" limit:10000 "} {"level":"info","ts":"2026-03-02T15:54:22.310495Z","caller":"traceutil/trace.go:171","msg":"trace[1849294321] range","detail":"{range_begin:/registry/volumeattachments/; range_end:/registry/volumeattachments0; response_count:0; response_revision:1; }","duration":"727.550243ms","start":"2026-03-02T15:54:21.58293Z","end":"2026-03-02T15:54:22.31048Z","steps":["trace[1849294321] 'count revisions from in-memory index tree' (duration: 727.469051ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.314806Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.582927Z","time spent":"731.865744ms","remote":"127.0.0.1:35838","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":0,"response size":28,"request content":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.310999Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.79408Z","time spent":"516.901301ms","remote":"127.0.0.1:35956","response type":"/etcdserverpb.KV/Range","request count":0,"request size":87,"response count":0,"response size":28,"request content":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.313045Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"919.723188ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/\" range_end:\"/registry/jobs0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.315126Z","caller":"traceutil/trace.go:171","msg":"trace[555605405] range","detail":"{range_begin:/registry/jobs/; range_end:/registry/jobs0; response_count:0; response_revision:1; }","duration":"921.819822ms","start":"2026-03-02T15:54:21.393297Z","end":"2026-03-02T15:54:22.315117Z","steps":["trace[555605405] 'count revisions from in-memory index tree' (duration: 919.602165ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.315169Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.393285Z","time spent":"921.873863ms","remote":"127.0.0.1:35710","response type":"/etcdserverpb.KV/Range","request count":0,"request size":36,"response count":0,"response size":28,"request content":"key:\"/registry/jobs/\" range_end:\"/registry/jobs0\" count_only:true "} {"level":"info","ts":"2026-03-02T15:54:22.313178Z","caller":"traceutil/trace.go:171","msg":"trace[852753547] range","detail":"{range_begin:/registry/rolebindings/; range_end:/registry/rolebindings0; response_count:0; response_revision:1; }","duration":"793.204083ms","start":"2026-03-02T15:54:21.519961Z","end":"2026-03-02T15:54:22.313165Z","steps":["trace[852753547] 'range keys from in-memory index tree' (duration: 793.066379ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.315325Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.519949Z","time spent":"795.366369ms","remote":"127.0.0.1:35784","response type":"/etcdserverpb.KV/Range","request count":0,"request size":53,"response count":0,"response size":28,"request content":"key:\"/registry/rolebindings/\" range_end:\"/registry/rolebindings0\" limit:10000 "} {"level":"info","ts":"2026-03-02T15:54:22.312799Z","caller":"traceutil/trace.go:171","msg":"trace[1129237315] range","detail":"{range_begin:/registry/roles/; range_end:/registry/roles0; response_count:0; response_revision:1; }","duration":"806.231369ms","start":"2026-03-02T15:54:21.506556Z","end":"2026-03-02T15:54:22.312788Z","steps":["trace[1129237315] 'range keys from in-memory index tree' (duration: 806.118107ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.315515Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.506545Z","time spent":"808.959941ms","remote":"127.0.0.1:35770","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":0,"response size":28,"request content":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" limit:10000 "} {"level":"info","ts":"2026-03-02T15:54:22.310841Z","caller":"traceutil/trace.go:171","msg":"trace[234477913] range","detail":"{range_begin:/registry/statefulsets/; range_end:/registry/statefulsets0; response_count:0; response_revision:1; }","duration":"595.218858ms","start":"2026-03-02T15:54:21.715618Z","end":"2026-03-02T15:54:22.310837Z","steps":["trace[234477913] 'range keys from in-memory index tree' (duration: 595.107895ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.315644Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.715609Z","time spent":"600.025392ms","remote":"127.0.0.1:35914","response type":"/etcdserverpb.KV/Range","request count":0,"request size":53,"response count":0,"response size":28,"request content":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.310518Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"552.42924ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.315778Z","caller":"traceutil/trace.go:171","msg":"trace[525090344] range","detail":"{range_begin:/registry/controllerrevisions/; range_end:/registry/controllerrevisions0; response_count:0; response_revision:1; }","duration":"557.796099ms","start":"2026-03-02T15:54:21.757968Z","end":"2026-03-02T15:54:22.315765Z","steps":["trace[525090344] 'count revisions from in-memory index tree' (duration: 552.327697ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.315822Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.757939Z","time spent":"557.871641ms","remote":"127.0.0.1:35944","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":0,"response size":28,"request content":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.310443Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"540.899051ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.315988Z","caller":"traceutil/trace.go:171","msg":"trace[478422467] range","detail":"{range_begin:/registry/controllerrevisions/; range_end:/registry/controllerrevisions0; response_count:0; response_revision:1; }","duration":"546.461175ms","start":"2026-03-02T15:54:21.769518Z","end":"2026-03-02T15:54:22.31598Z","steps":["trace[478422467] 'range keys from in-memory index tree' (duration: 540.84324ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.316027Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.757872Z","time spent":"558.145648ms","remote":"127.0.0.1:35944","response type":"/etcdserverpb.KV/Range","request count":0,"request size":67,"response count":0,"response size":28,"request content":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.310397Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.70361Z","time spent":"606.766317ms","remote":"127.0.0.1:35912","response type":"/etcdserverpb.KV/Range","request count":0,"request size":51,"response count":0,"response size":28,"request content":"key:\"/registry/deployments/\" range_end:\"/registry/deployments0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.311469Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.621983Z","time spent":"689.455627ms","remote":"127.0.0.1:35862","response type":"/etcdserverpb.KV/Range","request count":0,"request size":68,"response count":0,"response size":28,"request content":"key:\"/registry/csistoragecapacities/\" range_end:\"/registry/csistoragecapacities0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313293Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.519938Z","time spent":"793.346716ms","remote":"127.0.0.1:35784","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":0,"response size":28,"request content":"key:\"/registry/rolebindings/\" range_end:\"/registry/rolebindings0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.31068Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.592914Z","time spent":"717.751609ms","remote":"127.0.0.1:35840","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":0,"response size":28,"request content":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.312841Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.419955Z","time spent":"892.872782ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":0,"response size":28,"request content":"key:\"/registry/leases/\" range_end:\"/registry/leases0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.313379Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.532737Z","time spent":"780.633327ms","remote":"127.0.0.1:35798","response type":"/etcdserverpb.KV/Range","request count":0,"request size":53,"response count":0,"response size":28,"request content":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" limit:10000 "} {"level":"info","ts":"2026-03-02T15:54:22.316902Z","caller":"traceutil/trace.go:171","msg":"trace[633832869] range","detail":"{range_begin:/registry/ingressclasses/; range_end:/registry/ingressclasses0; response_count:0; response_revision:1; }","duration":"842.048577ms","start":"2026-03-02T15:54:21.46876Z","end":"2026-03-02T15:54:22.310808Z","steps":["trace[633832869] 'count revisions from in-memory index tree' (duration: 841.834551ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.31036Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.582822Z","time spent":"727.521342ms","remote":"127.0.0.1:35838","response type":"/etcdserverpb.KV/Range","request count":0,"request size":63,"response count":0,"response size":28,"request content":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.317137Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.468757Z","time spent":"848.307759ms","remote":"127.0.0.1:35762","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":0,"response size":28,"request content":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.310167Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"411.4208ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.317267Z","caller":"traceutil/trace.go:171","msg":"trace[846553675] range","detail":"{range_begin:/registry/apiregistration.k8s.io/apiservices/; range_end:/registry/apiregistration.k8s.io/apiservices0; response_count:0; response_revision:1; }","duration":"418.651857ms","start":"2026-03-02T15:54:21.898605Z","end":"2026-03-02T15:54:22.317257Z","steps":["trace[846553675] 'range keys from in-memory index tree' (duration: 411.308017ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.317312Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.898576Z","time spent":"418.725149ms","remote":"127.0.0.1:35980","response type":"/etcdserverpb.KV/Range","request count":0,"request size":97,"response count":0,"response size":28,"request content":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.310722Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"717.737199ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.317492Z","caller":"traceutil/trace.go:171","msg":"trace[600472171] range","detail":"{range_begin:/registry/csinodes/; range_end:/registry/csinodes0; response_count:0; response_revision:1; }","duration":"724.644658ms","start":"2026-03-02T15:54:21.592835Z","end":"2026-03-02T15:54:22.317479Z","steps":["trace[600472171] 'range keys from in-memory index tree' (duration: 717.598566ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.317535Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.592823Z","time spent":"724.702149ms","remote":"127.0.0.1:35840","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":0,"response size":28,"request content":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.310772Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"702.885995ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csidrivers/\" range_end:\"/registry/csidrivers0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.317721Z","caller":"traceutil/trace.go:171","msg":"trace[1617666980] range","detail":"{range_begin:/registry/csidrivers/; range_end:/registry/csidrivers0; response_count:0; response_revision:1; }","duration":"709.880056ms","start":"2026-03-02T15:54:21.607833Z","end":"2026-03-02T15:54:22.317713Z","steps":["trace[1617666980] 'count revisions from in-memory index tree' (duration: 702.760652ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.317764Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.607817Z","time spent":"709.937187ms","remote":"127.0.0.1:35854","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":0,"response size":28,"request content":"key:\"/registry/csidrivers/\" range_end:\"/registry/csidrivers0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.311876Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.7449Z","time spent":"566.970377ms","remote":"127.0.0.1:35936","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":0,"response size":28,"request content":"key:\"/registry/replicasets/\" range_end:\"/registry/replicasets0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.311914Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"644.043761ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.317902Z","caller":"traceutil/trace.go:171","msg":"trace[346683371] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:1; }","duration":"650.061157ms","start":"2026-03-02T15:54:21.667822Z","end":"2026-03-02T15:54:22.317883Z","steps":["trace[346683371] 'range keys from in-memory index tree' (duration: 643.968879ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.317949Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.667815Z","time spent":"650.119348ms","remote":"127.0.0.1:35892","response type":"/etcdserverpb.KV/Range","request count":0,"request size":83,"response count":0,"response size":28,"request content":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.31229Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"630.744857ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.318038Z","caller":"traceutil/trace.go:171","msg":"trace[424970768] range","detail":"{range_begin:/registry/flowschemas/; range_end:/registry/flowschemas0; response_count:0; response_revision:1; }","duration":"636.504276ms","start":"2026-03-02T15:54:21.681506Z","end":"2026-03-02T15:54:22.318011Z","steps":["trace[424970768] 'range keys from in-memory index tree' (duration: 630.594104ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:22.312423Z","caller":"traceutil/trace.go:171","msg":"trace[1579850590] range","detail":"{range_begin:/registry/validatingwebhookconfigurations/; range_end:/registry/validatingwebhookconfigurations0; response_count:0; response_revision:1; }","duration":"531.415966ms","start":"2026-03-02T15:54:21.780991Z","end":"2026-03-02T15:54:22.312407Z","steps":["trace[1579850590] 'count revisions from in-memory index tree' (duration: 529.588519ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.318101Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.78097Z","time spent":"537.117943ms","remote":"127.0.0.1:35948","response type":"/etcdserverpb.KV/Range","request count":0,"request size":90,"response count":0,"response size":28,"request content":"key:\"/registry/validatingwebhookconfigurations/\" range_end:\"/registry/validatingwebhookconfigurations0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.318104Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.681484Z","time spent":"636.599768ms","remote":"127.0.0.1:35900","response type":"/etcdserverpb.KV/Range","request count":0,"request size":51,"response count":0,"response size":28,"request content":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.312434Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.694118Z","time spent":"618.302235ms","remote":"127.0.0.1:35910","response type":"/etcdserverpb.KV/Range","request count":0,"request size":83,"response count":0,"response size":28,"request content":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.312707Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"754.45293ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/priorityclasses/\" range_end:\"/registry/priorityclasses0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.318333Z","caller":"traceutil/trace.go:171","msg":"trace[184209616] range","detail":"{range_begin:/registry/priorityclasses/; range_end:/registry/priorityclasses0; response_count:0; response_revision:1; }","duration":"760.111876ms","start":"2026-03-02T15:54:21.558212Z","end":"2026-03-02T15:54:22.318324Z","steps":["trace[184209616] 'count revisions from in-memory index tree' (duration: 754.326976ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.318376Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.558203Z","time spent":"760.162797ms","remote":"127.0.0.1:35820","response type":"/etcdserverpb.KV/Range","request count":0,"request size":58,"response count":0,"response size":28,"request content":"key:\"/registry/priorityclasses/\" range_end:\"/registry/priorityclasses0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.310168Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"615.996246ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.318464Z","caller":"traceutil/trace.go:171","msg":"trace[1232738787] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:1; }","duration":"624.309601ms","start":"2026-03-02T15:54:21.694138Z","end":"2026-03-02T15:54:22.318448Z","steps":["trace[1232738787] 'count revisions from in-memory index tree' (duration: 615.886062ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.318515Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.694075Z","time spent":"624.423813ms","remote":"127.0.0.1:35910","response type":"/etcdserverpb.KV/Range","request count":0,"request size":82,"response count":0,"response size":28,"request content":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.31342Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"780.561995ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.318649Z","caller":"traceutil/trace.go:171","msg":"trace[1731576447] range","detail":"{range_begin:/registry/clusterroles/; range_end:/registry/clusterroles0; response_count:0; response_revision:1; }","duration":"785.814931ms","start":"2026-03-02T15:54:21.532826Z","end":"2026-03-02T15:54:22.318641Z","steps":["trace[1731576447] 'count revisions from in-memory index tree' (duration: 780.486273ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.318696Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.532811Z","time spent":"785.874933ms","remote":"127.0.0.1:35798","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":0,"response size":28,"request content":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313442Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"770.251488ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.318827Z","caller":"traceutil/trace.go:171","msg":"trace[135556879] range","detail":"{range_begin:/registry/clusterrolebindings/; range_end:/registry/clusterrolebindings0; response_count:0; response_revision:1; }","duration":"775.645908ms","start":"2026-03-02T15:54:21.543165Z","end":"2026-03-02T15:54:22.318811Z","steps":["trace[135556879] 'count revisions from in-memory index tree' (duration: 770.185437ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.318877Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.543154Z","time spent":"775.709199ms","remote":"127.0.0.1:35814","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":0,"response size":28,"request content":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313467Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"770.198677ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.319033Z","caller":"traceutil/trace.go:171","msg":"trace[322986156] range","detail":"{range_begin:/registry/clusterrolebindings/; range_end:/registry/clusterrolebindings0; response_count:0; response_revision:1; }","duration":"775.763121ms","start":"2026-03-02T15:54:21.543262Z","end":"2026-03-02T15:54:22.319025Z","steps":["trace[322986156] 'range keys from in-memory index tree' (duration: 770.122385ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.319074Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.54323Z","time spent":"775.834743ms","remote":"127.0.0.1:35814","response type":"/etcdserverpb.KV/Range","request count":0,"request size":67,"response count":0,"response size":28,"request content":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.313491Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"755.24867ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/priorityclasses/\" range_end:\"/registry/priorityclasses0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.319217Z","caller":"traceutil/trace.go:171","msg":"trace[1375768067] range","detail":"{range_begin:/registry/priorityclasses/; range_end:/registry/priorityclasses0; response_count:0; response_revision:1; }","duration":"760.985028ms","start":"2026-03-02T15:54:21.558225Z","end":"2026-03-02T15:54:22.31921Z","steps":["trace[1375768067] 'range keys from in-memory index tree' (duration: 755.180848ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.319266Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.558214Z","time spent":"761.04179ms","remote":"127.0.0.1:35820","response type":"/etcdserverpb.KV/Range","request count":0,"request size":59,"response count":0,"response size":28,"request content":"key:\"/registry/priorityclasses/\" range_end:\"/registry/priorityclasses0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.313666Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"913.711932ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cronjobs/\" range_end:\"/registry/cronjobs0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.319478Z","caller":"traceutil/trace.go:171","msg":"trace[495029681] range","detail":"{range_begin:/registry/cronjobs/; range_end:/registry/cronjobs0; response_count:0; response_revision:1; }","duration":"919.525572ms","start":"2026-03-02T15:54:21.399939Z","end":"2026-03-02T15:54:22.319465Z","steps":["trace[495029681] 'count revisions from in-memory index tree' (duration: 913.690262ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.319528Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.399936Z","time spent":"919.577683ms","remote":"127.0.0.1:35718","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":0,"response size":28,"request content":"key:\"/registry/cronjobs/\" range_end:\"/registry/cronjobs0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313688Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"902.609905ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.319619Z","caller":"traceutil/trace.go:171","msg":"trace[520402433] range","detail":"{range_begin:/registry/certificatesigningrequests/; range_end:/registry/certificatesigningrequests0; response_count:0; response_revision:1; }","duration":"908.542798ms","start":"2026-03-02T15:54:21.411062Z","end":"2026-03-02T15:54:22.319605Z","steps":["trace[520402433] 'count revisions from in-memory index tree' (duration: 902.583384ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.319669Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.411056Z","time spent":"908.60042ms","remote":"127.0.0.1:35734","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":0,"response size":28,"request content":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313705Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"902.508262ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.319805Z","caller":"traceutil/trace.go:171","msg":"trace[187601311] range","detail":"{range_begin:/registry/certificatesigningrequests/; range_end:/registry/certificatesigningrequests0; response_count:0; response_revision:1; }","duration":"908.599999ms","start":"2026-03-02T15:54:21.411181Z","end":"2026-03-02T15:54:22.319781Z","steps":["trace[187601311] 'range keys from in-memory index tree' (duration: 902.479751ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.319853Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.411177Z","time spent":"908.659792ms","remote":"127.0.0.1:35734","response type":"/etcdserverpb.KV/Range","request count":0,"request size":81,"response count":0,"response size":28,"request content":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.313733Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"871.690775ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/networkpolicies/\" range_end:\"/registry/networkpolicies0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.319973Z","caller":"traceutil/trace.go:171","msg":"trace[23191592] range","detail":"{range_begin:/registry/networkpolicies/; range_end:/registry/networkpolicies0; response_count:0; response_revision:1; }","duration":"877.927866ms","start":"2026-03-02T15:54:21.442037Z","end":"2026-03-02T15:54:22.319965Z","steps":["trace[23191592] 'count revisions from in-memory index tree' (duration: 871.649194ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.320022Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.442025Z","time spent":"877.986957ms","remote":"127.0.0.1:35742","response type":"/etcdserverpb.KV/Range","request count":0,"request size":58,"response count":0,"response size":28,"request content":"key:\"/registry/networkpolicies/\" range_end:\"/registry/networkpolicies0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.31375Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"893.737805ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/\" range_end:\"/registry/leases0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.32012Z","caller":"traceutil/trace.go:171","msg":"trace[86315170] range","detail":"{range_begin:/registry/leases/; range_end:/registry/leases0; response_count:0; response_revision:1; }","duration":"900.11944ms","start":"2026-03-02T15:54:21.419988Z","end":"2026-03-02T15:54:22.320108Z","steps":["trace[86315170] 'count revisions from in-memory index tree' (duration: 893.642742ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.320222Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.419975Z","time spent":"900.201352ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":0,"response size":28,"request content":"key:\"/registry/leases/\" range_end:\"/registry/leases0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313771Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"884.385693ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/endpointslices/\" range_end:\"/registry/endpointslices0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.320328Z","caller":"traceutil/trace.go:171","msg":"trace[1023440274] range","detail":"{range_begin:/registry/endpointslices/; range_end:/registry/endpointslices0; response_count:0; response_revision:1; }","duration":"890.949893ms","start":"2026-03-02T15:54:21.429364Z","end":"2026-03-02T15:54:22.320314Z","steps":["trace[1023440274] 'count revisions from in-memory index tree' (duration: 884.319782ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.320382Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.429355Z","time spent":"891.011414ms","remote":"127.0.0.1:35740","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":0,"response size":28,"request content":"key:\"/registry/endpointslices/\" range_end:\"/registry/endpointslices0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313774Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"853.812522ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.320468Z","caller":"traceutil/trace.go:171","msg":"trace[954354171] range","detail":"{range_begin:/registry/ingress/; range_end:/registry/ingress0; response_count:0; response_revision:1; }","duration":"860.514255ms","start":"2026-03-02T15:54:21.459945Z","end":"2026-03-02T15:54:22.320459Z","steps":["trace[954354171] 'count revisions from in-memory index tree' (duration: 853.78938ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.320512Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.459942Z","time spent":"860.559176ms","remote":"127.0.0.1:35748","response type":"/etcdserverpb.KV/Range","request count":0,"request size":42,"response count":0,"response size":28,"request content":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:54:22.313787Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"884.330361ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/endpointslices/\" range_end:\"/registry/endpointslices0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.320577Z","caller":"traceutil/trace.go:171","msg":"trace[330226540] range","detail":"{range_begin:/registry/endpointslices/; range_end:/registry/endpointslices0; response_count:0; response_revision:1; }","duration":"891.115327ms","start":"2026-03-02T15:54:21.429451Z","end":"2026-03-02T15:54:22.320566Z","steps":["trace[330226540] 'range keys from in-memory index tree' (duration: 884.27327ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.320619Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.429428Z","time spent":"891.177949ms","remote":"127.0.0.1:35740","response type":"/etcdserverpb.KV/Range","request count":0,"request size":57,"response count":0,"response size":28,"request content":"key:\"/registry/endpointslices/\" range_end:\"/registry/endpointslices0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.313812Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"853.897384ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.321488Z","caller":"traceutil/trace.go:171","msg":"trace[1038656074] range","detail":"{range_begin:/registry/ingress/; range_end:/registry/ingress0; response_count:0; response_revision:1; }","duration":"861.571652ms","start":"2026-03-02T15:54:21.459901Z","end":"2026-03-02T15:54:22.321472Z","steps":["trace[1038656074] 'range keys from in-memory index tree' (duration: 853.824872ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.321561Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.459893Z","time spent":"861.650884ms","remote":"127.0.0.1:35748","response type":"/etcdserverpb.KV/Range","request count":0,"request size":43,"response count":0,"response size":28,"request content":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.31381Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"871.779136ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/networkpolicies/\" range_end:\"/registry/networkpolicies0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-03-02T15:54:22.321654Z","caller":"traceutil/trace.go:171","msg":"trace[1725397781] range","detail":"{range_begin:/registry/networkpolicies/; range_end:/registry/networkpolicies0; response_count:0; response_revision:1; }","duration":"879.635579ms","start":"2026-03-02T15:54:21.442007Z","end":"2026-03-02T15:54:22.321643Z","steps":["trace[1725397781] 'range keys from in-memory index tree' (duration: 871.714275ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:22.321689Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.441998Z","time spent":"879.680731ms","remote":"127.0.0.1:35742","response type":"/etcdserverpb.KV/Range","request count":0,"request size":59,"response count":0,"response size":28,"request content":"key:\"/registry/networkpolicies/\" range_end:\"/registry/networkpolicies0\" limit:10000 "} {"level":"warn","ts":"2026-03-02T15:54:22.314087Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:21.656216Z","time spent":"657.851989ms","remote":"127.0.0.1:35876","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":0,"response size":28,"request content":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true "} {"level":"info","ts":"2026-03-02T15:54:59.076758Z","caller":"traceutil/trace.go:171","msg":"trace[229444045] linearizableReadLoop","detail":"{readStateIndex:509; appliedIndex:508; }","duration":"261.683004ms","start":"2026-03-02T15:54:58.81505Z","end":"2026-03-02T15:54:59.076733Z","steps":["trace[229444045] 'read index received' (duration: 261.453398ms)","trace[229444045] 'applied index is now lower than readState.Index' (duration: 228.716µs)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:54:59.076879Z","caller":"traceutil/trace.go:171","msg":"trace[275138043] transaction","detail":"{read_only:false; response_revision:491; number_of_response:1; }","duration":"799.411614ms","start":"2026-03-02T15:54:58.277457Z","end":"2026-03-02T15:54:59.076869Z","steps":["trace[275138043] 'process raft request' (duration: 799.117856ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:59.077003Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"261.52652ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-03-02T15:54:59.077118Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"217.216703ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:54:59.077126Z","caller":"traceutil/trace.go:171","msg":"trace[826679938] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:491; }","duration":"261.695155ms","start":"2026-03-02T15:54:58.815413Z","end":"2026-03-02T15:54:59.077108Z","steps":["trace[826679938] 'agreement among raft nodes before linearized reading' (duration: 261.530671ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:59.077149Z","caller":"traceutil/trace.go:171","msg":"trace[545382117] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:491; }","duration":"217.287345ms","start":"2026-03-02T15:54:58.859852Z","end":"2026-03-02T15:54:59.07714Z","steps":["trace[545382117] 'agreement among raft nodes before linearized reading' (duration: 217.240863ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:59.077254Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"262.202187ms","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-03-02T15:54:59.077275Z","caller":"traceutil/trace.go:171","msg":"trace[441743823] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:491; }","duration":"262.268549ms","start":"2026-03-02T15:54:58.814999Z","end":"2026-03-02T15:54:59.077268Z","steps":["trace[441743823] 'agreement among raft nodes before linearized reading' (duration: 262.223238ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:54:59.077817Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:58.277425Z","time spent":"799.490386ms","remote":"127.0.0.1:35652","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-02T15:54:59.226674Z","caller":"traceutil/trace.go:171","msg":"trace[716198870] transaction","detail":"{read_only:false; response_revision:494; number_of_response:1; }","duration":"144.434279ms","start":"2026-03-02T15:54:59.082216Z","end":"2026-03-02T15:54:59.226651Z","steps":["trace[716198870] 'process raft request' (duration: 144.387308ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:54:59.22691Z","caller":"traceutil/trace.go:171","msg":"trace[118180284] transaction","detail":"{read_only:false; response_revision:493; number_of_response:1; }","duration":"145.493926ms","start":"2026-03-02T15:54:59.081393Z","end":"2026-03-02T15:54:59.226887Z","steps":["trace[118180284] 'process raft request' (duration: 145.081685ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:00.012098Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"367.100192ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-03-02T15:55:00.012208Z","caller":"traceutil/trace.go:171","msg":"trace[883101720] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:494; }","duration":"367.265297ms","start":"2026-03-02T15:54:59.644912Z","end":"2026-03-02T15:55:00.012177Z","steps":["trace[883101720] 'range keys from in-memory index tree' (duration: 366.931659ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:00.013002Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:54:59.644887Z","time spent":"368.096278ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-03-02T15:55:00.741456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.924027ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-03-02T15:55:00.741628Z","caller":"traceutil/trace.go:171","msg":"trace[1719544010] transaction","detail":"{read_only:false; response_revision:495; number_of_response:1; }","duration":"724.72976ms","start":"2026-03-02T15:55:00.016885Z","end":"2026-03-02T15:55:00.741615Z","steps":["trace[1719544010] 'process raft request' (duration: 724.643348ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:00.7417Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:00.016858Z","time spent":"724.796221ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-02T15:55:16.301661Z","caller":"traceutil/trace.go:171","msg":"trace[1851526270] linearizableReadLoop","detail":"{readStateIndex:663; appliedIndex:662; }","duration":"160.386432ms","start":"2026-03-02T15:55:16.141252Z","end":"2026-03-02T15:55:16.301639Z","steps":["trace[1851526270] 'read index received' (duration: 160.240788ms)","trace[1851526270] 'applied index is now lower than readState.Index' (duration: 144.554µs)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:55:16.301835Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.564507ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:490"} {"level":"info","ts":"2026-03-02T15:55:16.301867Z","caller":"traceutil/trace.go:171","msg":"trace[576095755] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:639; }","duration":"160.635818ms","start":"2026-03-02T15:55:16.141221Z","end":"2026-03-02T15:55:16.301857Z","steps":["trace[576095755] 'agreement among raft nodes before linearized reading' (duration: 160.498944ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:16.301838Z","caller":"traceutil/trace.go:171","msg":"trace[1135942704] transaction","detail":"{read_only:false; response_revision:639; number_of_response:1; }","duration":"181.927719ms","start":"2026-03-02T15:55:16.119761Z","end":"2026-03-02T15:55:16.301689Z","steps":["trace[1135942704] 'process raft request' (duration: 181.751335ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:18.618833Z","caller":"traceutil/trace.go:171","msg":"trace[344086229] transaction","detail":"{read_only:false; response_revision:674; number_of_response:1; }","duration":"264.619357ms","start":"2026-03-02T15:55:18.354188Z","end":"2026-03-02T15:55:18.618807Z","steps":["trace[344086229] 'process raft request' (duration: 264.465182ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:18.631592Z","caller":"traceutil/trace.go:171","msg":"trace[1888492389] linearizableReadLoop","detail":"{readStateIndex:700; appliedIndex:698; }","duration":"243.874803ms","start":"2026-03-02T15:55:18.387694Z","end":"2026-03-02T15:55:18.631569Z","steps":["trace[1888492389] 'read index received' (duration: 231.001197ms)","trace[1888492389] 'applied index is now lower than readState.Index' (duration: 12.872606ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:55:18.631687Z","caller":"traceutil/trace.go:171","msg":"trace[70617236] transaction","detail":"{read_only:false; response_revision:675; number_of_response:1; }","duration":"254.556779ms","start":"2026-03-02T15:55:18.377085Z","end":"2026-03-02T15:55:18.631641Z","steps":["trace[70617236] 'process raft request' (duration: 254.383654ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:18.631831Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.115189ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/coredns-7c96b6546b-69wkk\" ","response":"range_response_count:1 size:4884"} {"level":"info","ts":"2026-03-02T15:55:18.631877Z","caller":"traceutil/trace.go:171","msg":"trace[804611018] range","detail":"{range_begin:/registry/pods/kube-system/coredns-7c96b6546b-69wkk; range_end:; response_count:1; response_revision:675; }","duration":"244.221253ms","start":"2026-03-02T15:55:18.387645Z","end":"2026-03-02T15:55:18.631866Z","steps":["trace[804611018] 'agreement among raft nodes before linearized reading' (duration: 244.019157ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:19.631932Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"772.814328ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:55:19.631991Z","caller":"traceutil/trace.go:171","msg":"trace[1426245180] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:675; }","duration":"772.929832ms","start":"2026-03-02T15:55:18.859043Z","end":"2026-03-02T15:55:19.631973Z","steps":["trace[1426245180] 'range keys from in-memory index tree' (duration: 772.720836ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:19.632017Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:18.859019Z","time spent":"772.992663ms","remote":"127.0.0.1:35436","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-03-02T15:55:19.632093Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"408.664959ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-03-02T15:55:19.632161Z","caller":"traceutil/trace.go:171","msg":"trace[1299070002] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:675; }","duration":"408.797103ms","start":"2026-03-02T15:55:19.223342Z","end":"2026-03-02T15:55:19.632139Z","steps":["trace[1299070002] 'range keys from in-memory index tree' (duration: 408.467564ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:19.632151Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"311.606106ms","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-03-02T15:55:19.6322Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:19.223299Z","time spent":"408.894776ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-03-02T15:55:19.632169Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"311.566515ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-03-02T15:55:19.632231Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"717.987292ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-03-02T15:55:19.632289Z","caller":"traceutil/trace.go:171","msg":"trace[2116959784] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:675; }","duration":"311.76265ms","start":"2026-03-02T15:55:19.320497Z","end":"2026-03-02T15:55:19.63226Z","steps":["trace[2116959784] 'range keys from in-memory index tree' (duration: 311.231306ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:19.632305Z","caller":"traceutil/trace.go:171","msg":"trace[270950237] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:675; }","duration":"718.071835ms","start":"2026-03-02T15:55:18.914216Z","end":"2026-03-02T15:55:19.632288Z","steps":["trace[270950237] 'range keys from in-memory index tree' (duration: 717.788477ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:19.632347Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:18.914077Z","time spent":"718.26258ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-03-02T15:55:19.632361Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:19.32047Z","time spent":"311.877153ms","remote":"127.0.0.1:35738","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":"info","ts":"2026-03-02T15:55:19.632215Z","caller":"traceutil/trace.go:171","msg":"trace[1453281414] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:675; }","duration":"311.715729ms","start":"2026-03-02T15:55:19.320483Z","end":"2026-03-02T15:55:19.632199Z","steps":["trace[1453281414] 'range keys from in-memory index tree' (duration: 311.37547ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:19.632434Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:19.320452Z","time spent":"311.976837ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-03-02T15:55:19.826333Z","caller":"traceutil/trace.go:171","msg":"trace[565507813] transaction","detail":"{read_only:false; response_revision:678; number_of_response:1; }","duration":"189.810839ms","start":"2026-03-02T15:55:19.636506Z","end":"2026-03-02T15:55:19.826317Z","steps":["trace[565507813] 'process raft request' (duration: 189.756047ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:19.826493Z","caller":"traceutil/trace.go:171","msg":"trace[1366704444] transaction","detail":"{read_only:false; response_revision:679; number_of_response:1; }","duration":"189.797268ms","start":"2026-03-02T15:55:19.636686Z","end":"2026-03-02T15:55:19.826483Z","steps":["trace[1366704444] 'process raft request' (duration: 189.608283ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:19.826329Z","caller":"traceutil/trace.go:171","msg":"trace[1087649877] transaction","detail":"{read_only:false; response_revision:677; number_of_response:1; }","duration":"190.009734ms","start":"2026-03-02T15:55:19.636294Z","end":"2026-03-02T15:55:19.826303Z","steps":["trace[1087649877] 'process raft request' (duration: 189.818209ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:23.892649Z","caller":"traceutil/trace.go:171","msg":"trace[1317903030] transaction","detail":"{read_only:false; response_revision:686; number_of_response:1; }","duration":"222.41721ms","start":"2026-03-02T15:55:23.670216Z","end":"2026-03-02T15:55:23.892634Z","steps":["trace[1317903030] 'process raft request' (duration: 222.258036ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:23.892939Z","caller":"traceutil/trace.go:171","msg":"trace[50734227] linearizableReadLoop","detail":"{readStateIndex:712; appliedIndex:711; }","duration":"162.087161ms","start":"2026-03-02T15:55:23.730513Z","end":"2026-03-02T15:55:23.892601Z","steps":["trace[50734227] 'read index received' (duration: 161.924207ms)","trace[50734227] 'applied index is now lower than readState.Index' (duration: 162.254µs)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:55:23.892995Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.472413ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-03-02T15:55:23.893063Z","caller":"traceutil/trace.go:171","msg":"trace[1063765455] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:686; }","duration":"162.584786ms","start":"2026-03-02T15:55:23.73046Z","end":"2026-03-02T15:55:23.893045Z","steps":["trace[1063765455] 'agreement among raft nodes before linearized reading' (duration: 162.399091ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:23.999964Z","caller":"traceutil/trace.go:171","msg":"trace[1293628686] transaction","detail":"{read_only:false; response_revision:688; number_of_response:1; }","duration":"102.70589ms","start":"2026-03-02T15:55:23.897236Z","end":"2026-03-02T15:55:23.999942Z","steps":["trace[1293628686] 'process raft request' (duration: 102.536155ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:24.000156Z","caller":"traceutil/trace.go:171","msg":"trace[94516266] transaction","detail":"{read_only:false; response_revision:689; number_of_response:1; }","duration":"102.499634ms","start":"2026-03-02T15:55:23.897642Z","end":"2026-03-02T15:55:24.000142Z","steps":["trace[94516266] 'process raft request' (duration: 102.264398ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:24.000231Z","caller":"traceutil/trace.go:171","msg":"trace[1066608573] transaction","detail":"{read_only:false; response_revision:690; number_of_response:1; }","duration":"102.487454ms","start":"2026-03-02T15:55:23.897713Z","end":"2026-03-02T15:55:24.0002Z","steps":["trace[1066608573] 'process raft request' (duration: 102.37047ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:25.158209Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":9823086013787892909,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-02T15:55:25.659608Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":9823086013787892909,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-02T15:55:26.160709Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":9823086013787892909,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-02T15:55:26.354111Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.770743602s","expected-duration":"1s"} {"level":"warn","ts":"2026-03-02T15:55:26.354613Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:24.583275Z","time spent":"1.771332738s","remote":"127.0.0.1:35486","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"warn","ts":"2026-03-02T15:55:26.490185Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:25.603383Z","time spent":"886.79806ms","remote":"127.0.0.1:35542","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"info","ts":"2026-03-02T15:55:26.490285Z","caller":"traceutil/trace.go:171","msg":"trace[346852994] linearizableReadLoop","detail":"{readStateIndex:718; appliedIndex:716; }","duration":"1.832863209s","start":"2026-03-02T15:55:24.657391Z","end":"2026-03-02T15:55:26.490255Z","steps":["trace[346852994] 'read index received' (duration: 1.697150497s)","trace[346852994] 'applied index is now lower than readState.Index' (duration: 135.709642ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:55:26.490367Z","caller":"traceutil/trace.go:171","msg":"trace[890245978] transaction","detail":"{read_only:false; response_revision:691; number_of_response:1; }","duration":"134.454948ms","start":"2026-03-02T15:55:26.355885Z","end":"2026-03-02T15:55:26.49034Z","steps":["trace[890245978] 'process raft request' (duration: 134.302464ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:26.490502Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.628647143s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:55:26.490541Z","caller":"traceutil/trace.go:171","msg":"trace[1262243418] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:691; }","duration":"1.628723175s","start":"2026-03-02T15:55:24.861803Z","end":"2026-03-02T15:55:26.490526Z","steps":["trace[1262243418] 'agreement among raft nodes before linearized reading' (duration: 1.628605992s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:26.490547Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"480.834656ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-03-02T15:55:26.490544Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.833130908s","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-03-02T15:55:26.490577Z","caller":"traceutil/trace.go:171","msg":"trace[1206560073] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:691; }","duration":"480.892247ms","start":"2026-03-02T15:55:26.009675Z","end":"2026-03-02T15:55:26.490568Z","steps":["trace[1206560073] 'agreement among raft nodes before linearized reading' (duration: 480.755723ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:26.4906Z","caller":"traceutil/trace.go:171","msg":"trace[13525395] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:691; }","duration":"1.83323s","start":"2026-03-02T15:55:24.657357Z","end":"2026-03-02T15:55:26.490587Z","steps":["trace[13525395] 'agreement among raft nodes before linearized reading' (duration: 1.833002323s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:26.49061Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:26.009665Z","time spent":"480.939368ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-03-02T15:55:26.490628Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"552.58958ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-03-02T15:55:26.490631Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"483.071767ms","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-03-02T15:55:26.490684Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.348631ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-03-02T15:55:26.490682Z","caller":"traceutil/trace.go:171","msg":"trace[2136962548] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:691; }","duration":"483.16206ms","start":"2026-03-02T15:55:26.007505Z","end":"2026-03-02T15:55:26.490667Z","steps":["trace[2136962548] 'agreement among raft nodes before linearized reading' (duration: 483.013576ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:26.490696Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"483.056826ms","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-03-02T15:55:26.490702Z","caller":"traceutil/trace.go:171","msg":"trace[1134981160] range","detail":"{range_begin:/registry/clusterrolebindings/; range_end:/registry/clusterrolebindings0; response_count:0; response_revision:691; }","duration":"174.399303ms","start":"2026-03-02T15:55:26.316297Z","end":"2026-03-02T15:55:26.490696Z","steps":["trace[1134981160] 'agreement among raft nodes before linearized reading' (duration: 174.346991ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:26.490714Z","caller":"traceutil/trace.go:171","msg":"trace[717848020] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:691; }","duration":"483.108258ms","start":"2026-03-02T15:55:26.007601Z","end":"2026-03-02T15:55:26.490709Z","steps":["trace[717848020] 'agreement among raft nodes before linearized reading' (duration: 483.061407ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:26.490716Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:26.007485Z","time spent":"483.223492ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-03-02T15:55:26.49073Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:26.007578Z","time spent":"483.148739ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-03-02T15:55:26.490628Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:24.657338Z","time spent":"1.833285122s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-03-02T15:55:26.490784Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"258.150188ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:55:26.4908Z","caller":"traceutil/trace.go:171","msg":"trace[2065015757] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:691; }","duration":"258.22502ms","start":"2026-03-02T15:55:26.232571Z","end":"2026-03-02T15:55:26.490796Z","steps":["trace[2065015757] 'agreement among raft nodes before linearized reading' (duration: 258.20251ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:26.49065Z","caller":"traceutil/trace.go:171","msg":"trace[1862621167] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:691; }","duration":"552.63406ms","start":"2026-03-02T15:55:25.938011Z","end":"2026-03-02T15:55:26.490645Z","steps":["trace[1862621167] 'agreement among raft nodes before linearized reading' (duration: 552.568758ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:26.490845Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:25.937995Z","time spent":"552.843326ms","remote":"127.0.0.1:35738","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-03-02T15:55:26.490566Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:24.861785Z","time spent":"1.628777547s","remote":"127.0.0.1:35436","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-03-02T15:55:32.802859Z","caller":"traceutil/trace.go:171","msg":"trace[116091783] transaction","detail":"{read_only:false; response_revision:719; number_of_response:1; }","duration":"181.89361ms","start":"2026-03-02T15:55:32.62094Z","end":"2026-03-02T15:55:32.802834Z","steps":["trace[116091783] 'process raft request' (duration: 181.849169ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:32.803252Z","caller":"traceutil/trace.go:171","msg":"trace[91057740] transaction","detail":"{read_only:false; response_revision:717; number_of_response:1; }","duration":"182.734863ms","start":"2026-03-02T15:55:32.620495Z","end":"2026-03-02T15:55:32.80323Z","steps":["trace[91057740] 'process raft request' (duration: 182.218938ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:32.803291Z","caller":"traceutil/trace.go:171","msg":"trace[1341767917] transaction","detail":"{read_only:false; response_revision:716; number_of_response:1; }","duration":"184.290256ms","start":"2026-03-02T15:55:32.618976Z","end":"2026-03-02T15:55:32.803267Z","steps":["trace[1341767917] 'process raft request' (duration: 132.278668ms)","trace[1341767917] 'compare' (duration: 51.348739ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:55:32.803372Z","caller":"traceutil/trace.go:171","msg":"trace[2048804204] transaction","detail":"{read_only:false; response_revision:718; number_of_response:1; }","duration":"182.588988ms","start":"2026-03-02T15:55:32.620769Z","end":"2026-03-02T15:55:32.803358Z","steps":["trace[2048804204] 'process raft request' (duration: 181.988672ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:52.869992Z","caller":"traceutil/trace.go:171","msg":"trace[1910493101] transaction","detail":"{read_only:false; response_revision:771; number_of_response:1; }","duration":"138.917501ms","start":"2026-03-02T15:55:52.731039Z","end":"2026-03-02T15:55:52.869957Z","steps":["trace[1910493101] 'process raft request' (duration: 138.651364ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:53.411658Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"310.655459ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-02T15:55:53.411823Z","caller":"traceutil/trace.go:171","msg":"trace[1859842825] linearizableReadLoop","detail":"{readStateIndex:805; appliedIndex:804; }","duration":"456.070749ms","start":"2026-03-02T15:55:52.955688Z","end":"2026-03-02T15:55:53.411758Z","steps":["trace[1859842825] 'read index received' (duration: 145.169064ms)","trace[1859842825] 'applied index is now lower than readState.Index' (duration: 310.900425ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:55:53.412075Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"456.372548ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-03-02T15:55:53.412117Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"224.570858ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cronjobs/\" range_end:\"/registry/cronjobs0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:55:53.412101Z","caller":"traceutil/trace.go:171","msg":"trace[15247840] transaction","detail":"{read_only:false; response_revision:772; number_of_response:1; }","duration":"499.080019ms","start":"2026-03-02T15:55:52.91299Z","end":"2026-03-02T15:55:53.41207Z","steps":["trace[15247840] 'process raft request' (duration: 187.922906ms)","trace[15247840] 'compare' (duration: 310.530525ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:55:53.412157Z","caller":"traceutil/trace.go:171","msg":"trace[2111978991] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:772; }","duration":"456.481631ms","start":"2026-03-02T15:55:52.955655Z","end":"2026-03-02T15:55:53.412137Z","steps":["trace[2111978991] 'agreement among raft nodes before linearized reading' (duration: 456.238944ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:53.412182Z","caller":"traceutil/trace.go:171","msg":"trace[352585889] range","detail":"{range_begin:/registry/cronjobs/; range_end:/registry/cronjobs0; response_count:0; response_revision:772; }","duration":"224.687411ms","start":"2026-03-02T15:55:53.187476Z","end":"2026-03-02T15:55:53.412164Z","steps":["trace[352585889] 'agreement among raft nodes before linearized reading' (duration: 224.543317ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:53.412172Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"429.735991ms","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-03-02T15:55:53.412246Z","caller":"traceutil/trace.go:171","msg":"trace[946215376] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:772; }","duration":"429.841344ms","start":"2026-03-02T15:55:52.982389Z","end":"2026-03-02T15:55:53.41223Z","steps":["trace[946215376] 'agreement among raft nodes before linearized reading' (duration: 429.731951ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:53.412265Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:52.912968Z","time spent":"499.222242ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-02T15:55:53.412345Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:52.982368Z","time spent":"429.942617ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-03-02T15:55:53.412203Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:52.955643Z","time spent":"456.551033ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-03-02T15:55:53.412098Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"429.997978ms","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-03-02T15:55:53.41249Z","caller":"traceutil/trace.go:171","msg":"trace[1026385962] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:772; }","duration":"430.42067ms","start":"2026-03-02T15:55:52.982057Z","end":"2026-03-02T15:55:53.412477Z","steps":["trace[1026385962] 'agreement among raft nodes before linearized reading' (duration: 429.884085ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:53.412537Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:52.982041Z","time spent":"430.485202ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-03-02T15:55:53.536696Z","caller":"traceutil/trace.go:171","msg":"trace[1703627246] transaction","detail":"{read_only:false; response_revision:774; number_of_response:1; }","duration":"120.087971ms","start":"2026-03-02T15:55:53.416566Z","end":"2026-03-02T15:55:53.536654Z","steps":["trace[1703627246] 'process raft request' (duration: 94.821862ms)","trace[1703627246] 'compare' (duration: 25.091974ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:55:53.536731Z","caller":"traceutil/trace.go:171","msg":"trace[2091259267] transaction","detail":"{read_only:false; response_revision:775; number_of_response:1; }","duration":"119.472273ms","start":"2026-03-02T15:55:53.417231Z","end":"2026-03-02T15:55:53.536703Z","steps":["trace[2091259267] 'process raft request' (duration: 119.36288ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:55.954094Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":9823086013787893158,"retry-timeout":"500ms"} {"level":"info","ts":"2026-03-02T15:55:56.160923Z","caller":"traceutil/trace.go:171","msg":"trace[1885041464] linearizableReadLoop","detail":"{readStateIndex:813; appliedIndex:812; }","duration":"706.864785ms","start":"2026-03-02T15:55:55.454026Z","end":"2026-03-02T15:55:56.160891Z","steps":["trace[1885041464] 'read index received' (duration: 706.627178ms)","trace[1885041464] 'applied index is now lower than readState.Index' (duration: 236.427µs)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:55:56.161245Z","caller":"traceutil/trace.go:171","msg":"trace[870559150] transaction","detail":"{read_only:false; response_revision:779; number_of_response:1; }","duration":"737.610336ms","start":"2026-03-02T15:55:55.423601Z","end":"2026-03-02T15:55:56.161211Z","steps":["trace[870559150] 'process raft request' (duration: 737.129862ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:56.161337Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"490.806141ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-02T15:55:56.161372Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:55.423583Z","time spent":"737.734758ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-02T15:55:56.161407Z","caller":"traceutil/trace.go:171","msg":"trace[1912387669] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:779; }","duration":"490.940745ms","start":"2026-03-02T15:55:55.670456Z","end":"2026-03-02T15:55:56.161397Z","steps":["trace[1912387669] 'agreement among raft nodes before linearized reading' (duration: 490.76732ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:56.161438Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:55.670428Z","time spent":"490.998627ms","remote":"127.0.0.1:35606","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":0,"response size":29,"request content":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:55:56.161413Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"620.307681ms","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-03-02T15:55:56.161476Z","caller":"traceutil/trace.go:171","msg":"trace[386007821] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:779; }","duration":"620.403284ms","start":"2026-03-02T15:55:55.541056Z","end":"2026-03-02T15:55:56.16146Z","steps":["trace[386007821] 'agreement among raft nodes before linearized reading' (duration: 620.171558ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:56.161514Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:55.541043Z","time spent":"620.464196ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-03-02T15:55:56.161686Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"707.667878ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-03-02T15:55:56.161708Z","caller":"traceutil/trace.go:171","msg":"trace[442409532] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:779; }","duration":"707.722569ms","start":"2026-03-02T15:55:55.453978Z","end":"2026-03-02T15:55:56.161701Z","steps":["trace[442409532] 'agreement among raft nodes before linearized reading' (duration: 707.141253ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:56.161761Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:55.453962Z","time spent":"707.793881ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-03-02T15:55:56.162277Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"621.868364ms","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-03-02T15:55:56.162315Z","caller":"traceutil/trace.go:171","msg":"trace[785621045] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:779; }","duration":"621.959238ms","start":"2026-03-02T15:55:55.540345Z","end":"2026-03-02T15:55:56.162304Z","steps":["trace[785621045] 'agreement among raft nodes before linearized reading' (duration: 620.830067ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:56.162347Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:55.540321Z","time spent":"622.017189ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-03-02T15:55:56.432006Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"494.782541ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-03-02T15:55:56.432097Z","caller":"traceutil/trace.go:171","msg":"trace[1903322449] range","detail":"{range_begin:/registry/pods/; range_end:/registry/pods0; response_count:0; response_revision:779; }","duration":"494.931125ms","start":"2026-03-02T15:55:55.937141Z","end":"2026-03-02T15:55:56.432072Z","steps":["trace[1903322449] 'agreement among raft nodes before linearized reading' (duration: 224.338343ms)","trace[1903322449] 'count revisions from in-memory index tree' (duration: 270.453228ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:55:56.432146Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:55.937121Z","time spent":"495.015178ms","remote":"127.0.0.1:35652","response type":"/etcdserverpb.KV/Range","request count":0,"request size":36,"response count":10,"response size":31,"request content":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true "} {"level":"info","ts":"2026-03-02T15:55:56.432137Z","caller":"traceutil/trace.go:171","msg":"trace[571630915] transaction","detail":"{read_only:false; response_revision:780; number_of_response:1; }","duration":"267.152867ms","start":"2026-03-02T15:55:56.164956Z","end":"2026-03-02T15:55:56.432109Z","steps":["trace[571630915] 'process raft request' (duration: 215.761246ms)","trace[571630915] 'compare' (duration: 51.177525ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:55:56.988897Z","caller":"traceutil/trace.go:171","msg":"trace[252505661] transaction","detail":"{read_only:false; response_revision:781; number_of_response:1; }","duration":"823.500459ms","start":"2026-03-02T15:55:56.165373Z","end":"2026-03-02T15:55:56.988873Z","steps":["trace[252505661] 'process raft request' (duration: 790.784554ms)","trace[252505661] 'compare' (duration: 32.137539ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:55:56.989037Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:56.165362Z","time spent":"823.609912ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-02T15:55:56.989068Z","caller":"traceutil/trace.go:171","msg":"trace[1295743955] linearizableReadLoop","detail":"{readStateIndex:816; appliedIndex:813; }","duration":"757.896885ms","start":"2026-03-02T15:55:56.231142Z","end":"2026-03-02T15:55:56.989039Z","steps":["trace[1295743955] 'read index received' (duration: 149.576326ms)","trace[1295743955] 'applied index is now lower than readState.Index' (duration: 608.319299ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:55:56.989437Z","caller":"traceutil/trace.go:171","msg":"trace[209034243] transaction","detail":"{read_only:false; response_revision:782; number_of_response:1; }","duration":"823.88688ms","start":"2026-03-02T15:55:56.165534Z","end":"2026-03-02T15:55:56.989421Z","steps":["trace[209034243] 'process raft request' (duration: 823.267463ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:56.989496Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"423.464858ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/horizontalpodautoscalers/\" range_end:\"/registry/horizontalpodautoscalers0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-02T15:55:56.989518Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"758.370418ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:55:56.989536Z","caller":"traceutil/trace.go:171","msg":"trace[1400694498] range","detail":"{range_begin:/registry/horizontalpodautoscalers/; range_end:/registry/horizontalpodautoscalers0; response_count:0; response_revision:782; }","duration":"423.54059ms","start":"2026-03-02T15:55:56.565982Z","end":"2026-03-02T15:55:56.989523Z","steps":["trace[1400694498] 'agreement among raft nodes before linearized reading' (duration: 423.478798ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:55:56.9896Z","caller":"traceutil/trace.go:171","msg":"trace[484087963] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:782; }","duration":"758.44895ms","start":"2026-03-02T15:55:56.2311Z","end":"2026-03-02T15:55:56.989549Z","steps":["trace[484087963] 'agreement among raft nodes before linearized reading' (duration: 758.348148ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:56.989614Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:56.165515Z","time spent":"823.973952ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-02T15:55:56.989627Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:56.565963Z","time spent":"423.643893ms","remote":"127.0.0.1:35688","response type":"/etcdserverpb.KV/Range","request count":0,"request size":76,"response count":0,"response size":29,"request content":"key:\"/registry/horizontalpodautoscalers/\" range_end:\"/registry/horizontalpodautoscalers0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:55:56.989631Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.621486ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:55:56.989692Z","caller":"traceutil/trace.go:171","msg":"trace[514749403] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:782; }","duration":"128.733929ms","start":"2026-03-02T15:55:56.860945Z","end":"2026-03-02T15:55:56.989679Z","steps":["trace[514749403] 'agreement among raft nodes before linearized reading' (duration: 128.591955ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:55:56.989634Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:55:56.231082Z","time spent":"758.545144ms","remote":"127.0.0.1:35436","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-03-02T15:56:05.150972Z","caller":"traceutil/trace.go:171","msg":"trace[1920879986] transaction","detail":"{read_only:false; response_revision:804; number_of_response:1; }","duration":"121.060957ms","start":"2026-03-02T15:56:05.029899Z","end":"2026-03-02T15:56:05.15096Z","steps":["trace[1920879986] 'process raft request' (duration: 120.191953ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:10.845329Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":9823086013787893361,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-02T15:56:11.033642Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.005311598s","expected-duration":"1s"} {"level":"warn","ts":"2026-03-02T15:56:11.834387Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"800.480233ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-03-02T15:56:11.834825Z","caller":"traceutil/trace.go:171","msg":"trace[1557587389] linearizableReadLoop","detail":"{readStateIndex:906; appliedIndex:905; }","duration":"1.490540043s","start":"2026-03-02T15:56:10.344237Z","end":"2026-03-02T15:56:11.834777Z","steps":["trace[1557587389] 'read index received' (duration: 689.573677ms)","trace[1557587389] 'applied index is now lower than readState.Index' (duration: 800.964626ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:56:11.835018Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.490762889s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-02T15:56:11.83508Z","caller":"traceutil/trace.go:171","msg":"trace[570138214] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:868; }","duration":"1.490889713s","start":"2026-03-02T15:56:10.344177Z","end":"2026-03-02T15:56:11.835066Z","steps":["trace[570138214] 'agreement among raft nodes before linearized reading' (duration: 1.490717468s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:11.835121Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:10.344147Z","time spent":"1.490968376s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-03-02T15:56:11.835502Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.27377859s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-03-02T15:56:11.835835Z","caller":"traceutil/trace.go:171","msg":"trace[1230497025] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:868; }","duration":"1.27415125s","start":"2026-03-02T15:56:10.561662Z","end":"2026-03-02T15:56:11.835814Z","steps":["trace[1230497025] 'agreement among raft nodes before linearized reading' (duration: 1.273311037s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:11.835646Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"599.493186ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:490"} {"level":"info","ts":"2026-03-02T15:56:11.836442Z","caller":"traceutil/trace.go:171","msg":"trace[383562175] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:868; }","duration":"600.288499ms","start":"2026-03-02T15:56:11.236106Z","end":"2026-03-02T15:56:11.836395Z","steps":["trace[383562175] 'agreement among raft nodes before linearized reading' (duration: 599.314992ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:11.835677Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"974.236778ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:56:11.836709Z","caller":"traceutil/trace.go:171","msg":"trace[609873561] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:868; }","duration":"975.298097ms","start":"2026-03-02T15:56:10.861391Z","end":"2026-03-02T15:56:11.836689Z","steps":["trace[609873561] 'agreement among raft nodes before linearized reading' (duration: 974.243038ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:11.835673Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"616.593729ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-03-02T15:56:11.836838Z","caller":"traceutil/trace.go:171","msg":"trace[684383582] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:868; }","duration":"617.818782ms","start":"2026-03-02T15:56:11.218994Z","end":"2026-03-02T15:56:11.836813Z","steps":["trace[684383582] 'agreement among raft nodes before linearized reading' (duration: 616.447455ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:11.835766Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"599.323802ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"warn","ts":"2026-03-02T15:56:11.836899Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:11.218976Z","time spent":"617.908545ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-03-02T15:56:11.836924Z","caller":"traceutil/trace.go:171","msg":"trace[1449467550] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:868; }","duration":"600.496214ms","start":"2026-03-02T15:56:11.236413Z","end":"2026-03-02T15:56:11.836909Z","steps":["trace[1449467550] 'agreement among raft nodes before linearized reading' (duration: 599.283211ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:11.836981Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:11.236395Z","time spent":"600.573967ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-03-02T15:56:11.836824Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:11.236096Z","time spent":"600.448993ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":514,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-03-02T15:56:11.835938Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:10.561636Z","time spent":"1.274282974s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-03-02T15:56:11.83686Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:10.861376Z","time spent":"975.42163ms","remote":"127.0.0.1:35436","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-03-02T15:56:26.80889Z","caller":"traceutil/trace.go:171","msg":"trace[697608162] transaction","detail":"{read_only:false; response_revision:932; number_of_response:1; }","duration":"102.928216ms","start":"2026-03-02T15:56:26.705938Z","end":"2026-03-02T15:56:26.808866Z","steps":["trace[697608162] 'process raft request' (duration: 77.248846ms)","trace[697608162] 'compare' (duration: 25.142685ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:56:28.110704Z","caller":"traceutil/trace.go:171","msg":"trace[2115159170] linearizableReadLoop","detail":"{readStateIndex:976; appliedIndex:975; }","duration":"150.168762ms","start":"2026-03-02T15:56:27.960516Z","end":"2026-03-02T15:56:28.110685Z","steps":["trace[2115159170] 'read index received' (duration: 150.035568ms)","trace[2115159170] 'applied index is now lower than readState.Index' (duration: 132.364µs)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:56:28.110782Z","caller":"traceutil/trace.go:171","msg":"trace[1101477897] transaction","detail":"{read_only:false; response_revision:934; number_of_response:1; }","duration":"184.151241ms","start":"2026-03-02T15:56:27.926585Z","end":"2026-03-02T15:56:28.110736Z","steps":["trace[1101477897] 'process raft request' (duration: 183.987627ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:28.110886Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.369808ms","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-03-02T15:56:28.110927Z","caller":"traceutil/trace.go:171","msg":"trace[1537290468] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:934; }","duration":"150.46976ms","start":"2026-03-02T15:56:27.960445Z","end":"2026-03-02T15:56:28.110914Z","steps":["trace[1537290468] 'agreement among raft nodes before linearized reading' (duration: 150.341417ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:28.110983Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.317776ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-03-02T15:56:28.111049Z","caller":"traceutil/trace.go:171","msg":"trace[421522410] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:934; }","duration":"150.42085ms","start":"2026-03-02T15:56:27.960608Z","end":"2026-03-02T15:56:28.111029Z","steps":["trace[421522410] 'agreement among raft nodes before linearized reading' (duration: 150.213664ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:28.111108Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.690074ms","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-03-02T15:56:28.111147Z","caller":"traceutil/trace.go:171","msg":"trace[1304199136] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:934; }","duration":"147.737916ms","start":"2026-03-02T15:56:27.9634Z","end":"2026-03-02T15:56:28.111138Z","steps":["trace[1304199136] 'agreement among raft nodes before linearized reading' (duration: 147.647723ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:28.111216Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.966872ms","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-03-02T15:56:28.11125Z","caller":"traceutil/trace.go:171","msg":"trace[246760319] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:934; }","duration":"148.013553ms","start":"2026-03-02T15:56:27.963226Z","end":"2026-03-02T15:56:28.111239Z","steps":["trace[246760319] 'agreement among raft nodes before linearized reading' (duration: 147.918421ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:28.225078Z","caller":"traceutil/trace.go:171","msg":"trace[1740095845] transaction","detail":"{read_only:false; response_revision:936; number_of_response:1; }","duration":"108.363366ms","start":"2026-03-02T15:56:28.116694Z","end":"2026-03-02T15:56:28.225058Z","steps":["trace[1740095845] 'process raft request' (duration: 108.232753ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:28.225361Z","caller":"traceutil/trace.go:171","msg":"trace[1977278425] transaction","detail":"{read_only:false; response_revision:937; number_of_response:1; }","duration":"108.316794ms","start":"2026-03-02T15:56:28.117034Z","end":"2026-03-02T15:56:28.22535Z","steps":["trace[1977278425] 'process raft request' (duration: 108.002296ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:28.225729Z","caller":"traceutil/trace.go:171","msg":"trace[180862267] linearizableReadLoop","detail":"{readStateIndex:980; appliedIndex:976; }","duration":"102.758151ms","start":"2026-03-02T15:56:28.122947Z","end":"2026-03-02T15:56:28.225705Z","steps":["trace[180862267] 'read index received' (duration: 60.846752ms)","trace[180862267] 'applied index is now lower than readState.Index' (duration: 41.910409ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:56:28.226276Z","caller":"traceutil/trace.go:171","msg":"trace[278038314] transaction","detail":"{read_only:false; response_revision:938; number_of_response:1; }","duration":"109.169878ms","start":"2026-03-02T15:56:28.117088Z","end":"2026-03-02T15:56:28.226258Z","steps":["trace[278038314] 'process raft request' (duration: 108.212302ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:28.22681Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.847141ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/podtemplates/\" range_end:\"/registry/podtemplates0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:56:28.226866Z","caller":"traceutil/trace.go:171","msg":"trace[331453992] range","detail":"{range_begin:/registry/podtemplates/; range_end:/registry/podtemplates0; response_count:0; response_revision:938; }","duration":"103.941874ms","start":"2026-03-02T15:56:28.122911Z","end":"2026-03-02T15:56:28.226853Z","steps":["trace[331453992] 'agreement among raft nodes before linearized reading' (duration: 103.851381ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:29.581206Z","caller":"traceutil/trace.go:171","msg":"trace[1382442952] transaction","detail":"{read_only:false; response_revision:946; number_of_response:1; }","duration":"344.721071ms","start":"2026-03-02T15:56:29.236461Z","end":"2026-03-02T15:56:29.581182Z","steps":["trace[1382442952] 'process raft request' (duration: 344.583817ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:29.581348Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:29.236437Z","time spent":"344.837985ms","remote":"127.0.0.1:35640","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5736,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-02T15:56:29.581825Z","caller":"traceutil/trace.go:171","msg":"trace[1872111608] linearizableReadLoop","detail":"{readStateIndex:988; appliedIndex:988; }","duration":"295.027128ms","start":"2026-03-02T15:56:29.286783Z","end":"2026-03-02T15:56:29.581811Z","steps":["trace[1872111608] 'read index received' (duration: 295.021157ms)","trace[1872111608] 'applied index is now lower than readState.Index' (duration: 4.931µs)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:56:29.581927Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.139241ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rolebindings/\" range_end:\"/registry/rolebindings0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-03-02T15:56:29.581995Z","caller":"traceutil/trace.go:171","msg":"trace[1998390281] range","detail":"{range_begin:/registry/rolebindings/; range_end:/registry/rolebindings0; response_count:0; response_revision:946; }","duration":"295.249004ms","start":"2026-03-02T15:56:29.286734Z","end":"2026-03-02T15:56:29.581983Z","steps":["trace[1998390281] 'agreement among raft nodes before linearized reading' (duration: 295.143901ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:29.811967Z","caller":"traceutil/trace.go:171","msg":"trace[1510393958] linearizableReadLoop","detail":"{readStateIndex:989; appliedIndex:988; }","duration":"230.076792ms","start":"2026-03-02T15:56:29.581861Z","end":"2026-03-02T15:56:29.811938Z","steps":["trace[1510393958] 'read index received' (duration: 229.742463ms)","trace[1510393958] 'applied index is now lower than readState.Index' (duration: 333.079µs)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:56:29.812194Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"498.344519ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-03-02T15:56:29.81225Z","caller":"traceutil/trace.go:171","msg":"trace[472049144] range","detail":"{range_begin:/registry/certificatesigningrequests/; range_end:/registry/certificatesigningrequests0; response_count:0; response_revision:947; }","duration":"498.450643ms","start":"2026-03-02T15:56:29.313781Z","end":"2026-03-02T15:56:29.812232Z","steps":["trace[472049144] 'agreement among raft nodes before linearized reading' (duration: 498.35645ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:29.812405Z","caller":"traceutil/trace.go:171","msg":"trace[540052008] transaction","detail":"{read_only:false; response_revision:947; number_of_response:1; }","duration":"314.063374ms","start":"2026-03-02T15:56:29.498325Z","end":"2026-03-02T15:56:29.812388Z","steps":["trace[540052008] 'process raft request' (duration: 313.287893ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:29.812536Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:29.498291Z","time spent":"314.186128ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-02T15:56:29.813849Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:29.313761Z","time spent":"498.593496ms","remote":"127.0.0.1:35734","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":1,"response size":31,"request content":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:56:30.420676Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.607346ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-03-02T15:56:30.420869Z","caller":"traceutil/trace.go:171","msg":"trace[1885930375] linearizableReadLoop","detail":"{readStateIndex:990; appliedIndex:989; }","duration":"559.413418ms","start":"2026-03-02T15:56:29.861382Z","end":"2026-03-02T15:56:30.420795Z","steps":["trace[1885930375] 'read index received' (duration: 447.638507ms)","trace[1885930375] 'applied index is now lower than readState.Index' (duration: 111.773041ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:56:30.42102Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"559.618553ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:56:30.421112Z","caller":"traceutil/trace.go:171","msg":"trace[1767341107] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:947; }","duration":"559.765948ms","start":"2026-03-02T15:56:29.861324Z","end":"2026-03-02T15:56:30.42109Z","steps":["trace[1767341107] 'agreement among raft nodes before linearized reading' (duration: 559.601374ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:30.421172Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:29.861301Z","time spent":"559.86163ms","remote":"127.0.0.1:35436","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-03-02T15:56:30.421188Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"443.562455ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:56:30.421274Z","caller":"traceutil/trace.go:171","msg":"trace[1528478808] range","detail":"{range_begin:/registry/volumeattachments/; range_end:/registry/volumeattachments0; response_count:0; response_revision:947; }","duration":"443.718279ms","start":"2026-03-02T15:56:29.977536Z","end":"2026-03-02T15:56:30.421254Z","steps":["trace[1528478808] 'agreement among raft nodes before linearized reading' (duration: 443.551844ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:30.421276Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.533549ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-03-02T15:56:30.421322Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:29.977514Z","time spent":"443.795911ms","remote":"127.0.0.1:35838","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":0,"response size":29,"request content":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:56:30.421342Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.892269ms","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-03-02T15:56:30.421393Z","caller":"traceutil/trace.go:171","msg":"trace[1700177598] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:947; }","duration":"211.983511ms","start":"2026-03-02T15:56:30.209397Z","end":"2026-03-02T15:56:30.42138Z","steps":["trace[1700177598] 'agreement among raft nodes before linearized reading' (duration: 211.751305ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:30.421445Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.657132ms","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-03-02T15:56:30.421484Z","caller":"traceutil/trace.go:171","msg":"trace[20146873] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:947; }","duration":"190.705403ms","start":"2026-03-02T15:56:30.230769Z","end":"2026-03-02T15:56:30.421474Z","steps":["trace[20146873] 'agreement among raft nodes before linearized reading' (duration: 190.60645ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:30.421721Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"305.483207ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-03-02T15:56:30.421722Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.95422ms","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-03-02T15:56:30.421759Z","caller":"traceutil/trace.go:171","msg":"trace[1201443362] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:947; }","duration":"305.550499ms","start":"2026-03-02T15:56:30.116199Z","end":"2026-03-02T15:56:30.42175Z","steps":["trace[1201443362] 'agreement among raft nodes before linearized reading' (duration: 305.446786ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:30.421768Z","caller":"traceutil/trace.go:171","msg":"trace[1771271340] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:947; }","duration":"191.012602ms","start":"2026-03-02T15:56:30.230744Z","end":"2026-03-02T15:56:30.421757Z","steps":["trace[1771271340] 'agreement among raft nodes before linearized reading' (duration: 190.794506ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:30.421348Z","caller":"traceutil/trace.go:171","msg":"trace[123201431] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:947; }","duration":"190.633901ms","start":"2026-03-02T15:56:30.230695Z","end":"2026-03-02T15:56:30.421328Z","steps":["trace[123201431] 'agreement among raft nodes before linearized reading' (duration: 190.410925ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:30.421798Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:30.116178Z","time spent":"305.611771ms","remote":"127.0.0.1:35738","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":"info","ts":"2026-03-02T15:56:30.535792Z","caller":"traceutil/trace.go:171","msg":"trace[1382966260] transaction","detail":"{read_only:false; response_revision:949; number_of_response:1; }","duration":"110.127765ms","start":"2026-03-02T15:56:30.425639Z","end":"2026-03-02T15:56:30.535767Z","steps":["trace[1382966260] 'process raft request' (duration: 95.347547ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:30.536285Z","caller":"traceutil/trace.go:171","msg":"trace[579820872] transaction","detail":"{read_only:false; response_revision:950; number_of_response:1; }","duration":"110.276779ms","start":"2026-03-02T15:56:30.425994Z","end":"2026-03-02T15:56:30.536271Z","steps":["trace[579820872] 'process raft request' (duration: 109.718614ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:30.536681Z","caller":"traceutil/trace.go:171","msg":"trace[1409985749] transaction","detail":"{read_only:false; response_revision:952; number_of_response:1; }","duration":"108.220462ms","start":"2026-03-02T15:56:30.428448Z","end":"2026-03-02T15:56:30.536668Z","steps":["trace[1409985749] 'process raft request' (duration: 108.183741ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:30.536761Z","caller":"traceutil/trace.go:171","msg":"trace[1694650482] transaction","detail":"{read_only:false; response_revision:951; number_of_response:1; }","duration":"110.401282ms","start":"2026-03-02T15:56:30.426348Z","end":"2026-03-02T15:56:30.53675Z","steps":["trace[1694650482] 'process raft request' (duration: 109.902429ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:32.675893Z","caller":"traceutil/trace.go:171","msg":"trace[951307127] linearizableReadLoop","detail":"{readStateIndex:996; appliedIndex:995; }","duration":"136.502134ms","start":"2026-03-02T15:56:32.539368Z","end":"2026-03-02T15:56:32.675871Z","steps":["trace[951307127] 'read index received' (duration: 136.262327ms)","trace[951307127] 'applied index is now lower than readState.Index' (duration: 238.737µs)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:56:32.675953Z","caller":"traceutil/trace.go:171","msg":"trace[1100476389] transaction","detail":"{read_only:false; response_revision:953; number_of_response:1; }","duration":"205.867862ms","start":"2026-03-02T15:56:32.470052Z","end":"2026-03-02T15:56:32.67592Z","steps":["trace[1100476389] 'process raft request' (duration: 205.677187ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:32.676425Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.00842ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-03-02T15:56:32.67652Z","caller":"traceutil/trace.go:171","msg":"trace[891181222] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:953; }","duration":"136.161764ms","start":"2026-03-02T15:56:32.540335Z","end":"2026-03-02T15:56:32.676497Z","steps":["trace[891181222] 'agreement among raft nodes before linearized reading' (duration: 135.933838ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:32.676123Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.72973ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-02T15:56:32.676667Z","caller":"traceutil/trace.go:171","msg":"trace[973408539] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:953; }","duration":"137.314616ms","start":"2026-03-02T15:56:32.539335Z","end":"2026-03-02T15:56:32.67665Z","steps":["trace[973408539] 'agreement among raft nodes before linearized reading' (duration: 136.662218ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:32.676826Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.935468ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-03-02T15:56:32.676874Z","caller":"traceutil/trace.go:171","msg":"trace[461241961] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:953; }","duration":"135.99652ms","start":"2026-03-02T15:56:32.540866Z","end":"2026-03-02T15:56:32.676862Z","steps":["trace[461241961] 'agreement among raft nodes before linearized reading' (duration: 135.874087ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:32.67703Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.184344ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:490"} {"level":"info","ts":"2026-03-02T15:56:32.677072Z","caller":"traceutil/trace.go:171","msg":"trace[810286468] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:953; }","duration":"136.242956ms","start":"2026-03-02T15:56:32.540819Z","end":"2026-03-02T15:56:32.677062Z","steps":["trace[810286468] 'agreement among raft nodes before linearized reading' (duration: 136.141114ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:32.98483Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.26271ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-02T15:56:32.984964Z","caller":"traceutil/trace.go:171","msg":"trace[1641943606] transaction","detail":"{read_only:false; response_revision:954; number_of_response:1; }","duration":"301.918848ms","start":"2026-03-02T15:56:32.683014Z","end":"2026-03-02T15:56:32.984933Z","steps":["trace[1641943606] 'process raft request' (duration: 200.330329ms)","trace[1641943606] 'compare' (duration: 101.023754ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:56:32.985045Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:32.682988Z","time spent":"302.013851ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-02T15:56:33.546698Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"348.803705ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-02T15:56:33.547146Z","caller":"traceutil/trace.go:171","msg":"trace[1998805657] transaction","detail":"{read_only:false; response_revision:955; number_of_response:1; }","duration":"861.125871ms","start":"2026-03-02T15:56:32.68598Z","end":"2026-03-02T15:56:33.547105Z","steps":["trace[1998805657] 'process raft request' (duration: 511.779281ms)","trace[1998805657] 'compare' (duration: 348.548858ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:56:33.547271Z","caller":"traceutil/trace.go:171","msg":"trace[2001255193] transaction","detail":"{read_only:false; response_revision:957; number_of_response:1; }","duration":"861.09799ms","start":"2026-03-02T15:56:32.68615Z","end":"2026-03-02T15:56:33.547248Z","steps":["trace[2001255193] 'process raft request' (duration: 861.031948ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:33.547285Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:32.685964Z","time spent":"861.244554ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-02T15:56:33.547377Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:32.686126Z","time spent":"861.201123ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-02T15:56:33.547454Z","caller":"traceutil/trace.go:171","msg":"trace[1688861078] transaction","detail":"{read_only:false; response_revision:956; number_of_response:1; }","duration":"861.374288ms","start":"2026-03-02T15:56:32.68605Z","end":"2026-03-02T15:56:33.547425Z","steps":["trace[1688861078] 'process raft request' (duration: 860.790642ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:33.547606Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:32.686044Z","time spent":"861.479961ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-02T15:56:34.093557Z","caller":"traceutil/trace.go:171","msg":"trace[1436107451] transaction","detail":"{read_only:false; response_revision:958; number_of_response:1; }","duration":"174.67608ms","start":"2026-03-02T15:56:33.918849Z","end":"2026-03-02T15:56:34.093525Z","steps":["trace[1436107451] 'process raft request' (duration: 174.540186ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:38.908227Z","caller":"traceutil/trace.go:171","msg":"trace[497465503] transaction","detail":"{read_only:false; response_revision:1001; number_of_response:1; }","duration":"136.067753ms","start":"2026-03-02T15:56:38.772118Z","end":"2026-03-02T15:56:38.908186Z","steps":["trace[497465503] 'process raft request' (duration: 74.098489ms)","trace[497465503] 'compare' (duration: 61.747198ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:56:38.908517Z","caller":"traceutil/trace.go:171","msg":"trace[286889792] transaction","detail":"{read_only:false; response_revision:1002; number_of_response:1; }","duration":"135.076085ms","start":"2026-03-02T15:56:38.773418Z","end":"2026-03-02T15:56:38.908494Z","steps":["trace[286889792] 'process raft request' (duration: 134.722405ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:38.908735Z","caller":"traceutil/trace.go:171","msg":"trace[897348648] transaction","detail":"{read_only:false; response_revision:1003; number_of_response:1; }","duration":"133.051499ms","start":"2026-03-02T15:56:38.775661Z","end":"2026-03-02T15:56:38.908713Z","steps":["trace[897348648] 'process raft request' (duration: 132.682329ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:39.233343Z","caller":"traceutil/trace.go:171","msg":"trace[2113495680] transaction","detail":"{read_only:false; response_revision:1006; number_of_response:1; }","duration":"130.57325ms","start":"2026-03-02T15:56:39.102722Z","end":"2026-03-02T15:56:39.233296Z","steps":["trace[2113495680] 'process raft request' (duration: 49.305183ms)","trace[2113495680] 'compare' (duration: 81.039691ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:56:40.071143Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"416.172576ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-02T15:56:40.071385Z","caller":"traceutil/trace.go:171","msg":"trace[1857234459] linearizableReadLoop","detail":"{readStateIndex:1053; appliedIndex:1051; }","duration":"209.78366ms","start":"2026-03-02T15:56:39.861589Z","end":"2026-03-02T15:56:40.071373Z","steps":["trace[1857234459] 'read index received' (duration: 57.481µs)","trace[1857234459] 'applied index is now lower than readState.Index' (duration: 209.725289ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:56:40.0714Z","caller":"traceutil/trace.go:171","msg":"trace[1704105361] transaction","detail":"{read_only:false; response_revision:1008; number_of_response:1; }","duration":"495.269864ms","start":"2026-03-02T15:56:39.576108Z","end":"2026-03-02T15:56:40.071378Z","steps":["trace[1704105361] 'process raft request' (duration: 78.761888ms)","trace[1704105361] 'compare' (duration: 415.973991ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:56:40.071462Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"209.906054ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:56:40.071496Z","caller":"traceutil/trace.go:171","msg":"trace[1512903445] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1009; }","duration":"209.962966ms","start":"2026-03-02T15:56:39.861509Z","end":"2026-03-02T15:56:40.071472Z","steps":["trace[1512903445] 'agreement among raft nodes before linearized reading' (duration: 209.906995ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:40.071511Z","caller":"traceutil/trace.go:171","msg":"trace[747823142] transaction","detail":"{read_only:false; response_revision:1009; number_of_response:1; }","duration":"495.201452ms","start":"2026-03-02T15:56:39.576298Z","end":"2026-03-02T15:56:40.0715Z","steps":["trace[747823142] 'process raft request' (duration: 494.922694ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:40.07164Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:39.57629Z","time spent":"495.251723ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-02T15:56:40.071651Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:39.576097Z","time spent":"495.390237ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-02T15:56:40.573254Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":9823086013787893657,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-02T15:56:41.074022Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":9823086013787893657,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-02T15:56:41.28888Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.419251813s","expected-duration":"1s"} {"level":"warn","ts":"2026-03-02T15:56:42.073242Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.000236379s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"","error":"context deadline exceeded"} {"level":"info","ts":"2026-03-02T15:56:42.073331Z","caller":"traceutil/trace.go:171","msg":"trace[1979164716] range","detail":"{range_begin:/registry/health; range_end:; }","duration":"2.000369951s","start":"2026-03-02T15:56:40.072941Z","end":"2026-03-02T15:56:42.073311Z","steps":["trace[1979164716] 'agreement among raft nodes before linearized reading' (duration: 2.000257188s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:42.073429Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:40.072928Z","time spent":"2.000487895s","remote":"127.0.0.1:35450","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":0,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-03-02T15:56:43.254836Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.426762491s","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:56:43.25497Z","caller":"traceutil/trace.go:171","msg":"trace[1901417007] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:1009; }","duration":"1.426904635s","start":"2026-03-02T15:56:41.828047Z","end":"2026-03-02T15:56:43.254951Z","steps":["trace[1901417007] 'range keys from in-memory index tree' (duration: 1.42674652s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.534828Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.245714514s","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-03-02T15:56:43.535775Z","caller":"traceutil/trace.go:171","msg":"trace[1801706319] transaction","detail":"{read_only:false; response_revision:1010; number_of_response:1; }","duration":"3.53488355s","start":"2026-03-02T15:56:40.000847Z","end":"2026-03-02T15:56:43.535731Z","steps":["trace[1801706319] 'process raft request' (duration: 3.534097019s)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:43.535848Z","caller":"traceutil/trace.go:171","msg":"trace[1983555573] linearizableReadLoop","detail":"{readStateIndex:1055; appliedIndex:1053; }","duration":"3.462854879s","start":"2026-03-02T15:56:40.07297Z","end":"2026-03-02T15:56:43.535825Z","steps":["trace[1983555573] 'read index received' (duration: 1.216129916s)","trace[1983555573] 'applied index is now lower than readState.Index' (duration: 2.246722583s)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:56:43.536227Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:40.000822Z","time spent":"3.535294962s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-02T15:56:43.536608Z","caller":"traceutil/trace.go:171","msg":"trace[258385019] transaction","detail":"{read_only:false; response_revision:1011; number_of_response:1; }","duration":"1.459084714s","start":"2026-03-02T15:56:42.077503Z","end":"2026-03-02T15:56:43.536588Z","steps":["trace[258385019] 'process raft request' (duration: 1.458969311s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.536696Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:42.077486Z","time spent":"1.459169016s","remote":"127.0.0.1:35542","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":759,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-03-02T15:56:43.536713Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"3.435844142s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" ","response":"range_response_count:1 size:530"} {"level":"warn","ts":"2026-03-02T15:56:43.537031Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.624009525s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-03-02T15:56:43.537065Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"3.195033384s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-resizer-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:509"} {"level":"info","ts":"2026-03-02T15:56:43.5371Z","caller":"traceutil/trace.go:171","msg":"trace[2046959536] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1011; }","duration":"2.624116678s","start":"2026-03-02T15:56:40.912968Z","end":"2026-03-02T15:56:43.537085Z","steps":["trace[2046959536] 'agreement among raft nodes before linearized reading' (duration: 2.623921842s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.537161Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.454905958s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-02T15:56:43.537182Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:40.912949Z","time spent":"2.62422009s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"info","ts":"2026-03-02T15:56:43.537164Z","caller":"traceutil/trace.go:171","msg":"trace[348274036] range","detail":"{range_begin:/registry/leases/kube-system/external-resizer-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1011; }","duration":"3.195171788s","start":"2026-03-02T15:56:40.341975Z","end":"2026-03-02T15:56:43.537147Z","steps":["trace[348274036] 'agreement among raft nodes before linearized reading' (duration: 3.194931221s)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:43.537222Z","caller":"traceutil/trace.go:171","msg":"trace[1731475765] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1011; }","duration":"1.45497949s","start":"2026-03-02T15:56:42.082226Z","end":"2026-03-02T15:56:43.537205Z","steps":["trace[1731475765] 'agreement among raft nodes before linearized reading' (duration: 1.454907898s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.537257Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:40.341954Z","time spent":"3.195291441s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":1,"response size":533,"request content":"key:\"/registry/leases/kube-system/external-resizer-rbd-csi-ceph-com\" "} {"level":"warn","ts":"2026-03-02T15:56:43.537295Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.351008796s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:56:43.537057Z","caller":"traceutil/trace.go:171","msg":"trace[1023712429] range","detail":"{range_begin:/registry/leases/kube-system/rbd.csi.ceph.com-kube-system; range_end:; response_count:1; response_revision:1011; }","duration":"3.436180292s","start":"2026-03-02T15:56:40.100804Z","end":"2026-03-02T15:56:43.536985Z","steps":["trace[1023712429] 'agreement among raft nodes before linearized reading' (duration: 3.435773681s)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:43.53735Z","caller":"traceutil/trace.go:171","msg":"trace[2079912840] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:1011; }","duration":"2.351109489s","start":"2026-03-02T15:56:41.186225Z","end":"2026-03-02T15:56:43.537335Z","steps":["trace[2079912840] 'agreement among raft nodes before linearized reading' (duration: 2.350886863s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.537367Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.209458501s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/\" range_end:\"/registry/configmaps0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-03-02T15:56:43.537274Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:42.082215Z","time spent":"1.455043082s","remote":"127.0.0.1:35436","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-03-02T15:56:43.537092Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.952194859s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:535"} {"level":"warn","ts":"2026-03-02T15:56:43.537549Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.462366144s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-03-02T15:56:43.537544Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.462139568s","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-03-02T15:56:43.537618Z","caller":"traceutil/trace.go:171","msg":"trace[718895384] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1011; }","duration":"1.462469687s","start":"2026-03-02T15:56:42.075135Z","end":"2026-03-02T15:56:43.537605Z","steps":["trace[718895384] 'agreement among raft nodes before linearized reading' (duration: 1.462305093s)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:43.53762Z","caller":"traceutil/trace.go:171","msg":"trace[1384490896] range","detail":"{range_begin:/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1011; }","duration":"1.952757784s","start":"2026-03-02T15:56:41.584842Z","end":"2026-03-02T15:56:43.5376Z","steps":["trace[1384490896] 'agreement among raft nodes before linearized reading' (duration: 1.952156417s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.537668Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:42.075113Z","time spent":"1.46254271s","remote":"127.0.0.1:35738","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-03-02T15:56:43.53769Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:41.584823Z","time spent":"1.952845027s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":75,"response count":1,"response size":559,"request content":"key:\"/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com\" "} {"level":"info","ts":"2026-03-02T15:56:43.537628Z","caller":"traceutil/trace.go:171","msg":"trace[276154990] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1011; }","duration":"1.462296562s","start":"2026-03-02T15:56:42.075319Z","end":"2026-03-02T15:56:43.537615Z","steps":["trace[276154990] 'agreement among raft nodes before linearized reading' (duration: 1.462119998s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.537805Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:42.075303Z","time spent":"1.462479967s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-03-02T15:56:43.537404Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:40.100746Z","time spent":"3.436642214s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":59,"response count":1,"response size":554,"request content":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" "} {"level":"warn","ts":"2026-03-02T15:56:43.536774Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.926869478s","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-03-02T15:56:43.537406Z","caller":"traceutil/trace.go:171","msg":"trace[562176520] range","detail":"{range_begin:/registry/configmaps/; range_end:/registry/configmaps0; response_count:0; response_revision:1011; }","duration":"1.209534163s","start":"2026-03-02T15:56:42.32786Z","end":"2026-03-02T15:56:43.537394Z","steps":["trace[562176520] 'agreement among raft nodes before linearized reading' (duration: 1.209439611s)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:43.538333Z","caller":"traceutil/trace.go:171","msg":"trace[1390340988] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1011; }","duration":"1.928403301s","start":"2026-03-02T15:56:41.60981Z","end":"2026-03-02T15:56:43.538214Z","steps":["trace[1390340988] 'agreement among raft nodes before linearized reading' (duration: 1.926791266s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.538439Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:41.609788Z","time spent":"1.928597596s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-03-02T15:56:43.538337Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:42.327839Z","time spent":"1.21047578s","remote":"127.0.0.1:35568","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":15,"response size":31,"request content":"key:\"/registry/configmaps/\" range_end:\"/registry/configmaps0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:56:43.537408Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:41.186208Z","time spent":"2.351185811s","remote":"127.0.0.1:33576","response type":"/etcdserverpb.KV/Range","request count":0,"request size":112,"response count":0,"response size":29,"request content":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" count_only:true "} {"level":"warn","ts":"2026-03-02T15:56:43.539255Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.51139007s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"warn","ts":"2026-03-02T15:56:43.539469Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"572.406077ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:526"} {"level":"info","ts":"2026-03-02T15:56:43.539613Z","caller":"traceutil/trace.go:171","msg":"trace[77132423] range","detail":"{range_begin:/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1011; }","duration":"575.126722ms","start":"2026-03-02T15:56:42.964454Z","end":"2026-03-02T15:56:43.53958Z","steps":["trace[77132423] 'agreement among raft nodes before linearized reading' (duration: 572.369586ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:56:43.539573Z","caller":"traceutil/trace.go:171","msg":"trace[1882612256] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1011; }","duration":"2.511673128s","start":"2026-03-02T15:56:41.027806Z","end":"2026-03-02T15:56:43.539479Z","steps":["trace[1882612256] 'agreement among raft nodes before linearized reading' (duration: 2.508927212s)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:56:43.539772Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:41.027785Z","time spent":"2.511968187s","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-03-02T15:56:43.540597Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T15:56:42.964435Z","time spent":"575.209254ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":1,"response size":550,"request content":"key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" "} {"level":"info","ts":"2026-03-02T15:57:07.958605Z","caller":"traceutil/trace.go:171","msg":"trace[827134858] transaction","detail":"{read_only:false; response_revision:1115; number_of_response:1; }","duration":"124.40303ms","start":"2026-03-02T15:57:07.834161Z","end":"2026-03-02T15:57:07.958564Z","steps":["trace[827134858] 'process raft request' (duration: 54.381804ms)","trace[827134858] 'compare' (duration: 69.756108ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:57:07.958737Z","caller":"traceutil/trace.go:171","msg":"trace[1156574715] transaction","detail":"{read_only:false; response_revision:1117; number_of_response:1; }","duration":"123.212137ms","start":"2026-03-02T15:57:07.835471Z","end":"2026-03-02T15:57:07.958683Z","steps":["trace[1156574715] 'process raft request' (duration: 123.087834ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:07.958974Z","caller":"traceutil/trace.go:171","msg":"trace[1853930391] transaction","detail":"{read_only:false; response_revision:1116; number_of_response:1; }","duration":"123.587978ms","start":"2026-03-02T15:57:07.835375Z","end":"2026-03-02T15:57:07.958963Z","steps":["trace[1853930391] 'process raft request' (duration: 123.112205ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:07.959084Z","caller":"traceutil/trace.go:171","msg":"trace[617139315] transaction","detail":"{read_only:false; response_revision:1118; number_of_response:1; }","duration":"123.498465ms","start":"2026-03-02T15:57:07.835521Z","end":"2026-03-02T15:57:07.959019Z","steps":["trace[617139315] 'process raft request' (duration: 123.088144ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:32.125598Z","caller":"traceutil/trace.go:171","msg":"trace[1852227478] transaction","detail":"{read_only:false; response_revision:1211; number_of_response:1; }","duration":"118.535174ms","start":"2026-03-02T15:57:32.007009Z","end":"2026-03-02T15:57:32.125544Z","steps":["trace[1852227478] 'process raft request' (duration: 118.39993ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:32.165418Z","caller":"traceutil/trace.go:171","msg":"trace[1454526034] transaction","detail":"{read_only:false; response_revision:1212; number_of_response:1; }","duration":"156.338893ms","start":"2026-03-02T15:57:32.009034Z","end":"2026-03-02T15:57:32.165373Z","steps":["trace[1454526034] 'process raft request' (duration: 156.051315ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:36.455287Z","caller":"traceutil/trace.go:171","msg":"trace[70215889] linearizableReadLoop","detail":"{readStateIndex:1287; appliedIndex:1286; }","duration":"150.560208ms","start":"2026-03-02T15:57:36.304691Z","end":"2026-03-02T15:57:36.455251Z","steps":["trace[70215889] 'read index received' (duration: 149.932202ms)","trace[70215889] 'applied index is now lower than readState.Index' (duration: 626.216µs)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:57:36.455383Z","caller":"traceutil/trace.go:171","msg":"trace[264955529] transaction","detail":"{read_only:false; response_revision:1231; number_of_response:1; }","duration":"151.488343ms","start":"2026-03-02T15:57:36.303863Z","end":"2026-03-02T15:57:36.455352Z","steps":["trace[264955529] 'process raft request' (duration: 150.836336ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:57:36.455534Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.821295ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-03-02T15:57:36.455595Z","caller":"traceutil/trace.go:171","msg":"trace[745041462] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1231; }","duration":"150.917618ms","start":"2026-03-02T15:57:36.304661Z","end":"2026-03-02T15:57:36.455579Z","steps":["trace[745041462] 'agreement among raft nodes before linearized reading' (duration: 150.700822ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:57:36.455767Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.3828ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-03-02T15:57:36.455786Z","caller":"traceutil/trace.go:171","msg":"trace[1625602316] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1231; }","duration":"148.433042ms","start":"2026-03-02T15:57:36.307348Z","end":"2026-03-02T15:57:36.455781Z","steps":["trace[1625602316] 'agreement among raft nodes before linearized reading' (duration: 148.37784ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:57:36.455759Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.849866ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-02T15:57:36.45587Z","caller":"traceutil/trace.go:171","msg":"trace[1660665104] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1231; }","duration":"151.008ms","start":"2026-03-02T15:57:36.304847Z","end":"2026-03-02T15:57:36.455855Z","steps":["trace[1660665104] 'agreement among raft nodes before linearized reading' (duration: 150.742793ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:36.594038Z","caller":"traceutil/trace.go:171","msg":"trace[1594793562] transaction","detail":"{read_only:false; response_revision:1233; number_of_response:1; }","duration":"134.333465ms","start":"2026-03-02T15:57:36.459676Z","end":"2026-03-02T15:57:36.59401Z","steps":["trace[1594793562] 'process raft request' (duration: 95.56997ms)","trace[1594793562] 'compare' (duration: 38.596851ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:57:36.594941Z","caller":"traceutil/trace.go:171","msg":"trace[407648406] transaction","detail":"{read_only:false; response_revision:1234; number_of_response:1; }","duration":"134.740246ms","start":"2026-03-02T15:57:36.460181Z","end":"2026-03-02T15:57:36.594921Z","steps":["trace[407648406] 'process raft request' (duration: 133.788141ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:42.73791Z","caller":"traceutil/trace.go:171","msg":"trace[1795298497] transaction","detail":"{read_only:false; response_revision:1256; number_of_response:1; }","duration":"116.039127ms","start":"2026-03-02T15:57:42.621848Z","end":"2026-03-02T15:57:42.737887Z","steps":["trace[1795298497] 'process raft request' (duration: 84.301ms)","trace[1795298497] 'compare' (duration: 31.603733ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:57:42.757404Z","caller":"traceutil/trace.go:171","msg":"trace[559581579] transaction","detail":"{read_only:false; response_revision:1257; number_of_response:1; }","duration":"134.372636ms","start":"2026-03-02T15:57:42.623015Z","end":"2026-03-02T15:57:42.757388Z","steps":["trace[559581579] 'process raft request' (duration: 134.276684ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:43.960309Z","caller":"traceutil/trace.go:171","msg":"trace[1912067740] transaction","detail":"{read_only:false; response_revision:1260; number_of_response:1; }","duration":"104.742896ms","start":"2026-03-02T15:57:43.855534Z","end":"2026-03-02T15:57:43.960276Z","steps":["trace[1912067740] 'process raft request' (duration: 104.266103ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:57:44.95622Z","caller":"traceutil/trace.go:171","msg":"trace[1052933877] transaction","detail":"{read_only:false; response_revision:1269; number_of_response:1; }","duration":"104.991252ms","start":"2026-03-02T15:57:44.851193Z","end":"2026-03-02T15:57:44.956185Z","steps":["trace[1052933877] 'process raft request' (duration: 43.316826ms)","trace[1052933877] 'compare' (duration: 61.417009ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:58:03.132053Z","caller":"traceutil/trace.go:171","msg":"trace[1602113630] transaction","detail":"{read_only:false; response_revision:1339; number_of_response:1; }","duration":"148.35771ms","start":"2026-03-02T15:58:02.983665Z","end":"2026-03-02T15:58:03.132023Z","steps":["trace[1602113630] 'process raft request' (duration: 66.711161ms)","trace[1602113630] 'compare' (duration: 81.542966ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:58:04.186546Z","caller":"traceutil/trace.go:171","msg":"trace[1781544714] linearizableReadLoop","detail":"{readStateIndex:1402; appliedIndex:1401; }","duration":"187.615447ms","start":"2026-03-02T15:58:03.998904Z","end":"2026-03-02T15:58:04.186519Z","steps":["trace[1781544714] 'read index received' (duration: 117.556088ms)","trace[1781544714] 'applied index is now lower than readState.Index' (duration: 70.058239ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:58:04.186608Z","caller":"traceutil/trace.go:171","msg":"trace[1238471374] transaction","detail":"{read_only:false; response_revision:1341; number_of_response:1; }","duration":"199.538545ms","start":"2026-03-02T15:58:03.987022Z","end":"2026-03-02T15:58:04.186561Z","steps":["trace[1238471374] 'process raft request' (duration: 129.398164ms)","trace[1238471374] 'compare' (duration: 69.970667ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:58:04.187054Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"188.131211ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:526"} {"level":"info","ts":"2026-03-02T15:58:04.187107Z","caller":"traceutil/trace.go:171","msg":"trace[917414444] range","detail":"{range_begin:/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1341; }","duration":"188.235394ms","start":"2026-03-02T15:58:03.998856Z","end":"2026-03-02T15:58:04.187092Z","steps":["trace[917414444] 'agreement among raft nodes before linearized reading' (duration: 187.764121ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:58:04.735334Z","caller":"traceutil/trace.go:171","msg":"trace[985700818] transaction","detail":"{read_only:false; response_revision:1346; number_of_response:1; }","duration":"105.155616ms","start":"2026-03-02T15:58:04.630149Z","end":"2026-03-02T15:58:04.735305Z","steps":["trace[985700818] 'process raft request' (duration: 105.012442ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:58:06.977117Z","caller":"traceutil/trace.go:171","msg":"trace[1240272003] linearizableReadLoop","detail":"{readStateIndex:1417; appliedIndex:1416; }","duration":"115.927954ms","start":"2026-03-02T15:58:06.861159Z","end":"2026-03-02T15:58:06.977087Z","steps":["trace[1240272003] 'read index received' (duration: 68.048816ms)","trace[1240272003] 'applied index is now lower than readState.Index' (duration: 47.877678ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:58:06.977259Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.088339ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T15:58:06.97731Z","caller":"traceutil/trace.go:171","msg":"trace[900684994] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1355; }","duration":"116.190031ms","start":"2026-03-02T15:58:06.861102Z","end":"2026-03-02T15:58:06.977292Z","steps":["trace[900684994] 'agreement among raft nodes before linearized reading' (duration: 116.097629ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:58:06.977317Z","caller":"traceutil/trace.go:171","msg":"trace[540243784] transaction","detail":"{read_only:false; response_revision:1355; number_of_response:1; }","duration":"196.72733ms","start":"2026-03-02T15:58:06.780521Z","end":"2026-03-02T15:58:06.977248Z","steps":["trace[540243784] 'process raft request' (duration: 148.74981ms)","trace[540243784] 'compare' (duration: 47.683532ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:58:22.871153Z","caller":"traceutil/trace.go:171","msg":"trace[910821226] transaction","detail":"{read_only:false; response_revision:1417; number_of_response:1; }","duration":"148.122693ms","start":"2026-03-02T15:58:22.723007Z","end":"2026-03-02T15:58:22.87113Z","steps":["trace[910821226] 'process raft request' (duration: 147.98744ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:58:23.061508Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.261846ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-02T15:58:23.061818Z","caller":"traceutil/trace.go:171","msg":"trace[313912344] transaction","detail":"{read_only:false; response_revision:1418; number_of_response:1; }","duration":"132.583569ms","start":"2026-03-02T15:58:22.9292Z","end":"2026-03-02T15:58:23.061783Z","steps":["trace[313912344] 'process raft request' (duration: 22.943132ms)","trace[313912344] 'compare' (duration: 109.141883ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:58:23.426748Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.913978ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-02T15:58:23.42692Z","caller":"traceutil/trace.go:171","msg":"trace[2001868921] transaction","detail":"{read_only:false; response_revision:1421; number_of_response:1; }","duration":"152.913741ms","start":"2026-03-02T15:58:23.273989Z","end":"2026-03-02T15:58:23.426903Z","steps":["trace[2001868921] 'process raft request' (duration: 31.776598ms)","trace[2001868921] 'compare' (duration: 120.814814ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:59:01.709158Z","caller":"traceutil/trace.go:171","msg":"trace[390147655] transaction","detail":"{read_only:false; response_revision:1578; number_of_response:1; }","duration":"100.384434ms","start":"2026-03-02T15:59:01.608735Z","end":"2026-03-02T15:59:01.70912Z","steps":["trace[390147655] 'process raft request' (duration: 87.026904ms)","trace[390147655] 'compare' (duration: 13.149964ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T15:59:03.645467Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.045443ms","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-03-02T15:59:03.645546Z","caller":"traceutil/trace.go:171","msg":"trace[914413339] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1582; }","duration":"104.152576ms","start":"2026-03-02T15:59:03.541375Z","end":"2026-03-02T15:59:03.645527Z","steps":["trace[914413339] 'range keys from in-memory index tree' (duration: 103.924949ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T15:59:04.716584Z","caller":"traceutil/trace.go:171","msg":"trace[1769787824] linearizableReadLoop","detail":"{readStateIndex:1662; appliedIndex:1661; }","duration":"117.938567ms","start":"2026-03-02T15:59:04.598615Z","end":"2026-03-02T15:59:04.716553Z","steps":["trace[1769787824] 'read index received' (duration: 117.773053ms)","trace[1769787824] 'applied index is now lower than readState.Index' (duration: 164.164µs)"],"step_count":2} {"level":"info","ts":"2026-03-02T15:59:04.716667Z","caller":"traceutil/trace.go:171","msg":"trace[524398231] transaction","detail":"{read_only:false; response_revision:1589; number_of_response:1; }","duration":"120.28637ms","start":"2026-03-02T15:59:04.596347Z","end":"2026-03-02T15:59:04.716633Z","steps":["trace[524398231] 'process raft request' (duration: 120.057794ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T15:59:04.716797Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.166913ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.200\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-03-02T15:59:04.716839Z","caller":"traceutil/trace.go:171","msg":"trace[868882863] range","detail":"{range_begin:/registry/masterleases/162.253.55.200; range_end:; response_count:1; response_revision:1589; }","duration":"118.247206ms","start":"2026-03-02T15:59:04.598579Z","end":"2026-03-02T15:59:04.716827Z","steps":["trace[868882863] 'agreement among raft nodes before linearized reading' (duration: 118.092882ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T16:00:04.63719Z","caller":"traceutil/trace.go:171","msg":"trace[2065616416] transaction","detail":"{read_only:false; response_revision:1864; number_of_response:1; }","duration":"118.526656ms","start":"2026-03-02T16:00:04.518625Z","end":"2026-03-02T16:00:04.637152Z","steps":["trace[2065616416] 'process raft request' (duration: 118.268829ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T16:00:05.096376Z","caller":"traceutil/trace.go:171","msg":"trace[1238136248] linearizableReadLoop","detail":"{readStateIndex:1951; appliedIndex:1950; }","duration":"356.555054ms","start":"2026-03-02T16:00:04.739764Z","end":"2026-03-02T16:00:05.096319Z","steps":["trace[1238136248] 'read index received' (duration: 341.417074ms)","trace[1238136248] 'applied index is now lower than readState.Index' (duration: 15.13569ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T16:00:05.096761Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"356.971025ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:526"} {"level":"info","ts":"2026-03-02T16:00:05.09681Z","caller":"traceutil/trace.go:171","msg":"trace[1271706736] range","detail":"{range_begin:/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1864; }","duration":"357.110759ms","start":"2026-03-02T16:00:04.739683Z","end":"2026-03-02T16:00:05.096793Z","steps":["trace[1271706736] 'agreement among raft nodes before linearized reading' (duration: 356.864202ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T16:00:05.096865Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T16:00:04.73965Z","time spent":"357.204042ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":1,"response size":550,"request content":"key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" "} {"level":"warn","ts":"2026-03-02T16:00:05.097072Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"230.513655ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-02T16:00:05.097128Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.858375ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:474"} {"level":"warn","ts":"2026-03-02T16:00:05.097142Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T16:00:04.638684Z","time spent":"457.863613ms","remote":"127.0.0.1:35486","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"info","ts":"2026-03-02T16:00:05.097213Z","caller":"traceutil/trace.go:171","msg":"trace[1647643052] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1864; }","duration":"268.998069ms","start":"2026-03-02T16:00:04.828191Z","end":"2026-03-02T16:00:05.097189Z","steps":["trace[1647643052] 'agreement among raft nodes before linearized reading' (duration: 268.761312ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T16:00:05.09722Z","caller":"traceutil/trace.go:171","msg":"trace[1242205618] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1864; }","duration":"230.674058ms","start":"2026-03-02T16:00:04.866493Z","end":"2026-03-02T16:00:05.097167Z","steps":["trace[1242205618] 'agreement among raft nodes before linearized reading' (duration: 230.500703ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T16:00:19.797603Z","caller":"traceutil/trace.go:171","msg":"trace[351346950] transaction","detail":"{read_only:false; response_revision:1932; number_of_response:1; }","duration":"100.451775ms","start":"2026-03-02T16:00:19.697124Z","end":"2026-03-02T16:00:19.797576Z","steps":["trace[351346950] 'process raft request' (duration: 65.59547ms)","trace[351346950] 'compare' (duration: 34.677481ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T16:00:20.373389Z","caller":"traceutil/trace.go:171","msg":"trace[761145238] transaction","detail":"{read_only:false; response_revision:1939; number_of_response:1; }","duration":"156.050184ms","start":"2026-03-02T16:00:20.217308Z","end":"2026-03-02T16:00:20.373358Z","steps":["trace[761145238] 'process raft request' (duration: 94.141865ms)","trace[761145238] 'compare' (duration: 61.795876ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T16:00:25.020533Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"281.255341ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-02T16:00:25.020649Z","caller":"traceutil/trace.go:171","msg":"trace[873415915] linearizableReadLoop","detail":"{readStateIndex:2044; appliedIndex:2043; }","duration":"333.615162ms","start":"2026-03-02T16:00:24.687018Z","end":"2026-03-02T16:00:25.020633Z","steps":["trace[873415915] 'read index received' (duration: 52.107854ms)","trace[873415915] 'applied index is now lower than readState.Index' (duration: 281.505928ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T16:00:25.020687Z","caller":"traceutil/trace.go:171","msg":"trace[1398611692] transaction","detail":"{read_only:false; response_revision:1953; number_of_response:1; }","duration":"340.042766ms","start":"2026-03-02T16:00:24.680605Z","end":"2026-03-02T16:00:25.020648Z","steps":["trace[1398611692] 'process raft request' (duration: 58.58415ms)","trace[1398611692] 'compare' (duration: 281.136047ms)"],"step_count":2} {"level":"warn","ts":"2026-03-02T16:00:25.020909Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"333.886319ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/kube-system/kube-proxy\" ","response":"range_response_count:1 size:1949"} {"level":"info","ts":"2026-03-02T16:00:25.020976Z","caller":"traceutil/trace.go:171","msg":"trace[2033322545] range","detail":"{range_begin:/registry/configmaps/kube-system/kube-proxy; range_end:; response_count:1; response_revision:1953; }","duration":"333.980452ms","start":"2026-03-02T16:00:24.686985Z","end":"2026-03-02T16:00:25.020965Z","steps":["trace[2033322545] 'agreement among raft nodes before linearized reading' (duration: 333.820477ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T16:00:25.020967Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T16:00:24.680585Z","time spent":"340.236211ms","remote":"127.0.0.1:35486","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-02T16:00:25.020979Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"331.913595ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/kube-system/kube-apiserver-legacy-service-account-token-tracking\" ","response":"range_response_count:1 size:370"} {"level":"warn","ts":"2026-03-02T16:00:25.021036Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T16:00:24.68697Z","time spent":"334.055273ms","remote":"127.0.0.1:35568","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":1973,"request content":"key:\"/registry/configmaps/kube-system/kube-proxy\" "} {"level":"info","ts":"2026-03-02T16:00:25.021064Z","caller":"traceutil/trace.go:171","msg":"trace[330251370] range","detail":"{range_begin:/registry/configmaps/kube-system/kube-apiserver-legacy-service-account-token-tracking; range_end:; response_count:1; response_revision:1953; }","duration":"332.026589ms","start":"2026-03-02T16:00:24.689016Z","end":"2026-03-02T16:00:25.021042Z","steps":["trace[330251370] 'agreement among raft nodes before linearized reading' (duration: 331.841744ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T16:00:25.021114Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T16:00:24.689Z","time spent":"332.10438ms","remote":"127.0.0.1:35568","response type":"/etcdserverpb.KV/Range","request count":0,"request size":87,"response count":1,"response size":394,"request content":"key:\"/registry/configmaps/kube-system/kube-apiserver-legacy-service-account-token-tracking\" "} {"level":"warn","ts":"2026-03-02T16:00:25.021207Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.019441ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-02T16:00:25.02123Z","caller":"traceutil/trace.go:171","msg":"trace[1212334764] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1953; }","duration":"160.091054ms","start":"2026-03-02T16:00:24.861131Z","end":"2026-03-02T16:00:25.021222Z","steps":["trace[1212334764] 'agreement among raft nodes before linearized reading' (duration: 160.053843ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T16:00:25.021449Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"250.036774ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/kube-public/\" range_end:\"/registry/persistentvolumeclaims/kube-public0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-02T16:00:25.021511Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.746663ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-resizer-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:509"} {"level":"info","ts":"2026-03-02T16:00:25.021528Z","caller":"traceutil/trace.go:171","msg":"trace[1262482983] range","detail":"{range_begin:/registry/persistentvolumeclaims/kube-public/; range_end:/registry/persistentvolumeclaims/kube-public0; response_count:0; response_revision:1953; }","duration":"250.157967ms","start":"2026-03-02T16:00:24.771347Z","end":"2026-03-02T16:00:25.021505Z","steps":["trace[1262482983] 'agreement among raft nodes before linearized reading' (duration: 250.012323ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T16:00:25.021544Z","caller":"traceutil/trace.go:171","msg":"trace[256554922] range","detail":"{range_begin:/registry/leases/kube-system/external-resizer-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1953; }","duration":"330.792145ms","start":"2026-03-02T16:00:24.690741Z","end":"2026-03-02T16:00:25.021533Z","steps":["trace[256554922] 'agreement among raft nodes before linearized reading' (duration: 330.663962ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T16:00:25.021613Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-03-02T16:00:24.690733Z","time spent":"330.872207ms","remote":"127.0.0.1:35738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":1,"response size":533,"request content":"key:\"/registry/leases/kube-system/external-resizer-rbd-csi-ceph-com\" "} {"level":"warn","ts":"2026-03-02T16:00:25.022328Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.623605ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/\" range_end:\"/registry/serviceaccounts/kube-system0\" limit:500 ","response":"range_response_count:39 size:9533"} {"level":"info","ts":"2026-03-02T16:00:25.022562Z","caller":"traceutil/trace.go:171","msg":"trace[1553370976] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/; range_end:/registry/serviceaccounts/kube-system0; response_count:39; response_revision:1953; }","duration":"175.798999ms","start":"2026-03-02T16:00:24.846628Z","end":"2026-03-02T16:00:25.022427Z","steps":["trace[1553370976] 'agreement among raft nodes before linearized reading' (duration: 175.07846ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T16:00:25.387466Z","caller":"traceutil/trace.go:171","msg":"trace[1049576994] linearizableReadLoop","detail":"{readStateIndex:2047; appliedIndex:2045; }","duration":"112.709388ms","start":"2026-03-02T16:00:25.274732Z","end":"2026-03-02T16:00:25.387442Z","steps":["trace[1049576994] 'read index received' (duration: 27.022384ms)","trace[1049576994] 'applied index is now lower than readState.Index' (duration: 85.685664ms)"],"step_count":2} {"level":"info","ts":"2026-03-02T16:00:25.387585Z","caller":"traceutil/trace.go:171","msg":"trace[1932719731] transaction","detail":"{read_only:false; response_revision:1956; number_of_response:1; }","duration":"130.918652ms","start":"2026-03-02T16:00:25.256637Z","end":"2026-03-02T16:00:25.387556Z","steps":["trace[1932719731] 'process raft request' (duration: 130.659545ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T16:00:25.387639Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.882923ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/roles/kube-public/\" range_end:\"/registry/roles/kube-public0\" limit:500 ","response":"range_response_count:2 size:1073"} {"level":"info","ts":"2026-03-02T16:00:25.387674Z","caller":"traceutil/trace.go:171","msg":"trace[2096365308] range","detail":"{range_begin:/registry/roles/kube-public/; range_end:/registry/roles/kube-public0; response_count:2; response_revision:1956; }","duration":"112.977086ms","start":"2026-03-02T16:00:25.274687Z","end":"2026-03-02T16:00:25.387664Z","steps":["trace[2096365308] 'agreement among raft nodes before linearized reading' (duration: 112.876713ms)"],"step_count":1} {"level":"warn","ts":"2026-03-02T16:00:25.739116Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.646069ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/daemonsets/kube-system/cilium\" ","response":"range_response_count:1 size:14480"} {"level":"warn","ts":"2026-03-02T16:00:25.739157Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.551236ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/daemonsets/kube-system/ceph-csi-rbd-nodeplugin\" ","response":"range_response_count:1 size:9390"} {"level":"info","ts":"2026-03-02T16:00:25.739246Z","caller":"traceutil/trace.go:171","msg":"trace[412194475] range","detail":"{range_begin:/registry/daemonsets/kube-system/ceph-csi-rbd-nodeplugin; range_end:; response_count:1; response_revision:1957; }","duration":"125.662509ms","start":"2026-03-02T16:00:25.613563Z","end":"2026-03-02T16:00:25.739225Z","steps":["trace[412194475] 'range keys from in-memory index tree' (duration: 125.307279ms)"],"step_count":1} {"level":"info","ts":"2026-03-02T16:00:25.739206Z","caller":"traceutil/trace.go:171","msg":"trace[1288693349] range","detail":"{range_begin:/registry/daemonsets/kube-system/cilium; range_end:; response_count:1; response_revision:1957; }","duration":"104.780013ms","start":"2026-03-02T16:00:25.634405Z","end":"2026-03-02T16:00:25.739185Z","steps":["trace[1288693349] 'range keys from in-memory index tree' (duration: 104.465634ms)"],"step_count":1}