{"level":"warn","ts":"2026-08-11T11:11:59.460089Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-08-11T11:11:59.460211Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.121:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.121:2380","--initial-cluster=instance=https://199.19.213.121:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.121:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.121: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-08-11T11:11:59.460295Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-08-11T11:11:59.460315Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.121:2380"]} {"level":"info","ts":"2026-08-11T11:11:59.460342Z","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-08-11T11:11:59.461072Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.121:2379"]} {"level":"info","ts":"2026-08-11T11:11:59.461165Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.121:2380"],"listen-peer-urls":["https://199.19.213.121:2380"],"advertise-client-urls":["https://199.19.213.121:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.121:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.121: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-08-11T11:11:59.469372Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"7.963033ms"} {"level":"info","ts":"2026-08-11T11:11:59.481783Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"31541ae44470b70","cluster-id":"8ae2d89c48d1447d"} {"level":"info","ts":"2026-08-11T11:11:59.481874Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 switched to configuration voters=()"} {"level":"info","ts":"2026-08-11T11:11:59.4819Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became follower at term 0"} {"level":"info","ts":"2026-08-11T11:11:59.481915Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 31541ae44470b70 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-08-11T11:11:59.481925Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became follower at term 1"} {"level":"info","ts":"2026-08-11T11:11:59.481979Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 switched to configuration voters=(222155973350329200)"} {"level":"warn","ts":"2026-08-11T11:11:59.494018Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-08-11T11:11:59.496926Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-08-11T11:11:59.499948Z","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-08-11T11:11:59.503564Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"31541ae44470b70","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-08-11T11:11:59.504323Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"31541ae44470b70","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-08-11T11:11:59.504409Z","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-08-11T11:11:59.504506Z","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-08-11T11:11:59.504524Z","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-08-11T11:11:59.505688Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 switched to configuration voters=(222155973350329200)"} {"level":"info","ts":"2026-08-11T11:11:59.505875Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"8ae2d89c48d1447d","local-member-id":"31541ae44470b70","added-peer-id":"31541ae44470b70","added-peer-peer-urls":["https://199.19.213.121:2380"]} {"level":"info","ts":"2026-08-11T11:11:59.514184Z","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-08-11T11:11:59.514326Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.121:2380"} {"level":"info","ts":"2026-08-11T11:11:59.514374Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.121:2380"} {"level":"info","ts":"2026-08-11T11:11:59.514503Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"31541ae44470b70","initial-advertise-peer-urls":["https://199.19.213.121:2380"],"listen-peer-urls":["https://199.19.213.121:2380"],"advertise-client-urls":["https://199.19.213.121:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.121:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-08-11T11:11:59.514553Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-08-11T11:11:59.982473Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 is starting a new election at term 1"} {"level":"info","ts":"2026-08-11T11:11:59.982568Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became pre-candidate at term 1"} {"level":"info","ts":"2026-08-11T11:11:59.982646Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 received MsgPreVoteResp from 31541ae44470b70 at term 1"} {"level":"info","ts":"2026-08-11T11:11:59.982676Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became candidate at term 2"} {"level":"info","ts":"2026-08-11T11:11:59.982718Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 received MsgVoteResp from 31541ae44470b70 at term 2"} {"level":"info","ts":"2026-08-11T11:11:59.982745Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became leader at term 2"} {"level":"info","ts":"2026-08-11T11:11:59.98279Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 31541ae44470b70 elected leader 31541ae44470b70 at term 2"} {"level":"info","ts":"2026-08-11T11:12:00.098794Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-08-11T11:12:00.122795Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"31541ae44470b70","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.121:2379]}","request-path":"/0/members/31541ae44470b70/attributes","cluster-id":"8ae2d89c48d1447d","publish-timeout":"7s"} {"level":"info","ts":"2026-08-11T11:12:00.123078Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-08-11T11:12:00.123817Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-08-11T11:12:00.124197Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-08-11T11:12:00.124232Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-08-11T11:12:00.127003Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-08-11T11:12:00.130216Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.121:2379"} {"level":"info","ts":"2026-08-11T11:12:00.14624Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"8ae2d89c48d1447d","local-member-id":"31541ae44470b70","cluster-version":"3.5"} {"level":"info","ts":"2026-08-11T11:12:00.146386Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-08-11T11:12:00.14644Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"warn","ts":"2026-08-11T11:12:00.424698Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.028179ms","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-08-11T11:12:00.42486Z","caller":"traceutil/trace.go:171","msg":"trace[363880940] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:1; }","duration":"121.244564ms","start":"2026-08-11T11:12:00.303581Z","end":"2026-08-11T11:12:00.424826Z","steps":["trace[363880940] 'count revisions from in-memory index tree' (duration: 120.959187ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.42502Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.452749ms","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":"warn","ts":"2026-08-11T11:12:00.425109Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.666513ms","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-08-11T11:12:00.425116Z","caller":"traceutil/trace.go:171","msg":"trace[12584473] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:1; }","duration":"121.568393ms","start":"2026-08-11T11:12:00.303534Z","end":"2026-08-11T11:12:00.425103Z","steps":["trace[12584473] 'range keys from in-memory index tree' (duration: 121.345986ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.425173Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.661612ms","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":"info","ts":"2026-08-11T11:12:00.42521Z","caller":"traceutil/trace.go:171","msg":"trace[822394607] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:1; }","duration":"192.706443ms","start":"2026-08-11T11:12:00.23249Z","end":"2026-08-11T11:12:00.425197Z","steps":["trace[822394607] 'range keys from in-memory index tree' (duration: 192.625471ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.425367Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"180.849099ms","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-08-11T11:12:00.425396Z","caller":"traceutil/trace.go:171","msg":"trace[199696675] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:1; }","duration":"180.897591ms","start":"2026-08-11T11:12:00.24449Z","end":"2026-08-11T11:12:00.425388Z","steps":["trace[199696675] 'count revisions from in-memory index tree' (duration: 180.804028ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.425503Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.022564ms","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-08-11T11:12:00.425528Z","caller":"traceutil/trace.go:171","msg":"trace[693612817] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:1; }","duration":"181.078916ms","start":"2026-08-11T11:12:00.244443Z","end":"2026-08-11T11:12:00.425522Z","steps":["trace[693612817] 'range keys from in-memory index tree' (duration: 180.940042ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.425617Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.193073ms","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":"info","ts":"2026-08-11T11:12:00.425642Z","caller":"traceutil/trace.go:171","msg":"trace[894667193] range","detail":"{range_begin:/registry/configmaps/; range_end:/registry/configmaps0; response_count:0; response_revision:1; }","duration":"171.256164ms","start":"2026-08-11T11:12:00.25438Z","end":"2026-08-11T11:12:00.425636Z","steps":["trace[894667193] 'range keys from in-memory index tree' (duration: 171.0756ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.425741Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.155332ms","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":"info","ts":"2026-08-11T11:12:00.425765Z","caller":"traceutil/trace.go:171","msg":"trace[1220120363] range","detail":"{range_begin:/registry/configmaps/; range_end:/registry/configmaps0; response_count:0; response_revision:1; }","duration":"171.192493ms","start":"2026-08-11T11:12:00.254567Z","end":"2026-08-11T11:12:00.42576Z","steps":["trace[1220120363] 'count revisions from in-memory index tree' (duration: 171.132271ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.425866Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.42251ms","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":"info","ts":"2026-08-11T11:12:00.425891Z","caller":"traceutil/trace.go:171","msg":"trace[693491210] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:1; }","duration":"157.484102ms","start":"2026-08-11T11:12:00.268401Z","end":"2026-08-11T11:12:00.425885Z","steps":["trace[693491210] 'count revisions from in-memory index tree' (duration: 157.337258ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.425999Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.99012ms","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-08-11T11:12:00.426023Z","caller":"traceutil/trace.go:171","msg":"trace[724925660] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:1; }","duration":"157.03965ms","start":"2026-08-11T11:12:00.268978Z","end":"2026-08-11T11:12:00.426018Z","steps":["trace[724925660] 'range keys from in-memory index tree' (duration: 156.934907ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.426125Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.075895ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/\" range_end:\"/registry/serviceaccounts0\" limit:10000 ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-08-11T11:12:00.426148Z","caller":"traceutil/trace.go:171","msg":"trace[1805247165] range","detail":"{range_begin:/registry/serviceaccounts/; range_end:/registry/serviceaccounts0; response_count:0; response_revision:1; }","duration":"147.131246ms","start":"2026-08-11T11:12:00.279011Z","end":"2026-08-11T11:12:00.426142Z","steps":["trace[1805247165] 'range keys from in-memory index tree' (duration: 147.027834ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.426226Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.028675ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/\" range_end:\"/registry/serviceaccounts0\" count_only:true ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-08-11T11:12:00.426251Z","caller":"traceutil/trace.go:171","msg":"trace[1660392913] range","detail":"{range_begin:/registry/serviceaccounts/; range_end:/registry/serviceaccounts0; response_count:0; response_revision:1; }","duration":"146.50693ms","start":"2026-08-11T11:12:00.279739Z","end":"2026-08-11T11:12:00.426246Z","steps":["trace[1660392913] 'count revisions from in-memory index tree' (duration: 139.935562ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.426297Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.05679ms","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":"info","ts":"2026-08-11T11:12:00.426323Z","caller":"traceutil/trace.go:171","msg":"trace[1289064582] range","detail":"{range_begin:/registry/podtemplates/; range_end:/registry/podtemplates0; response_count:0; response_revision:1; }","duration":"132.111142ms","start":"2026-08-11T11:12:00.294206Z","end":"2026-08-11T11:12:00.426318Z","steps":["trace[1289064582] 'range keys from in-memory index tree' (duration: 132.008209ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.426433Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.130773ms","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-08-11T11:12:00.426458Z","caller":"traceutil/trace.go:171","msg":"trace[108724432] range","detail":"{range_begin:/registry/podtemplates/; range_end:/registry/podtemplates0; response_count:0; response_revision:1; }","duration":"132.204084ms","start":"2026-08-11T11:12:00.294248Z","end":"2026-08-11T11:12:00.426452Z","steps":["trace[108724432] 'count revisions from in-memory index tree' (duration: 132.052901ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.424727Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"243.35072ms","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-08-11T11:12:00.426534Z","caller":"traceutil/trace.go:171","msg":"trace[732692801] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:1; }","duration":"245.184347ms","start":"2026-08-11T11:12:00.181337Z","end":"2026-08-11T11:12:00.426521Z","steps":["trace[732692801] 'count revisions from in-memory index tree' (duration: 243.278438ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:00.425076Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"203.208062ms","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-08-11T11:12:00.426624Z","caller":"traceutil/trace.go:171","msg":"trace[641899911] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:1; }","duration":"204.787473ms","start":"2026-08-11T11:12:00.22183Z","end":"2026-08-11T11:12:00.426618Z","steps":["trace[641899911] 'count revisions from in-memory index tree' (duration: 203.143551ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:00.425144Z","caller":"traceutil/trace.go:171","msg":"trace[1853277831] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:1; }","duration":"192.707013ms","start":"2026-08-11T11:12:00.232422Z","end":"2026-08-11T11:12:00.425129Z","steps":["trace[1853277831] 'count revisions from in-memory index tree' (duration: 192.596531ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:05.75729Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.819097ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-08-11T11:12:05.757591Z","caller":"traceutil/trace.go:171","msg":"trace[397631408] transaction","detail":"{read_only:false; response_revision:283; number_of_response:1; }","duration":"168.990731ms","start":"2026-08-11T11:12:05.588581Z","end":"2026-08-11T11:12:05.757571Z","steps":["trace[397631408] 'process raft request' (duration: 168.921329ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:05.757782Z","caller":"traceutil/trace.go:171","msg":"trace[1344311694] transaction","detail":"{read_only:false; response_revision:282; number_of_response:1; }","duration":"175.31258ms","start":"2026-08-11T11:12:05.582424Z","end":"2026-08-11T11:12:05.757737Z","steps":["trace[1344311694] 'process raft request' (duration: 174.981672ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:05.757782Z","caller":"traceutil/trace.go:171","msg":"trace[1152735318] transaction","detail":"{read_only:false; response_revision:281; number_of_response:1; }","duration":"224.285282ms","start":"2026-08-11T11:12:05.533467Z","end":"2026-08-11T11:12:05.757752Z","steps":["trace[1152735318] 'process raft request' (duration: 81.47312ms)","trace[1152735318] 'compare' (duration: 141.575421ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:12:10.673265Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824334587192278284,"retry-timeout":"500ms"} {"level":"info","ts":"2026-08-11T11:12:10.88146Z","caller":"traceutil/trace.go:171","msg":"trace[12008287] linearizableReadLoop","detail":"{readStateIndex:350; appliedIndex:349; }","duration":"709.178239ms","start":"2026-08-11T11:12:10.172259Z","end":"2026-08-11T11:12:10.881437Z","steps":["trace[12008287] 'read index received' (duration: 709.109417ms)","trace[12008287] 'applied index is now lower than readState.Index' (duration: 67.691µs)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:12:10.881638Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"709.353763ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:477"} {"level":"info","ts":"2026-08-11T11:12:10.881688Z","caller":"traceutil/trace.go:171","msg":"trace[1316181553] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:343; }","duration":"709.453036ms","start":"2026-08-11T11:12:10.172223Z","end":"2026-08-11T11:12:10.881676Z","steps":["trace[1316181553] 'agreement among raft nodes before linearized reading' (duration: 709.342603ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:10.881535Z","caller":"traceutil/trace.go:171","msg":"trace[1381283542] transaction","detail":"{read_only:false; response_revision:343; number_of_response:1; }","duration":"742.457695ms","start":"2026-08-11T11:12:10.139037Z","end":"2026-08-11T11:12:10.881495Z","steps":["trace[1381283542] 'process raft request' (duration: 742.24822ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:10.88172Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.1722Z","time spent":"709.512406ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":500,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-08-11T11:12:10.88189Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.995839ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/bootstrap-signer\" ","response":"range_response_count:1 size:197"} {"level":"warn","ts":"2026-08-11T11:12:10.881929Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"453.251491ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ttl-controller\" ","response":"range_response_count:1 size:193"} {"level":"info","ts":"2026-08-11T11:12:10.881979Z","caller":"traceutil/trace.go:171","msg":"trace[506025486] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/bootstrap-signer; range_end:; response_count:1; response_revision:343; }","duration":"254.147133ms","start":"2026-08-11T11:12:10.627811Z","end":"2026-08-11T11:12:10.881958Z","steps":["trace[506025486] 'agreement among raft nodes before linearized reading' (duration: 253.958988ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:10.881958Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"503.28157ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/node-controller\" ","response":"range_response_count:1 size:195"} {"level":"warn","ts":"2026-08-11T11:12:10.882002Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"403.741075ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpointslice-controller\" ","response":"range_response_count:1 size:214"} {"level":"warn","ts":"2026-08-11T11:12:10.882055Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"603.985882ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/daemon-set-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-08-11T11:12:10.882065Z","caller":"traceutil/trace.go:171","msg":"trace[954647632] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpointslice-controller; range_end:; response_count:1; response_revision:343; }","duration":"403.846308ms","start":"2026-08-11T11:12:10.4782Z","end":"2026-08-11T11:12:10.882046Z","steps":["trace[954647632] 'agreement among raft nodes before linearized reading' (duration: 403.666123ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:10.882062Z","caller":"traceutil/trace.go:171","msg":"trace[1844845635] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/node-controller; range_end:; response_count:1; response_revision:343; }","duration":"503.447864ms","start":"2026-08-11T11:12:10.37859Z","end":"2026-08-11T11:12:10.882038Z","steps":["trace[1844845635] 'agreement among raft nodes before linearized reading' (duration: 503.209548ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:10.882094Z","caller":"traceutil/trace.go:171","msg":"trace[605548307] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/daemon-set-controller; range_end:; response_count:1; response_revision:343; }","duration":"604.057444ms","start":"2026-08-11T11:12:10.278024Z","end":"2026-08-11T11:12:10.882081Z","steps":["trace[605548307] 'agreement among raft nodes before linearized reading' (duration: 603.781987ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:10.88212Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.378565Z","time spent":"503.542835ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":55,"response count":1,"response size":218,"request content":"key:\"/registry/serviceaccounts/kube-system/node-controller\" "} {"level":"warn","ts":"2026-08-11T11:12:10.882123Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.478179Z","time spent":"403.91529ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":1,"response size":237,"request content":"key:\"/registry/serviceaccounts/kube-system/endpointslice-controller\" "} {"level":"warn","ts":"2026-08-11T11:12:10.882142Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.278005Z","time spent":"604.125786ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":61,"response count":1,"response size":230,"request content":"key:\"/registry/serviceaccounts/kube-system/daemon-set-controller\" "} {"level":"warn","ts":"2026-08-11T11:12:10.88219Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.139015Z","time spent":"742.756833ms","remote":"127.0.0.1:35512","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1251,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:12:10.882234Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"653.115178ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/service-account-controller\" ","response":"range_response_count:1 size:218"} {"level":"warn","ts":"2026-08-11T11:12:10.882216Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"353.47652ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpoint-controller\" ","response":"range_response_count:1 size:203"} {"level":"info","ts":"2026-08-11T11:12:10.882002Z","caller":"traceutil/trace.go:171","msg":"trace[72537841] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ttl-controller; range_end:; response_count:1; response_revision:343; }","duration":"453.490437ms","start":"2026-08-11T11:12:10.428493Z","end":"2026-08-11T11:12:10.881983Z","steps":["trace[72537841] 'agreement among raft nodes before linearized reading' (duration: 453.174159ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:10.882264Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"553.622925ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/deployment-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-08-11T11:12:10.882272Z","caller":"traceutil/trace.go:171","msg":"trace[530936002] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/service-account-controller; range_end:; response_count:1; response_revision:343; }","duration":"653.20609ms","start":"2026-08-11T11:12:10.229054Z","end":"2026-08-11T11:12:10.882261Z","steps":["trace[530936002] 'agreement among raft nodes before linearized reading' (duration: 652.771959ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:10.882305Z","caller":"traceutil/trace.go:171","msg":"trace[1135213027] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpoint-controller; range_end:; response_count:1; response_revision:343; }","duration":"353.613225ms","start":"2026-08-11T11:12:10.528669Z","end":"2026-08-11T11:12:10.882282Z","steps":["trace[1135213027] 'agreement among raft nodes before linearized reading' (duration: 353.04321ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:10.882316Z","caller":"traceutil/trace.go:171","msg":"trace[145457411] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/deployment-controller; range_end:; response_count:1; response_revision:343; }","duration":"553.718728ms","start":"2026-08-11T11:12:10.328584Z","end":"2026-08-11T11:12:10.882303Z","steps":["trace[145457411] 'agreement among raft nodes before linearized reading' (duration: 553.181405ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:10.882318Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.42845Z","time spent":"453.852556ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":216,"request content":"key:\"/registry/serviceaccounts/kube-system/ttl-controller\" "} {"level":"warn","ts":"2026-08-11T11:12:10.882327Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.229028Z","time spent":"653.287523ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":1,"response size":241,"request content":"key:\"/registry/serviceaccounts/kube-system/service-account-controller\" "} {"level":"warn","ts":"2026-08-11T11:12:10.882352Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.528647Z","time spent":"353.694646ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":59,"response count":1,"response size":226,"request content":"key:\"/registry/serviceaccounts/kube-system/endpoint-controller\" "} {"level":"warn","ts":"2026-08-11T11:12:10.882357Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.32856Z","time spent":"553.787129ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":61,"response count":1,"response size":230,"request content":"key:\"/registry/serviceaccounts/kube-system/deployment-controller\" "} {"level":"warn","ts":"2026-08-11T11:12:10.882481Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"305.089894ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/root-ca-cert-publisher\" ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-08-11T11:12:10.882512Z","caller":"traceutil/trace.go:171","msg":"trace[751769492] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/root-ca-cert-publisher; range_end:; response_count:1; response_revision:343; }","duration":"305.149455ms","start":"2026-08-11T11:12:10.577352Z","end":"2026-08-11T11:12:10.882501Z","steps":["trace[751769492] 'agreement among raft nodes before linearized reading' (duration: 304.351195ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:10.88254Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.577333Z","time spent":"305.200297ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":1,"response size":232,"request content":"key:\"/registry/serviceaccounts/kube-system/root-ca-cert-publisher\" "} {"level":"warn","ts":"2026-08-11T11:12:10.882796Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"704.89449ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/clusterrole-aggregation-controller\" ","response":"range_response_count:1 size:234"} {"level":"info","ts":"2026-08-11T11:12:10.88288Z","caller":"traceutil/trace.go:171","msg":"trace[1402776000] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/clusterrole-aggregation-controller; range_end:; response_count:1; response_revision:343; }","duration":"705.030434ms","start":"2026-08-11T11:12:10.177827Z","end":"2026-08-11T11:12:10.882858Z","steps":["trace[1402776000] 'agreement among raft nodes before linearized reading' (duration: 703.774423ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:10.88298Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:12:10.177778Z","time spent":"705.183358ms","remote":"127.0.0.1:35444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":257,"request content":"key:\"/registry/serviceaccounts/kube-system/clusterrole-aggregation-controller\" "} {"level":"info","ts":"2026-08-11T11:12:11.087252Z","caller":"traceutil/trace.go:171","msg":"trace[691598795] linearizableReadLoop","detail":"{readStateIndex:351; appliedIndex:350; }","duration":"192.184974ms","start":"2026-08-11T11:12:10.895045Z","end":"2026-08-11T11:12:11.08723Z","steps":["trace[691598795] 'read index received' (duration: 177.148916ms)","trace[691598795] 'applied index is now lower than readState.Index' (duration: 15.034788ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:12:11.0873Z","caller":"traceutil/trace.go:171","msg":"trace[1634163466] transaction","detail":"{read_only:false; response_revision:344; number_of_response:1; }","duration":"199.620621ms","start":"2026-08-11T11:12:10.887618Z","end":"2026-08-11T11:12:11.087238Z","steps":["trace[1634163466] 'process raft request' (duration: 184.44827ms)","trace[1634163466] 'compare' (duration: 14.948886ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:12:11.087395Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.332878ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/deployment-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-08-11T11:12:11.088068Z","caller":"traceutil/trace.go:171","msg":"trace[1732866413] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/deployment-controller; range_end:; response_count:1; response_revision:344; }","duration":"193.036696ms","start":"2026-08-11T11:12:10.895004Z","end":"2026-08-11T11:12:11.08804Z","steps":["trace[1732866413] 'agreement among raft nodes before linearized reading' (duration: 192.317777ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:11.088554Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.392555ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/daemon-set-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-08-11T11:12:11.08864Z","caller":"traceutil/trace.go:171","msg":"trace[1145610739] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/daemon-set-controller; range_end:; response_count:1; response_revision:345; }","duration":"193.490237ms","start":"2026-08-11T11:12:10.895139Z","end":"2026-08-11T11:12:11.088629Z","steps":["trace[1145610739] 'agreement among raft nodes before linearized reading' (duration: 193.355664ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:11.088691Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.309685ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpoint-controller\" ","response":"range_response_count:1 size:203"} {"level":"info","ts":"2026-08-11T11:12:11.088752Z","caller":"traceutil/trace.go:171","msg":"trace[704700415] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpoint-controller; range_end:; response_count:1; response_revision:345; }","duration":"110.424467ms","start":"2026-08-11T11:12:10.978311Z","end":"2026-08-11T11:12:11.088736Z","steps":["trace[704700415] 'agreement among raft nodes before linearized reading' (duration: 110.298764ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:11.088782Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.109488ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpointslice-controller\" ","response":"range_response_count:1 size:214"} {"level":"info","ts":"2026-08-11T11:12:11.08882Z","caller":"traceutil/trace.go:171","msg":"trace[25402413] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpointslice-controller; range_end:; response_count:1; response_revision:345; }","duration":"193.162579ms","start":"2026-08-11T11:12:10.895647Z","end":"2026-08-11T11:12:11.088809Z","steps":["trace[25402413] 'agreement among raft nodes before linearized reading' (duration: 193.078037ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:11.088828Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.447066ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/bootstrap-signer\" ","response":"range_response_count:1 size:197"} {"level":"info","ts":"2026-08-11T11:12:11.088876Z","caller":"traceutil/trace.go:171","msg":"trace[99503809] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/bootstrap-signer; range_end:; response_count:1; response_revision:345; }","duration":"193.508727ms","start":"2026-08-11T11:12:10.89536Z","end":"2026-08-11T11:12:11.088869Z","steps":["trace[99503809] 'agreement among raft nodes before linearized reading' (duration: 193.436366ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:11.088946Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.674422ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/root-ca-cert-publisher\" ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-08-11T11:12:11.088964Z","caller":"traceutil/trace.go:171","msg":"trace[997395900] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/root-ca-cert-publisher; range_end:; response_count:1; response_revision:345; }","duration":"193.719383ms","start":"2026-08-11T11:12:10.895238Z","end":"2026-08-11T11:12:11.088957Z","steps":["trace[997395900] 'agreement among raft nodes before linearized reading' (duration: 193.686862ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:11.089066Z","caller":"traceutil/trace.go:171","msg":"trace[638873203] transaction","detail":"{read_only:false; response_revision:345; number_of_response:1; }","duration":"193.912318ms","start":"2026-08-11T11:12:10.895135Z","end":"2026-08-11T11:12:11.089047Z","steps":["trace[638873203] 'process raft request' (duration: 193.276222ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:11.090472Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.313293ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ttl-controller\" ","response":"range_response_count:1 size:193"} {"level":"info","ts":"2026-08-11T11:12:11.09052Z","caller":"traceutil/trace.go:171","msg":"trace[918147673] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ttl-controller; range_end:; response_count:1; response_revision:345; }","duration":"162.403916ms","start":"2026-08-11T11:12:10.928103Z","end":"2026-08-11T11:12:11.090507Z","steps":["trace[918147673] 'agreement among raft nodes before linearized reading' (duration: 160.921218ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:13.662431Z","caller":"traceutil/trace.go:171","msg":"trace[1638909016] linearizableReadLoop","detail":"{readStateIndex:409; appliedIndex:408; }","duration":"154.865186ms","start":"2026-08-11T11:12:13.507538Z","end":"2026-08-11T11:12:13.662403Z","steps":["trace[1638909016] 'read index received' (duration: 154.523367ms)","trace[1638909016] 'applied index is now lower than readState.Index' (duration: 340.239µs)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:12:13.662501Z","caller":"traceutil/trace.go:171","msg":"trace[1772362567] transaction","detail":"{read_only:false; response_revision:401; number_of_response:1; }","duration":"280.840164ms","start":"2026-08-11T11:12:13.381628Z","end":"2026-08-11T11:12:13.662469Z","steps":["trace[1772362567] 'process raft request' (duration: 280.610538ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:13.662569Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.008889ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.121\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-08-11T11:12:13.66261Z","caller":"traceutil/trace.go:171","msg":"trace[1484753887] range","detail":"{range_begin:/registry/masterleases/199.19.213.121; range_end:; response_count:1; response_revision:401; }","duration":"155.109182ms","start":"2026-08-11T11:12:13.507491Z","end":"2026-08-11T11:12:13.6626Z","steps":["trace[1484753887] 'agreement among raft nodes before linearized reading' (duration: 155.003449ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:15.892293Z","caller":"traceutil/trace.go:171","msg":"trace[1995245479] transaction","detail":"{read_only:false; response_revision:407; number_of_response:1; }","duration":"215.828749ms","start":"2026-08-11T11:12:15.676441Z","end":"2026-08-11T11:12:15.89227Z","steps":["trace[1995245479] 'process raft request' (duration: 215.660164ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:15.894381Z","caller":"traceutil/trace.go:171","msg":"trace[1145343212] transaction","detail":"{read_only:false; response_revision:408; number_of_response:1; }","duration":"138.681958ms","start":"2026-08-11T11:12:15.755677Z","end":"2026-08-11T11:12:15.894359Z","steps":["trace[1145343212] 'process raft request' (duration: 138.537915ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:26.201119Z","caller":"traceutil/trace.go:171","msg":"trace[1104001648] transaction","detail":"{read_only:false; response_revision:435; number_of_response:1; }","duration":"169.003811ms","start":"2026-08-11T11:12:26.032087Z","end":"2026-08-11T11:12:26.201091Z","steps":["trace[1104001648] 'process raft request' (duration: 168.846488ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:26.238575Z","caller":"traceutil/trace.go:171","msg":"trace[661223742] transaction","detail":"{read_only:false; response_revision:436; number_of_response:1; }","duration":"205.600711ms","start":"2026-08-11T11:12:26.032937Z","end":"2026-08-11T11:12:26.238538Z","steps":["trace[661223742] 'process raft request' (duration: 197.424246ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:26.238935Z","caller":"traceutil/trace.go:171","msg":"trace[1915298133] transaction","detail":"{read_only:false; response_revision:437; number_of_response:1; }","duration":"205.733186ms","start":"2026-08-11T11:12:26.033169Z","end":"2026-08-11T11:12:26.238902Z","steps":["trace[1915298133] 'process raft request' (duration: 205.271124ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:29.541596Z","caller":"traceutil/trace.go:171","msg":"trace[120083201] transaction","detail":"{read_only:false; response_revision:444; number_of_response:1; }","duration":"113.727441ms","start":"2026-08-11T11:12:29.427456Z","end":"2026-08-11T11:12:29.541184Z","steps":["trace[120083201] 'process raft request' (duration: 113.490545ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:42.417544Z","caller":"traceutil/trace.go:171","msg":"trace[1862776553] transaction","detail":"{read_only:false; response_revision:501; number_of_response:1; }","duration":"105.181056ms","start":"2026-08-11T11:12:42.312323Z","end":"2026-08-11T11:12:42.417504Z","steps":["trace[1862776553] 'process raft request' (duration: 104.9475ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:12:42.698093Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.491608ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-08-11T11:12:42.698208Z","caller":"traceutil/trace.go:171","msg":"trace[1068657672] linearizableReadLoop","detail":"{readStateIndex:516; appliedIndex:515; }","duration":"259.974879ms","start":"2026-08-11T11:12:42.438213Z","end":"2026-08-11T11:12:42.698188Z","steps":["trace[1068657672] 'read index received' (duration: 126.273076ms)","trace[1068657672] 'applied index is now lower than readState.Index' (duration: 133.700083ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:12:42.698292Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"260.079812ms","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-08-11T11:12:42.698325Z","caller":"traceutil/trace.go:171","msg":"trace[1770464876] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:502; }","duration":"260.173274ms","start":"2026-08-11T11:12:42.438141Z","end":"2026-08-11T11:12:42.698315Z","steps":["trace[1770464876] 'agreement among raft nodes before linearized reading' (duration: 260.102953ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:12:42.698417Z","caller":"traceutil/trace.go:171","msg":"trace[1149992037] transaction","detail":"{read_only:false; response_revision:502; number_of_response:1; }","duration":"275.870089ms","start":"2026-08-11T11:12:42.422519Z","end":"2026-08-11T11:12:42.698389Z","steps":["trace[1149992037] 'process raft request' (duration: 141.967771ms)","trace[1149992037] 'compare' (duration: 133.347684ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:13:00.310392Z","caller":"traceutil/trace.go:171","msg":"trace[188470812] transaction","detail":"{read_only:false; response_revision:577; number_of_response:1; }","duration":"174.260563ms","start":"2026-08-11T11:13:00.136102Z","end":"2026-08-11T11:13:00.310363Z","steps":["trace[188470812] 'process raft request' (duration: 174.089769ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:00.327749Z","caller":"traceutil/trace.go:171","msg":"trace[1453496505] transaction","detail":"{read_only:false; response_revision:581; number_of_response:1; }","duration":"138.812062ms","start":"2026-08-11T11:13:00.188902Z","end":"2026-08-11T11:13:00.327714Z","steps":["trace[1453496505] 'process raft request' (duration: 138.422362ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:00.327826Z","caller":"traceutil/trace.go:171","msg":"trace[879563414] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"109.529875ms","start":"2026-08-11T11:13:00.218246Z","end":"2026-08-11T11:13:00.327775Z","steps":["trace[879563414] 'process raft request' (duration: 109.160356ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:00.327945Z","caller":"traceutil/trace.go:171","msg":"trace[39191525] transaction","detail":"{read_only:false; response_revision:584; number_of_response:1; }","duration":"107.766881ms","start":"2026-08-11T11:13:00.220095Z","end":"2026-08-11T11:13:00.327862Z","steps":["trace[39191525] 'process raft request' (duration: 107.35743ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:00.327933Z","caller":"traceutil/trace.go:171","msg":"trace[1452456865] transaction","detail":"{read_only:false; response_revision:579; number_of_response:1; }","duration":"187.123187ms","start":"2026-08-11T11:13:00.140752Z","end":"2026-08-11T11:13:00.327875Z","steps":["trace[1452456865] 'process raft request' (duration: 186.419429ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:00.328025Z","caller":"traceutil/trace.go:171","msg":"trace[741927514] transaction","detail":"{read_only:false; response_revision:580; number_of_response:1; }","duration":"145.497219ms","start":"2026-08-11T11:13:00.182513Z","end":"2026-08-11T11:13:00.32801Z","steps":["trace[741927514] 'process raft request' (duration: 144.74317ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:00.327972Z","caller":"traceutil/trace.go:171","msg":"trace[341635347] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"134.033072ms","start":"2026-08-11T11:13:00.193794Z","end":"2026-08-11T11:13:00.327827Z","steps":["trace[341635347] 'process raft request' (duration: 133.57329ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:00.328124Z","caller":"traceutil/trace.go:171","msg":"trace[709645796] transaction","detail":"{read_only:false; response_revision:578; number_of_response:1; }","duration":"187.469076ms","start":"2026-08-11T11:13:00.140647Z","end":"2026-08-11T11:13:00.328116Z","steps":["trace[709645796] 'process raft request' (duration: 186.313377ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:00.328158Z","caller":"traceutil/trace.go:171","msg":"trace[2104472022] transaction","detail":"{read_only:false; response_revision:585; number_of_response:1; }","duration":"106.814297ms","start":"2026-08-11T11:13:00.221338Z","end":"2026-08-11T11:13:00.328152Z","steps":["trace[2104472022] 'process raft request' (duration: 106.186091ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:02.32753Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.727138ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-08-11T11:13:02.32766Z","caller":"traceutil/trace.go:171","msg":"trace[1375021738] linearizableReadLoop","detail":"{readStateIndex:674; appliedIndex:673; }","duration":"274.761602ms","start":"2026-08-11T11:13:02.05288Z","end":"2026-08-11T11:13:02.327642Z","steps":["trace[1375021738] 'read index received' (duration: 147.687376ms)","trace[1375021738] 'applied index is now lower than readState.Index' (duration: 127.072756ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:13:02.327691Z","caller":"traceutil/trace.go:171","msg":"trace[951029518] transaction","detail":"{read_only:false; response_revision:654; number_of_response:1; }","duration":"278.568578ms","start":"2026-08-11T11:13:02.049085Z","end":"2026-08-11T11:13:02.327653Z","steps":["trace[951029518] 'process raft request' (duration: 151.613324ms)","trace[951029518] 'compare' (duration: 126.562294ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:02.32785Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"274.970507ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/envoyextensionpolicies.gateway.envoyproxy.io\" ","response":"range_response_count:1 size:74769"} {"level":"info","ts":"2026-08-11T11:13:02.327894Z","caller":"traceutil/trace.go:171","msg":"trace[1921641170] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/envoyextensionpolicies.gateway.envoyproxy.io; range_end:; response_count:1; response_revision:654; }","duration":"275.074109ms","start":"2026-08-11T11:13:02.052809Z","end":"2026-08-11T11:13:02.327883Z","steps":["trace[1921641170] 'agreement among raft nodes before linearized reading' (duration: 274.881925ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:03.610784Z","caller":"traceutil/trace.go:171","msg":"trace[158918253] transaction","detail":"{read_only:false; response_revision:659; number_of_response:1; }","duration":"165.801741ms","start":"2026-08-11T11:13:03.444951Z","end":"2026-08-11T11:13:03.610753Z","steps":["trace[158918253] 'process raft request' (duration: 165.541115ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:04.127044Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"279.940991ms","expected-duration":"100ms","prefix":"","request":"header: lease_grant:","response":"size:40"} {"level":"info","ts":"2026-08-11T11:13:04.127242Z","caller":"traceutil/trace.go:171","msg":"trace[1440072990] transaction","detail":"{read_only:false; response_revision:660; number_of_response:1; }","duration":"310.639494ms","start":"2026-08-11T11:13:03.816588Z","end":"2026-08-11T11:13:04.127227Z","steps":["trace[1440072990] 'process raft request' (duration: 310.542791ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:04.127244Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:03.611978Z","time spent":"515.255261ms","remote":"127.0.0.1:35292","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"warn","ts":"2026-08-11T11:13:04.127326Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:03.81656Z","time spent":"310.710716ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:13:04.127443Z","caller":"traceutil/trace.go:171","msg":"trace[261151262] linearizableReadLoop","detail":"{readStateIndex:680; appliedIndex:679; }","duration":"383.697131ms","start":"2026-08-11T11:13:03.743713Z","end":"2026-08-11T11:13:04.12741Z","steps":["trace[261151262] 'read index received' (duration: 103.428741ms)","trace[261151262] 'applied index is now lower than readState.Index' (duration: 280.26608ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:04.127568Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"383.861795ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:04.127602Z","caller":"traceutil/trace.go:171","msg":"trace[1832076891] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:660; }","duration":"383.959708ms","start":"2026-08-11T11:13:03.743632Z","end":"2026-08-11T11:13:04.127592Z","steps":["trace[1832076891] 'agreement among raft nodes before linearized reading' (duration: 383.910197ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:04.127628Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:03.743585Z","time spent":"384.03609ms","remote":"127.0.0.1:35258","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-08-11T11:13:04.12764Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.91845ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/envoy-gateway-system/envoy-gateway\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:04.127693Z","caller":"traceutil/trace.go:171","msg":"trace[2062155029] range","detail":"{range_begin:/registry/serviceaccounts/envoy-gateway-system/envoy-gateway; range_end:; response_count:0; response_revision:660; }","duration":"146.020983ms","start":"2026-08-11T11:13:03.981652Z","end":"2026-08-11T11:13:04.127673Z","steps":["trace[2062155029] 'agreement among raft nodes before linearized reading' (duration: 145.91925ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:09.290019Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.279286ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-08-11T11:13:09.290141Z","caller":"traceutil/trace.go:171","msg":"trace[1590009494] linearizableReadLoop","detail":"{readStateIndex:720; appliedIndex:719; }","duration":"393.859988ms","start":"2026-08-11T11:13:08.896248Z","end":"2026-08-11T11:13:09.290108Z","steps":["trace[1590009494] 'read index received' (duration: 106.349026ms)","trace[1590009494] 'applied index is now lower than readState.Index' (duration: 287.509172ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:09.29043Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"394.168405ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-08-11T11:13:09.290484Z","caller":"traceutil/trace.go:171","msg":"trace[54846568] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:697; }","duration":"394.267608ms","start":"2026-08-11T11:13:08.896203Z","end":"2026-08-11T11:13:09.29047Z","steps":["trace[54846568] 'agreement among raft nodes before linearized reading' (duration: 394.025812ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:09.29054Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:08.896181Z","time spent":"394.345749ms","remote":"127.0.0.1:35520","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-08-11T11:13:09.290608Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"374.274295ms","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-08-11T11:13:09.290739Z","caller":"traceutil/trace.go:171","msg":"trace[349781388] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:697; }","duration":"374.48459ms","start":"2026-08-11T11:13:08.916233Z","end":"2026-08-11T11:13:09.290717Z","steps":["trace[349781388] 'agreement among raft nodes before linearized reading' (duration: 374.115761ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:09.290816Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:08.916196Z","time spent":"374.608743ms","remote":"127.0.0.1:35520","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-08-11T11:13:09.868047Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.071901ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-08-11T11:13:09.868169Z","caller":"traceutil/trace.go:171","msg":"trace[619545689] linearizableReadLoop","detail":"{readStateIndex:722; appliedIndex:721; }","duration":"352.716419ms","start":"2026-08-11T11:13:09.515434Z","end":"2026-08-11T11:13:09.86815Z","steps":["trace[619545689] 'read index received' (duration: 218.455913ms)","trace[619545689] 'applied index is now lower than readState.Index' (duration: 134.258876ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:13:09.868439Z","caller":"traceutil/trace.go:171","msg":"trace[2038925830] transaction","detail":"{read_only:false; response_revision:699; number_of_response:1; }","duration":"573.150124ms","start":"2026-08-11T11:13:09.295275Z","end":"2026-08-11T11:13:09.868425Z","steps":["trace[2038925830] 'process raft request' (duration: 438.621751ms)","trace[2038925830] 'compare' (duration: 133.862336ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:09.868503Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:09.295255Z","time spent":"573.214556ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:13:09.868701Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"353.265682ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-d75ts\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-08-11T11:13:09.868729Z","caller":"traceutil/trace.go:171","msg":"trace[1694432253] range","detail":"{range_begin:/registry/pods/kube-system/cilium-d75ts; range_end:; response_count:1; response_revision:699; }","duration":"353.336134ms","start":"2026-08-11T11:13:09.515383Z","end":"2026-08-11T11:13:09.86872Z","steps":["trace[1694432253] 'agreement among raft nodes before linearized reading' (duration: 353.18126ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:09.868754Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:09.515361Z","time spent":"353.387116ms","remote":"127.0.0.1:35430","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16988,"request content":"key:\"/registry/pods/kube-system/cilium-d75ts\" "} {"level":"warn","ts":"2026-08-11T11:13:09.868748Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.702841ms","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-08-11T11:13:09.868794Z","caller":"traceutil/trace.go:171","msg":"trace[971782182] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:699; }","duration":"235.748792ms","start":"2026-08-11T11:13:09.633032Z","end":"2026-08-11T11:13:09.868781Z","steps":["trace[971782182] 'agreement among raft nodes before linearized reading' (duration: 235.629529ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:09.868803Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.473539ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:09.868897Z","caller":"traceutil/trace.go:171","msg":"trace[1447884722] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:699; }","duration":"123.623093ms","start":"2026-08-11T11:13:09.745255Z","end":"2026-08-11T11:13:09.868878Z","steps":["trace[1447884722] 'agreement among raft nodes before linearized reading' (duration: 123.472579ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:10.025133Z","caller":"traceutil/trace.go:171","msg":"trace[972354782] transaction","detail":"{read_only:false; response_revision:701; number_of_response:1; }","duration":"139.976176ms","start":"2026-08-11T11:13:09.885128Z","end":"2026-08-11T11:13:10.025104Z","steps":["trace[972354782] 'process raft request' (duration: 122.798082ms)","trace[972354782] 'compare' (duration: 17.042301ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:10.982941Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"527.901276ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.983013Z","caller":"traceutil/trace.go:171","msg":"trace[328653505] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:701; }","duration":"528.030809ms","start":"2026-08-11T11:13:10.454966Z","end":"2026-08-11T11:13:10.982997Z","steps":["trace[328653505] 'range keys from in-memory index tree' (duration: 527.824834ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983054Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.454948Z","time spent":"528.093331ms","remote":"127.0.0.1:39766","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:10000 "} {"level":"warn","ts":"2026-08-11T11:13:10.983135Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"528.032199ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.983184Z","caller":"traceutil/trace.go:171","msg":"trace[1619618318] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:701; }","duration":"528.126011ms","start":"2026-08-11T11:13:10.455048Z","end":"2026-08-11T11:13:10.983174Z","steps":["trace[1619618318] 'count revisions from in-memory index tree' (duration: 527.931417ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983197Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"584.741349ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.983208Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.455024Z","time spent":"528.176153ms","remote":"127.0.0.1:39766","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" count_only:true "} {"level":"info","ts":"2026-08-11T11:13:10.98322Z","caller":"traceutil/trace.go:171","msg":"trace[1496074341] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:701; }","duration":"584.797191ms","start":"2026-08-11T11:13:10.398415Z","end":"2026-08-11T11:13:10.983213Z","steps":["trace[1496074341] 'count revisions from in-memory index tree' (duration: 584.628026ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983239Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.398396Z","time spent":"584.837081ms","remote":"127.0.0.1:39750","response type":"/etcdserverpb.KV/Range","request count":0,"request size":110,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" count_only:true "} {"level":"warn","ts":"2026-08-11T11:13:10.983301Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"527.730522ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.983327Z","caller":"traceutil/trace.go:171","msg":"trace[1611818240] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:701; }","duration":"527.779533ms","start":"2026-08-11T11:13:10.45554Z","end":"2026-08-11T11:13:10.983319Z","steps":["trace[1611818240] 'range keys from in-memory index tree' (duration: 527.688881ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983352Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.455532Z","time spent":"527.813443ms","remote":"127.0.0.1:39766","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:500 "} {"level":"warn","ts":"2026-08-11T11:13:10.98338Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"584.423752ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.983416Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"326.37143ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.98342Z","caller":"traceutil/trace.go:171","msg":"trace[1724644841] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:701; }","duration":"584.478613ms","start":"2026-08-11T11:13:10.39893Z","end":"2026-08-11T11:13:10.983409Z","steps":["trace[1724644841] 'range keys from in-memory index tree' (duration: 584.35303ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:10.983441Z","caller":"traceutil/trace.go:171","msg":"trace[951296094] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:701; }","duration":"326.424331ms","start":"2026-08-11T11:13:10.65701Z","end":"2026-08-11T11:13:10.983434Z","steps":["trace[951296094] 'range keys from in-memory index tree' (duration: 326.280568ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.98345Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.398924Z","time spent":"584.515964ms","remote":"127.0.0.1:39750","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:500 "} {"level":"warn","ts":"2026-08-11T11:13:10.983455Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"391.9708ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.98356Z","caller":"traceutil/trace.go:171","msg":"trace[1809864653] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:701; }","duration":"392.152744ms","start":"2026-08-11T11:13:10.591387Z","end":"2026-08-11T11:13:10.983539Z","steps":["trace[1809864653] 'count revisions from in-memory index tree' (duration: 391.742935ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983614Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.591352Z","time spent":"392.248657ms","remote":"127.0.0.1:39778","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" count_only:true "} {"level":"warn","ts":"2026-08-11T11:13:10.983568Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"362.598844ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.983727Z","caller":"traceutil/trace.go:171","msg":"trace[1368663720] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:701; }","duration":"362.780199ms","start":"2026-08-11T11:13:10.620915Z","end":"2026-08-11T11:13:10.983695Z","steps":["trace[1368663720] 'count revisions from in-memory index tree' (duration: 362.495332ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983784Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.71712ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.98381Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"391.879838ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.983844Z","caller":"traceutil/trace.go:171","msg":"trace[584977709] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:701; }","duration":"391.957599ms","start":"2026-08-11T11:13:10.59188Z","end":"2026-08-11T11:13:10.983837Z","steps":["trace[584977709] 'range keys from in-memory index tree' (duration: 391.771215ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983853Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.517215ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.983636Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"326.581495ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.983872Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.591854Z","time spent":"392.010891ms","remote":"127.0.0.1:39778","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:500 "} {"level":"info","ts":"2026-08-11T11:13:10.983881Z","caller":"traceutil/trace.go:171","msg":"trace[737647454] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:701; }","duration":"190.562846ms","start":"2026-08-11T11:13:10.793309Z","end":"2026-08-11T11:13:10.983872Z","steps":["trace[737647454] 'count revisions from in-memory index tree' (duration: 190.470663ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:10.983927Z","caller":"traceutil/trace.go:171","msg":"trace[255694672] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:701; }","duration":"326.897763ms","start":"2026-08-11T11:13:10.65701Z","end":"2026-08-11T11:13:10.983908Z","steps":["trace[255694672] 'count revisions from in-memory index tree' (duration: 326.463712ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:10.983821Z","caller":"traceutil/trace.go:171","msg":"trace[1469105602] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:701; }","duration":"190.775462ms","start":"2026-08-11T11:13:10.793036Z","end":"2026-08-11T11:13:10.983812Z","steps":["trace[1469105602] 'range keys from in-memory index tree' (duration: 190.669059ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983967Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"447.705455ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.984005Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.656988Z","time spent":"326.974894ms","remote":"127.0.0.1:39796","response type":"/etcdserverpb.KV/Range","request count":0,"request size":114,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" count_only:true "} {"level":"warn","ts":"2026-08-11T11:13:10.984015Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"392.546274ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.983674Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"326.053682ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.984194Z","caller":"traceutil/trace.go:171","msg":"trace[365550976] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:701; }","duration":"326.569495ms","start":"2026-08-11T11:13:10.657613Z","end":"2026-08-11T11:13:10.984182Z","steps":["trace[365550976] 'range keys from in-memory index tree' (duration: 326.015131ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.984241Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"447.695735ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.984293Z","caller":"traceutil/trace.go:171","msg":"trace[314235170] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:701; }","duration":"447.761316ms","start":"2026-08-11T11:13:10.536522Z","end":"2026-08-11T11:13:10.984284Z","steps":["trace[314235170] 'range keys from in-memory index tree' (duration: 447.649894ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.984349Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.536514Z","time spent":"447.824438ms","remote":"127.0.0.1:39770","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:500 "} {"level":"warn","ts":"2026-08-11T11:13:10.983925Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"447.825228ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.984433Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"368.643974ms","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-08-11T11:13:10.984471Z","caller":"traceutil/trace.go:171","msg":"trace[1859341269] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:701; }","duration":"368.713866ms","start":"2026-08-11T11:13:10.615747Z","end":"2026-08-11T11:13:10.984461Z","steps":["trace[1859341269] 'range keys from in-memory index tree' (duration: 368.448229ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.984508Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.615727Z","time spent":"368.774997ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":529,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-08-11T11:13:10.984327Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"363.316243ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.984582Z","caller":"traceutil/trace.go:171","msg":"trace[1919630258] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:701; }","duration":"448.422193ms","start":"2026-08-11T11:13:10.536032Z","end":"2026-08-11T11:13:10.984455Z","steps":["trace[1919630258] 'range keys from in-memory index tree' (duration: 447.746946ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.983509Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.656996Z","time spent":"326.459952ms","remote":"127.0.0.1:39796","response type":"/etcdserverpb.KV/Range","request count":0,"request size":115,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:10000 "} {"level":"info","ts":"2026-08-11T11:13:10.984148Z","caller":"traceutil/trace.go:171","msg":"trace[505048829] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:701; }","duration":"392.732489ms","start":"2026-08-11T11:13:10.591405Z","end":"2026-08-11T11:13:10.984138Z","steps":["trace[505048829] 'range keys from in-memory index tree' (duration: 392.388681ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.984715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"362.958394ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:10.984797Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.591372Z","time spent":"393.406146ms","remote":"127.0.0.1:39778","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:10000 "} {"level":"warn","ts":"2026-08-11T11:13:10.984252Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.657601Z","time spent":"326.632316ms","remote":"127.0.0.1:39796","response type":"/etcdserverpb.KV/Range","request count":0,"request size":115,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:500 "} {"level":"warn","ts":"2026-08-11T11:13:10.983839Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.620872Z","time spent":"362.923732ms","remote":"127.0.0.1:39782","response type":"/etcdserverpb.KV/Range","request count":0,"request size":88,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" count_only:true "} {"level":"info","ts":"2026-08-11T11:13:10.98401Z","caller":"traceutil/trace.go:171","msg":"trace[1926437971] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:701; }","duration":"447.806317ms","start":"2026-08-11T11:13:10.536192Z","end":"2026-08-11T11:13:10.983999Z","steps":["trace[1926437971] 'count revisions from in-memory index tree' (duration: 447.583422ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:10.984623Z","caller":"traceutil/trace.go:171","msg":"trace[598721125] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:701; }","duration":"363.734372ms","start":"2026-08-11T11:13:10.620866Z","end":"2026-08-11T11:13:10.9846Z","steps":["trace[598721125] 'range keys from in-memory index tree' (duration: 363.026555ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.984998Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.536009Z","time spent":"448.976607ms","remote":"127.0.0.1:39770","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:10000 "} {"level":"warn","ts":"2026-08-11T11:13:10.985037Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.536164Z","time spent":"448.853014ms","remote":"127.0.0.1:39770","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" count_only:true "} {"level":"info","ts":"2026-08-11T11:13:10.984807Z","caller":"traceutil/trace.go:171","msg":"trace[133603694] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:701; }","duration":"363.073366ms","start":"2026-08-11T11:13:10.621724Z","end":"2026-08-11T11:13:10.984797Z","steps":["trace[133603694] 'range keys from in-memory index tree' (duration: 362.903893ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.985345Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.621715Z","time spent":"363.616349ms","remote":"127.0.0.1:39782","response type":"/etcdserverpb.KV/Range","request count":0,"request size":89,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:500 "} {"level":"warn","ts":"2026-08-11T11:13:10.985071Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.62084Z","time spent":"364.186124ms","remote":"127.0.0.1:39782","response type":"/etcdserverpb.KV/Range","request count":0,"request size":89,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:10000 "} {"level":"warn","ts":"2026-08-11T11:13:10.983358Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"584.79414ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:10.986086Z","caller":"traceutil/trace.go:171","msg":"trace[1901165453] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:701; }","duration":"587.330323ms","start":"2026-08-11T11:13:10.39844Z","end":"2026-08-11T11:13:10.98577Z","steps":["trace[1901165453] 'range keys from in-memory index tree' (duration: 584.715979ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:10.986719Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.398416Z","time spent":"587.709663ms","remote":"127.0.0.1:39750","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:10000 "} {"level":"info","ts":"2026-08-11T11:13:11.321894Z","caller":"traceutil/trace.go:171","msg":"trace[1530050675] linearizableReadLoop","detail":"{readStateIndex:725; appliedIndex:724; }","duration":"330.512172ms","start":"2026-08-11T11:13:10.991361Z","end":"2026-08-11T11:13:11.321873Z","steps":["trace[1530050675] 'read index received' (duration: 330.328008ms)","trace[1530050675] 'applied index is now lower than readState.Index' (duration: 183.484µs)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:13:11.322001Z","caller":"traceutil/trace.go:171","msg":"trace[160848245] transaction","detail":"{read_only:false; response_revision:702; number_of_response:1; }","duration":"332.333617ms","start":"2026-08-11T11:13:10.98961Z","end":"2026-08-11T11:13:11.321943Z","steps":["trace[160848245] 'process raft request' (duration: 332.132162ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:11.32211Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.079471ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:11.322111Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.737997ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:11.322141Z","caller":"traceutil/trace.go:171","msg":"trace[1781118781] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:702; }","duration":"330.145564ms","start":"2026-08-11T11:13:10.991986Z","end":"2026-08-11T11:13:11.322132Z","steps":["trace[1781118781] 'agreement among raft nodes before linearized reading' (duration: 330.049551ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:11.322146Z","caller":"traceutil/trace.go:171","msg":"trace[61351038] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:702; }","duration":"330.795049ms","start":"2026-08-11T11:13:10.991343Z","end":"2026-08-11T11:13:11.322138Z","steps":["trace[61351038] 'agreement among raft nodes before linearized reading' (duration: 330.682786ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:11.322154Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.989586Z","time spent":"332.481011ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:13:11.322171Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.991277Z","time spent":"330.885831ms","remote":"127.0.0.1:39824","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:10000 "} {"level":"warn","ts":"2026-08-11T11:13:11.322159Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.758038ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:11.32225Z","caller":"traceutil/trace.go:171","msg":"trace[1728395621] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:702; }","duration":"330.907342ms","start":"2026-08-11T11:13:10.991317Z","end":"2026-08-11T11:13:11.322225Z","steps":["trace[1728395621] 'agreement among raft nodes before linearized reading' (duration: 330.688607ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:11.322297Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.991301Z","time spent":"330.985014ms","remote":"127.0.0.1:39824","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" count_only:true "} {"level":"warn","ts":"2026-08-11T11:13:11.322171Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:10.991978Z","time spent":"330.184384ms","remote":"127.0.0.1:39824","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:500 "} {"level":"warn","ts":"2026-08-11T11:13:11.32252Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"231.543118ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:11.322546Z","caller":"traceutil/trace.go:171","msg":"trace[1104206846] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:702; }","duration":"231.585809ms","start":"2026-08-11T11:13:11.090953Z","end":"2026-08-11T11:13:11.322539Z","steps":["trace[1104206846] 'agreement among raft nodes before linearized reading' (duration: 231.544428ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:11.322556Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"280.044156ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:11.322586Z","caller":"traceutil/trace.go:171","msg":"trace[1509837772] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:702; }","duration":"280.144419ms","start":"2026-08-11T11:13:11.042433Z","end":"2026-08-11T11:13:11.322578Z","steps":["trace[1509837772] 'agreement among raft nodes before linearized reading' (duration: 280.091077ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:11.322662Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.634675ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:13:11.322683Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"280.385214ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:11.322708Z","caller":"traceutil/trace.go:171","msg":"trace[659555901] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:702; }","duration":"280.450706ms","start":"2026-08-11T11:13:11.042252Z","end":"2026-08-11T11:13:11.322703Z","steps":["trace[659555901] 'agreement among raft nodes before linearized reading' (duration: 280.407515ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:11.32272Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.759628ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:11.322742Z","caller":"traceutil/trace.go:171","msg":"trace[1980821307] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:702; }","duration":"232.81727ms","start":"2026-08-11T11:13:11.08992Z","end":"2026-08-11T11:13:11.322737Z","steps":["trace[1980821307] 'agreement among raft nodes before linearized reading' (duration: 232.777759ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:11.322683Z","caller":"traceutil/trace.go:171","msg":"trace[317492217] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:702; }","duration":"232.696056ms","start":"2026-08-11T11:13:11.089977Z","end":"2026-08-11T11:13:11.322673Z","steps":["trace[317492217] 'agreement among raft nodes before linearized reading' (duration: 232.660465ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:13.036485Z","caller":"traceutil/trace.go:171","msg":"trace[1208912092] transaction","detail":"{read_only:false; response_revision:719; number_of_response:1; }","duration":"335.548087ms","start":"2026-08-11T11:13:12.700897Z","end":"2026-08-11T11:13:13.036446Z","steps":["trace[1208912092] 'process raft request' (duration: 319.554142ms)","trace[1208912092] 'compare' (duration: 15.563044ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:13.036666Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:12.700886Z","time spent":"335.713031ms","remote":"127.0.0.1:35314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3353,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-08-11T11:13:13.038776Z","caller":"traceutil/trace.go:171","msg":"trace[1681539782] linearizableReadLoop","detail":"{readStateIndex:743; appliedIndex:741; }","duration":"292.78502ms","start":"2026-08-11T11:13:12.745942Z","end":"2026-08-11T11:13:13.038727Z","steps":["trace[1681539782] 'read index received' (duration: 274.52793ms)","trace[1681539782] 'applied index is now lower than readState.Index' (duration: 18.25572ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:13:13.038877Z","caller":"traceutil/trace.go:171","msg":"trace[1739322729] transaction","detail":"{read_only:false; response_revision:720; number_of_response:1; }","duration":"337.134966ms","start":"2026-08-11T11:13:12.701696Z","end":"2026-08-11T11:13:13.038831Z","steps":["trace[1739322729] 'process raft request' (duration: 336.734186ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:13.03987Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:12.701687Z","time spent":"337.968866ms","remote":"127.0.0.1:35314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4580,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-08-11T11:13:13.039049Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"293.081908ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:13.039149Z","caller":"traceutil/trace.go:171","msg":"trace[1433798158] transaction","detail":"{read_only:false; response_revision:721; number_of_response:1; }","duration":"145.992116ms","start":"2026-08-11T11:13:12.892878Z","end":"2026-08-11T11:13:13.038871Z","steps":["trace[1433798158] 'process raft request' (duration: 145.727169ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:13.040587Z","caller":"traceutil/trace.go:171","msg":"trace[1134983377] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:721; }","duration":"294.681067ms","start":"2026-08-11T11:13:12.745885Z","end":"2026-08-11T11:13:13.040566Z","steps":["trace[1134983377] 'agreement among raft nodes before linearized reading' (duration: 293.058097ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:24.074277Z","caller":"traceutil/trace.go:171","msg":"trace[294866148] linearizableReadLoop","detail":"{readStateIndex:869; appliedIndex:868; }","duration":"116.59615ms","start":"2026-08-11T11:13:23.957655Z","end":"2026-08-11T11:13:24.074251Z","steps":["trace[294866148] 'read index received' (duration: 116.117968ms)","trace[294866148] 'applied index is now lower than readState.Index' (duration: 476.552µs)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:13:24.074403Z","caller":"traceutil/trace.go:171","msg":"trace[952456087] transaction","detail":"{read_only:false; response_revision:842; number_of_response:1; }","duration":"136.113502ms","start":"2026-08-11T11:13:23.938247Z","end":"2026-08-11T11:13:24.074361Z","steps":["trace[952456087] 'process raft request' (duration: 135.740862ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:24.074527Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.849906ms","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-08-11T11:13:24.074574Z","caller":"traceutil/trace.go:171","msg":"trace[277573930] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:842; }","duration":"116.920798ms","start":"2026-08-11T11:13:23.957642Z","end":"2026-08-11T11:13:24.074563Z","steps":["trace[277573930] 'agreement among raft nodes before linearized reading' (duration: 116.720053ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:28.006795Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824334587192279379,"retry-timeout":"500ms"} {"level":"info","ts":"2026-08-11T11:13:28.141707Z","caller":"traceutil/trace.go:171","msg":"trace[776756658] transaction","detail":"{read_only:false; response_revision:860; number_of_response:1; }","duration":"730.92018ms","start":"2026-08-11T11:13:27.410761Z","end":"2026-08-11T11:13:28.141681Z","steps":["trace[776756658] 'process raft request' (duration: 730.679624ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:28.141904Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:27.410696Z","time spent":"731.114685ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:13:28.170684Z","caller":"traceutil/trace.go:171","msg":"trace[1452609661] linearizableReadLoop","detail":"{readStateIndex:889; appliedIndex:886; }","duration":"664.918911ms","start":"2026-08-11T11:13:27.50574Z","end":"2026-08-11T11:13:28.170659Z","steps":["trace[1452609661] 'read index received' (duration: 635.73892ms)","trace[1452609661] 'applied index is now lower than readState.Index' (duration: 29.178791ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:28.170997Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"665.199088ms","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-08-11T11:13:28.171075Z","caller":"traceutil/trace.go:171","msg":"trace[903083153] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:862; }","duration":"665.357932ms","start":"2026-08-11T11:13:27.505675Z","end":"2026-08-11T11:13:28.171033Z","steps":["trace[903083153] 'agreement among raft nodes before linearized reading' (duration: 665.098875ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:28.171118Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:27.505655Z","time spent":"665.450394ms","remote":"127.0.0.1:35520","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":"info","ts":"2026-08-11T11:13:28.171277Z","caller":"traceutil/trace.go:171","msg":"trace[1624939942] transaction","detail":"{read_only:false; response_revision:861; number_of_response:1; }","duration":"519.584741ms","start":"2026-08-11T11:13:27.651674Z","end":"2026-08-11T11:13:28.171259Z","steps":["trace[1624939942] 'process raft request' (duration: 518.794632ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:28.171404Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:27.651646Z","time spent":"519.689384ms","remote":"127.0.0.1:35482","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2785,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:13:28.171482Z","caller":"traceutil/trace.go:171","msg":"trace[1497666156] transaction","detail":"{read_only:false; response_revision:862; number_of_response:1; }","duration":"171.548766ms","start":"2026-08-11T11:13:27.999906Z","end":"2026-08-11T11:13:28.171455Z","steps":["trace[1497666156] 'process raft request' (duration: 170.706155ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:28.171468Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"429.20557ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:13:28.171689Z","caller":"traceutil/trace.go:171","msg":"trace[2117614791] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:862; }","duration":"429.481027ms","start":"2026-08-11T11:13:27.742185Z","end":"2026-08-11T11:13:28.171666Z","steps":["trace[2117614791] 'agreement among raft nodes before linearized reading' (duration: 429.21031ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:28.171751Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:27.742159Z","time spent":"429.569248ms","remote":"127.0.0.1:35258","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-08-11T11:13:32.523917Z","caller":"traceutil/trace.go:171","msg":"trace[1352365677] transaction","detail":"{read_only:false; response_revision:910; number_of_response:1; }","duration":"134.696706ms","start":"2026-08-11T11:13:32.389182Z","end":"2026-08-11T11:13:32.523879Z","steps":["trace[1352365677] 'process raft request' (duration: 91.158681ms)","trace[1352365677] 'compare' (duration: 43.354901ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:13:32.550295Z","caller":"traceutil/trace.go:171","msg":"trace[452226492] transaction","detail":"{read_only:false; response_revision:911; number_of_response:1; }","duration":"160.733609ms","start":"2026-08-11T11:13:32.389536Z","end":"2026-08-11T11:13:32.55027Z","steps":["trace[452226492] 'process raft request' (duration: 160.555265ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:34.996567Z","caller":"traceutil/trace.go:171","msg":"trace[1597984983] transaction","detail":"{read_only:false; response_revision:930; number_of_response:1; }","duration":"102.332067ms","start":"2026-08-11T11:13:34.894213Z","end":"2026-08-11T11:13:34.996545Z","steps":["trace[1597984983] 'process raft request' (duration: 78.246793ms)","trace[1597984983] 'compare' (duration: 23.957891ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:13:36.824662Z","caller":"traceutil/trace.go:171","msg":"trace[1287880359] transaction","detail":"{read_only:false; response_revision:952; number_of_response:1; }","duration":"139.458644ms","start":"2026-08-11T11:13:36.685156Z","end":"2026-08-11T11:13:36.824615Z","steps":["trace[1287880359] 'process raft request' (duration: 139.160417ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:13:42.723611Z","caller":"traceutil/trace.go:171","msg":"trace[1855074483] transaction","detail":"{read_only:false; response_revision:1002; number_of_response:1; }","duration":"101.436715ms","start":"2026-08-11T11:13:42.622146Z","end":"2026-08-11T11:13:42.723583Z","steps":["trace[1855074483] 'process raft request' (duration: 101.22754ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:53.507028Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"283.674336ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-08-11T11:13:53.50722Z","caller":"traceutil/trace.go:171","msg":"trace[1406461047] transaction","detail":"{read_only:false; response_revision:1038; number_of_response:1; }","duration":"608.19342ms","start":"2026-08-11T11:13:52.898965Z","end":"2026-08-11T11:13:53.507158Z","steps":["trace[1406461047] 'process raft request' (duration: 324.286418ms)","trace[1406461047] 'compare' (duration: 283.147703ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:53.507438Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:52.898926Z","time spent":"608.388084ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:13:53.507457Z","caller":"traceutil/trace.go:171","msg":"trace[66724653] linearizableReadLoop","detail":"{readStateIndex:1071; appliedIndex:1070; }","duration":"478.322762ms","start":"2026-08-11T11:13:53.029109Z","end":"2026-08-11T11:13:53.507432Z","steps":["trace[66724653] 'read index received' (duration: 194.156045ms)","trace[66724653] 'applied index is now lower than readState.Index' (duration: 284.164037ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:53.507679Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"478.570189ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-08-11T11:13:53.507723Z","caller":"traceutil/trace.go:171","msg":"trace[699093720] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1038; }","duration":"478.663341ms","start":"2026-08-11T11:13:53.029045Z","end":"2026-08-11T11:13:53.507709Z","steps":["trace[699093720] 'agreement among raft nodes before linearized reading' (duration: 478.480187ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:53.507762Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:53.029019Z","time spent":"478.734662ms","remote":"127.0.0.1:35520","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-08-11T11:13:53.508412Z","caller":"traceutil/trace.go:171","msg":"trace[1907527943] transaction","detail":"{read_only:false; response_revision:1039; number_of_response:1; }","duration":"342.520919ms","start":"2026-08-11T11:13:53.165773Z","end":"2026-08-11T11:13:53.508294Z","steps":["trace[1907527943] 'process raft request' (duration: 341.938264ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:13:53.509817Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:53.165748Z","time spent":"343.756519ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":533,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:13:54.32697Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"305.629947ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-08-11T11:13:54.327435Z","caller":"traceutil/trace.go:171","msg":"trace[288410467] transaction","detail":"{read_only:false; response_revision:1040; number_of_response:1; }","duration":"812.806832ms","start":"2026-08-11T11:13:53.51461Z","end":"2026-08-11T11:13:54.327417Z","steps":["trace[288410467] 'process raft request' (duration: 506.622931ms)","trace[288410467] 'compare' (duration: 305.406552ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:13:54.327527Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:53.514569Z","time spent":"812.930615ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:13:54.32765Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:13:53.514587Z","time spent":"813.054908ms","remote":"127.0.0.1:35292","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"info","ts":"2026-08-11T11:14:20.76743Z","caller":"traceutil/trace.go:171","msg":"trace[146357179] transaction","detail":"{read_only:false; response_revision:1131; number_of_response:1; }","duration":"295.511152ms","start":"2026-08-11T11:14:20.471811Z","end":"2026-08-11T11:14:20.767322Z","steps":["trace[146357179] 'process raft request' (duration: 295.363798ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:21.155958Z","caller":"traceutil/trace.go:171","msg":"trace[98779283] transaction","detail":"{read_only:false; response_revision:1132; number_of_response:1; }","duration":"683.39743ms","start":"2026-08-11T11:14:20.472525Z","end":"2026-08-11T11:14:21.155923Z","steps":["trace[98779283] 'process raft request' (duration: 683.181575ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:21.156151Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"458.365812ms","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-08-11T11:14:21.156148Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:20.472499Z","time spent":"683.551565ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:14:21.1562Z","caller":"traceutil/trace.go:171","msg":"trace[871555965] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1132; }","duration":"458.468145ms","start":"2026-08-11T11:14:20.697723Z","end":"2026-08-11T11:14:21.156192Z","steps":["trace[871555965] 'agreement among raft nodes before linearized reading' (duration: 458.26801ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:21.156239Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:20.697705Z","time spent":"458.526957ms","remote":"127.0.0.1:35520","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":"info","ts":"2026-08-11T11:14:21.155929Z","caller":"traceutil/trace.go:171","msg":"trace[337715012] linearizableReadLoop","detail":"{readStateIndex:1172; appliedIndex:1170; }","duration":"458.104386ms","start":"2026-08-11T11:14:20.697771Z","end":"2026-08-11T11:14:21.155875Z","steps":["trace[337715012] 'read index received' (duration: 69.490149ms)","trace[337715012] 'applied index is now lower than readState.Index' (duration: 388.612467ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:14:21.156803Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"412.917472ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:14:21.156869Z","caller":"traceutil/trace.go:171","msg":"trace[1636587241] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1132; }","duration":"413.027485ms","start":"2026-08-11T11:14:20.743829Z","end":"2026-08-11T11:14:21.156856Z","steps":["trace[1636587241] 'agreement among raft nodes before linearized reading' (duration: 412.940062ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:21.156897Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:20.743807Z","time spent":"413.083775ms","remote":"127.0.0.1:35258","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-08-11T11:14:21.157248Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.705747ms","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-08-11T11:14:21.157291Z","caller":"traceutil/trace.go:171","msg":"trace[1566925957] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1132; }","duration":"125.800689ms","start":"2026-08-11T11:14:21.031484Z","end":"2026-08-11T11:14:21.157284Z","steps":["trace[1566925957] 'agreement among raft nodes before linearized reading' (duration: 125.649585ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:22.678985Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"935.016759ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:14:22.67908Z","caller":"traceutil/trace.go:171","msg":"trace[1517759147] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1136; }","duration":"935.154801ms","start":"2026-08-11T11:14:21.743905Z","end":"2026-08-11T11:14:22.67906Z","steps":["trace[1517759147] 'range keys from in-memory index tree' (duration: 934.932646ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:22.679113Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:21.743885Z","time spent":"935.220553ms","remote":"127.0.0.1:35258","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-08-11T11:14:22.931281Z","caller":"traceutil/trace.go:171","msg":"trace[941264663] transaction","detail":"{read_only:false; response_revision:1137; number_of_response:1; }","duration":"153.104139ms","start":"2026-08-11T11:14:22.778159Z","end":"2026-08-11T11:14:22.931263Z","steps":["trace[941264663] 'process raft request' (duration: 152.989676ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:23.714004Z","caller":"traceutil/trace.go:171","msg":"trace[3399817] transaction","detail":"{read_only:false; response_revision:1139; number_of_response:1; }","duration":"452.159238ms","start":"2026-08-11T11:14:23.261816Z","end":"2026-08-11T11:14:23.713975Z","steps":["trace[3399817] 'process raft request' (duration: 400.614926ms)","trace[3399817] 'compare' (duration: 51.389528ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:14:23.714175Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:23.26179Z","time spent":"452.289731ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:14:23.749066Z","caller":"traceutil/trace.go:171","msg":"trace[129161865] linearizableReadLoop","detail":"{readStateIndex:1180; appliedIndex:1178; }","duration":"233.444837ms","start":"2026-08-11T11:14:23.515595Z","end":"2026-08-11T11:14:23.74904Z","steps":["trace[129161865] 'read index received' (duration: 146.852733ms)","trace[129161865] 'applied index is now lower than readState.Index' (duration: 86.590724ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:23.749412Z","caller":"traceutil/trace.go:171","msg":"trace[424472538] transaction","detail":"{read_only:false; response_revision:1140; number_of_response:1; }","duration":"487.22337ms","start":"2026-08-11T11:14:23.262167Z","end":"2026-08-11T11:14:23.749391Z","steps":["trace[424472538] 'process raft request' (duration: 486.733758ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:23.749612Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:23.262149Z","time spent":"487.376674ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:14:23.749927Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"234.34294ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.121\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-08-11T11:14:23.749983Z","caller":"traceutil/trace.go:171","msg":"trace[1553848353] range","detail":"{range_begin:/registry/masterleases/199.19.213.121; range_end:; response_count:1; response_revision:1140; }","duration":"234.396481ms","start":"2026-08-11T11:14:23.51557Z","end":"2026-08-11T11:14:23.749967Z","steps":["trace[1553848353] 'agreement among raft nodes before linearized reading' (duration: 234.249157ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:23.93895Z","caller":"traceutil/trace.go:171","msg":"trace[333774535] linearizableReadLoop","detail":"{readStateIndex:1181; appliedIndex:1180; }","duration":"189.772321ms","start":"2026-08-11T11:14:23.749153Z","end":"2026-08-11T11:14:23.938925Z","steps":["trace[333774535] 'read index received' (duration: 178.623023ms)","trace[333774535] 'applied index is now lower than readState.Index' (duration: 11.148268ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:23.939011Z","caller":"traceutil/trace.go:171","msg":"trace[1707163696] transaction","detail":"{read_only:false; response_revision:1141; number_of_response:1; }","duration":"255.003393ms","start":"2026-08-11T11:14:23.683975Z","end":"2026-08-11T11:14:23.938979Z","steps":["trace[1707163696] 'process raft request' (duration: 243.786854ms)","trace[1707163696] 'compare' (duration: 10.961133ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:14:23.939051Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"191.610446ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:14:23.93909Z","caller":"traceutil/trace.go:171","msg":"trace[436539506] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1141; }","duration":"191.693178ms","start":"2026-08-11T11:14:23.747385Z","end":"2026-08-11T11:14:23.939078Z","steps":["trace[436539506] 'agreement among raft nodes before linearized reading' (duration: 191.591046ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:23.939144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"222.770262ms","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-08-11T11:14:23.939172Z","caller":"traceutil/trace.go:171","msg":"trace[1777096559] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1141; }","duration":"222.836094ms","start":"2026-08-11T11:14:23.716327Z","end":"2026-08-11T11:14:23.939163Z","steps":["trace[1777096559] 'agreement among raft nodes before linearized reading' (duration: 222.70813ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:23.939199Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"277.963345ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:14:23.939229Z","caller":"traceutil/trace.go:171","msg":"trace[1944015943] range","detail":"{range_begin:/registry/cilium.io/ciliumcidrgroups/; range_end:/registry/cilium.io/ciliumcidrgroups0; response_count:0; response_revision:1141; }","duration":"278.071527ms","start":"2026-08-11T11:14:23.661148Z","end":"2026-08-11T11:14:23.939219Z","steps":["trace[1944015943] 'agreement among raft nodes before linearized reading' (duration: 277.994385ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:23.957557Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.779447ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:14:23.957674Z","caller":"traceutil/trace.go:171","msg":"trace[1250126984] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:1141; }","duration":"137.966312ms","start":"2026-08-11T11:14:23.819682Z","end":"2026-08-11T11:14:23.957648Z","steps":["trace[1250126984] 'agreement among raft nodes before linearized reading' (duration: 137.734536ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:29.51306Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.755159ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-08-11T11:14:29.513153Z","caller":"traceutil/trace.go:171","msg":"trace[325317133] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:1158; }","duration":"125.919293ms","start":"2026-08-11T11:14:29.387213Z","end":"2026-08-11T11:14:29.513133Z","steps":["trace[325317133] 'count revisions from in-memory index tree' (duration: 125.657706ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:29.974783Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.161835ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-08-11T11:14:29.974893Z","caller":"traceutil/trace.go:171","msg":"trace[1989173209] transaction","detail":"{read_only:false; response_revision:1160; number_of_response:1; }","duration":"185.972526ms","start":"2026-08-11T11:14:29.7889Z","end":"2026-08-11T11:14:29.974873Z","steps":["trace[1989173209] 'process raft request' (duration: 29.614666ms)","trace[1989173209] 'compare' (duration: 156.035402ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:30.158399Z","caller":"traceutil/trace.go:171","msg":"trace[1208951493] transaction","detail":"{read_only:false; response_revision:1161; number_of_response:1; }","duration":"369.195474ms","start":"2026-08-11T11:14:29.789172Z","end":"2026-08-11T11:14:30.158367Z","steps":["trace[1208951493] 'process raft request' (duration: 367.277997ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:30.158668Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:29.789154Z","time spent":"369.399939ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:14:30.178582Z","caller":"traceutil/trace.go:171","msg":"trace[1689289318] linearizableReadLoop","detail":"{readStateIndex:1204; appliedIndex:1202; }","duration":"163.318043ms","start":"2026-08-11T11:14:30.015234Z","end":"2026-08-11T11:14:30.178552Z","steps":["trace[1689289318] 'read index received' (duration: 141.208783ms)","trace[1689289318] 'applied index is now lower than readState.Index' (duration: 22.10798ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:30.178747Z","caller":"traceutil/trace.go:171","msg":"trace[451059810] transaction","detail":"{read_only:false; response_revision:1162; number_of_response:1; }","duration":"184.686684ms","start":"2026-08-11T11:14:29.994002Z","end":"2026-08-11T11:14:30.178688Z","steps":["trace[451059810] 'process raft request' (duration: 184.344836ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:30.178878Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.60789ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:476"} {"level":"info","ts":"2026-08-11T11:14:30.178944Z","caller":"traceutil/trace.go:171","msg":"trace[194818661] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1162; }","duration":"163.763184ms","start":"2026-08-11T11:14:30.015163Z","end":"2026-08-11T11:14:30.178926Z","steps":["trace[194818661] 'agreement among raft nodes before linearized reading' (duration: 163.495887ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:40.745128Z","caller":"traceutil/trace.go:171","msg":"trace[373275657] transaction","detail":"{read_only:false; response_revision:1198; number_of_response:1; }","duration":"170.406129ms","start":"2026-08-11T11:14:40.574689Z","end":"2026-08-11T11:14:40.745095Z","steps":["trace[373275657] 'process raft request' (duration: 92.47183ms)","trace[373275657] 'compare' (duration: 77.433487ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:40.74531Z","caller":"traceutil/trace.go:171","msg":"trace[1612074840] transaction","detail":"{read_only:false; response_revision:1199; number_of_response:1; }","duration":"169.951758ms","start":"2026-08-11T11:14:40.575342Z","end":"2026-08-11T11:14:40.745294Z","steps":["trace[1612074840] 'process raft request' (duration: 169.537928ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:40.956046Z","caller":"traceutil/trace.go:171","msg":"trace[637539298] transaction","detail":"{read_only:false; response_revision:1204; number_of_response:1; }","duration":"151.664873ms","start":"2026-08-11T11:14:40.80434Z","end":"2026-08-11T11:14:40.956004Z","steps":["trace[637539298] 'process raft request' (duration: 108.407287ms)","trace[637539298] 'compare' (duration: 43.077911ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:41.232633Z","caller":"traceutil/trace.go:171","msg":"trace[1754850235] linearizableReadLoop","detail":"{readStateIndex:1251; appliedIndex:1250; }","duration":"175.764282ms","start":"2026-08-11T11:14:41.056845Z","end":"2026-08-11T11:14:41.23261Z","steps":["trace[1754850235] 'read index received' (duration: 141.968142ms)","trace[1754850235] 'applied index is now lower than readState.Index' (duration: 33.79469ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:41.232689Z","caller":"traceutil/trace.go:171","msg":"trace[785199261] transaction","detail":"{read_only:false; response_revision:1206; number_of_response:1; }","duration":"270.378026ms","start":"2026-08-11T11:14:40.962297Z","end":"2026-08-11T11:14:41.232675Z","steps":["trace[785199261] 'process raft request' (duration: 236.470313ms)","trace[785199261] 'compare' (duration: 33.599625ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:14:41.232865Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.003108ms","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-08-11T11:14:41.232894Z","caller":"traceutil/trace.go:171","msg":"trace[39909831] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1206; }","duration":"176.0855ms","start":"2026-08-11T11:14:41.056802Z","end":"2026-08-11T11:14:41.232887Z","steps":["trace[39909831] 'agreement among raft nodes before linearized reading' (duration: 175.890685ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:41.408467Z","caller":"traceutil/trace.go:171","msg":"trace[389511222] transaction","detail":"{read_only:false; response_revision:1212; number_of_response:1; }","duration":"115.81183ms","start":"2026-08-11T11:14:41.292597Z","end":"2026-08-11T11:14:41.408408Z","steps":["trace[389511222] 'process raft request' (duration: 115.543444ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:41.604924Z","caller":"traceutil/trace.go:171","msg":"trace[718489634] transaction","detail":"{read_only:false; response_revision:1214; number_of_response:1; }","duration":"192.424386ms","start":"2026-08-11T11:14:41.412478Z","end":"2026-08-11T11:14:41.604902Z","steps":["trace[718489634] 'process raft request' (duration: 191.400301ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:41.605162Z","caller":"traceutil/trace.go:171","msg":"trace[250377096] transaction","detail":"{read_only:false; response_revision:1215; number_of_response:1; }","duration":"192.469188ms","start":"2026-08-11T11:14:41.412686Z","end":"2026-08-11T11:14:41.605155Z","steps":["trace[250377096] 'process raft request' (duration: 192.145689ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:41.63298Z","caller":"traceutil/trace.go:171","msg":"trace[1800278688] transaction","detail":"{read_only:false; response_revision:1217; number_of_response:1; }","duration":"172.967123ms","start":"2026-08-11T11:14:41.459983Z","end":"2026-08-11T11:14:41.632951Z","steps":["trace[1800278688] 'process raft request' (duration: 172.908172ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:41.633034Z","caller":"traceutil/trace.go:171","msg":"trace[255506956] transaction","detail":"{read_only:false; response_revision:1216; number_of_response:1; }","duration":"173.077265ms","start":"2026-08-11T11:14:41.459911Z","end":"2026-08-11T11:14:41.632988Z","steps":["trace[255506956] 'process raft request' (duration: 172.838569ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:41.908359Z","caller":"traceutil/trace.go:171","msg":"trace[731518822] transaction","detail":"{read_only:false; response_revision:1242; number_of_response:1; }","duration":"114.846887ms","start":"2026-08-11T11:14:41.793472Z","end":"2026-08-11T11:14:41.908319Z","steps":["trace[731518822] 'process raft request' (duration: 16.841859ms)","trace[731518822] 'compare' (duration: 97.729171ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:42.196433Z","caller":"traceutil/trace.go:171","msg":"trace[83323582] transaction","detail":"{read_only:false; response_revision:1243; number_of_response:1; }","duration":"400.577455ms","start":"2026-08-11T11:14:41.79579Z","end":"2026-08-11T11:14:42.196367Z","steps":["trace[83323582] 'process raft request' (duration: 352.925839ms)","trace[83323582] 'compare' (duration: 47.231045ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:42.196479Z","caller":"traceutil/trace.go:171","msg":"trace[634527731] linearizableReadLoop","detail":"{readStateIndex:1289; appliedIndex:1287; }","duration":"399.373405ms","start":"2026-08-11T11:14:41.797081Z","end":"2026-08-11T11:14:42.196455Z","steps":["trace[634527731] 'read index received' (duration: 13.24397ms)","trace[634527731] 'applied index is now lower than readState.Index' (duration: 386.128245ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:42.196633Z","caller":"traceutil/trace.go:171","msg":"trace[594735408] transaction","detail":"{read_only:false; response_revision:1244; number_of_response:1; }","duration":"395.98357ms","start":"2026-08-11T11:14:41.80064Z","end":"2026-08-11T11:14:42.196623Z","steps":["trace[594735408] 'process raft request' (duration: 395.612221ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.196624Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:41.795777Z","time spent":"400.741169ms","remote":"127.0.0.1:35728","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":11206,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:14:42.196793Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:41.800618Z","time spent":"396.046482ms","remote":"127.0.0.1:35408","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":915,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:14:42.197146Z","caller":"traceutil/trace.go:171","msg":"trace[1774877985] transaction","detail":"{read_only:false; response_revision:1245; number_of_response:1; }","duration":"396.401771ms","start":"2026-08-11T11:14:41.800711Z","end":"2026-08-11T11:14:42.197113Z","steps":["trace[1774877985] 'process raft request' (duration: 395.653663ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.197277Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:41.800694Z","time spent":"396.517934ms","remote":"127.0.0.1:35524","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1508,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:14:42.197439Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"231.389166ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ceph-csi-rbd-nodeplugin\" ","response":"range_response_count:1 size:751"} {"level":"warn","ts":"2026-08-11T11:14:42.197524Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"400.428811ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-xdgjj\" ","response":"range_response_count:1 size:10774"} {"level":"warn","ts":"2026-08-11T11:14:42.197532Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.669281ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ceph-csi-rbd-provisioner\" ","response":"range_response_count:1 size:754"} {"level":"info","ts":"2026-08-11T11:14:42.197615Z","caller":"traceutil/trace.go:171","msg":"trace[696565131] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ceph-csi-rbd-provisioner; range_end:; response_count:1; response_revision:1245; }","duration":"128.781863ms","start":"2026-08-11T11:14:42.068811Z","end":"2026-08-11T11:14:42.197593Z","steps":["trace[696565131] 'agreement among raft nodes before linearized reading' (duration: 128.575078ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.197553Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"376.436225ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumloadbalancerippools/\" range_end:\"/registry/cilium.io/ciliumloadbalancerippools0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:14:42.197686Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"231.353925ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ceph-csi-rbd-nodeplugin\" ","response":"range_response_count:1 size:751"} {"level":"info","ts":"2026-08-11T11:14:42.197737Z","caller":"traceutil/trace.go:171","msg":"trace[1381446499] range","detail":"{range_begin:/registry/pods/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-xdgjj; range_end:; response_count:1; response_revision:1245; }","duration":"400.526884ms","start":"2026-08-11T11:14:41.797056Z","end":"2026-08-11T11:14:42.197583Z","steps":["trace[1381446499] 'agreement among raft nodes before linearized reading' (duration: 399.622962ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:42.19777Z","caller":"traceutil/trace.go:171","msg":"trace[73167472] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ceph-csi-rbd-nodeplugin; range_end:; response_count:1; response_revision:1245; }","duration":"231.442257ms","start":"2026-08-11T11:14:41.966309Z","end":"2026-08-11T11:14:42.197751Z","steps":["trace[73167472] 'agreement among raft nodes before linearized reading' (duration: 231.284623ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.197807Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:41.797046Z","time spent":"400.744079ms","remote":"127.0.0.1:35430","response type":"/etcdserverpb.KV/Range","request count":0,"request size":69,"response count":1,"response size":10797,"request content":"key:\"/registry/pods/kube-system/ceph-csi-rbd-provisioner-69cb97fb6-xdgjj\" "} {"level":"info","ts":"2026-08-11T11:14:42.197548Z","caller":"traceutil/trace.go:171","msg":"trace[1829563227] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ceph-csi-rbd-nodeplugin; range_end:; response_count:1; response_revision:1245; }","duration":"231.56438ms","start":"2026-08-11T11:14:41.965955Z","end":"2026-08-11T11:14:42.197519Z","steps":["trace[1829563227] 'agreement among raft nodes before linearized reading' (duration: 231.190161ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:42.197921Z","caller":"traceutil/trace.go:171","msg":"trace[1957588543] range","detail":"{range_begin:/registry/cilium.io/ciliumloadbalancerippools/; range_end:/registry/cilium.io/ciliumloadbalancerippools0; response_count:0; response_revision:1245; }","duration":"376.748302ms","start":"2026-08-11T11:14:41.820985Z","end":"2026-08-11T11:14:42.197733Z","steps":["trace[1957588543] 'agreement among raft nodes before linearized reading' (duration: 376.132066ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.198048Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:41.820963Z","time spent":"377.06181ms","remote":"127.0.0.1:55804","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumloadbalancerippools/\" range_end:\"/registry/cilium.io/ciliumloadbalancerippools0\" count_only:true "} {"level":"warn","ts":"2026-08-11T11:14:42.197921Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"170.734988ms","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-08-11T11:14:42.198189Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.131838ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ceph-csi-rbd-provisioner\" ","response":"range_response_count:1 size:754"} {"level":"info","ts":"2026-08-11T11:14:42.198256Z","caller":"traceutil/trace.go:171","msg":"trace[1545891110] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1245; }","duration":"171.116567ms","start":"2026-08-11T11:14:42.027105Z","end":"2026-08-11T11:14:42.198222Z","steps":["trace[1545891110] 'agreement among raft nodes before linearized reading' (duration: 170.009349ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.198253Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"374.435725ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/kube-system/\" range_end:\"/registry/secrets/kube-system0\" ","response":"range_response_count:6 size:363682"} {"level":"info","ts":"2026-08-11T11:14:42.19832Z","caller":"traceutil/trace.go:171","msg":"trace[1086255873] range","detail":"{range_begin:/registry/secrets/kube-system/; range_end:/registry/secrets/kube-system0; response_count:6; response_revision:1245; }","duration":"374.517587ms","start":"2026-08-11T11:14:41.823786Z","end":"2026-08-11T11:14:42.198304Z","steps":["trace[1086255873] 'agreement among raft nodes before linearized reading' (duration: 374.182189ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.198381Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:41.823761Z","time spent":"374.603119ms","remote":"127.0.0.1:35354","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":6,"response size":363705,"request content":"key:\"/registry/secrets/kube-system/\" range_end:\"/registry/secrets/kube-system0\" "} {"level":"info","ts":"2026-08-11T11:14:42.198421Z","caller":"traceutil/trace.go:171","msg":"trace[1427134121] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ceph-csi-rbd-provisioner; range_end:; response_count:1; response_revision:1245; }","duration":"130.23754ms","start":"2026-08-11T11:14:42.067994Z","end":"2026-08-11T11:14:42.198231Z","steps":["trace[1427134121] 'agreement among raft nodes before linearized reading' (duration: 129.919482ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:42.432001Z","caller":"traceutil/trace.go:171","msg":"trace[1390899603] transaction","detail":"{read_only:false; response_revision:1246; number_of_response:1; }","duration":"226.519335ms","start":"2026-08-11T11:14:42.205433Z","end":"2026-08-11T11:14:42.431952Z","steps":["trace[1390899603] 'process raft request' (duration: 160.692667ms)","trace[1390899603] 'compare' (duration: 65.638763ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:42.433329Z","caller":"traceutil/trace.go:171","msg":"trace[1639491661] linearizableReadLoop","detail":"{readStateIndex:1293; appliedIndex:1291; }","duration":"207.83271ms","start":"2026-08-11T11:14:42.225473Z","end":"2026-08-11T11:14:42.433305Z","steps":["trace[1639491661] 'read index received' (duration: 140.634498ms)","trace[1639491661] 'applied index is now lower than readState.Index' (duration: 67.197172ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:42.43334Z","caller":"traceutil/trace.go:171","msg":"trace[1273759999] transaction","detail":"{read_only:false; response_revision:1247; number_of_response:1; }","duration":"215.527202ms","start":"2026-08-11T11:14:42.217783Z","end":"2026-08-11T11:14:42.433311Z","steps":["trace[1273759999] 'process raft request' (duration: 215.281546ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:42.433497Z","caller":"traceutil/trace.go:171","msg":"trace[756399383] transaction","detail":"{read_only:false; response_revision:1248; number_of_response:1; }","duration":"203.647806ms","start":"2026-08-11T11:14:42.22983Z","end":"2026-08-11T11:14:42.433478Z","steps":["trace[756399383] 'process raft request' (duration: 203.41473ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.434177Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.913654ms","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-08-11T11:14:42.434214Z","caller":"traceutil/trace.go:171","msg":"trace[1490685376] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1248; }","duration":"111.985476ms","start":"2026-08-11T11:14:42.322221Z","end":"2026-08-11T11:14:42.434206Z","steps":["trace[1490685376] 'agreement among raft nodes before linearized reading' (duration: 111.576006ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.434218Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.726182ms","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-08-11T11:14:42.434283Z","caller":"traceutil/trace.go:171","msg":"trace[23617986] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1248; }","duration":"208.844215ms","start":"2026-08-11T11:14:42.225425Z","end":"2026-08-11T11:14:42.434269Z","steps":["trace[23617986] 'agreement among raft nodes before linearized reading' (duration: 208.090876ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:42.434746Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.890153ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/kube-system/\" range_end:\"/registry/secrets/kube-system0\" ","response":"range_response_count:6 size:363682"} {"level":"info","ts":"2026-08-11T11:14:42.434824Z","caller":"traceutil/trace.go:171","msg":"trace[491728560] range","detail":"{range_begin:/registry/secrets/kube-system/; range_end:/registry/secrets/kube-system0; response_count:6; response_revision:1248; }","duration":"117.966015ms","start":"2026-08-11T11:14:42.316835Z","end":"2026-08-11T11:14:42.434801Z","steps":["trace[491728560] 'agreement among raft nodes before linearized reading' (duration: 116.926649ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:43.693309Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.737935ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.121\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-08-11T11:14:43.69343Z","caller":"traceutil/trace.go:171","msg":"trace[1481228923] range","detail":"{range_begin:/registry/masterleases/199.19.213.121; range_end:; response_count:1; response_revision:1255; }","duration":"176.895419ms","start":"2026-08-11T11:14:43.516496Z","end":"2026-08-11T11:14:43.693392Z","steps":["trace[1481228923] 'range keys from in-memory index tree' (duration: 176.52865ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:44.580098Z","caller":"traceutil/trace.go:171","msg":"trace[746024144] transaction","detail":"{read_only:false; response_revision:1258; number_of_response:1; }","duration":"139.252065ms","start":"2026-08-11T11:14:44.440819Z","end":"2026-08-11T11:14:44.580071Z","steps":["trace[746024144] 'process raft request' (duration: 139.07411ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:44.665365Z","caller":"traceutil/trace.go:171","msg":"trace[630104444] linearizableReadLoop","detail":"{readStateIndex:1306; appliedIndex:1304; }","duration":"204.994009ms","start":"2026-08-11T11:14:44.460332Z","end":"2026-08-11T11:14:44.665326Z","steps":["trace[630104444] 'read index received' (duration: 119.524103ms)","trace[630104444] 'applied index is now lower than readState.Index' (duration: 85.468806ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:44.665418Z","caller":"traceutil/trace.go:171","msg":"trace[1679136402] transaction","detail":"{read_only:false; response_revision:1259; number_of_response:1; }","duration":"220.660659ms","start":"2026-08-11T11:14:44.444718Z","end":"2026-08-11T11:14:44.665379Z","steps":["trace[1679136402] 'process raft request' (duration: 211.260625ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:44.665695Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.327868ms","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-08-11T11:14:44.665739Z","caller":"traceutil/trace.go:171","msg":"trace[791592715] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1259; }","duration":"205.42891ms","start":"2026-08-11T11:14:44.460295Z","end":"2026-08-11T11:14:44.665724Z","steps":["trace[791592715] 'agreement among raft nodes before linearized reading' (duration: 205.208265ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:44.665765Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"203.43525ms","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-08-11T11:14:44.665842Z","caller":"traceutil/trace.go:171","msg":"trace[1634741358] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1259; }","duration":"203.553074ms","start":"2026-08-11T11:14:44.46227Z","end":"2026-08-11T11:14:44.665824Z","steps":["trace[1634741358] 'agreement among raft nodes before linearized reading' (duration: 203.281627ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:45.970425Z","caller":"traceutil/trace.go:171","msg":"trace[1768139601] transaction","detail":"{read_only:false; response_revision:1263; number_of_response:1; }","duration":"208.123087ms","start":"2026-08-11T11:14:45.762267Z","end":"2026-08-11T11:14:45.97039Z","steps":["trace[1768139601] 'process raft request' (duration: 207.910682ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:47.166159Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824334587192280280,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-08-11T11:14:47.666594Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824334587192280280,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-08-11T11:14:47.763414Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.177133491s","expected-duration":"1s"} {"level":"info","ts":"2026-08-11T11:14:47.763894Z","caller":"traceutil/trace.go:171","msg":"trace[680115252] linearizableReadLoop","detail":"{readStateIndex:1312; appliedIndex:1311; }","duration":"1.09868395s","start":"2026-08-11T11:14:46.665181Z","end":"2026-08-11T11:14:47.763865Z","steps":["trace[680115252] 'read index received' (duration: 1.098434784s)","trace[680115252] 'applied index is now lower than readState.Index' (duration: 248.116µs)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:14:47.76401Z","caller":"traceutil/trace.go:171","msg":"trace[1069167315] transaction","detail":"{read_only:false; response_revision:1265; number_of_response:1; }","duration":"1.177789678s","start":"2026-08-11T11:14:46.586184Z","end":"2026-08-11T11:14:47.763973Z","steps":["trace[1069167315] 'process raft request' (duration: 1.177507801s)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:47.764072Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.098872584s","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-08-11T11:14:47.764125Z","caller":"traceutil/trace.go:171","msg":"trace[775077317] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:1265; }","duration":"1.099018118s","start":"2026-08-11T11:14:46.66509Z","end":"2026-08-11T11:14:47.764108Z","steps":["trace[775077317] 'agreement among raft nodes before linearized reading' (duration: 1.098901085s)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:47.764189Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:46.665054Z","time spent":"1.099118371s","remote":"127.0.0.1:55812","response type":"/etcdserverpb.KV/Range","request count":0,"request size":112,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" count_only:true "} {"level":"warn","ts":"2026-08-11T11:14:47.764198Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:46.586128Z","time spent":"1.177964512s","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:14:47.764307Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"589.113884ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/\" range_end:\"/registry/jobs0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:14:47.764293Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"461.645534ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-08-11T11:14:47.764408Z","caller":"traceutil/trace.go:171","msg":"trace[439083988] range","detail":"{range_begin:/registry/jobs/; range_end:/registry/jobs0; response_count:0; response_revision:1265; }","duration":"589.252608ms","start":"2026-08-11T11:14:47.175109Z","end":"2026-08-11T11:14:47.764362Z","steps":["trace[439083988] 'agreement among raft nodes before linearized reading' (duration: 589.069263ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:47.764431Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.066226542s","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-08-11T11:14:47.764462Z","caller":"traceutil/trace.go:171","msg":"trace[645653571] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1265; }","duration":"461.86278ms","start":"2026-08-11T11:14:47.302589Z","end":"2026-08-11T11:14:47.764452Z","steps":["trace[645653571] 'agreement among raft nodes before linearized reading' (duration: 461.639514ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:47.76446Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:47.175071Z","time spent":"589.375471ms","remote":"127.0.0.1:35482","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":"warn","ts":"2026-08-11T11:14:47.764498Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:47.302562Z","time spent":"461.928941ms","remote":"127.0.0.1:35520","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-08-11T11:14:47.764506Z","caller":"traceutil/trace.go:171","msg":"trace[96151663] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1265; }","duration":"1.066357346s","start":"2026-08-11T11:14:46.698129Z","end":"2026-08-11T11:14:47.764487Z","steps":["trace[96151663] 'agreement among raft nodes before linearized reading' (duration: 1.066096809s)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:47.764557Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:46.698089Z","time spent":"1.066455348s","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-08-11T11:14:47.764844Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.094621359s","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-08-11T11:14:47.764939Z","caller":"traceutil/trace.go:171","msg":"trace[200270079] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1265; }","duration":"1.094749471s","start":"2026-08-11T11:14:46.670162Z","end":"2026-08-11T11:14:47.764911Z","steps":["trace[200270079] 'agreement among raft nodes before linearized reading' (duration: 1.093929081s)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:47.764993Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:46.670149Z","time spent":"1.094833854s","remote":"127.0.0.1:35520","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-08-11T11:14:47.765009Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.087671405s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-08-11T11:14:47.765056Z","caller":"traceutil/trace.go:171","msg":"trace[1562789100] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1265; }","duration":"1.087769869s","start":"2026-08-11T11:14:46.677274Z","end":"2026-08-11T11:14:47.765044Z","steps":["trace[1562789100] 'agreement among raft nodes before linearized reading' (duration: 1.086979149s)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:47.765087Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:46.677242Z","time spent":"1.08783799s","remote":"127.0.0.1:35520","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":"info","ts":"2026-08-11T11:14:48.134667Z","caller":"traceutil/trace.go:171","msg":"trace[1296797643] transaction","detail":"{read_only:false; response_revision:1266; number_of_response:1; }","duration":"365.466851ms","start":"2026-08-11T11:14:47.769175Z","end":"2026-08-11T11:14:48.134641Z","steps":["trace[1296797643] 'process raft request' (duration: 365.291087ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:48.134829Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:47.769156Z","time spent":"365.583994ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:14:48.137416Z","caller":"traceutil/trace.go:171","msg":"trace[34501504] transaction","detail":"{read_only:false; response_revision:1267; number_of_response:1; }","duration":"368.010734ms","start":"2026-08-11T11:14:47.769382Z","end":"2026-08-11T11:14:48.137393Z","steps":["trace[34501504] 'process raft request' (duration: 367.813689ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:48.137567Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:47.769351Z","time spent":"368.136007ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:14:48.1377Z","caller":"traceutil/trace.go:171","msg":"trace[159651593] transaction","detail":"{read_only:false; response_revision:1268; number_of_response:1; }","duration":"367.948043ms","start":"2026-08-11T11:14:47.769733Z","end":"2026-08-11T11:14:48.137681Z","steps":["trace[159651593] 'process raft request' (duration: 367.606035ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:48.138007Z","caller":"traceutil/trace.go:171","msg":"trace[1298042272] linearizableReadLoop","detail":"{readStateIndex:1316; appliedIndex:1312; }","duration":"163.520698ms","start":"2026-08-11T11:14:47.974473Z","end":"2026-08-11T11:14:48.137994Z","steps":["trace[1298042272] 'read index received' (duration: 159.98996ms)","trace[1298042272] 'applied index is now lower than readState.Index' (duration: 3.529698ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:14:48.138138Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.671721ms","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-08-11T11:14:48.138166Z","caller":"traceutil/trace.go:171","msg":"trace[1702469846] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1269; }","duration":"163.742293ms","start":"2026-08-11T11:14:47.974415Z","end":"2026-08-11T11:14:48.138157Z","steps":["trace[1702469846] 'agreement among raft nodes before linearized reading' (duration: 163.61903ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:14:48.138249Z","caller":"traceutil/trace.go:171","msg":"trace[1468938693] transaction","detail":"{read_only:false; response_revision:1269; number_of_response:1; }","duration":"368.439805ms","start":"2026-08-11T11:14:47.7698Z","end":"2026-08-11T11:14:48.138239Z","steps":["trace[1468938693] 'process raft request' (duration: 367.804599ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:14:48.138312Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:47.769788Z","time spent":"368.493526ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:14:48.139417Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:14:47.769713Z","time spent":"368.288471ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:15:04.303353Z","caller":"traceutil/trace.go:171","msg":"trace[1332477870] transaction","detail":"{read_only:false; response_revision:1318; number_of_response:1; }","duration":"479.010116ms","start":"2026-08-11T11:15:03.82431Z","end":"2026-08-11T11:15:04.30332Z","steps":["trace[1332477870] 'process raft request' (duration: 478.720248ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:04.30351Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:03.824283Z","time spent":"479.138109ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:15:06.332655Z","caller":"traceutil/trace.go:171","msg":"trace[2089550003] transaction","detail":"{read_only:false; response_revision:1329; number_of_response:1; }","duration":"100.823408ms","start":"2026-08-11T11:15:06.231797Z","end":"2026-08-11T11:15:06.332621Z","steps":["trace[2089550003] 'process raft request' (duration: 100.636533ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:06.586484Z","caller":"traceutil/trace.go:171","msg":"trace[575098996] transaction","detail":"{read_only:false; response_revision:1332; number_of_response:1; }","duration":"179.184837ms","start":"2026-08-11T11:15:06.407278Z","end":"2026-08-11T11:15:06.586463Z","steps":["trace[575098996] 'process raft request' (duration: 179.032203ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:06.586662Z","caller":"traceutil/trace.go:171","msg":"trace[90730459] transaction","detail":"{read_only:false; response_revision:1333; number_of_response:1; }","duration":"179.334101ms","start":"2026-08-11T11:15:06.40732Z","end":"2026-08-11T11:15:06.586654Z","steps":["trace[90730459] 'process raft request' (duration: 179.111475ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:06.587062Z","caller":"traceutil/trace.go:171","msg":"trace[1121347064] transaction","detail":"{read_only:false; response_revision:1334; number_of_response:1; }","duration":"179.644479ms","start":"2026-08-11T11:15:06.407408Z","end":"2026-08-11T11:15:06.587052Z","steps":["trace[1121347064] 'process raft request' (duration: 179.213688ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:06.58706Z","caller":"traceutil/trace.go:171","msg":"trace[689335042] transaction","detail":"{read_only:false; response_revision:1335; number_of_response:1; }","duration":"179.622898ms","start":"2026-08-11T11:15:06.40741Z","end":"2026-08-11T11:15:06.587033Z","steps":["trace[689335042] 'process raft request' (duration: 179.505076ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:08.957564Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824334587192280463,"retry-timeout":"500ms"} {"level":"info","ts":"2026-08-11T11:15:08.998006Z","caller":"traceutil/trace.go:171","msg":"trace[635197494] transaction","detail":"{read_only:false; response_revision:1339; number_of_response:1; }","duration":"589.933844ms","start":"2026-08-11T11:15:08.408044Z","end":"2026-08-11T11:15:08.997978Z","steps":["trace[635197494] 'process raft request' (duration: 589.730109ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:08.998242Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:08.408022Z","time spent":"590.074798ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:15:09.248694Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.028475ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-08-11T11:15:09.248794Z","caller":"traceutil/trace.go:171","msg":"trace[1057731773] linearizableReadLoop","detail":"{readStateIndex:1391; appliedIndex:1389; }","duration":"792.259627ms","start":"2026-08-11T11:15:08.456516Z","end":"2026-08-11T11:15:09.248776Z","steps":["trace[1057731773] 'read index received' (duration: 541.195312ms)","trace[1057731773] 'applied index is now lower than readState.Index' (duration: 251.062825ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:15:09.248928Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"505.019223ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:15:09.248958Z","caller":"traceutil/trace.go:171","msg":"trace[1694769025] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1339; }","duration":"505.093484ms","start":"2026-08-11T11:15:08.743856Z","end":"2026-08-11T11:15:09.24895Z","steps":["trace[1694769025] 'agreement among raft nodes before linearized reading' (duration: 505.025343ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:09.248986Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:08.743832Z","time spent":"505.149486ms","remote":"127.0.0.1:35244","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-08-11T11:15:09.249047Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"657.536956ms","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-08-11T11:15:09.249077Z","caller":"traceutil/trace.go:171","msg":"trace[832415387] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1339; }","duration":"657.576696ms","start":"2026-08-11T11:15:08.591493Z","end":"2026-08-11T11:15:09.24907Z","steps":["trace[832415387] 'agreement among raft nodes before linearized reading' (duration: 657.509375ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:09.249101Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:08.591486Z","time spent":"657.606398ms","remote":"127.0.0.1:35520","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-08-11T11:15:09.249272Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"658.288844ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-08-11T11:15:09.249299Z","caller":"traceutil/trace.go:171","msg":"trace[2048749558] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1339; }","duration":"658.334536ms","start":"2026-08-11T11:15:08.590958Z","end":"2026-08-11T11:15:09.249292Z","steps":["trace[2048749558] 'agreement among raft nodes before linearized reading' (duration: 658.272064ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:09.249312Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"288.168408ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-08-11T11:15:09.249316Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:08.59095Z","time spent":"658.360956ms","remote":"127.0.0.1:35520","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":"info","ts":"2026-08-11T11:15:09.249332Z","caller":"traceutil/trace.go:171","msg":"trace[584957170] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:1339; }","duration":"288.21419ms","start":"2026-08-11T11:15:08.961112Z","end":"2026-08-11T11:15:09.249326Z","steps":["trace[584957170] 'agreement among raft nodes before linearized reading' (duration: 288.178849ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:09.249453Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"658.761386ms","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-08-11T11:15:09.24948Z","caller":"traceutil/trace.go:171","msg":"trace[1904000636] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1339; }","duration":"658.827967ms","start":"2026-08-11T11:15:08.590646Z","end":"2026-08-11T11:15:09.249474Z","steps":["trace[1904000636] 'agreement among raft nodes before linearized reading' (duration: 658.762196ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:09.249499Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:08.590627Z","time spent":"658.866939ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-08-11T11:15:09.249278Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"792.76402ms","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-08-11T11:15:09.249458Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"304.897115ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:15:09.249632Z","caller":"traceutil/trace.go:171","msg":"trace[1197302642] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1339; }","duration":"793.16539ms","start":"2026-08-11T11:15:08.456459Z","end":"2026-08-11T11:15:09.249624Z","steps":["trace[1197302642] 'agreement among raft nodes before linearized reading' (duration: 792.77309ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:09.249645Z","caller":"traceutil/trace.go:171","msg":"trace[1051521273] range","detail":"{range_begin:/registry/ingress/; range_end:/registry/ingress0; response_count:0; response_revision:1339; }","duration":"305.112221ms","start":"2026-08-11T11:15:08.944526Z","end":"2026-08-11T11:15:09.249638Z","steps":["trace[1051521273] 'agreement among raft nodes before linearized reading' (duration: 304.908795ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:09.249659Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:08.45643Z","time spent":"793.222272ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":529,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-08-11T11:15:09.24967Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:08.944506Z","time spent":"305.156421ms","remote":"127.0.0.1:35540","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-08-11T11:15:09.248986Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"658.298015ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-08-11T11:15:09.249803Z","caller":"traceutil/trace.go:171","msg":"trace[535118240] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1339; }","duration":"659.150045ms","start":"2026-08-11T11:15:08.590646Z","end":"2026-08-11T11:15:09.249796Z","steps":["trace[535118240] 'agreement among raft nodes before linearized reading' (duration: 658.233913ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:09.249828Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:08.590627Z","time spent":"659.193647ms","remote":"127.0.0.1:35520","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-08-11T11:15:09.381038Z","caller":"traceutil/trace.go:171","msg":"trace[974403206] transaction","detail":"{read_only:false; response_revision:1342; number_of_response:1; }","duration":"126.542477ms","start":"2026-08-11T11:15:09.254473Z","end":"2026-08-11T11:15:09.381015Z","steps":["trace[974403206] 'process raft request' (duration: 126.493556ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:09.381089Z","caller":"traceutil/trace.go:171","msg":"trace[1596754196] transaction","detail":"{read_only:false; response_revision:1341; number_of_response:1; }","duration":"126.623989ms","start":"2026-08-11T11:15:09.254424Z","end":"2026-08-11T11:15:09.381048Z","steps":["trace[1596754196] 'process raft request' (duration: 126.406314ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:09.381364Z","caller":"traceutil/trace.go:171","msg":"trace[1690750184] transaction","detail":"{read_only:false; response_revision:1344; number_of_response:1; }","duration":"126.276021ms","start":"2026-08-11T11:15:09.255073Z","end":"2026-08-11T11:15:09.381349Z","steps":["trace[1690750184] 'process raft request' (duration: 126.051765ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:09.381341Z","caller":"traceutil/trace.go:171","msg":"trace[503164984] transaction","detail":"{read_only:false; response_revision:1343; number_of_response:1; }","duration":"126.838235ms","start":"2026-08-11T11:15:09.25446Z","end":"2026-08-11T11:15:09.381298Z","steps":["trace[503164984] 'process raft request' (duration: 126.528598ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:10.304818Z","caller":"traceutil/trace.go:171","msg":"trace[1513317400] transaction","detail":"{read_only:false; response_revision:1346; number_of_response:1; }","duration":"270.411867ms","start":"2026-08-11T11:15:10.034369Z","end":"2026-08-11T11:15:10.30478Z","steps":["trace[1513317400] 'process raft request' (duration: 270.256643ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:10.738749Z","caller":"traceutil/trace.go:171","msg":"trace[2101073595] transaction","detail":"{read_only:false; response_revision:1347; number_of_response:1; }","duration":"221.336786ms","start":"2026-08-11T11:15:10.517382Z","end":"2026-08-11T11:15:10.738719Z","steps":["trace[2101073595] 'process raft request' (duration: 221.12457ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:10.856263Z","caller":"traceutil/trace.go:171","msg":"trace[943678624] transaction","detail":"{read_only:false; response_revision:1348; number_of_response:1; }","duration":"170.754108ms","start":"2026-08-11T11:15:10.685463Z","end":"2026-08-11T11:15:10.856217Z","steps":["trace[943678624] 'process raft request' (duration: 170.580763ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:11.946268Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824334587192280490,"retry-timeout":"500ms"} {"level":"info","ts":"2026-08-11T11:15:12.117432Z","caller":"traceutil/trace.go:171","msg":"trace[2138488232] transaction","detail":"{read_only:false; response_revision:1353; number_of_response:1; }","duration":"729.115048ms","start":"2026-08-11T11:15:11.388286Z","end":"2026-08-11T11:15:12.117401Z","steps":["trace[2138488232] 'process raft request' (duration: 691.876301ms)","trace[2138488232] 'compare' (duration: 36.715194ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:15:12.117708Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:11.388245Z","time spent":"729.252831ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:15:12.131159Z","caller":"traceutil/trace.go:171","msg":"trace[574518611] transaction","detail":"{read_only:false; response_revision:1355; number_of_response:1; }","duration":"740.598473ms","start":"2026-08-11T11:15:11.390533Z","end":"2026-08-11T11:15:12.131131Z","steps":["trace[574518611] 'process raft request' (duration: 740.525291ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:12.131308Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:11.390513Z","time spent":"740.718045ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:15:12.131499Z","caller":"traceutil/trace.go:171","msg":"trace[575952187] transaction","detail":"{read_only:false; response_revision:1356; number_of_response:1; }","duration":"740.737426ms","start":"2026-08-11T11:15:11.390564Z","end":"2026-08-11T11:15:12.131302Z","steps":["trace[575952187] 'process raft request' (duration: 740.534311ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:12.131584Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:11.390541Z","time spent":"741.004993ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:15:12.131559Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"685.701507ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-08-11T11:15:12.131658Z","caller":"traceutil/trace.go:171","msg":"trace[1393739048] range","detail":"{range_begin:/registry/clusterroles/; range_end:/registry/clusterroles0; response_count:0; response_revision:1356; }","duration":"685.897532ms","start":"2026-08-11T11:15:11.445745Z","end":"2026-08-11T11:15:12.131643Z","steps":["trace[1393739048] 'agreement among raft nodes before linearized reading' (duration: 685.629675ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:12.13173Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:11.44572Z","time spent":"685.995564ms","remote":"127.0.0.1:35600","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":70,"response size":30,"request content":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true "} {"level":"info","ts":"2026-08-11T11:15:12.131805Z","caller":"traceutil/trace.go:171","msg":"trace[274439251] linearizableReadLoop","detail":"{readStateIndex:1408; appliedIndex:1404; }","duration":"685.428871ms","start":"2026-08-11T11:15:11.445816Z","end":"2026-08-11T11:15:12.131245Z","steps":["trace[274439251] 'read index received' (duration: 634.309509ms)","trace[274439251] 'applied index is now lower than readState.Index' (duration: 51.113202ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:15:12.13334Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"391.597282ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:15:12.133393Z","caller":"traceutil/trace.go:171","msg":"trace[10282047] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1356; }","duration":"391.651483ms","start":"2026-08-11T11:15:11.741729Z","end":"2026-08-11T11:15:12.13338Z","steps":["trace[10282047] 'agreement among raft nodes before linearized reading' (duration: 391.564991ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:12.133405Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"593.888023ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:5514"} {"level":"warn","ts":"2026-08-11T11:15:12.133424Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:11.741676Z","time spent":"391.741155ms","remote":"127.0.0.1:35258","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-08-11T11:15:12.133452Z","caller":"traceutil/trace.go:171","msg":"trace[737681180] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:1356; }","duration":"593.962875ms","start":"2026-08-11T11:15:11.539479Z","end":"2026-08-11T11:15:12.133442Z","steps":["trace[737681180] 'agreement among raft nodes before linearized reading' (duration: 593.828362ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:12.133483Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:11.539459Z","time spent":"594.016486ms","remote":"127.0.0.1:35422","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":1,"response size":5537,"request content":"key:\"/registry/minions/instance\" "} {"level":"info","ts":"2026-08-11T11:15:12.134217Z","caller":"traceutil/trace.go:171","msg":"trace[117667907] transaction","detail":"{read_only:false; response_revision:1354; number_of_response:1; }","duration":"743.626408ms","start":"2026-08-11T11:15:11.390527Z","end":"2026-08-11T11:15:12.134154Z","steps":["trace[117667907] 'process raft request' (duration: 740.382307ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:12.134661Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:11.390509Z","time spent":"743.806842ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-08-11T11:15:12.305713Z","caller":"traceutil/trace.go:171","msg":"trace[1235053562] transaction","detail":"{read_only:false; response_revision:1357; number_of_response:1; }","duration":"164.638554ms","start":"2026-08-11T11:15:12.14105Z","end":"2026-08-11T11:15:12.305688Z","steps":["trace[1235053562] 'process raft request' (duration: 155.354393ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:13.149259Z","caller":"traceutil/trace.go:171","msg":"trace[1546986764] transaction","detail":"{read_only:false; response_revision:1361; number_of_response:1; }","duration":"121.437471ms","start":"2026-08-11T11:15:13.027796Z","end":"2026-08-11T11:15:13.149233Z","steps":["trace[1546986764] 'process raft request' (duration: 121.225386ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:13.240752Z","caller":"traceutil/trace.go:171","msg":"trace[183179671] transaction","detail":"{read_only:false; response_revision:1362; number_of_response:1; }","duration":"202.775974ms","start":"2026-08-11T11:15:13.037945Z","end":"2026-08-11T11:15:13.240721Z","steps":["trace[183179671] 'process raft request' (duration: 202.335823ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:16.313501Z","caller":"traceutil/trace.go:171","msg":"trace[582452954] transaction","detail":"{read_only:false; response_revision:1391; number_of_response:1; }","duration":"110.086278ms","start":"2026-08-11T11:15:16.203385Z","end":"2026-08-11T11:15:16.313471Z","steps":["trace[582452954] 'process raft request' (duration: 109.888963ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:17.621143Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"247.250791ms","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-08-11T11:15:17.621239Z","caller":"traceutil/trace.go:171","msg":"trace[5780394] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1393; }","duration":"247.384584ms","start":"2026-08-11T11:15:17.373833Z","end":"2026-08-11T11:15:17.621217Z","steps":["trace[5780394] 'range keys from in-memory index tree' (duration: 247.022765ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:17.798984Z","caller":"traceutil/trace.go:171","msg":"trace[1122018696] transaction","detail":"{read_only:false; response_revision:1394; number_of_response:1; }","duration":"173.012524ms","start":"2026-08-11T11:15:17.625939Z","end":"2026-08-11T11:15:17.798951Z","steps":["trace[1122018696] 'process raft request' (duration: 172.84034ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:21.0878Z","caller":"traceutil/trace.go:171","msg":"trace[567666151] transaction","detail":"{read_only:false; response_revision:1432; number_of_response:1; }","duration":"191.009913ms","start":"2026-08-11T11:15:20.896763Z","end":"2026-08-11T11:15:21.087773Z","steps":["trace[567666151] 'process raft request' (duration: 190.856269ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:21.120735Z","caller":"traceutil/trace.go:171","msg":"trace[1960448266] transaction","detail":"{read_only:false; response_revision:1433; number_of_response:1; }","duration":"179.740262ms","start":"2026-08-11T11:15:20.940963Z","end":"2026-08-11T11:15:21.120703Z","steps":["trace[1960448266] 'process raft request' (duration: 178.548992ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:35.492983Z","caller":"traceutil/trace.go:171","msg":"trace[527771785] transaction","detail":"{read_only:false; response_revision:1498; number_of_response:1; }","duration":"100.608508ms","start":"2026-08-11T11:15:35.392345Z","end":"2026-08-11T11:15:35.492954Z","steps":["trace[527771785] 'process raft request' (duration: 100.434634ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:36.301103Z","caller":"traceutil/trace.go:171","msg":"trace[1424683165] transaction","detail":"{read_only:false; response_revision:1501; number_of_response:1; }","duration":"122.190667ms","start":"2026-08-11T11:15:36.178866Z","end":"2026-08-11T11:15:36.301056Z","steps":["trace[1424683165] 'process raft request' (duration: 31.534316ms)","trace[1424683165] 'compare' (duration: 90.157978ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:15:37.013638Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.172202ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:15:37.013747Z","caller":"traceutil/trace.go:171","msg":"trace[944116992] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1505; }","duration":"269.352066ms","start":"2026-08-11T11:15:36.74437Z","end":"2026-08-11T11:15:37.013722Z","steps":["trace[944116992] 'range keys from in-memory index tree' (duration: 269.050678ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:37.013706Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"346.285294ms","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":"info","ts":"2026-08-11T11:15:37.014568Z","caller":"traceutil/trace.go:171","msg":"trace[1541320087] range","detail":"{range_begin:/registry/horizontalpodautoscalers/; range_end:/registry/horizontalpodautoscalers0; response_count:0; response_revision:1505; }","duration":"347.177286ms","start":"2026-08-11T11:15:36.667356Z","end":"2026-08-11T11:15:37.014533Z","steps":["trace[1541320087] 'count revisions from in-memory index tree' (duration: 346.196262ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:37.01476Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:36.667331Z","time spent":"347.287579ms","remote":"127.0.0.1:35466","response type":"/etcdserverpb.KV/Range","request count":0,"request size":76,"response count":0,"response size":28,"request content":"key:\"/registry/horizontalpodautoscalers/\" range_end:\"/registry/horizontalpodautoscalers0\" count_only:true "} {"level":"info","ts":"2026-08-11T11:15:38.680815Z","caller":"traceutil/trace.go:171","msg":"trace[1050195421] linearizableReadLoop","detail":"{readStateIndex:1567; appliedIndex:1566; }","duration":"305.668481ms","start":"2026-08-11T11:15:38.375117Z","end":"2026-08-11T11:15:38.680785Z","steps":["trace[1050195421] 'read index received' (duration: 305.389454ms)","trace[1050195421] 'applied index is now lower than readState.Index' (duration: 277.347µs)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:15:38.680973Z","caller":"traceutil/trace.go:171","msg":"trace[859254063] transaction","detail":"{read_only:false; response_revision:1510; number_of_response:1; }","duration":"317.713422ms","start":"2026-08-11T11:15:38.363244Z","end":"2026-08-11T11:15:38.680957Z","steps":["trace[859254063] 'process raft request' (duration: 317.361023ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:38.681374Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:38.363225Z","time spent":"317.776394ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":519,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-08-11T11:15:38.681419Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"299.971629ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:15:38.681503Z","caller":"traceutil/trace.go:171","msg":"trace[1467244508] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1510; }","duration":"300.077271ms","start":"2026-08-11T11:15:38.381401Z","end":"2026-08-11T11:15:38.681479Z","steps":["trace[1467244508] 'agreement among raft nodes before linearized reading' (duration: 299.753123ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:38.681546Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:38.381374Z","time spent":"300.161834ms","remote":"127.0.0.1:35258","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-08-11T11:15:38.681734Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.662667ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"warn","ts":"2026-08-11T11:15:38.681759Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"215.695798ms","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-08-11T11:15:38.681806Z","caller":"traceutil/trace.go:171","msg":"trace[1750431740] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1510; }","duration":"140.79064ms","start":"2026-08-11T11:15:38.540998Z","end":"2026-08-11T11:15:38.681788Z","steps":["trace[1750431740] 'agreement among raft nodes before linearized reading' (duration: 140.575265ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:38.681844Z","caller":"traceutil/trace.go:171","msg":"trace[227100415] range","detail":"{range_begin:/registry/rolebindings/; range_end:/registry/rolebindings0; response_count:0; response_revision:1510; }","duration":"215.833362ms","start":"2026-08-11T11:15:38.465989Z","end":"2026-08-11T11:15:38.681822Z","steps":["trace[227100415] 'agreement among raft nodes before linearized reading' (duration: 215.661938ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:38.682108Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"306.996454ms","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-08-11T11:15:38.682142Z","caller":"traceutil/trace.go:171","msg":"trace[1148006729] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1510; }","duration":"307.059686ms","start":"2026-08-11T11:15:38.375074Z","end":"2026-08-11T11:15:38.682134Z","steps":["trace[1148006729] 'agreement among raft nodes before linearized reading' (duration: 306.972684ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:38.682195Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:15:38.375055Z","time spent":"307.104267ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-08-11T11:15:38.682265Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.626248ms","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-08-11T11:15:38.682302Z","caller":"traceutil/trace.go:171","msg":"trace[1753211570] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1510; }","duration":"104.729051ms","start":"2026-08-11T11:15:38.577564Z","end":"2026-08-11T11:15:38.682293Z","steps":["trace[1753211570] 'agreement among raft nodes before linearized reading' (duration: 103.955892ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:39.039805Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.939948ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-08-11T11:15:39.039926Z","caller":"traceutil/trace.go:171","msg":"trace[1317553841] linearizableReadLoop","detail":"{readStateIndex:1572; appliedIndex:1571; }","duration":"149.723304ms","start":"2026-08-11T11:15:38.890183Z","end":"2026-08-11T11:15:39.039906Z","steps":["trace[1317553841] 'read index received' (duration: 42.552µs)","trace[1317553841] 'applied index is now lower than readState.Index' (duration: 149.675311ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:15:39.04003Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.816736ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-08-11T11:15:39.040071Z","caller":"traceutil/trace.go:171","msg":"trace[719032824] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:1514; }","duration":"149.889837ms","start":"2026-08-11T11:15:38.89017Z","end":"2026-08-11T11:15:39.04006Z","steps":["trace[719032824] 'agreement among raft nodes before linearized reading' (duration: 149.785755ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:42.950793Z","caller":"traceutil/trace.go:171","msg":"trace[1703714957] transaction","detail":"{read_only:false; response_revision:1532; number_of_response:1; }","duration":"121.685714ms","start":"2026-08-11T11:15:42.829076Z","end":"2026-08-11T11:15:42.950762Z","steps":["trace[1703714957] 'process raft request' (duration: 60.808007ms)","trace[1703714957] 'compare' (duration: 60.17794ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:15:44.400888Z","caller":"traceutil/trace.go:171","msg":"trace[601176657] linearizableReadLoop","detail":"{readStateIndex:1596; appliedIndex:1595; }","duration":"214.885688ms","start":"2026-08-11T11:15:44.18597Z","end":"2026-08-11T11:15:44.400856Z","steps":["trace[601176657] 'read index received' (duration: 214.615991ms)","trace[601176657] 'applied index is now lower than readState.Index' (duration: 268.237µs)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:15:44.40105Z","caller":"traceutil/trace.go:171","msg":"trace[1621279245] transaction","detail":"{read_only:false; response_revision:1537; number_of_response:1; }","duration":"229.082382ms","start":"2026-08-11T11:15:44.17192Z","end":"2026-08-11T11:15:44.401003Z","steps":["trace[1621279245] 'process raft request' (duration: 228.730103ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:44.401361Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.149411ms","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:531"} {"level":"info","ts":"2026-08-11T11:15:44.401459Z","caller":"traceutil/trace.go:171","msg":"trace[71278312] range","detail":"{range_begin:/registry/leases/kube-system/rbd.csi.ceph.com-kube-system; range_end:; response_count:1; response_revision:1537; }","duration":"186.303645ms","start":"2026-08-11T11:15:44.215137Z","end":"2026-08-11T11:15:44.40144Z","steps":["trace[71278312] 'agreement among raft nodes before linearized reading' (duration: 186.06952ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:15:44.40121Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"215.223127ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:472"} {"level":"info","ts":"2026-08-11T11:15:44.401654Z","caller":"traceutil/trace.go:171","msg":"trace[1285713655] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1537; }","duration":"215.720159ms","start":"2026-08-11T11:15:44.185917Z","end":"2026-08-11T11:15:44.401637Z","steps":["trace[1285713655] 'agreement among raft nodes before linearized reading' (duration: 215.116854ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:56.580231Z","caller":"traceutil/trace.go:171","msg":"trace[1988769705] transaction","detail":"{read_only:false; response_revision:1592; number_of_response:1; }","duration":"222.846316ms","start":"2026-08-11T11:15:56.357357Z","end":"2026-08-11T11:15:56.580203Z","steps":["trace[1988769705] 'process raft request' (duration: 222.665312ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:15:56.580578Z","caller":"traceutil/trace.go:171","msg":"trace[1145274993] linearizableReadLoop","detail":"{readStateIndex:1653; appliedIndex:1653; }","duration":"116.741371ms","start":"2026-08-11T11:15:56.463823Z","end":"2026-08-11T11:15:56.580564Z","steps":["trace[1145274993] 'read index received' (duration: 116.734001ms)","trace[1145274993] 'applied index is now lower than readState.Index' (duration: 5.86µs)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:15:56.580742Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.904825ms","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-08-11T11:15:56.580772Z","caller":"traceutil/trace.go:171","msg":"trace[176251015] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1592; }","duration":"116.985187ms","start":"2026-08-11T11:15:56.463778Z","end":"2026-08-11T11:15:56.580763Z","steps":["trace[176251015] 'agreement among raft nodes before linearized reading' (duration: 116.845554ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:16:01.176779Z","caller":"traceutil/trace.go:171","msg":"trace[2017710855] transaction","detail":"{read_only:false; response_revision:1614; number_of_response:1; }","duration":"164.920812ms","start":"2026-08-11T11:16:01.011812Z","end":"2026-08-11T11:16:01.176733Z","steps":["trace[2017710855] 'process raft request' (duration: 119.821768ms)","trace[2017710855] 'compare' (duration: 44.421698ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:16:23.488458Z","caller":"traceutil/trace.go:171","msg":"trace[762821307] transaction","detail":"{read_only:false; response_revision:1717; number_of_response:1; }","duration":"108.410843ms","start":"2026-08-11T11:16:23.380017Z","end":"2026-08-11T11:16:23.488428Z","steps":["trace[762821307] 'process raft request' (duration: 103.156622ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:16:24.001874Z","caller":"traceutil/trace.go:171","msg":"trace[1393518717] transaction","detail":"{read_only:false; response_revision:1720; number_of_response:1; }","duration":"114.100305ms","start":"2026-08-11T11:16:23.887729Z","end":"2026-08-11T11:16:24.001829Z","steps":["trace[1393518717] 'process raft request' (duration: 47.067301ms)","trace[1393518717] 'compare' (duration: 66.777637ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:16:27.080784Z","caller":"traceutil/trace.go:171","msg":"trace[1350522189] transaction","detail":"{read_only:false; response_revision:1732; number_of_response:1; }","duration":"150.981105ms","start":"2026-08-11T11:16:26.929767Z","end":"2026-08-11T11:16:27.080748Z","steps":["trace[1350522189] 'process raft request' (duration: 148.196796ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:16:28.255435Z","caller":"traceutil/trace.go:171","msg":"trace[542697446] transaction","detail":"{read_only:false; response_revision:1738; number_of_response:1; }","duration":"209.309013ms","start":"2026-08-11T11:16:28.046092Z","end":"2026-08-11T11:16:28.255401Z","steps":["trace[542697446] 'process raft request' (duration: 179.910028ms)","trace[542697446] 'compare' (duration: 29.285442ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:16:47.352066Z","caller":"traceutil/trace.go:171","msg":"trace[1156324594] transaction","detail":"{read_only:false; response_revision:1824; number_of_response:1; }","duration":"111.935301ms","start":"2026-08-11T11:16:47.240102Z","end":"2026-08-11T11:16:47.352037Z","steps":["trace[1156324594] 'process raft request' (duration: 111.717526ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:16:47.557064Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.507539ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-08-11T11:16:47.557149Z","caller":"traceutil/trace.go:171","msg":"trace[230503503] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1824; }","duration":"102.640202ms","start":"2026-08-11T11:16:47.454491Z","end":"2026-08-11T11:16:47.557131Z","steps":["trace[230503503] 'range keys from in-memory index tree' (duration: 102.358786ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:16:47.742066Z","caller":"traceutil/trace.go:171","msg":"trace[335224873] linearizableReadLoop","detail":"{readStateIndex:1897; appliedIndex:1896; }","duration":"126.139212ms","start":"2026-08-11T11:16:47.61589Z","end":"2026-08-11T11:16:47.742029Z","steps":["trace[335224873] 'read index received' (duration: 12.845837ms)","trace[335224873] 'applied index is now lower than readState.Index' (duration: 113.291865ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:16:47.742523Z","caller":"traceutil/trace.go:171","msg":"trace[147567313] transaction","detail":"{read_only:false; response_revision:1826; number_of_response:1; }","duration":"181.056046ms","start":"2026-08-11T11:16:47.561442Z","end":"2026-08-11T11:16:47.742498Z","steps":["trace[147567313] 'process raft request' (duration: 103.37127ms)","trace[147567313] 'compare' (duration: 77.063971ms)"],"step_count":2} {"level":"warn","ts":"2026-08-11T11:16:47.743176Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.28302ms","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-08-11T11:16:47.743243Z","caller":"traceutil/trace.go:171","msg":"trace[1540160464] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1826; }","duration":"127.400973ms","start":"2026-08-11T11:16:47.615818Z","end":"2026-08-11T11:16:47.743219Z","steps":["trace[1540160464] 'agreement among raft nodes before linearized reading' (duration: 127.224849ms)"],"step_count":1} {"level":"info","ts":"2026-08-11T11:16:47.893415Z","caller":"traceutil/trace.go:171","msg":"trace[845719252] transaction","detail":"{read_only:false; response_revision:1828; number_of_response:1; }","duration":"145.268544ms","start":"2026-08-11T11:16:47.748119Z","end":"2026-08-11T11:16:47.893388Z","steps":["trace[845719252] 'process raft request' (duration: 111.951372ms)","trace[845719252] 'compare' (duration: 33.200299ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:17:13.648486Z","caller":"traceutil/trace.go:171","msg":"trace[843311643] transaction","detail":"{read_only:false; response_revision:1944; number_of_response:1; }","duration":"117.089738ms","start":"2026-08-11T11:17:13.531278Z","end":"2026-08-11T11:17:13.648368Z","steps":["trace[843311643] 'process raft request' (duration: 49.678935ms)","trace[843311643] 'compare' (duration: 67.030824ms)"],"step_count":2} {"level":"info","ts":"2026-08-11T11:19:25.972676Z","caller":"traceutil/trace.go:171","msg":"trace[1009819483] transaction","detail":"{read_only:false; response_revision:2584; number_of_response:1; }","duration":"929.360622ms","start":"2026-08-11T11:19:25.043286Z","end":"2026-08-11T11:19:25.972646Z","steps":["trace[1009819483] 'process raft request' (duration: 927.720721ms)"],"step_count":1} {"level":"warn","ts":"2026-08-11T11:19:25.972815Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-11T11:19:25.043265Z","time spent":"929.477364ms","remote":"127.0.0.1:35520","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":457,"response count":0,"response size":39,"request content":"compare: success:> failure: >"}