{"level":"warn","ts":"2026-02-19T05:58:52.4798Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-02-19T05:58:52.479917Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.242:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.242:2380","--initial-cluster=instance=https://199.204.45.242:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.242:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.242: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-02-19T05:58:52.479997Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-02-19T05:58:52.48001Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.242:2380"]} {"level":"info","ts":"2026-02-19T05:58:52.480026Z","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-02-19T05:58:52.483184Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.242:2379"]} {"level":"info","ts":"2026-02-19T05:58:52.483299Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.242:2380"],"listen-peer-urls":["https://199.204.45.242:2380"],"advertise-client-urls":["https://199.204.45.242:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.242:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.242: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-02-19T05:58:52.488373Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.781581ms"} {"level":"info","ts":"2026-02-19T05:58:52.500012Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"b844c110b9783e73","cluster-id":"49dc9693ccd466a9"} {"level":"info","ts":"2026-02-19T05:58:52.500137Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 switched to configuration voters=()"} {"level":"info","ts":"2026-02-19T05:58:52.500164Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became follower at term 0"} {"level":"info","ts":"2026-02-19T05:58:52.500177Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft b844c110b9783e73 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-02-19T05:58:52.500186Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became follower at term 1"} {"level":"info","ts":"2026-02-19T05:58:52.500272Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 switched to configuration voters=(13277949878970367603)"} {"level":"warn","ts":"2026-02-19T05:58:52.510619Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-02-19T05:58:52.511866Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-02-19T05:58:52.512828Z","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-02-19T05:58:52.515291Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"b844c110b9783e73","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-02-19T05:58:52.515492Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"b844c110b9783e73","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-02-19T05:58:52.515681Z","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-02-19T05:58:52.515774Z","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-02-19T05:58:52.515782Z","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-02-19T05:58:52.519635Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 switched to configuration voters=(13277949878970367603)"} {"level":"info","ts":"2026-02-19T05:58:52.519984Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"49dc9693ccd466a9","local-member-id":"b844c110b9783e73","added-peer-id":"b844c110b9783e73","added-peer-peer-urls":["https://199.204.45.242:2380"]} {"level":"info","ts":"2026-02-19T05:58:52.521417Z","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-02-19T05:58:52.52166Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.242:2380"} {"level":"info","ts":"2026-02-19T05:58:52.52174Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.242:2380"} {"level":"info","ts":"2026-02-19T05:58:52.521925Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"b844c110b9783e73","initial-advertise-peer-urls":["https://199.204.45.242:2380"],"listen-peer-urls":["https://199.204.45.242:2380"],"advertise-client-urls":["https://199.204.45.242:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.242:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-02-19T05:58:52.521951Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-02-19T05:58:53.50104Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 is starting a new election at term 1"} {"level":"info","ts":"2026-02-19T05:58:53.50114Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became pre-candidate at term 1"} {"level":"info","ts":"2026-02-19T05:58:53.501186Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 received MsgPreVoteResp from b844c110b9783e73 at term 1"} {"level":"info","ts":"2026-02-19T05:58:53.501213Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became candidate at term 2"} {"level":"info","ts":"2026-02-19T05:58:53.501234Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 received MsgVoteResp from b844c110b9783e73 at term 2"} {"level":"info","ts":"2026-02-19T05:58:53.501262Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became leader at term 2"} {"level":"info","ts":"2026-02-19T05:58:53.501277Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: b844c110b9783e73 elected leader b844c110b9783e73 at term 2"} {"level":"info","ts":"2026-02-19T05:58:53.502492Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"b844c110b9783e73","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.242:2379]}","request-path":"/0/members/b844c110b9783e73/attributes","cluster-id":"49dc9693ccd466a9","publish-timeout":"7s"} {"level":"info","ts":"2026-02-19T05:58:53.502985Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-02-19T05:58:53.502981Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-02-19T05:58:53.50324Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-02-19T05:58:53.50328Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-02-19T05:58:53.503469Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-02-19T05:58:53.50441Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"49dc9693ccd466a9","local-member-id":"b844c110b9783e73","cluster-version":"3.5"} {"level":"info","ts":"2026-02-19T05:58:53.504526Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-02-19T05:58:53.504557Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-02-19T05:58:53.505019Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.242:2379"} {"level":"info","ts":"2026-02-19T05:58:53.506626Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"warn","ts":"2026-02-19T05:59:09.009341Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"288.781507ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-vip-instance\" ","response":"range_response_count:1 size:4730"} {"level":"info","ts":"2026-02-19T05:59:09.009516Z","caller":"traceutil/trace.go:171","msg":"trace[1614172802] range","detail":"{range_begin:/registry/pods/kube-system/kube-vip-instance; range_end:; response_count:1; response_revision:408; }","duration":"289.052413ms","start":"2026-02-19T05:59:08.72043Z","end":"2026-02-19T05:59:09.009483Z","steps":["trace[1614172802] 'range keys from in-memory index tree' (duration: 288.647914ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T05:59:14.782253Z","caller":"traceutil/trace.go:171","msg":"trace[27311652] transaction","detail":"{read_only:false; response_revision:455; number_of_response:1; }","duration":"326.087145ms","start":"2026-02-19T05:59:14.456134Z","end":"2026-02-19T05:59:14.782221Z","steps":["trace[27311652] 'process raft request' (duration: 325.925472ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:14.783181Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:14.456104Z","time spent":"326.26454ms","remote":"127.0.0.1:59986","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-02-19T05:59:15.62965Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"805.583913ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-19T05:59:15.629721Z","caller":"traceutil/trace.go:171","msg":"trace[659018629] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:455; }","duration":"805.710316ms","start":"2026-02-19T05:59:14.823996Z","end":"2026-02-19T05:59:15.629707Z","steps":["trace[659018629] 'range keys from in-memory index tree' (duration: 805.499701ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:15.629747Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:14.82397Z","time spent":"805.772498ms","remote":"127.0.0.1:59730","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-02-19T05:59:15.630275Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.014953ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-19T05:59:15.630392Z","caller":"traceutil/trace.go:171","msg":"trace[338851252] linearizableReadLoop","detail":"{readStateIndex:469; appliedIndex:468; }","duration":"271.269884ms","start":"2026-02-19T05:59:15.359103Z","end":"2026-02-19T05:59:15.630373Z","steps":["trace[338851252] 'read index received' (duration: 163.697608ms)","trace[338851252] 'applied index is now lower than readState.Index' (duration: 107.570676ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T05:59:15.630433Z","caller":"traceutil/trace.go:171","msg":"trace[1037915705] transaction","detail":"{read_only:false; response_revision:456; number_of_response:1; }","duration":"309.569026ms","start":"2026-02-19T05:59:15.320852Z","end":"2026-02-19T05:59:15.630421Z","steps":["trace[1037915705] 'process raft request' (duration: 202.133573ms)","trace[1037915705] 'compare' (duration: 106.326527ms)"],"step_count":2} {"level":"warn","ts":"2026-02-19T05:59:15.630504Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:15.320814Z","time spent":"309.643168ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T05:59:15.630627Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"271.53061ms","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-02-19T05:59:15.630667Z","caller":"traceutil/trace.go:171","msg":"trace[207671351] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:456; }","duration":"271.610551ms","start":"2026-02-19T05:59:15.359046Z","end":"2026-02-19T05:59:15.630657Z","steps":["trace[207671351] 'agreement among raft nodes before linearized reading' (duration: 271.447498ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T05:59:15.75983Z","caller":"traceutil/trace.go:171","msg":"trace[810140807] transaction","detail":"{read_only:false; response_revision:457; number_of_response:1; }","duration":"124.236259ms","start":"2026-02-19T05:59:15.635564Z","end":"2026-02-19T05:59:15.7598Z","steps":["trace[810140807] 'process raft request' (duration: 124.048625ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T05:59:15.76399Z","caller":"traceutil/trace.go:171","msg":"trace[1806479118] transaction","detail":"{read_only:false; response_revision:458; number_of_response:1; }","duration":"127.276159ms","start":"2026-02-19T05:59:15.636689Z","end":"2026-02-19T05:59:15.763965Z","steps":["trace[1806479118] 'process raft request' (duration: 127.114766ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T05:59:15.76424Z","caller":"traceutil/trace.go:171","msg":"trace[2106532743] transaction","detail":"{read_only:false; response_revision:459; number_of_response:1; }","duration":"127.27083ms","start":"2026-02-19T05:59:15.636959Z","end":"2026-02-19T05:59:15.76423Z","steps":["trace[2106532743] 'process raft request' (duration: 126.967792ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T05:59:24.853674Z","caller":"traceutil/trace.go:171","msg":"trace[972231684] transaction","detail":"{read_only:false; response_revision:513; number_of_response:1; }","duration":"468.214147ms","start":"2026-02-19T05:59:24.385429Z","end":"2026-02-19T05:59:24.853643Z","steps":["trace[972231684] 'process raft request' (duration: 468.003132ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:24.853856Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:24.385398Z","time spent":"468.36701ms","remote":"127.0.0.1:59912","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4213,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-19T05:59:32.198053Z","caller":"traceutil/trace.go:171","msg":"trace[1836231252] transaction","detail":"{read_only:false; response_revision:533; number_of_response:1; }","duration":"359.698429ms","start":"2026-02-19T05:59:31.838312Z","end":"2026-02-19T05:59:32.198011Z","steps":["trace[1836231252] 'process raft request' (duration: 359.485954ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:32.198284Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:31.83829Z","time spent":"359.902434ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-19T05:59:32.198639Z","caller":"traceutil/trace.go:171","msg":"trace[528346402] linearizableReadLoop","detail":"{readStateIndex:549; appliedIndex:548; }","duration":"359.557586ms","start":"2026-02-19T05:59:31.839018Z","end":"2026-02-19T05:59:32.198576Z","steps":["trace[528346402] 'read index received' (duration: 358.701336ms)","trace[528346402] 'applied index is now lower than readState.Index' (duration: 852.28µs)"],"step_count":2} {"level":"warn","ts":"2026-02-19T05:59:32.198885Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"359.828212ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-19T05:59:32.198932Z","caller":"traceutil/trace.go:171","msg":"trace[1509606021] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:533; }","duration":"359.923363ms","start":"2026-02-19T05:59:31.838993Z","end":"2026-02-19T05:59:32.198917Z","steps":["trace[1509606021] 'agreement among raft nodes before linearized reading' (duration: 359.797341ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:32.198973Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:31.838982Z","time spent":"359.980765ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-02-19T05:59:32.334969Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.846556ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-02-19T05:59:32.335252Z","caller":"traceutil/trace.go:171","msg":"trace[1982953969] transaction","detail":"{read_only:false; response_revision:534; number_of_response:1; }","duration":"130.966595ms","start":"2026-02-19T05:59:32.204268Z","end":"2026-02-19T05:59:32.335235Z","steps":["trace[1982953969] 'process raft request' (duration: 130.794381ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T05:59:32.335226Z","caller":"traceutil/trace.go:171","msg":"trace[1973345307] linearizableReadLoop","detail":"{readStateIndex:550; appliedIndex:549; }","duration":"136.40848ms","start":"2026-02-19T05:59:32.198754Z","end":"2026-02-19T05:59:32.335163Z","steps":["trace[1973345307] 'read index received' (duration: 7.3901ms)","trace[1973345307] 'applied index is now lower than readState.Index' (duration: 129.01201ms)"],"step_count":2} {"level":"warn","ts":"2026-02-19T05:59:32.335406Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"471.83489ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-8n468\" ","response":"range_response_count:1 size:16656"} {"level":"info","ts":"2026-02-19T05:59:32.335504Z","caller":"traceutil/trace.go:171","msg":"trace[1451482693] range","detail":"{range_begin:/registry/pods/kube-system/cilium-8n468; range_end:; response_count:1; response_revision:534; }","duration":"471.968144ms","start":"2026-02-19T05:59:31.863521Z","end":"2026-02-19T05:59:32.33549Z","steps":["trace[1451482693] 'agreement among raft nodes before linearized reading' (duration: 471.698758ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:32.335525Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"484.542544ms","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-02-19T05:59:32.335545Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:31.863507Z","time spent":"472.029055ms","remote":"127.0.0.1:59918","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16679,"request content":"key:\"/registry/pods/kube-system/cilium-8n468\" "} {"level":"info","ts":"2026-02-19T05:59:32.335574Z","caller":"traceutil/trace.go:171","msg":"trace[484869760] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:534; }","duration":"484.636355ms","start":"2026-02-19T05:59:31.850926Z","end":"2026-02-19T05:59:32.335563Z","steps":["trace[484869760] 'agreement among raft nodes before linearized reading' (duration: 484.38731ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:32.335622Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:31.850913Z","time spent":"484.699526ms","remote":"127.0.0.1:59986","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-02-19T05:59:33.324489Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500112476764067981,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-02-19T05:59:33.825284Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500112476764067981,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-02-19T05:59:34.093719Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.702090748s","expected-duration":"1s"} {"level":"info","ts":"2026-02-19T05:59:34.094263Z","caller":"traceutil/trace.go:171","msg":"trace[406104479] linearizableReadLoop","detail":"{readStateIndex:553; appliedIndex:552; }","duration":"1.270380631s","start":"2026-02-19T05:59:32.82385Z","end":"2026-02-19T05:59:34.09423Z","steps":["trace[406104479] 'read index received' (duration: 1.270111525s)","trace[406104479] 'applied index is now lower than readState.Index' (duration: 267.466µs)"],"step_count":2} {"level":"info","ts":"2026-02-19T05:59:34.094378Z","caller":"traceutil/trace.go:171","msg":"trace[1916822150] transaction","detail":"{read_only:false; response_revision:536; number_of_response:1; }","duration":"1.74389884s","start":"2026-02-19T05:59:32.350457Z","end":"2026-02-19T05:59:34.094356Z","steps":["trace[1916822150] 'process raft request' (duration: 1.743515771s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:34.094505Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.20034682s","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-02-19T05:59:34.094555Z","caller":"traceutil/trace.go:171","msg":"trace[1198467169] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:536; }","duration":"1.200488162s","start":"2026-02-19T05:59:32.894053Z","end":"2026-02-19T05:59:34.094542Z","steps":["trace[1198467169] 'agreement among raft nodes before linearized reading' (duration: 1.20036959s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:34.0946Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:32.894016Z","time spent":"1.200575204s","remote":"127.0.0.1:59986","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-02-19T05:59:34.094615Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:32.350419Z","time spent":"1.744051654s","remote":"127.0.0.1:59918","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":16803,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T05:59:34.095017Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.270890523s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-19T05:59:34.095134Z","caller":"traceutil/trace.go:171","msg":"trace[1128606536] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:536; }","duration":"1.271276532s","start":"2026-02-19T05:59:32.823831Z","end":"2026-02-19T05:59:34.095108Z","steps":["trace[1128606536] 'agreement among raft nodes before linearized reading' (duration: 1.270680389s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:34.09522Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:32.823752Z","time spent":"1.271453676s","remote":"127.0.0.1:59730","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-02-19T05:59:36.328454Z","caller":"traceutil/trace.go:171","msg":"trace[742955283] linearizableReadLoop","detail":"{readStateIndex:584; appliedIndex:583; }","duration":"135.288573ms","start":"2026-02-19T05:59:36.193136Z","end":"2026-02-19T05:59:36.328424Z","steps":["trace[742955283] 'read index received' (duration: 135.013077ms)","trace[742955283] 'applied index is now lower than readState.Index' (duration: 274.296µs)"],"step_count":2} {"level":"info","ts":"2026-02-19T05:59:36.328577Z","caller":"traceutil/trace.go:171","msg":"trace[362264846] transaction","detail":"{read_only:false; response_revision:567; number_of_response:1; }","duration":"146.635045ms","start":"2026-02-19T05:59:36.181892Z","end":"2026-02-19T05:59:36.328527Z","steps":["trace[362264846] 'process raft request' (duration: 146.381629ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:36.328809Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.650891ms","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-02-19T05:59:36.328861Z","caller":"traceutil/trace.go:171","msg":"trace[839851665] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:567; }","duration":"135.722163ms","start":"2026-02-19T05:59:36.193122Z","end":"2026-02-19T05:59:36.328844Z","steps":["trace[839851665] 'agreement among raft nodes before linearized reading' (duration: 135.457297ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:36.328873Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.374131ms","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-02-19T05:59:36.328999Z","caller":"traceutil/trace.go:171","msg":"trace[1637183403] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:567; }","duration":"117.493824ms","start":"2026-02-19T05:59:36.211444Z","end":"2026-02-19T05:59:36.328938Z","steps":["trace[1637183403] 'agreement among raft nodes before linearized reading' (duration: 117.312069ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:52.924617Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500112476764068333,"retry-timeout":"500ms"} {"level":"info","ts":"2026-02-19T05:59:53.320986Z","caller":"traceutil/trace.go:171","msg":"trace[974831351] linearizableReadLoop","detail":"{readStateIndex:744; appliedIndex:743; }","duration":"896.53489ms","start":"2026-02-19T05:59:52.424418Z","end":"2026-02-19T05:59:53.320953Z","steps":["trace[974831351] 'read index received' (duration: 896.255734ms)","trace[974831351] 'applied index is now lower than readState.Index' (duration: 277.886µs)"],"step_count":2} {"level":"info","ts":"2026-02-19T05:59:53.321075Z","caller":"traceutil/trace.go:171","msg":"trace[1135304531] transaction","detail":"{read_only:false; response_revision:721; number_of_response:1; }","duration":"898.085126ms","start":"2026-02-19T05:59:52.422967Z","end":"2026-02-19T05:59:53.321052Z","steps":["trace[1135304531] 'process raft request' (duration: 897.784249ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:53.321221Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:52.422947Z","time spent":"898.170508ms","remote":"127.0.0.1:59986","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-02-19T05:59:53.321318Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"498.318129ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-19T05:59:53.321369Z","caller":"traceutil/trace.go:171","msg":"trace[1793378422] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:721; }","duration":"498.39774ms","start":"2026-02-19T05:59:52.822957Z","end":"2026-02-19T05:59:53.321354Z","steps":["trace[1793378422] 'agreement among raft nodes before linearized reading' (duration: 498.322228ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:53.321414Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:52.822938Z","time spent":"498.468602ms","remote":"127.0.0.1:59730","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-02-19T05:59:53.321588Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"841.626675ms","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-02-19T05:59:53.321725Z","caller":"traceutil/trace.go:171","msg":"trace[1322888457] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:721; }","duration":"841.806438ms","start":"2026-02-19T05:59:52.479888Z","end":"2026-02-19T05:59:53.321694Z","steps":["trace[1322888457] 'agreement among raft nodes before linearized reading' (duration: 841.407179ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:53.321791Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:52.479879Z","time spent":"841.9009ms","remote":"127.0.0.1:59986","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-02-19T05:59:53.321934Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"896.819787ms","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-02-19T05:59:53.322068Z","caller":"traceutil/trace.go:171","msg":"trace[1086206074] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:721; }","duration":"897.632266ms","start":"2026-02-19T05:59:52.424401Z","end":"2026-02-19T05:59:53.322034Z","steps":["trace[1086206074] 'agreement among raft nodes before linearized reading' (duration: 896.710624ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:53.322135Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:52.424394Z","time spent":"897.726639ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-02-19T05:59:53.322382Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"892.437906ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-19T05:59:53.32243Z","caller":"traceutil/trace.go:171","msg":"trace[1156289896] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:721; }","duration":"892.498507ms","start":"2026-02-19T05:59:52.429918Z","end":"2026-02-19T05:59:53.322416Z","steps":["trace[1156289896] 'agreement among raft nodes before linearized reading' (duration: 891.319599ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:53.322459Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:52.429909Z","time spent":"892.542918ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-02-19T05:59:54.111738Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"281.152772ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-19T05:59:54.111932Z","caller":"traceutil/trace.go:171","msg":"trace[1461365792] transaction","detail":"{read_only:false; response_revision:722; number_of_response:1; }","duration":"785.421829ms","start":"2026-02-19T05:59:53.32647Z","end":"2026-02-19T05:59:54.111892Z","steps":["trace[1461365792] 'process raft request' (duration: 503.97588ms)","trace[1461365792] 'compare' (duration: 280.931147ms)"],"step_count":2} {"level":"warn","ts":"2026-02-19T05:59:54.112014Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:53.326441Z","time spent":"785.539212ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-19T05:59:54.176757Z","caller":"traceutil/trace.go:171","msg":"trace[1467065421] transaction","detail":"{read_only:false; response_revision:723; number_of_response:1; }","duration":"849.351746ms","start":"2026-02-19T05:59:53.327366Z","end":"2026-02-19T05:59:54.176718Z","steps":["trace[1467065421] 'process raft request' (duration: 849.070158ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T05:59:54.176927Z","caller":"traceutil/trace.go:171","msg":"trace[526590438] linearizableReadLoop","detail":"{readStateIndex:747; appliedIndex:745; }","duration":"289.19594ms","start":"2026-02-19T05:59:53.887691Z","end":"2026-02-19T05:59:54.176887Z","steps":["trace[526590438] 'read index received' (duration: 288.705537ms)","trace[526590438] 'applied index is now lower than readState.Index' (duration: 486.933µs)"],"step_count":2} {"level":"warn","ts":"2026-02-19T05:59:54.17701Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:53.32735Z","time spent":"849.53297ms","remote":"127.0.0.1:59986","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-02-19T05:59:54.177069Z","caller":"traceutil/trace.go:171","msg":"trace[2128046931] transaction","detail":"{read_only:false; response_revision:724; number_of_response:1; }","duration":"849.203101ms","start":"2026-02-19T05:59:53.327822Z","end":"2026-02-19T05:59:54.177025Z","steps":["trace[2128046931] 'process raft request' (duration: 848.800552ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T05:59:54.177255Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T05:59:53.327808Z","time spent":"849.344905ms","remote":"127.0.0.1:59986","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-02-19T05:59:54.177292Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"289.572929ms","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-02-19T05:59:54.17739Z","caller":"traceutil/trace.go:171","msg":"trace[576041534] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:724; }","duration":"289.692862ms","start":"2026-02-19T05:59:53.887673Z","end":"2026-02-19T05:59:54.177366Z","steps":["trace[576041534] 'agreement among raft nodes before linearized reading' (duration: 289.360424ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T05:59:55.543892Z","caller":"traceutil/trace.go:171","msg":"trace[538630334] transaction","detail":"{read_only:false; response_revision:726; number_of_response:1; }","duration":"213.622344ms","start":"2026-02-19T05:59:55.330236Z","end":"2026-02-19T05:59:55.543858Z","steps":["trace[538630334] 'process raft request' (duration: 213.410999ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:20.70697Z","caller":"traceutil/trace.go:171","msg":"trace[1210657694] transaction","detail":"{read_only:false; response_revision:801; number_of_response:1; }","duration":"465.752951ms","start":"2026-02-19T06:00:20.241191Z","end":"2026-02-19T06:00:20.706944Z","steps":["trace[1210657694] 'process raft request' (duration: 465.605898ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:20.70721Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.241152Z","time spent":"465.914545ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":520,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-19T06:00:20.779628Z","caller":"traceutil/trace.go:171","msg":"trace[658574958] linearizableReadLoop","detail":"{readStateIndex:831; appliedIndex:829; }","duration":"477.786751ms","start":"2026-02-19T06:00:20.301808Z","end":"2026-02-19T06:00:20.779595Z","steps":["trace[658574958] 'read index received' (duration: 405.00433ms)","trace[658574958] 'applied index is now lower than readState.Index' (duration: 72.781061ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:20.779757Z","caller":"traceutil/trace.go:171","msg":"trace[97787262] transaction","detail":"{read_only:false; response_revision:802; number_of_response:1; }","duration":"535.497692ms","start":"2026-02-19T06:00:20.244215Z","end":"2026-02-19T06:00:20.779713Z","steps":["trace[97787262] 'process raft request' (duration: 535.181995ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:20.779948Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"478.093138ms","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-02-19T06:00:20.780003Z","caller":"traceutil/trace.go:171","msg":"trace[2098671654] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:802; }","duration":"478.206271ms","start":"2026-02-19T06:00:20.301782Z","end":"2026-02-19T06:00:20.779989Z","steps":["trace[2098671654] 'agreement among raft nodes before linearized reading' (duration: 477.976236ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:20.780015Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.244175Z","time spent":"535.708207ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T06:00:20.780047Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.301771Z","time spent":"478.267282ms","remote":"127.0.0.1:59986","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-02-19T06:00:20.780126Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"477.454853ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-19T06:00:20.780188Z","caller":"traceutil/trace.go:171","msg":"trace[1311519507] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:802; }","duration":"477.598676ms","start":"2026-02-19T06:00:20.302574Z","end":"2026-02-19T06:00:20.780173Z","steps":["trace[1311519507] 'agreement among raft nodes before linearized reading' (duration: 477.3267ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:20.780247Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"455.7403ms","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-02-19T06:00:20.780293Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.302527Z","time spent":"477.75358ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-02-19T06:00:20.780356Z","caller":"traceutil/trace.go:171","msg":"trace[1765458848] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:802; }","duration":"455.933094ms","start":"2026-02-19T06:00:20.324391Z","end":"2026-02-19T06:00:20.780324Z","steps":["trace[1765458848] 'agreement among raft nodes before linearized reading' (duration: 455.553065ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:20.780421Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.324376Z","time spent":"456.034056ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-02-19T06:00:21.153667Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"231.344205ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-19T06:00:21.153781Z","caller":"traceutil/trace.go:171","msg":"trace[697173253] transaction","detail":"{read_only:false; response_revision:803; number_of_response:1; }","duration":"368.518072ms","start":"2026-02-19T06:00:20.785244Z","end":"2026-02-19T06:00:21.153762Z","steps":["trace[697173253] 'process raft request' (duration: 136.982892ms)","trace[697173253] 'compare' (duration: 231.076479ms)"],"step_count":2} {"level":"warn","ts":"2026-02-19T06:00:21.15383Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.785221Z","time spent":"368.587094ms","remote":"127.0.0.1:59986","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-02-19T06:00:21.176452Z","caller":"traceutil/trace.go:171","msg":"trace[2071008434] transaction","detail":"{read_only:false; response_revision:804; number_of_response:1; }","duration":"390.707539ms","start":"2026-02-19T06:00:20.78571Z","end":"2026-02-19T06:00:21.176417Z","steps":["trace[2071008434] 'process raft request' (duration: 390.437923ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:21.176611Z","caller":"traceutil/trace.go:171","msg":"trace[1902519357] linearizableReadLoop","detail":"{readStateIndex:834; appliedIndex:831; }","duration":"353.218627ms","start":"2026-02-19T06:00:20.823352Z","end":"2026-02-19T06:00:21.176571Z","steps":["trace[1902519357] 'read index received' (duration: 99.047801ms)","trace[1902519357] 'applied index is now lower than readState.Index' (duration: 254.168916ms)"],"step_count":2} {"level":"warn","ts":"2026-02-19T06:00:21.176827Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.785693Z","time spent":"390.958254ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T06:00:21.176963Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"353.586875ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-19T06:00:21.176813Z","caller":"traceutil/trace.go:171","msg":"trace[942975271] transaction","detail":"{read_only:false; response_revision:805; number_of_response:1; }","duration":"390.225648ms","start":"2026-02-19T06:00:20.786546Z","end":"2026-02-19T06:00:21.176771Z","steps":["trace[942975271] 'process raft request' (duration: 389.812468ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:21.177023Z","caller":"traceutil/trace.go:171","msg":"trace[478044184] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:805; }","duration":"353.703078ms","start":"2026-02-19T06:00:20.823305Z","end":"2026-02-19T06:00:21.177008Z","steps":["trace[478044184] 'agreement among raft nodes before linearized reading' (duration: 353.415412ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:21.177065Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.823283Z","time spent":"353.773189ms","remote":"127.0.0.1:59730","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-02-19T06:00:21.177681Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:20.786521Z","time spent":"390.658537ms","remote":"127.0.0.1:59986","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-02-19T06:00:23.320964Z","caller":"traceutil/trace.go:171","msg":"trace[1213722132] linearizableReadLoop","detail":"{readStateIndex:837; appliedIndex:836; }","duration":"498.579735ms","start":"2026-02-19T06:00:22.822359Z","end":"2026-02-19T06:00:23.320938Z","steps":["trace[1213722132] 'read index received' (duration: 498.415491ms)","trace[1213722132] 'applied index is now lower than readState.Index' (duration: 162.954µs)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:23.321108Z","caller":"traceutil/trace.go:171","msg":"trace[967261792] transaction","detail":"{read_only:false; response_revision:807; number_of_response:1; }","duration":"531.615053ms","start":"2026-02-19T06:00:22.78941Z","end":"2026-02-19T06:00:23.321025Z","steps":["trace[967261792] 'process raft request' (duration: 531.348307ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:23.321294Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.587028ms","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-02-19T06:00:23.32134Z","caller":"traceutil/trace.go:171","msg":"trace[894017259] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:807; }","duration":"162.67924ms","start":"2026-02-19T06:00:23.158649Z","end":"2026-02-19T06:00:23.321328Z","steps":["trace[894017259] 'agreement among raft nodes before linearized reading' (duration: 162.554457ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:23.321369Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:22.78938Z","time spent":"531.856087ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T06:00:23.321174Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"498.790169ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-19T06:00:23.321587Z","caller":"traceutil/trace.go:171","msg":"trace[1168620244] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:807; }","duration":"499.238489ms","start":"2026-02-19T06:00:22.822334Z","end":"2026-02-19T06:00:23.321573Z","steps":["trace[1168620244] 'agreement among raft nodes before linearized reading' (duration: 498.777139ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:23.321633Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:22.822321Z","time spent":"499.302681ms","remote":"127.0.0.1:59730","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-02-19T06:00:23.321634Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.812752ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"warn","ts":"2026-02-19T06:00:23.32172Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.253108ms","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-02-19T06:00:23.321744Z","caller":"traceutil/trace.go:171","msg":"trace[322734143] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:807; }","duration":"137.958186ms","start":"2026-02-19T06:00:23.183763Z","end":"2026-02-19T06:00:23.321721Z","steps":["trace[322734143] 'agreement among raft nodes before linearized reading' (duration: 137.675949ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:23.321778Z","caller":"traceutil/trace.go:171","msg":"trace[1560029499] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:807; }","duration":"140.363442ms","start":"2026-02-19T06:00:23.181404Z","end":"2026-02-19T06:00:23.321767Z","steps":["trace[1560029499] 'agreement among raft nodes before linearized reading' (duration: 140.250579ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:23.615869Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.029027ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-19T06:00:23.616128Z","caller":"traceutil/trace.go:171","msg":"trace[51543478] transaction","detail":"{read_only:false; response_revision:810; number_of_response:1; }","duration":"288.595047ms","start":"2026-02-19T06:00:23.32751Z","end":"2026-02-19T06:00:23.616105Z","steps":["trace[51543478] 'process raft request' (duration: 288.551105ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:23.616123Z","caller":"traceutil/trace.go:171","msg":"trace[1399877326] transaction","detail":"{read_only:false; response_revision:808; number_of_response:1; }","duration":"288.859542ms","start":"2026-02-19T06:00:23.327209Z","end":"2026-02-19T06:00:23.616069Z","steps":["trace[1399877326] 'process raft request' (duration: 51.498947ms)","trace[1399877326] 'compare' (duration: 236.834733ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:23.616283Z","caller":"traceutil/trace.go:171","msg":"trace[2062460291] transaction","detail":"{read_only:false; response_revision:809; number_of_response:1; }","duration":"288.76628ms","start":"2026-02-19T06:00:23.32749Z","end":"2026-02-19T06:00:23.616256Z","steps":["trace[2062460291] 'process raft request' (duration: 288.516443ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:24.24037Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"416.940487ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-19T06:00:24.240484Z","caller":"traceutil/trace.go:171","msg":"trace[784253813] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:810; }","duration":"417.139282ms","start":"2026-02-19T06:00:23.823319Z","end":"2026-02-19T06:00:24.240458Z","steps":["trace[784253813] 'range keys from in-memory index tree' (duration: 416.816504ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:24.240538Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:23.823275Z","time spent":"417.246005ms","remote":"127.0.0.1:59730","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-02-19T06:00:24.240891Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"458.642646ms","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-02-19T06:00:24.240927Z","caller":"traceutil/trace.go:171","msg":"trace[1057671669] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:810; }","duration":"458.732629ms","start":"2026-02-19T06:00:23.782185Z","end":"2026-02-19T06:00:24.240918Z","steps":["trace[1057671669] 'range keys from in-memory index tree' (duration: 458.444051ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:24.240952Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:23.782158Z","time spent":"458.786449ms","remote":"127.0.0.1:59986","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":"info","ts":"2026-02-19T06:00:24.392917Z","caller":"traceutil/trace.go:171","msg":"trace[1805648474] transaction","detail":"{read_only:false; response_revision:811; number_of_response:1; }","duration":"146.71261ms","start":"2026-02-19T06:00:24.246178Z","end":"2026-02-19T06:00:24.392891Z","steps":["trace[1805648474] 'process raft request' (duration: 146.558076ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:32.939885Z","caller":"traceutil/trace.go:171","msg":"trace[674022651] transaction","detail":"{read_only:false; response_revision:835; number_of_response:1; }","duration":"109.414151ms","start":"2026-02-19T06:00:32.830447Z","end":"2026-02-19T06:00:32.939861Z","steps":["trace[674022651] 'process raft request' (duration: 109.229777ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:33.085516Z","caller":"traceutil/trace.go:171","msg":"trace[875300860] linearizableReadLoop","detail":"{readStateIndex:870; appliedIndex:868; }","duration":"117.182633ms","start":"2026-02-19T06:00:32.968301Z","end":"2026-02-19T06:00:33.085484Z","steps":["trace[875300860] 'read index received' (duration: 114.276055ms)","trace[875300860] 'applied index is now lower than readState.Index' (duration: 2.905168ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:33.085563Z","caller":"traceutil/trace.go:171","msg":"trace[571398696] transaction","detail":"{read_only:false; response_revision:837; number_of_response:1; }","duration":"134.374222ms","start":"2026-02-19T06:00:32.951137Z","end":"2026-02-19T06:00:33.085511Z","steps":["trace[571398696] 'process raft request' (duration: 134.29856ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:33.085627Z","caller":"traceutil/trace.go:171","msg":"trace[1911151108] transaction","detail":"{read_only:false; response_revision:836; number_of_response:1; }","duration":"135.306605ms","start":"2026-02-19T06:00:32.950255Z","end":"2026-02-19T06:00:33.085562Z","steps":["trace[1911151108] 'process raft request' (duration: 132.211193ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:33.085734Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.387508ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/\" range_end:\"/registry/services/specs0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-02-19T06:00:33.085777Z","caller":"traceutil/trace.go:171","msg":"trace[74240799] range","detail":"{range_begin:/registry/services/specs/; range_end:/registry/services/specs0; response_count:0; response_revision:837; }","duration":"117.494589ms","start":"2026-02-19T06:00:32.968271Z","end":"2026-02-19T06:00:33.085766Z","steps":["trace[74240799] 'agreement among raft nodes before linearized reading' (duration: 117.338556ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:37.811231Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500112476764068785,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-02-19T06:00:38.312281Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500112476764068785,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-02-19T06:00:38.813168Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500112476764068785,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-02-19T06:00:39.186675Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"2.307175977s","expected-duration":"1s"} {"level":"info","ts":"2026-02-19T06:00:39.231496Z","caller":"traceutil/trace.go:171","msg":"trace[1162967395] linearizableReadLoop","detail":"{readStateIndex:932; appliedIndex:930; }","duration":"1.921309141s","start":"2026-02-19T06:00:37.310149Z","end":"2026-02-19T06:00:39.231458Z","steps":["trace[1162967395] 'read index received' (duration: 1.877977304s)","trace[1162967395] 'applied index is now lower than readState.Index' (duration: 43.330657ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:39.231619Z","caller":"traceutil/trace.go:171","msg":"trace[1764784231] transaction","detail":"{read_only:false; response_revision:896; number_of_response:1; }","duration":"2.352233824s","start":"2026-02-19T06:00:36.879371Z","end":"2026-02-19T06:00:39.231604Z","steps":["trace[1764784231] 'process raft request' (duration: 2.308763903s)","trace[1764784231] 'compare' (duration: 42.661021ms)"],"step_count":2} {"level":"warn","ts":"2026-02-19T06:00:39.231724Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:36.879337Z","time spent":"2.352307506s","remote":"127.0.0.1:59774","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-19T06:00:39.23201Z","caller":"traceutil/trace.go:171","msg":"trace[59023429] transaction","detail":"{read_only:false; response_revision:897; number_of_response:1; }","duration":"2.14762183s","start":"2026-02-19T06:00:37.08438Z","end":"2026-02-19T06:00:39.232002Z","steps":["trace[59023429] 'process raft request' (duration: 2.146974785s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:39.232051Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:37.084328Z","time spent":"2.147698291s","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":672,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T06:00:39.232358Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.922222042s","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-02-19T06:00:39.232387Z","caller":"traceutil/trace.go:171","msg":"trace[210542872] range","detail":"{range_begin:/registry/horizontalpodautoscalers/; range_end:/registry/horizontalpodautoscalers0; response_count:0; response_revision:897; }","duration":"1.922306554s","start":"2026-02-19T06:00:37.310072Z","end":"2026-02-19T06:00:39.232378Z","steps":["trace[210542872] 'agreement among raft nodes before linearized reading' (duration: 1.922259053s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:39.232407Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:37.310041Z","time spent":"1.922360875s","remote":"127.0.0.1:59956","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":"warn","ts":"2026-02-19T06:00:39.232649Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.78181326s","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-02-19T06:00:39.232738Z","caller":"traceutil/trace.go:171","msg":"trace[219887204] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:897; }","duration":"1.781955173s","start":"2026-02-19T06:00:37.450755Z","end":"2026-02-19T06:00:39.232711Z","steps":["trace[219887204] 'agreement among raft nodes before linearized reading' (duration: 1.781700137s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:39.232791Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:37.450734Z","time spent":"1.782036085s","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-02-19T06:00:39.23292Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"789.33601ms","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":"warn","ts":"2026-02-19T06:00:39.232976Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.485203238s","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-02-19T06:00:39.23299Z","caller":"traceutil/trace.go:171","msg":"trace[1862668548] range","detail":"{range_begin:/registry/ingress/; range_end:/registry/ingress0; response_count:0; response_revision:897; }","duration":"789.473003ms","start":"2026-02-19T06:00:38.4435Z","end":"2026-02-19T06:00:39.232973Z","steps":["trace[1862668548] 'agreement among raft nodes before linearized reading' (duration: 789.35348ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:39.233024Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.489099338s","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-02-19T06:00:39.233044Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.40949596s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-19T06:00:39.233048Z","caller":"traceutil/trace.go:171","msg":"trace[1127454835] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:897; }","duration":"1.489133139s","start":"2026-02-19T06:00:37.743906Z","end":"2026-02-19T06:00:39.23304Z","steps":["trace[1127454835] 'agreement among raft nodes before linearized reading' (duration: 1.489063797s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:39.233043Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:38.443472Z","time spent":"789.557875ms","remote":"127.0.0.1:60012","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":"info","ts":"2026-02-19T06:00:39.233067Z","caller":"traceutil/trace.go:171","msg":"trace[698628848] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:897; }","duration":"1.409567071s","start":"2026-02-19T06:00:37.823494Z","end":"2026-02-19T06:00:39.233061Z","steps":["trace[698628848] 'agreement among raft nodes before linearized reading' (duration: 1.40952759s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:39.233093Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:37.823463Z","time spent":"1.409626213s","remote":"127.0.0.1:59730","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-02-19T06:00:39.233072Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:37.7439Z","time spent":"1.48916779s","remote":"127.0.0.1:59986","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-02-19T06:00:39.23319Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.491062854s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-19T06:00:39.233004Z","caller":"traceutil/trace.go:171","msg":"trace[329728126] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:897; }","duration":"1.485307611s","start":"2026-02-19T06:00:37.747689Z","end":"2026-02-19T06:00:39.232996Z","steps":["trace[329728126] 'agreement among raft nodes before linearized reading' (duration: 1.485193258s)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:39.233268Z","caller":"traceutil/trace.go:171","msg":"trace[468237819] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:897; }","duration":"1.491193577s","start":"2026-02-19T06:00:37.742052Z","end":"2026-02-19T06:00:39.233245Z","steps":["trace[468237819] 'agreement among raft nodes before linearized reading' (duration: 1.490932591s)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:39.233349Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:37.74203Z","time spent":"1.491303289s","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-02-19T06:00:39.233422Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:37.747648Z","time spent":"1.485754571s","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-02-19T06:00:39.233737Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"765.324682ms","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-02-19T06:00:39.233904Z","caller":"traceutil/trace.go:171","msg":"trace[1637224327] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:897; }","duration":"765.567848ms","start":"2026-02-19T06:00:38.468294Z","end":"2026-02-19T06:00:39.233862Z","steps":["trace[1637224327] 'agreement among raft nodes before linearized reading' (duration: 764.984974ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:39.233995Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:38.468271Z","time spent":"765.707692ms","remote":"127.0.0.1:59986","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":"info","ts":"2026-02-19T06:00:41.486872Z","caller":"traceutil/trace.go:171","msg":"trace[214806050] transaction","detail":"{read_only:false; response_revision:908; number_of_response:1; }","duration":"127.530364ms","start":"2026-02-19T06:00:41.359314Z","end":"2026-02-19T06:00:41.486844Z","steps":["trace[214806050] 'process raft request' (duration: 127.479323ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:41.486885Z","caller":"traceutil/trace.go:171","msg":"trace[391625241] transaction","detail":"{read_only:false; response_revision:906; number_of_response:1; }","duration":"127.643286ms","start":"2026-02-19T06:00:41.35921Z","end":"2026-02-19T06:00:41.486853Z","steps":["trace[391625241] 'process raft request' (duration: 127.38496ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:41.487077Z","caller":"traceutil/trace.go:171","msg":"trace[7934278] transaction","detail":"{read_only:false; response_revision:907; number_of_response:1; }","duration":"127.856591ms","start":"2026-02-19T06:00:41.359215Z","end":"2026-02-19T06:00:41.487072Z","steps":["trace[7934278] 'process raft request' (duration: 127.535884ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:51.375248Z","caller":"traceutil/trace.go:171","msg":"trace[144716409] transaction","detail":"{read_only:false; response_revision:931; number_of_response:1; }","duration":"117.574749ms","start":"2026-02-19T06:00:51.257636Z","end":"2026-02-19T06:00:51.375211Z","steps":["trace[144716409] 'process raft request' (duration: 117.395685ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:57.642836Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.902418ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-02-19T06:00:57.643412Z","caller":"traceutil/trace.go:171","msg":"trace[790077665] linearizableReadLoop","detail":"{readStateIndex:1007; appliedIndex:1005; }","duration":"197.335202ms","start":"2026-02-19T06:00:57.446055Z","end":"2026-02-19T06:00:57.64339Z","steps":["trace[790077665] 'read index received' (duration: 66.736137ms)","trace[790077665] 'applied index is now lower than readState.Index' (duration: 130.597555ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:57.643435Z","caller":"traceutil/trace.go:171","msg":"trace[1882545840] transaction","detail":"{read_only:false; response_revision:967; number_of_response:1; }","duration":"607.9394ms","start":"2026-02-19T06:00:57.035459Z","end":"2026-02-19T06:00:57.643399Z","steps":["trace[1882545840] 'process raft request' (duration: 477.370076ms)","trace[1882545840] 'compare' (duration: 129.569041ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:57.64351Z","caller":"traceutil/trace.go:171","msg":"trace[34310145] transaction","detail":"{read_only:false; response_revision:968; number_of_response:1; }","duration":"607.800727ms","start":"2026-02-19T06:00:57.03566Z","end":"2026-02-19T06:00:57.64346Z","steps":["trace[34310145] 'process raft request' (duration: 607.632763ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:57.643645Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:57.035427Z","time spent":"608.114274ms","remote":"127.0.0.1:59810","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":871,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-02-19T06:00:57.64375Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:57.035631Z","time spent":"607.985931ms","remote":"127.0.0.1:59774","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T06:00:57.643753Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"197.680629ms","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-02-19T06:00:57.643848Z","caller":"traceutil/trace.go:171","msg":"trace[791332044] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:968; }","duration":"197.805772ms","start":"2026-02-19T06:00:57.446015Z","end":"2026-02-19T06:00:57.64382Z","steps":["trace[791332044] 'agreement among raft nodes before linearized reading' (duration: 197.490844ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:57.813233Z","caller":"traceutil/trace.go:171","msg":"trace[1001051140] linearizableReadLoop","detail":"{readStateIndex:1012; appliedIndex:1007; }","duration":"162.635357ms","start":"2026-02-19T06:00:57.650567Z","end":"2026-02-19T06:00:57.813202Z","steps":["trace[1001051140] 'read index received' (duration: 35.318818ms)","trace[1001051140] 'applied index is now lower than readState.Index' (duration: 127.315199ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:57.813895Z","caller":"traceutil/trace.go:171","msg":"trace[82771551] transaction","detail":"{read_only:false; response_revision:973; number_of_response:1; }","duration":"163.373254ms","start":"2026-02-19T06:00:57.650478Z","end":"2026-02-19T06:00:57.813851Z","steps":["trace[82771551] 'process raft request' (duration: 162.680998ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:57.814006Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.395705ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/endpointslices/default/kubernetes\" ","response":"range_response_count:1 size:481"} {"level":"info","ts":"2026-02-19T06:00:57.814046Z","caller":"traceutil/trace.go:171","msg":"trace[2093416502] range","detail":"{range_begin:/registry/endpointslices/default/kubernetes; range_end:; response_count:1; response_revision:973; }","duration":"163.485918ms","start":"2026-02-19T06:00:57.650552Z","end":"2026-02-19T06:00:57.814038Z","steps":["trace[2093416502] 'agreement among raft nodes before linearized reading' (duration: 163.334864ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:57.813539Z","caller":"traceutil/trace.go:171","msg":"trace[878029740] transaction","detail":"{read_only:false; response_revision:971; number_of_response:1; }","duration":"164.466561ms","start":"2026-02-19T06:00:57.649033Z","end":"2026-02-19T06:00:57.813499Z","steps":["trace[878029740] 'process raft request' (duration: 164.020071ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:00:57.813799Z","caller":"traceutil/trace.go:171","msg":"trace[1036083402] transaction","detail":"{read_only:false; response_revision:970; number_of_response:1; }","duration":"164.929161ms","start":"2026-02-19T06:00:57.648837Z","end":"2026-02-19T06:00:57.813766Z","steps":["trace[1036083402] 'process raft request' (duration: 152.643273ms)","trace[1036083402] 'compare' (duration: 11.04329ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:00:57.813818Z","caller":"traceutil/trace.go:171","msg":"trace[1669803623] transaction","detail":"{read_only:false; response_revision:972; number_of_response:1; }","duration":"163.430916ms","start":"2026-02-19T06:00:57.650356Z","end":"2026-02-19T06:00:57.813787Z","steps":["trace[1669803623] 'process raft request' (duration: 162.75215ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:58.883875Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"357.547823ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-02-19T06:00:58.883973Z","caller":"traceutil/trace.go:171","msg":"trace[826432119] range","detail":"{range_begin:/registry/certificatesigningrequests/; range_end:/registry/certificatesigningrequests0; response_count:0; response_revision:979; }","duration":"357.696966ms","start":"2026-02-19T06:00:58.526249Z","end":"2026-02-19T06:00:58.883946Z","steps":["trace[826432119] 'count revisions from in-memory index tree' (duration: 357.43064ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:00:58.884035Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:58.526228Z","time spent":"357.794708ms","remote":"127.0.0.1:59980","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":1,"response size":30,"request content":"key:\"/registry/certificatesigningrequests/\" range_end:\"/registry/certificatesigningrequests0\" count_only:true "} {"level":"info","ts":"2026-02-19T06:01:00.125128Z","caller":"traceutil/trace.go:171","msg":"trace[1914978866] transaction","detail":"{read_only:false; response_revision:980; number_of_response:1; }","duration":"428.717153ms","start":"2026-02-19T06:00:59.696376Z","end":"2026-02-19T06:01:00.125094Z","steps":["trace[1914978866] 'process raft request' (duration: 428.527629ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:00.125325Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:59.696339Z","time spent":"428.878837ms","remote":"127.0.0.1:59986","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-02-19T06:01:00.161153Z","caller":"traceutil/trace.go:171","msg":"trace[843659630] linearizableReadLoop","detail":"{readStateIndex:1020; appliedIndex:1018; }","duration":"341.811593ms","start":"2026-02-19T06:00:59.81932Z","end":"2026-02-19T06:01:00.161132Z","steps":["trace[843659630] 'read index received' (duration: 305.613773ms)","trace[843659630] 'applied index is now lower than readState.Index' (duration: 36.19665ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:01:00.161415Z","caller":"traceutil/trace.go:171","msg":"trace[1824899632] transaction","detail":"{read_only:false; response_revision:981; number_of_response:1; }","duration":"432.385069ms","start":"2026-02-19T06:00:59.729018Z","end":"2026-02-19T06:01:00.161403Z","steps":["trace[1824899632] 'process raft request' (duration: 432.031971ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:00.161501Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:59.728982Z","time spent":"432.47104ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T06:01:00.161932Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"342.55163ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"warn","ts":"2026-02-19T06:01:00.161915Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"342.55694ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-19T06:01:00.161988Z","caller":"traceutil/trace.go:171","msg":"trace[1013427015] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:981; }","duration":"342.615071ms","start":"2026-02-19T06:00:59.81936Z","end":"2026-02-19T06:01:00.161975Z","steps":["trace[1013427015] 'agreement among raft nodes before linearized reading' (duration: 342.439597ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:00.162021Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:59.819357Z","time spent":"342.657272ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-02-19T06:01:00.162113Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"342.655732ms","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-02-19T06:01:00.162166Z","caller":"traceutil/trace.go:171","msg":"trace[1762480239] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:981; }","duration":"342.714764ms","start":"2026-02-19T06:00:59.819443Z","end":"2026-02-19T06:01:00.162158Z","steps":["trace[1762480239] 'agreement among raft nodes before linearized reading' (duration: 342.608831ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:00.162218Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:59.81944Z","time spent":"342.769905ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-02-19T06:01:00.162244Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"342.852527ms","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-02-19T06:01:00.162276Z","caller":"traceutil/trace.go:171","msg":"trace[761760432] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:981; }","duration":"342.889298ms","start":"2026-02-19T06:00:59.819377Z","end":"2026-02-19T06:01:00.162267Z","steps":["trace[761760432] 'agreement among raft nodes before linearized reading' (duration: 342.797236ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:00.162311Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:59.819373Z","time spent":"342.932069ms","remote":"127.0.0.1:59986","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":"info","ts":"2026-02-19T06:01:00.16201Z","caller":"traceutil/trace.go:171","msg":"trace[1275670705] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:981; }","duration":"342.711514ms","start":"2026-02-19T06:00:59.819275Z","end":"2026-02-19T06:01:00.161986Z","steps":["trace[1275670705] 'agreement among raft nodes before linearized reading' (duration: 342.418297ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:00.162409Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:59.819255Z","time spent":"343.146154ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-02-19T06:01:00.162502Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"338.154456ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-19T06:01:00.162541Z","caller":"traceutil/trace.go:171","msg":"trace[1508376783] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:981; }","duration":"338.34204ms","start":"2026-02-19T06:00:59.824188Z","end":"2026-02-19T06:01:00.16253Z","steps":["trace[1508376783] 'agreement among raft nodes before linearized reading' (duration: 338.287019ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:00.162573Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:00:59.824146Z","time spent":"338.421892ms","remote":"127.0.0.1:59730","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-02-19T06:01:00.312924Z","caller":"traceutil/trace.go:171","msg":"trace[1245357065] transaction","detail":"{read_only:false; response_revision:983; number_of_response:1; }","duration":"144.905431ms","start":"2026-02-19T06:01:00.167993Z","end":"2026-02-19T06:01:00.312898Z","steps":["trace[1245357065] 'process raft request' (duration: 144.812669ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:01:00.312924Z","caller":"traceutil/trace.go:171","msg":"trace[870033413] transaction","detail":"{read_only:false; response_revision:982; number_of_response:1; }","duration":"144.921782ms","start":"2026-02-19T06:01:00.167947Z","end":"2026-02-19T06:01:00.312869Z","steps":["trace[870033413] 'process raft request' (duration: 58.38894ms)","trace[870033413] 'compare' (duration: 86.276096ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:01:00.3133Z","caller":"traceutil/trace.go:171","msg":"trace[414488070] transaction","detail":"{read_only:false; response_revision:984; number_of_response:1; }","duration":"145.077666ms","start":"2026-02-19T06:01:00.168191Z","end":"2026-02-19T06:01:00.313269Z","steps":["trace[414488070] 'process raft request' (duration: 144.668846ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:01:00.313296Z","caller":"traceutil/trace.go:171","msg":"trace[1275333490] transaction","detail":"{read_only:false; response_revision:985; number_of_response:1; }","duration":"144.877781ms","start":"2026-02-19T06:01:00.168395Z","end":"2026-02-19T06:01:00.313273Z","steps":["trace[1275333490] 'process raft request' (duration: 144.743048ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:02.340004Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.574482ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-02-19T06:01:02.340393Z","caller":"traceutil/trace.go:171","msg":"trace[687356360] transaction","detail":"{read_only:false; response_revision:988; number_of_response:1; }","duration":"130.969994ms","start":"2026-02-19T06:01:02.20939Z","end":"2026-02-19T06:01:02.34036Z","steps":["trace[687356360] 'process raft request' (duration: 130.736669ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:01:02.713601Z","caller":"traceutil/trace.go:171","msg":"trace[1244832791] transaction","detail":"{read_only:false; response_revision:990; number_of_response:1; }","duration":"368.51321ms","start":"2026-02-19T06:01:02.345049Z","end":"2026-02-19T06:01:02.713563Z","steps":["trace[1244832791] 'process raft request' (duration: 361.341431ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:02.713888Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:01:02.345029Z","time spent":"368.710775ms","remote":"127.0.0.1:59986","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-02-19T06:01:02.713959Z","caller":"traceutil/trace.go:171","msg":"trace[1823105993] transaction","detail":"{read_only:false; response_revision:992; number_of_response:1; }","duration":"367.879155ms","start":"2026-02-19T06:01:02.346045Z","end":"2026-02-19T06:01:02.713924Z","steps":["trace[1823105993] 'process raft request' (duration: 367.716991ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:01:02.714172Z","caller":"traceutil/trace.go:171","msg":"trace[932370299] transaction","detail":"{read_only:false; response_revision:991; number_of_response:1; }","duration":"368.447328ms","start":"2026-02-19T06:01:02.3457Z","end":"2026-02-19T06:01:02.714147Z","steps":["trace[932370299] 'process raft request' (duration: 367.783252ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:02.714189Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:01:02.346003Z","time spent":"368.058599ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T06:01:02.714456Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:01:02.345688Z","time spent":"368.663754ms","remote":"127.0.0.1:59986","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-02-19T06:01:08.86321Z","caller":"traceutil/trace.go:171","msg":"trace[203072409] transaction","detail":"{read_only:false; response_revision:1012; number_of_response:1; }","duration":"491.115768ms","start":"2026-02-19T06:01:08.372063Z","end":"2026-02-19T06:01:08.863179Z","steps":["trace[203072409] 'process raft request' (duration: 490.906593ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:08.863538Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:01:08.372043Z","time spent":"491.376074ms","remote":"127.0.0.1:59986","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-02-19T06:01:08.864624Z","caller":"traceutil/trace.go:171","msg":"trace[1778284591] linearizableReadLoop","detail":"{readStateIndex:1054; appliedIndex:1052; }","duration":"477.322074ms","start":"2026-02-19T06:01:08.387272Z","end":"2026-02-19T06:01:08.864595Z","steps":["trace[1778284591] 'read index received' (duration: 475.642005ms)","trace[1778284591] 'applied index is now lower than readState.Index' (duration: 1.679249ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:01:08.864733Z","caller":"traceutil/trace.go:171","msg":"trace[872783292] transaction","detail":"{read_only:false; response_revision:1013; number_of_response:1; }","duration":"488.173208ms","start":"2026-02-19T06:01:08.376515Z","end":"2026-02-19T06:01:08.864689Z","steps":["trace[872783292] 'process raft request' (duration: 487.934303ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:08.864952Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:01:08.376483Z","time spent":"488.356323ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":458,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-19T06:01:08.86596Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"478.660716ms","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-02-19T06:01:08.866021Z","caller":"traceutil/trace.go:171","msg":"trace[1691766443] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1013; }","duration":"478.775948ms","start":"2026-02-19T06:01:08.387231Z","end":"2026-02-19T06:01:08.866007Z","steps":["trace[1691766443] 'agreement among raft nodes before linearized reading' (duration: 477.57025ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:08.866058Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:01:08.387216Z","time spent":"478.83335ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-02-19T06:01:08.866236Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.068601ms","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-02-19T06:01:08.866258Z","caller":"traceutil/trace.go:171","msg":"trace[1435805635] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1013; }","duration":"118.145173ms","start":"2026-02-19T06:01:08.748107Z","end":"2026-02-19T06:01:08.866252Z","steps":["trace[1435805635] 'agreement among raft nodes before linearized reading' (duration: 116.815633ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:08.866321Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.970299ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-19T06:01:08.866338Z","caller":"traceutil/trace.go:171","msg":"trace[1587016356] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1013; }","duration":"121.0051ms","start":"2026-02-19T06:01:08.745328Z","end":"2026-02-19T06:01:08.866333Z","steps":["trace[1587016356] 'agreement among raft nodes before linearized reading' (duration: 119.617248ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:08.868395Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.646772ms","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-02-19T06:01:08.868519Z","caller":"traceutil/trace.go:171","msg":"trace[1679822798] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1013; }","duration":"123.412087ms","start":"2026-02-19T06:01:08.745082Z","end":"2026-02-19T06:01:08.868494Z","steps":["trace[1679822798] 'agreement among raft nodes before linearized reading' (duration: 119.68193ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:01:44.765619Z","caller":"traceutil/trace.go:171","msg":"trace[1240640506] transaction","detail":"{read_only:false; response_revision:1183; number_of_response:1; }","duration":"126.441048ms","start":"2026-02-19T06:01:44.639149Z","end":"2026-02-19T06:01:44.76559Z","steps":["trace[1240640506] 'process raft request' (duration: 126.257234ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:01:47.233345Z","caller":"traceutil/trace.go:171","msg":"trace[1678685398] transaction","detail":"{read_only:false; response_revision:1194; number_of_response:1; }","duration":"105.124067ms","start":"2026-02-19T06:01:47.128187Z","end":"2026-02-19T06:01:47.233311Z","steps":["trace[1678685398] 'process raft request' (duration: 47.642818ms)","trace[1678685398] 'compare' (duration: 57.303415ms)"],"step_count":2} {"level":"info","ts":"2026-02-19T06:01:59.310284Z","caller":"traceutil/trace.go:171","msg":"trace[1193825810] transaction","detail":"{read_only:false; response_revision:1242; number_of_response:1; }","duration":"105.141089ms","start":"2026-02-19T06:01:59.205116Z","end":"2026-02-19T06:01:59.310257Z","steps":["trace[1193825810] 'process raft request' (duration: 104.964565ms)"],"step_count":1} {"level":"info","ts":"2026-02-19T06:01:59.886888Z","caller":"traceutil/trace.go:171","msg":"trace[875658987] transaction","detail":"{read_only:false; response_revision:1246; number_of_response:1; }","duration":"355.125239ms","start":"2026-02-19T06:01:59.531725Z","end":"2026-02-19T06:01:59.88685Z","steps":["trace[875658987] 'process raft request' (duration: 354.532345ms)"],"step_count":1} {"level":"warn","ts":"2026-02-19T06:01:59.887086Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-19T06:01:59.531684Z","time spent":"355.300003ms","remote":"127.0.0.1:59986","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":495,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-19T06:04:24.674275Z","caller":"traceutil/trace.go:171","msg":"trace[1490611107] transaction","detail":"{read_only:false; response_revision:1868; number_of_response:1; }","duration":"144.889842ms","start":"2026-02-19T06:04:24.529343Z","end":"2026-02-19T06:04:24.674233Z","steps":["trace[1490611107] 'process raft request' (duration: 144.639716ms)"],"step_count":1}