{"level":"warn","ts":"2026-01-28T14:58:40.195475Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-01-28T14:58:40.195785Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.5:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.5:2380","--initial-cluster=instance=https://199.19.213.5:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.5:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.5: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-01-28T14:58:40.195981Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-01-28T14:58:40.196079Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.5:2380"]}
{"level":"info","ts":"2026-01-28T14:58:40.196204Z","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-01-28T14:58:40.200014Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.5:2379"]}
{"level":"info","ts":"2026-01-28T14:58:40.200567Z","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":2,"max-cpu-available":2,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.5:2380"],"listen-peer-urls":["https://199.19.213.5:2380"],"advertise-client-urls":["https://199.19.213.5:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.5:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.5: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-01-28T14:58:40.212399Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"8.710367ms"}
{"level":"info","ts":"2026-01-28T14:58:40.237946Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"dcb0af7a3afe1d6d","cluster-id":"4564295d4e5c9a3e"}
{"level":"info","ts":"2026-01-28T14:58:40.238164Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d switched to configuration voters=()"}
{"level":"info","ts":"2026-01-28T14:58:40.238263Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d became follower at term 0"}
{"level":"info","ts":"2026-01-28T14:58:40.238341Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft dcb0af7a3afe1d6d [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-01-28T14:58:40.238384Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d became follower at term 1"}
{"level":"info","ts":"2026-01-28T14:58:40.238498Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d switched to configuration voters=(15902403223755824493)"}
{"level":"warn","ts":"2026-01-28T14:58:40.249963Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-01-28T14:58:40.252346Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-01-28T14:58:40.253948Z","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-01-28T14:58:40.261782Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"dcb0af7a3afe1d6d","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-01-28T14:58:40.265364Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"dcb0af7a3afe1d6d","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-01-28T14:58:40.26637Z","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-01-28T14:58:40.266408Z","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-01-28T14:58:40.266416Z","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-01-28T14:58:40.266832Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d switched to configuration voters=(15902403223755824493)"}
{"level":"info","ts":"2026-01-28T14:58:40.267532Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"4564295d4e5c9a3e","local-member-id":"dcb0af7a3afe1d6d","added-peer-id":"dcb0af7a3afe1d6d","added-peer-peer-urls":["https://199.19.213.5:2380"]}
{"level":"info","ts":"2026-01-28T14:58:40.282781Z","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-01-28T14:58:40.283343Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"dcb0af7a3afe1d6d","initial-advertise-peer-urls":["https://199.19.213.5:2380"],"listen-peer-urls":["https://199.19.213.5:2380"],"advertise-client-urls":["https://199.19.213.5:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.5:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-01-28T14:58:40.283124Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.5:2380"}
{"level":"info","ts":"2026-01-28T14:58:40.284301Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.5:2380"}
{"level":"info","ts":"2026-01-28T14:58:40.284465Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-01-28T14:58:40.440285Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d is starting a new election at term 1"}
{"level":"info","ts":"2026-01-28T14:58:40.440329Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d became pre-candidate at term 1"}
{"level":"info","ts":"2026-01-28T14:58:40.440377Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d received MsgPreVoteResp from dcb0af7a3afe1d6d at term 1"}
{"level":"info","ts":"2026-01-28T14:58:40.440401Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d became candidate at term 2"}
{"level":"info","ts":"2026-01-28T14:58:40.440407Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d received MsgVoteResp from dcb0af7a3afe1d6d at term 2"}
{"level":"info","ts":"2026-01-28T14:58:40.440415Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"dcb0af7a3afe1d6d became leader at term 2"}
{"level":"info","ts":"2026-01-28T14:58:40.440423Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: dcb0af7a3afe1d6d elected leader dcb0af7a3afe1d6d at term 2"}
{"level":"info","ts":"2026-01-28T14:58:40.441556Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"dcb0af7a3afe1d6d","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.5:2379]}","request-path":"/0/members/dcb0af7a3afe1d6d/attributes","cluster-id":"4564295d4e5c9a3e","publish-timeout":"7s"}
{"level":"info","ts":"2026-01-28T14:58:40.441579Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-01-28T14:58:40.441901Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-01-28T14:58:40.44199Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-01-28T14:58:40.453959Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-01-28T14:58:40.454083Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"4564295d4e5c9a3e","local-member-id":"dcb0af7a3afe1d6d","cluster-version":"3.5"}
{"level":"info","ts":"2026-01-28T14:58:40.454296Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-01-28T14:58:40.454314Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-01-28T14:58:40.472746Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-01-28T14:58:40.472768Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-01-28T14:58:40.488108Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.5:2379"}
{"level":"info","ts":"2026-01-28T14:58:57.942272Z","caller":"traceutil/trace.go:171","msg":"trace[113438724] transaction","detail":"{read_only:false; response_revision:424; number_of_response:1; }","duration":"447.230989ms","start":"2026-01-28T14:58:57.495014Z","end":"2026-01-28T14:58:57.942245Z","steps":["trace[113438724] 'process raft request'  (duration: 447.113726ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:58:57.94286Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:58:57.495004Z","time spent":"447.395152ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:414 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-01-28T14:58:58.733819Z","caller":"traceutil/trace.go:171","msg":"trace[1698117426] linearizableReadLoop","detail":"{readStateIndex:440; appliedIndex:439; }","duration":"421.804121ms","start":"2026-01-28T14:58:58.311993Z","end":"2026-01-28T14:58:58.733798Z","steps":["trace[1698117426] 'read index received'  (duration: 421.640337ms)","trace[1698117426] 'applied index is now lower than readState.Index'  (duration: 162.664µs)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:58:58.734203Z","caller":"traceutil/trace.go:171","msg":"trace[321359445] transaction","detail":"{read_only:false; response_revision:425; number_of_response:1; }","duration":"774.34529ms","start":"2026-01-28T14:58:57.959843Z","end":"2026-01-28T14:58:58.734188Z","steps":["trace[321359445] 'process raft request'  (duration: 773.846568ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:58:58.734362Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:58:57.959826Z","time spent":"774.449823ms","remote":"127.0.0.1:39882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4046,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:416 > success:<request_put:<key:\"/registry/minions/instance\" value_size:4012 >> failure:<request_range:<key:\"/registry/minions/instance\" > >"}
{"level":"warn","ts":"2026-01-28T14:58:58.734603Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"422.613609ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T14:58:58.734662Z","caller":"traceutil/trace.go:171","msg":"trace[716795263] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:425; }","duration":"422.673791ms","start":"2026-01-28T14:58:58.311975Z","end":"2026-01-28T14:58:58.734649Z","steps":["trace[716795263] 'agreement among raft nodes before linearized reading'  (duration: 422.584809ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:58:58.734693Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:58:58.311922Z","time spent":"422.764643ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-01-28T14:58:58.734874Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"421.112355ms","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-01-28T14:58:58.734963Z","caller":"traceutil/trace.go:171","msg":"trace[1161825000] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:425; }","duration":"421.209638ms","start":"2026-01-28T14:58:58.313737Z","end":"2026-01-28T14:58:58.734947Z","steps":["trace[1161825000] 'agreement among raft nodes before linearized reading'  (duration: 421.102316ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:58:58.735007Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:58:58.313731Z","time spent":"421.263769ms","remote":"127.0.0.1:39972","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-01-28T14:58:58.735284Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.490479ms","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-01-28T14:58:58.735327Z","caller":"traceutil/trace.go:171","msg":"trace[649799437] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:425; }","duration":"196.567461ms","start":"2026-01-28T14:58:58.538741Z","end":"2026-01-28T14:58:58.735308Z","steps":["trace[649799437] 'agreement among raft nodes before linearized reading'  (duration: 196.49781ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:58:58.735505Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"388.664353ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:58:58.735536Z","caller":"traceutil/trace.go:171","msg":"trace[1801490448] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:425; }","duration":"388.731604ms","start":"2026-01-28T14:58:58.346795Z","end":"2026-01-28T14:58:58.735527Z","steps":["trace[1801490448] 'agreement among raft nodes before linearized reading'  (duration: 388.684093ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:58:58.735562Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:58:58.346777Z","time spent":"388.779896ms","remote":"127.0.0.1:39682","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-01-28T14:59:00.457382Z","caller":"traceutil/trace.go:171","msg":"trace[367291636] linearizableReadLoop","detail":"{readStateIndex:446; appliedIndex:445; }","duration":"111.66429ms","start":"2026-01-28T14:59:00.345686Z","end":"2026-01-28T14:59:00.45735Z","steps":["trace[367291636] 'read index received'  (duration: 111.461325ms)","trace[367291636] 'applied index is now lower than readState.Index'  (duration: 202.185µs)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T14:59:00.45751Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.800933ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:00.457554Z","caller":"traceutil/trace.go:171","msg":"trace[1402201515] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:430; }","duration":"111.887554ms","start":"2026-01-28T14:59:00.345656Z","end":"2026-01-28T14:59:00.457543Z","steps":["trace[1402201515] 'agreement among raft nodes before linearized reading'  (duration: 111.792692ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:00.45793Z","caller":"traceutil/trace.go:171","msg":"trace[1581427850] transaction","detail":"{read_only:false; response_revision:430; number_of_response:1; }","duration":"255.440973ms","start":"2026-01-28T14:59:00.202477Z","end":"2026-01-28T14:59:00.457918Z","steps":["trace[1581427850] 'process raft request'  (duration: 254.724837ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:06.219511Z","caller":"traceutil/trace.go:171","msg":"trace[806854672] transaction","detail":"{read_only:false; response_revision:472; number_of_response:1; }","duration":"242.23209ms","start":"2026-01-28T14:59:05.977257Z","end":"2026-01-28T14:59:06.21949Z","steps":["trace[806854672] 'process raft request'  (duration: 242.096917ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:06.304074Z","caller":"traceutil/trace.go:171","msg":"trace[1887698899] transaction","detail":"{read_only:false; response_revision:473; number_of_response:1; }","duration":"320.30925ms","start":"2026-01-28T14:59:05.983748Z","end":"2026-01-28T14:59:06.304057Z","steps":["trace[1887698899] 'process raft request'  (duration: 313.440137ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:06.305035Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:05.983737Z","time spent":"321.22491ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:415 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:472 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >"}
{"level":"info","ts":"2026-01-28T14:59:14.651338Z","caller":"traceutil/trace.go:171","msg":"trace[1545171556] transaction","detail":"{read_only:false; response_revision:525; number_of_response:1; }","duration":"352.244852ms","start":"2026-01-28T14:59:14.299071Z","end":"2026-01-28T14:59:14.651316Z","steps":["trace[1545171556] 'process raft request'  (duration: 352.107728ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:14.651505Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:14.299062Z","time spent":"352.346674ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:515 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-01-28T14:59:14.953793Z","caller":"traceutil/trace.go:171","msg":"trace[1984312332] linearizableReadLoop","detail":"{readStateIndex:546; appliedIndex:545; }","duration":"140.535422ms","start":"2026-01-28T14:59:14.813239Z","end":"2026-01-28T14:59:14.953775Z","steps":["trace[1984312332] 'read index received'  (duration: 140.377829ms)","trace[1984312332] 'applied index is now lower than readState.Index'  (duration: 157.033µs)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:14.954068Z","caller":"traceutil/trace.go:171","msg":"trace[776815806] transaction","detail":"{read_only:false; response_revision:526; number_of_response:1; }","duration":"653.852295ms","start":"2026-01-28T14:59:14.300207Z","end":"2026-01-28T14:59:14.954059Z","steps":["trace[776815806] 'process raft request'  (duration: 653.463665ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:14.954142Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:14.3002Z","time spent":"653.887255ms","remote":"127.0.0.1:39882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4252,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:425 > success:<request_put:<key:\"/registry/minions/instance\" value_size:4218 >> failure:<request_range:<key:\"/registry/minions/instance\" > >"}
{"level":"warn","ts":"2026-01-28T14:59:14.954273Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.039374ms","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-01-28T14:59:14.954293Z","caller":"traceutil/trace.go:171","msg":"trace[1457219286] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:526; }","duration":"141.094896ms","start":"2026-01-28T14:59:14.813192Z","end":"2026-01-28T14:59:14.954287Z","steps":["trace[1457219286] 'agreement among raft nodes before linearized reading'  (duration: 141.055245ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:14.954418Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.558829ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T14:59:14.954443Z","caller":"traceutil/trace.go:171","msg":"trace[1142062728] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:526; }","duration":"138.621441ms","start":"2026-01-28T14:59:14.815816Z","end":"2026-01-28T14:59:14.954437Z","steps":["trace[1142062728] 'agreement among raft nodes before linearized reading'  (duration: 138.57999ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:14.954567Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.771701ms","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-01-28T14:59:14.954586Z","caller":"traceutil/trace.go:171","msg":"trace[2074513171] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:526; }","duration":"137.808402ms","start":"2026-01-28T14:59:14.816774Z","end":"2026-01-28T14:59:14.954582Z","steps":["trace[2074513171] 'agreement among raft nodes before linearized reading'  (duration: 137.776951ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:16.87952Z","caller":"traceutil/trace.go:171","msg":"trace[1499998868] transaction","detail":"{read_only:false; response_revision:530; number_of_response:1; }","duration":"222.032508ms","start":"2026-01-28T14:59:16.657465Z","end":"2026-01-28T14:59:16.879498Z","steps":["trace[1499998868] 'process raft request'  (duration: 221.942436ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:17.115936Z","caller":"traceutil/trace.go:171","msg":"trace[1518036475] linearizableReadLoop","detail":"{readStateIndex:551; appliedIndex:550; }","duration":"137.243708ms","start":"2026-01-28T14:59:16.978669Z","end":"2026-01-28T14:59:17.115913Z","steps":["trace[1518036475] 'read index received'  (duration: 132.050863ms)","trace[1518036475] 'applied index is now lower than readState.Index'  (duration: 5.191905ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:17.116197Z","caller":"traceutil/trace.go:171","msg":"trace[282164110] transaction","detail":"{read_only:false; response_revision:531; number_of_response:1; }","duration":"433.086612ms","start":"2026-01-28T14:59:16.683097Z","end":"2026-01-28T14:59:17.116183Z","steps":["trace[282164110] 'process raft request'  (duration: 427.664591ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:17.116288Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:16.683078Z","time spent":"433.148433ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:473 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:472 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >"}
{"level":"warn","ts":"2026-01-28T14:59:17.116509Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.836102ms","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-01-28T14:59:17.116539Z","caller":"traceutil/trace.go:171","msg":"trace[1868880163] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:531; }","duration":"137.887924ms","start":"2026-01-28T14:59:16.978642Z","end":"2026-01-28T14:59:17.11653Z","steps":["trace[1868880163] 'agreement among raft nodes before linearized reading'  (duration: 137.784061ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:17.116711Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.930428ms","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-01-28T14:59:17.116737Z","caller":"traceutil/trace.go:171","msg":"trace[1850689585] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:531; }","duration":"134.957928ms","start":"2026-01-28T14:59:16.981771Z","end":"2026-01-28T14:59:17.116729Z","steps":["trace[1850689585] 'agreement among raft nodes before linearized reading'  (duration: 134.883187ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:17.116944Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.99657ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T14:59:17.11697Z","caller":"traceutil/trace.go:171","msg":"trace[1564089124] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:531; }","duration":"131.04043ms","start":"2026-01-28T14:59:16.985922Z","end":"2026-01-28T14:59:17.116962Z","steps":["trace[1564089124] 'agreement among raft nodes before linearized reading'  (duration: 130.970689ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:17.242205Z","caller":"traceutil/trace.go:171","msg":"trace[527275244] transaction","detail":"{read_only:false; response_revision:534; number_of_response:1; }","duration":"116.695711ms","start":"2026-01-28T14:59:17.125489Z","end":"2026-01-28T14:59:17.242184Z","steps":["trace[527275244] 'process raft request'  (duration: 116.654ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:17.242351Z","caller":"traceutil/trace.go:171","msg":"trace[1690337389] transaction","detail":"{read_only:false; response_revision:533; number_of_response:1; }","duration":"118.692806ms","start":"2026-01-28T14:59:17.12365Z","end":"2026-01-28T14:59:17.242342Z","steps":["trace[1690337389] 'process raft request'  (duration: 118.382129ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:17.588507Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"242.089806ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:17.588572Z","caller":"traceutil/trace.go:171","msg":"trace[180085495] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:534; }","duration":"242.189828ms","start":"2026-01-28T14:59:17.346371Z","end":"2026-01-28T14:59:17.58856Z","steps":["trace[180085495] 'range keys from in-memory index tree'  (duration: 242.042865ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:23.045757Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"469.456124ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-qtgpt\" ","response":"range_response_count:1 size:16648"}
{"level":"info","ts":"2026-01-28T14:59:23.045826Z","caller":"traceutil/trace.go:171","msg":"trace[1106372121] range","detail":"{range_begin:/registry/pods/kube-system/cilium-qtgpt; range_end:; response_count:1; response_revision:545; }","duration":"469.566187ms","start":"2026-01-28T14:59:22.576233Z","end":"2026-01-28T14:59:23.045799Z","steps":["trace[1106372121] 'range keys from in-memory index tree'  (duration: 469.355531ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:23.045882Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:22.576218Z","time spent":"469.656758ms","remote":"127.0.0.1:39892","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16671,"request content":"key:\"/registry/pods/kube-system/cilium-qtgpt\" "}
{"level":"warn","ts":"2026-01-28T14:59:23.046212Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.79071ms","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-01-28T14:59:23.046239Z","caller":"traceutil/trace.go:171","msg":"trace[768100335] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:545; }","duration":"119.869912ms","start":"2026-01-28T14:59:22.926363Z","end":"2026-01-28T14:59:23.046233Z","steps":["trace[768100335] 'range keys from in-memory index tree'  (duration: 119.599695ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:23.171462Z","caller":"traceutil/trace.go:171","msg":"trace[1081614218] transaction","detail":"{read_only:false; response_revision:546; number_of_response:1; }","duration":"121.965119ms","start":"2026-01-28T14:59:23.049447Z","end":"2026-01-28T14:59:23.171412Z","steps":["trace[1081614218] 'process raft request'  (duration: 121.827846ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:23.735382Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2120522545338643106,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-01-28T14:59:24.236451Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2120522545338643106,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-01-28T14:59:24.297244Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.125943556s","expected-duration":"1s"}
{"level":"info","ts":"2026-01-28T14:59:24.297668Z","caller":"traceutil/trace.go:171","msg":"trace[1647492520] linearizableReadLoop","detail":"{readStateIndex:569; appliedIndex:567; }","duration":"1.062825518s","start":"2026-01-28T14:59:23.234823Z","end":"2026-01-28T14:59:24.297648Z","steps":["trace[1647492520] 'read index received'  (duration: 1.062541402s)","trace[1647492520] 'applied index is now lower than readState.Index'  (duration: 283.016µs)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:24.297775Z","caller":"traceutil/trace.go:171","msg":"trace[1732327112] transaction","detail":"{read_only:false; response_revision:547; number_of_response:1; }","duration":"1.235927967s","start":"2026-01-28T14:59:23.061817Z","end":"2026-01-28T14:59:24.297745Z","steps":["trace[1732327112] 'process raft request'  (duration: 1.23560014s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:24.297886Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:23.061801Z","time spent":"1.235998559s","remote":"127.0.0.1:39892","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":16795,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/cilium-qtgpt\" mod_revision:512 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-qtgpt\" value_size:16746 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-qtgpt\" > >"}
{"level":"info","ts":"2026-01-28T14:59:24.298227Z","caller":"traceutil/trace.go:171","msg":"trace[523295670] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"1.219628084s","start":"2026-01-28T14:59:23.078583Z","end":"2026-01-28T14:59:24.298211Z","steps":["trace[523295670] 'process raft request'  (duration: 1.218970129s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:24.298291Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:23.078542Z","time spent":"1.219713096s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":672,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:523 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:599 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >"}
{"level":"warn","ts":"2026-01-28T14:59:24.298491Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.063660287s","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-01-28T14:59:24.298533Z","caller":"traceutil/trace.go:171","msg":"trace[163778406] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:548; }","duration":"1.063728108s","start":"2026-01-28T14:59:23.234791Z","end":"2026-01-28T14:59:24.298519Z","steps":["trace[163778406] 'agreement among raft nodes before linearized reading'  (duration: 1.063605106s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:24.298565Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:23.234774Z","time spent":"1.063783419s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-01-28T14:59:24.298564Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.032931412s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"}
{"level":"info","ts":"2026-01-28T14:59:24.298599Z","caller":"traceutil/trace.go:171","msg":"trace[695756165] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:548; }","duration":"1.032991974s","start":"2026-01-28T14:59:23.265598Z","end":"2026-01-28T14:59:24.29859Z","steps":["trace[695756165] 'agreement among raft nodes before linearized reading'  (duration: 1.032898432s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:24.298629Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:23.265584Z","time spent":"1.033039125s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":455,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-01-28T14:59:24.298705Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"432.480309ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.5\" ","response":"range_response_count:1 size:131"}
{"level":"info","ts":"2026-01-28T14:59:24.298728Z","caller":"traceutil/trace.go:171","msg":"trace[320193119] range","detail":"{range_begin:/registry/masterleases/199.19.213.5; range_end:; response_count:1; response_revision:548; }","duration":"432.542151ms","start":"2026-01-28T14:59:23.866178Z","end":"2026-01-28T14:59:24.29872Z","steps":["trace[320193119] 'agreement among raft nodes before linearized reading'  (duration: 432.50326ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:24.29875Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:23.866156Z","time spent":"432.589261ms","remote":"127.0.0.1:39724","response type":"/etcdserverpb.KV/Range","request count":0,"request size":37,"response count":1,"response size":154,"request content":"key:\"/registry/masterleases/199.19.213.5\" "}
{"level":"warn","ts":"2026-01-28T14:59:24.298869Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"954.055154ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:24.298924Z","caller":"traceutil/trace.go:171","msg":"trace[938941890] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:548; }","duration":"954.142356ms","start":"2026-01-28T14:59:23.344773Z","end":"2026-01-28T14:59:24.298916Z","steps":["trace[938941890] 'agreement among raft nodes before linearized reading'  (duration: 954.079055ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:24.298947Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:23.344754Z","time spent":"954.187688ms","remote":"127.0.0.1:39682","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-01-28T14:59:24.299047Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.033381263s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-01-28T14:59:24.299083Z","caller":"traceutil/trace.go:171","msg":"trace[1758319694] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:548; }","duration":"1.033431923s","start":"2026-01-28T14:59:23.26564Z","end":"2026-01-28T14:59:24.299072Z","steps":["trace[1758319694] 'agreement among raft nodes before linearized reading'  (duration: 1.033334051s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:24.299139Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:23.265635Z","time spent":"1.033470414s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"info","ts":"2026-01-28T14:59:24.514654Z","caller":"traceutil/trace.go:171","msg":"trace[911827441] linearizableReadLoop","detail":"{readStateIndex:570; appliedIndex:569; }","duration":"205.541961ms","start":"2026-01-28T14:59:24.309085Z","end":"2026-01-28T14:59:24.514627Z","steps":["trace[911827441] 'read index received'  (duration: 176.662318ms)","trace[911827441] 'applied index is now lower than readState.Index'  (duration: 28.875763ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T14:59:24.514831Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.726725ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:24.514874Z","caller":"traceutil/trace.go:171","msg":"trace[720748519] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:549; }","duration":"205.801216ms","start":"2026-01-28T14:59:24.309059Z","end":"2026-01-28T14:59:24.514861Z","steps":["trace[720748519] 'agreement among raft nodes before linearized reading'  (duration: 205.662133ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:24.515266Z","caller":"traceutil/trace.go:171","msg":"trace[231067948] transaction","detail":"{read_only:false; response_revision:549; number_of_response:1; }","duration":"206.489603ms","start":"2026-01-28T14:59:24.308758Z","end":"2026-01-28T14:59:24.515248Z","steps":["trace[231067948] 'process raft request'  (duration: 177.014935ms)","trace[231067948] 'compare'  (duration: 28.475295ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:24.586774Z","caller":"traceutil/trace.go:171","msg":"trace[791717602] transaction","detail":"{read_only:false; response_revision:550; number_of_response:1; }","duration":"277.567137ms","start":"2026-01-28T14:59:24.309193Z","end":"2026-01-28T14:59:24.58676Z","steps":["trace[791717602] 'process raft request'  (duration: 277.24589ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:24.586858Z","caller":"traceutil/trace.go:171","msg":"trace[1112403735] transaction","detail":"{read_only:false; response_revision:551; number_of_response:1; }","duration":"277.613997ms","start":"2026-01-28T14:59:24.30923Z","end":"2026-01-28T14:59:24.586844Z","steps":["trace[1112403735] 'process raft request'  (duration: 277.2694ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:35.489315Z","caller":"traceutil/trace.go:171","msg":"trace[770025811] transaction","detail":"{read_only:false; response_revision:672; number_of_response:1; }","duration":"153.395489ms","start":"2026-01-28T14:59:35.335904Z","end":"2026-01-28T14:59:35.489299Z","steps":["trace[770025811] 'process raft request'  (duration: 153.294437ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:41.167458Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2120522545338643444,"retry-timeout":"500ms"}
{"level":"info","ts":"2026-01-28T14:59:41.243466Z","caller":"traceutil/trace.go:171","msg":"trace[1958461454] transaction","detail":"{read_only:false; response_revision:729; number_of_response:1; }","duration":"613.504075ms","start":"2026-01-28T14:59:40.629944Z","end":"2026-01-28T14:59:41.243448Z","steps":["trace[1958461454] 'process raft request'  (duration: 613.381222ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:41.243574Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:40.629935Z","time spent":"613.586966ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:701 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"warn","ts":"2026-01-28T14:59:42.987077Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"788.150327ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643446 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/events/kube-system/coredns-5dd5756b68-qd8vs.188eed159c78462e\" mod_revision:0 > success:<request_put:<key:\"/registry/events/kube-system/coredns-5dd5756b68-qd8vs.188eed159c78462e\" value_size:635 lease:2120522545338642110 >> failure:<>>","response":"size:16"}
{"level":"info","ts":"2026-01-28T14:59:42.987145Z","caller":"traceutil/trace.go:171","msg":"trace[1646793304] linearizableReadLoop","detail":"{readStateIndex:756; appliedIndex:755; }","duration":"2.319803156s","start":"2026-01-28T14:59:40.66733Z","end":"2026-01-28T14:59:42.987134Z","steps":["trace[1646793304] 'read index received'  (duration: 576.140481ms)","trace[1646793304] 'applied index is now lower than readState.Index'  (duration: 1.743661745s)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:42.987179Z","caller":"traceutil/trace.go:171","msg":"trace[2029559611] transaction","detail":"{read_only:false; response_revision:730; number_of_response:1; }","duration":"2.306634252s","start":"2026-01-28T14:59:40.680521Z","end":"2026-01-28T14:59:42.987155Z","steps":["trace[2029559611] 'process raft request'  (duration: 1.517267428s)","trace[2029559611] 'compare'  (duration: 787.977123ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T14:59:42.987261Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.31992742s","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-01-28T14:59:42.987277Z","caller":"traceutil/trace.go:171","msg":"trace[665944335] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:730; }","duration":"2.31997154s","start":"2026-01-28T14:59:40.6673Z","end":"2026-01-28T14:59:42.987271Z","steps":["trace[665944335] 'agreement among raft nodes before linearized reading'  (duration: 2.319887148s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:42.987271Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:40.680503Z","time spent":"2.306723415s","remote":"127.0.0.1:39778","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":723,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/events/kube-system/coredns-5dd5756b68-qd8vs.188eed159c78462e\" mod_revision:0 > success:<request_put:<key:\"/registry/events/kube-system/coredns-5dd5756b68-qd8vs.188eed159c78462e\" value_size:635 lease:2120522545338642110 >> failure:<>"}
{"level":"warn","ts":"2026-01-28T14:59:42.987294Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:40.667284Z","time spent":"2.3200058s","remote":"127.0.0.1:39972","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-01-28T14:59:42.98742Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.30698072s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/coredns-5dd5756b68-qd8vs\" ","response":"range_response_count:1 size:4822"}
{"level":"info","ts":"2026-01-28T14:59:42.987432Z","caller":"traceutil/trace.go:171","msg":"trace[2024991257] range","detail":"{range_begin:/registry/pods/kube-system/coredns-5dd5756b68-qd8vs; range_end:; response_count:1; response_revision:730; }","duration":"2.307028221s","start":"2026-01-28T14:59:40.6804Z","end":"2026-01-28T14:59:42.987428Z","steps":["trace[2024991257] 'agreement among raft nodes before linearized reading'  (duration: 2.306989551s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:42.987444Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:40.680386Z","time spent":"2.307055162s","remote":"127.0.0.1:39892","response type":"/etcdserverpb.KV/Range","request count":0,"request size":53,"response count":1,"response size":4845,"request content":"key:\"/registry/pods/kube-system/coredns-5dd5756b68-qd8vs\" "}
{"level":"warn","ts":"2026-01-28T14:59:42.987531Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.644082095s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-01-28T14:59:42.987546Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.730039051s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"info","ts":"2026-01-28T14:59:42.987561Z","caller":"traceutil/trace.go:171","msg":"trace[1887348815] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:730; }","duration":"1.730131683s","start":"2026-01-28T14:59:41.257425Z","end":"2026-01-28T14:59:42.987557Z","steps":["trace[1887348815] 'agreement among raft nodes before linearized reading'  (duration: 1.730085092s)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:42.98756Z","caller":"traceutil/trace.go:171","msg":"trace[1941531895] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:730; }","duration":"1.644129646s","start":"2026-01-28T14:59:41.34342Z","end":"2026-01-28T14:59:42.987549Z","steps":["trace[1941531895] 'agreement among raft nodes before linearized reading'  (duration: 1.644081025s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:42.987573Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:41.257408Z","time spent":"1.730161484s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-01-28T14:59:42.98758Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:41.343406Z","time spent":"1.644171007s","remote":"127.0.0.1:39684","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-01-28T14:59:42.987642Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.212864662s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T14:59:42.987654Z","caller":"traceutil/trace.go:171","msg":"trace[1580821688] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:730; }","duration":"2.212876692s","start":"2026-01-28T14:59:40.774774Z","end":"2026-01-28T14:59:42.987651Z","steps":["trace[1580821688] 'agreement among raft nodes before linearized reading'  (duration: 2.212844092s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:42.987665Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:40.77476Z","time spent":"2.212903094s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-01-28T14:59:42.987791Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"451.864582ms","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-01-28T14:59:42.987816Z","caller":"traceutil/trace.go:171","msg":"trace[1300536137] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:730; }","duration":"451.916694ms","start":"2026-01-28T14:59:42.535893Z","end":"2026-01-28T14:59:42.98781Z","steps":["trace[1300536137] 'agreement among raft nodes before linearized reading'  (duration: 451.828222ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:42.987834Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:42.535879Z","time spent":"451.951334ms","remote":"127.0.0.1:39972","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-01-28T14:59:43.639314Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"543.241478ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:43.639421Z","caller":"traceutil/trace.go:171","msg":"trace[287952657] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:731; }","duration":"543.357092ms","start":"2026-01-28T14:59:43.096051Z","end":"2026-01-28T14:59:43.639408Z","steps":["trace[287952657] 'range keys from in-memory index tree'  (duration: 543.229868ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:43.787124Z","caller":"traceutil/trace.go:171","msg":"trace[866669689] linearizableReadLoop","detail":"{readStateIndex:758; appliedIndex:757; }","duration":"789.14409ms","start":"2026-01-28T14:59:42.997962Z","end":"2026-01-28T14:59:43.787106Z","steps":["trace[866669689] 'read index received'  (duration: 75.440942ms)","trace[866669689] 'applied index is now lower than readState.Index'  (duration: 713.702498ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:43.787219Z","caller":"traceutil/trace.go:171","msg":"trace[1176924420] transaction","detail":"{read_only:false; response_revision:732; number_of_response:1; }","duration":"791.675885ms","start":"2026-01-28T14:59:42.995537Z","end":"2026-01-28T14:59:43.787213Z","steps":["trace[1176924420] 'process raft request'  (duration: 791.376358ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:43.787314Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:42.995532Z","time spent":"791.707496ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:702 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-01-28T14:59:43.787446Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"789.465387ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:43.787499Z","caller":"traceutil/trace.go:171","msg":"trace[1438477637] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:734; }","duration":"789.541778ms","start":"2026-01-28T14:59:42.997944Z","end":"2026-01-28T14:59:43.787486Z","steps":["trace[1438477637] 'agreement among raft nodes before linearized reading'  (duration: 789.455666ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:43.787525Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:42.997937Z","time spent":"789.583319ms","remote":"127.0.0.1:39682","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-01-28T14:59:43.787606Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"539.987277ms","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-01-28T14:59:43.78763Z","caller":"traceutil/trace.go:171","msg":"trace[1884476152] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:734; }","duration":"540.053648ms","start":"2026-01-28T14:59:43.24757Z","end":"2026-01-28T14:59:43.787623Z","steps":["trace[1884476152] 'agreement among raft nodes before linearized reading'  (duration: 539.967166ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:43.78765Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:43.247554Z","time spent":"540.091369ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"info","ts":"2026-01-28T14:59:43.787658Z","caller":"traceutil/trace.go:171","msg":"trace[2037552079] transaction","detail":"{read_only:false; response_revision:733; number_of_response:1; }","duration":"789.655181ms","start":"2026-01-28T14:59:42.997995Z","end":"2026-01-28T14:59:43.78765Z","steps":["trace[2037552079] 'process raft request'  (duration: 789.060248ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:43.787722Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:42.997989Z","time spent":"789.688671ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:714 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-01-28T14:59:43.787775Z","caller":"traceutil/trace.go:171","msg":"trace[487394387] transaction","detail":"{read_only:false; response_revision:734; number_of_response:1; }","duration":"783.38682ms","start":"2026-01-28T14:59:43.004383Z","end":"2026-01-28T14:59:43.787769Z","steps":["trace[487394387] 'process raft request'  (duration: 782.700335ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:43.787808Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:43.004372Z","time spent":"783.417201ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:728 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"warn","ts":"2026-01-28T14:59:46.686154Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"364.536205ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643476 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:734 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T14:59:46.686354Z","caller":"traceutil/trace.go:171","msg":"trace[2143190683] transaction","detail":"{read_only:false; response_revision:742; number_of_response:1; }","duration":"829.173201ms","start":"2026-01-28T14:59:45.857165Z","end":"2026-01-28T14:59:46.686338Z","steps":["trace[2143190683] 'process raft request'  (duration: 829.111099ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:46.686432Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:45.857149Z","time spent":"829.239763ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:733 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-01-28T14:59:46.686735Z","caller":"traceutil/trace.go:171","msg":"trace[742324775] transaction","detail":"{read_only:false; response_revision:741; number_of_response:1; }","duration":"874.871939ms","start":"2026-01-28T14:59:45.811849Z","end":"2026-01-28T14:59:46.686721Z","steps":["trace[742324775] 'process raft request'  (duration: 509.68887ms)","trace[742324775] 'compare'  (duration: 363.632955ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T14:59:46.686792Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:45.811831Z","time spent":"874.930191ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:734 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-01-28T14:59:46.686911Z","caller":"traceutil/trace.go:171","msg":"trace[281600466] linearizableReadLoop","detail":"{readStateIndex:769; appliedIndex:768; }","duration":"834.900639ms","start":"2026-01-28T14:59:45.852Z","end":"2026-01-28T14:59:46.686901Z","steps":["trace[281600466] 'read index received'  (duration: 469.544756ms)","trace[281600466] 'applied index is now lower than readState.Index'  (duration: 365.354893ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T14:59:46.687128Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"862.205277ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-01-28T14:59:46.687159Z","caller":"traceutil/trace.go:171","msg":"trace[1985208687] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:742; }","duration":"862.26931ms","start":"2026-01-28T14:59:45.824879Z","end":"2026-01-28T14:59:46.687148Z","steps":["trace[1985208687] 'agreement among raft nodes before linearized reading'  (duration: 862.164817ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:46.687188Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:45.824868Z","time spent":"862.31334ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"warn","ts":"2026-01-28T14:59:46.687318Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"343.435824ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:46.687344Z","caller":"traceutil/trace.go:171","msg":"trace[1349770628] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:742; }","duration":"343.485475ms","start":"2026-01-28T14:59:46.34385Z","end":"2026-01-28T14:59:46.687336Z","steps":["trace[1349770628] 'agreement among raft nodes before linearized reading'  (duration: 343.447484ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:46.687369Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:46.343836Z","time spent":"343.527546ms","remote":"127.0.0.1:39682","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-01-28T14:59:47.525295Z","caller":"traceutil/trace.go:171","msg":"trace[1358119485] linearizableReadLoop","detail":"{readStateIndex:772; appliedIndex:771; }","duration":"441.278815ms","start":"2026-01-28T14:59:47.084001Z","end":"2026-01-28T14:59:47.525279Z","steps":["trace[1358119485] 'read index received'  (duration: 441.185953ms)","trace[1358119485] 'applied index is now lower than readState.Index'  (duration: 92.332µs)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:47.525355Z","caller":"traceutil/trace.go:171","msg":"trace[33374558] transaction","detail":"{read_only:false; response_revision:744; number_of_response:1; }","duration":"554.920919ms","start":"2026-01-28T14:59:46.97043Z","end":"2026-01-28T14:59:47.525351Z","steps":["trace[33374558] 'process raft request'  (duration: 554.743014ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:47.525416Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:46.970409Z","time spent":"554.9588ms","remote":"127.0.0.1:39882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4767,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:664 > success:<request_put:<key:\"/registry/minions/instance\" value_size:4733 >> failure:<request_range:<key:\"/registry/minions/instance\" > >"}
{"level":"warn","ts":"2026-01-28T14:59:47.525528Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"441.527442ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"info","ts":"2026-01-28T14:59:47.525545Z","caller":"traceutil/trace.go:171","msg":"trace[1749637491] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:744; }","duration":"441.575893ms","start":"2026-01-28T14:59:47.083963Z","end":"2026-01-28T14:59:47.525539Z","steps":["trace[1749637491] 'agreement among raft nodes before linearized reading'  (duration: 441.513802ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:47.525558Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:47.083944Z","time spent":"441.611223ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-01-28T14:59:47.762242Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.212188ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643484 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:683 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:472 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T14:59:47.762363Z","caller":"traceutil/trace.go:171","msg":"trace[1869925248] linearizableReadLoop","detail":"{readStateIndex:773; appliedIndex:772; }","duration":"237.016742ms","start":"2026-01-28T14:59:47.525336Z","end":"2026-01-28T14:59:47.762352Z","steps":["trace[1869925248] 'read index received'  (duration: 90.64802ms)","trace[1869925248] 'applied index is now lower than readState.Index'  (duration: 146.368192ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:47.762364Z","caller":"traceutil/trace.go:171","msg":"trace[1352014819] transaction","detail":"{read_only:false; response_revision:745; number_of_response:1; }","duration":"381.219207ms","start":"2026-01-28T14:59:47.381129Z","end":"2026-01-28T14:59:47.762348Z","steps":["trace[1352014819] 'process raft request'  (duration: 234.846765ms)","trace[1352014819] 'compare'  (duration: 145.992563ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T14:59:47.76241Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"417.724561ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-01-28T14:59:47.762416Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:47.381106Z","time spent":"381.284529ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:683 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:472 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >"}
{"level":"info","ts":"2026-01-28T14:59:47.762426Z","caller":"traceutil/trace.go:171","msg":"trace[270668354] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:746; }","duration":"417.776161ms","start":"2026-01-28T14:59:47.344644Z","end":"2026-01-28T14:59:47.762421Z","steps":["trace[270668354] 'agreement among raft nodes before linearized reading'  (duration: 417.73743ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:47.762443Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:47.344624Z","time spent":"417.815413ms","remote":"127.0.0.1:39682","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-01-28T14:59:47.76252Z","caller":"traceutil/trace.go:171","msg":"trace[353332608] transaction","detail":"{read_only:false; response_revision:746; number_of_response:1; }","duration":"232.111094ms","start":"2026-01-28T14:59:47.530238Z","end":"2026-01-28T14:59:47.762349Z","steps":["trace[353332608] 'process raft request'  (duration: 232.076693ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:48.021071Z","caller":"traceutil/trace.go:171","msg":"trace[2014411882] transaction","detail":"{read_only:false; response_revision:747; number_of_response:1; }","duration":"160.857085ms","start":"2026-01-28T14:59:47.8602Z","end":"2026-01-28T14:59:48.021057Z","steps":["trace[2014411882] 'process raft request'  (duration: 151.159519ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:49.279072Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"580.297425ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T14:59:49.279122Z","caller":"traceutil/trace.go:171","msg":"trace[99529232] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:747; }","duration":"580.362536ms","start":"2026-01-28T14:59:48.698748Z","end":"2026-01-28T14:59:49.27911Z","steps":["trace[99529232] 'range keys from in-memory index tree'  (duration: 580.217783ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:49.279145Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:48.698746Z","time spent":"580.394747ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-01-28T14:59:49.279365Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"900.727436ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:49.27939Z","caller":"traceutil/trace.go:171","msg":"trace[804558215] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:747; }","duration":"900.780498ms","start":"2026-01-28T14:59:48.378602Z","end":"2026-01-28T14:59:49.279382Z","steps":["trace[804558215] 'count revisions from in-memory index tree'  (duration: 900.670855ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:49.27941Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:48.378586Z","time spent":"900.817409ms","remote":"127.0.0.1:39850","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":0,"response size":28,"request content":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T14:59:49.279566Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"787.635315ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T14:59:49.279585Z","caller":"traceutil/trace.go:171","msg":"trace[203019008] range","detail":"{range_begin:/registry/roles/; range_end:/registry/roles0; response_count:0; response_revision:747; }","duration":"787.679826ms","start":"2026-01-28T14:59:48.491901Z","end":"2026-01-28T14:59:49.27958Z","steps":["trace[203019008] 'count revisions from in-memory index tree'  (duration: 787.586824ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:49.279603Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:48.491886Z","time spent":"787.712547ms","remote":"127.0.0.1:40038","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":13,"response size":30,"request content":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T14:59:49.279871Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"552.676678ms","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-01-28T14:59:49.279892Z","caller":"traceutil/trace.go:171","msg":"trace[821386956] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:747; }","duration":"552.719709ms","start":"2026-01-28T14:59:48.727168Z","end":"2026-01-28T14:59:49.279887Z","steps":["trace[821386956] 'range keys from in-memory index tree'  (duration: 552.613596ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:49.279908Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:48.727155Z","time spent":"552.7505ms","remote":"127.0.0.1:39972","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-01-28T14:59:49.280002Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"581.285757ms","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-01-28T14:59:49.280019Z","caller":"traceutil/trace.go:171","msg":"trace[1796950514] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:747; }","duration":"581.325587ms","start":"2026-01-28T14:59:48.698689Z","end":"2026-01-28T14:59:49.280015Z","steps":["trace[1796950514] 'range keys from in-memory index tree'  (duration: 581.181364ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:49.280031Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:48.698677Z","time spent":"581.351078ms","remote":"127.0.0.1:39972","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-01-28T14:59:49.280172Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"306.626504ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:49.28019Z","caller":"traceutil/trace.go:171","msg":"trace[966730159] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:747; }","duration":"306.679806ms","start":"2026-01-28T14:59:48.973506Z","end":"2026-01-28T14:59:49.280186Z","steps":["trace[966730159] 'range keys from in-memory index tree'  (duration: 306.569983ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:49.280213Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T14:59:48.973488Z","time spent":"306.714466ms","remote":"127.0.0.1:39682","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-01-28T14:59:49.401148Z","caller":"traceutil/trace.go:171","msg":"trace[543040821] transaction","detail":"{read_only:false; response_revision:748; number_of_response:1; }","duration":"117.927678ms","start":"2026-01-28T14:59:49.283198Z","end":"2026-01-28T14:59:49.401126Z","steps":["trace[543040821] 'process raft request'  (duration: 117.753544ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:49.449296Z","caller":"traceutil/trace.go:171","msg":"trace[546307118] transaction","detail":"{read_only:false; response_revision:749; number_of_response:1; }","duration":"164.963387ms","start":"2026-01-28T14:59:49.284307Z","end":"2026-01-28T14:59:49.44927Z","steps":["trace[546307118] 'process raft request'  (duration: 164.486166ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:49.449352Z","caller":"traceutil/trace.go:171","msg":"trace[944495515] transaction","detail":"{read_only:false; response_revision:750; number_of_response:1; }","duration":"164.977187ms","start":"2026-01-28T14:59:49.284346Z","end":"2026-01-28T14:59:49.449323Z","steps":["trace[944495515] 'process raft request'  (duration: 164.559638ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T14:59:49.519696Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.835918ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T14:59:49.519616Z","caller":"traceutil/trace.go:171","msg":"trace[1413072936] linearizableReadLoop","detail":"{readStateIndex:779; appliedIndex:775; }","duration":"175.750636ms","start":"2026-01-28T14:59:49.343843Z","end":"2026-01-28T14:59:49.519594Z","steps":["trace[1413072936] 'read index received'  (duration: 57.169904ms)","trace[1413072936] 'applied index is now lower than readState.Index'  (duration: 118.579852ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T14:59:49.519735Z","caller":"traceutil/trace.go:171","msg":"trace[231972103] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:750; }","duration":"175.92716ms","start":"2026-01-28T14:59:49.343801Z","end":"2026-01-28T14:59:49.519728Z","steps":["trace[231972103] 'agreement among raft nodes before linearized reading'  (duration: 175.841428ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:50.127402Z","caller":"traceutil/trace.go:171","msg":"trace[1803555614] transaction","detail":"{read_only:false; response_revision:752; number_of_response:1; }","duration":"100.453869ms","start":"2026-01-28T14:59:50.026924Z","end":"2026-01-28T14:59:50.127378Z","steps":["trace[1803555614] 'process raft request'  (duration: 100.250535ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T14:59:51.919305Z","caller":"traceutil/trace.go:171","msg":"trace[321030767] transaction","detail":"{read_only:false; response_revision:761; number_of_response:1; }","duration":"124.393482ms","start":"2026-01-28T14:59:51.79489Z","end":"2026-01-28T14:59:51.919283Z","steps":["trace[321030767] 'process raft request'  (duration: 124.256909ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:03.66617Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.78499ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:03.666223Z","caller":"traceutil/trace.go:171","msg":"trace[1905225413] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:792; }","duration":"128.877103ms","start":"2026-01-28T15:00:03.537335Z","end":"2026-01-28T15:00:03.666212Z","steps":["trace[1905225413] 'range keys from in-memory index tree'  (duration: 128.668688ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:04.564765Z","caller":"traceutil/trace.go:171","msg":"trace[592451613] linearizableReadLoop","detail":"{readStateIndex:829; appliedIndex:828; }","duration":"221.132249ms","start":"2026-01-28T15:00:04.343603Z","end":"2026-01-28T15:00:04.564735Z","steps":["trace[592451613] 'read index received'  (duration: 220.988716ms)","trace[592451613] 'applied index is now lower than readState.Index'  (duration: 142.883µs)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:04.564885Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.269662ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:04.564905Z","caller":"traceutil/trace.go:171","msg":"trace[624845558] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:796; }","duration":"221.330224ms","start":"2026-01-28T15:00:04.343569Z","end":"2026-01-28T15:00:04.564899Z","steps":["trace[624845558] 'agreement among raft nodes before linearized reading'  (duration: 221.244122ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:04.565135Z","caller":"traceutil/trace.go:171","msg":"trace[475435530] transaction","detail":"{read_only:false; response_revision:796; number_of_response:1; }","duration":"383.494518ms","start":"2026-01-28T15:00:04.181634Z","end":"2026-01-28T15:00:04.565128Z","steps":["trace[475435530] 'process raft request'  (duration: 383.002727ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:04.565193Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:04.181625Z","time spent":"383.526558ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:790 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:06.227807Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"670.120976ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:06.22788Z","caller":"traceutil/trace.go:171","msg":"trace[1293081608] range","detail":"{range_begin:/registry/flowschemas/; range_end:/registry/flowschemas0; response_count:0; response_revision:799; }","duration":"670.234569ms","start":"2026-01-28T15:00:05.557627Z","end":"2026-01-28T15:00:06.227862Z","steps":["trace[1293081608] 'count revisions from in-memory index tree'  (duration: 670.063235ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:06.22789Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"258.142293ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"warn","ts":"2026-01-28T15:00:06.227936Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:05.557612Z","time spent":"670.29721ms","remote":"127.0.0.1:40134","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":13,"response size":30,"request content":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true "}
{"level":"info","ts":"2026-01-28T15:00:06.227991Z","caller":"traceutil/trace.go:171","msg":"trace[934091075] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:799; }","duration":"258.243785ms","start":"2026-01-28T15:00:05.969694Z","end":"2026-01-28T15:00:06.227938Z","steps":["trace[934091075] 'range keys from in-memory index tree'  (duration: 257.97557ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:06.228353Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"524.222944ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:06.22839Z","caller":"traceutil/trace.go:171","msg":"trace[261551470] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:799; }","duration":"524.280276ms","start":"2026-01-28T15:00:05.704098Z","end":"2026-01-28T15:00:06.228379Z","steps":["trace[261551470] 'range keys from in-memory index tree'  (duration: 524.0481ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:06.228417Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:05.704086Z","time spent":"524.324886ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"info","ts":"2026-01-28T15:00:07.792956Z","caller":"traceutil/trace.go:171","msg":"trace[91141309] linearizableReadLoop","detail":"{readStateIndex:836; appliedIndex:835; }","duration":"287.815484ms","start":"2026-01-28T15:00:07.505121Z","end":"2026-01-28T15:00:07.792936Z","steps":["trace[91141309] 'read index received'  (duration: 287.655071ms)","trace[91141309] 'applied index is now lower than readState.Index'  (duration: 159.723µs)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:07.79632Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.571536ms","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-01-28T15:00:07.796368Z","caller":"traceutil/trace.go:171","msg":"trace[1521171411] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:803; }","duration":"268.649888ms","start":"2026-01-28T15:00:07.527704Z","end":"2026-01-28T15:00:07.796354Z","steps":["trace[1521171411] 'agreement among raft nodes before linearized reading'  (duration: 268.543076ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:07.793997Z","caller":"traceutil/trace.go:171","msg":"trace[1880662716] transaction","detail":"{read_only:false; response_revision:803; number_of_response:1; }","duration":"303.377253ms","start":"2026-01-28T15:00:07.490594Z","end":"2026-01-28T15:00:07.793972Z","steps":["trace[1880662716] 'process raft request'  (duration: 302.230787ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:07.803255Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:07.490583Z","time spent":"312.530546ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:798 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:07.803512Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.3873ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:07.803541Z","caller":"traceutil/trace.go:171","msg":"trace[448459446] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:803; }","duration":"298.438322ms","start":"2026-01-28T15:00:07.505095Z","end":"2026-01-28T15:00:07.803533Z","steps":["trace[448459446] 'agreement among raft nodes before linearized reading'  (duration: 288.879749ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:08.460551Z","caller":"traceutil/trace.go:171","msg":"trace[1457682079] transaction","detail":"{read_only:false; response_revision:804; number_of_response:1; }","duration":"651.918251ms","start":"2026-01-28T15:00:07.808614Z","end":"2026-01-28T15:00:08.460532Z","steps":["trace[1457682079] 'process raft request'  (duration: 560.106184ms)","trace[1457682079] 'compare'  (duration: 91.740255ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:08.460707Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:07.808603Z","time spent":"652.050054ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:799 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:08.479181Z","caller":"traceutil/trace.go:171","msg":"trace[958497842] linearizableReadLoop","detail":"{readStateIndex:838; appliedIndex:836; }","duration":"151.670241ms","start":"2026-01-28T15:00:08.327493Z","end":"2026-01-28T15:00:08.479164Z","steps":["trace[958497842] 'read index received'  (duration: 41.178128ms)","trace[958497842] 'applied index is now lower than readState.Index'  (duration: 110.491403ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:08.47941Z","caller":"traceutil/trace.go:171","msg":"trace[523378047] transaction","detail":"{read_only:false; response_revision:805; number_of_response:1; }","duration":"363.089173ms","start":"2026-01-28T15:00:08.1163Z","end":"2026-01-28T15:00:08.479389Z","steps":["trace[523378047] 'process raft request'  (duration: 362.772156ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:08.479553Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:08.116283Z","time spent":"363.174184ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":520,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:778 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:471 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:08.479839Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.845292ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:08.479868Z","caller":"traceutil/trace.go:171","msg":"trace[1827298581] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:805; }","duration":"150.890574ms","start":"2026-01-28T15:00:08.32897Z","end":"2026-01-28T15:00:08.479861Z","steps":["trace[1827298581] 'agreement among raft nodes before linearized reading'  (duration: 150.785772ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:08.479959Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"152.346426ms","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-01-28T15:00:08.480068Z","caller":"traceutil/trace.go:171","msg":"trace[836959231] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:805; }","duration":"152.596032ms","start":"2026-01-28T15:00:08.327453Z","end":"2026-01-28T15:00:08.480049Z","steps":["trace[836959231] 'agreement among raft nodes before linearized reading'  (duration: 151.966967ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:09.407921Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"336.98512ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643674 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:800 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:09.409289Z","caller":"traceutil/trace.go:171","msg":"trace[344425502] transaction","detail":"{read_only:false; response_revision:806; number_of_response:1; }","duration":"926.06859ms","start":"2026-01-28T15:00:08.483197Z","end":"2026-01-28T15:00:09.409266Z","steps":["trace[344425502] 'process raft request'  (duration: 587.668539ms)","trace[344425502] 'compare'  (duration: 336.884568ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:09.409499Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:08.483184Z","time spent":"926.156292ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:800 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:10.766996Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.060414155s","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643675 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:801 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:10.768974Z","caller":"traceutil/trace.go:171","msg":"trace[1374649151] transaction","detail":"{read_only:false; response_revision:807; number_of_response:1; }","duration":"2.28451339s","start":"2026-01-28T15:00:08.484431Z","end":"2026-01-28T15:00:10.768945Z","steps":["trace[1374649151] 'process raft request'  (duration: 1.222092619s)","trace[1374649151] 'compare'  (duration: 1.060294193s)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:10.769207Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:08.484423Z","time spent":"2.284708994s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:801 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:10.76992Z","caller":"traceutil/trace.go:171","msg":"trace[685866616] linearizableReadLoop","detail":"{readStateIndex:840; appliedIndex:838; }","duration":"2.194914662s","start":"2026-01-28T15:00:08.574993Z","end":"2026-01-28T15:00:10.769907Z","steps":["trace[685866616] 'read index received'  (duration: 495.809701ms)","trace[685866616] 'applied index is now lower than readState.Index'  (duration: 1.699103361s)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:10.956695Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.619527ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643676 > lease_revoke:<id:1d6d9c051d1df464>","response":"size:28"}
{"level":"info","ts":"2026-01-28T15:00:10.956782Z","caller":"traceutil/trace.go:171","msg":"trace[1923139485] linearizableReadLoop","detail":"{readStateIndex:841; appliedIndex:840; }","duration":"185.352091ms","start":"2026-01-28T15:00:10.771417Z","end":"2026-01-28T15:00:10.956769Z","steps":["trace[1923139485] 'read index received'  (duration: 37.231µs)","trace[1923139485] 'applied index is now lower than readState.Index'  (duration: 185.31384ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:10.9569Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.377395699s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:10.956917Z","caller":"traceutil/trace.go:171","msg":"trace[2071710334] range","detail":"{range_begin:/registry/clusterroles/; range_end:/registry/clusterroles0; response_count:0; response_revision:807; }","duration":"2.377441821s","start":"2026-01-28T15:00:08.579469Z","end":"2026-01-28T15:00:10.956911Z","steps":["trace[2071710334] 'agreement among raft nodes before linearized reading'  (duration: 2.377331919s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:10.956938Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:08.579459Z","time spent":"2.377473601s","remote":"127.0.0.1:40056","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":66,"response size":30,"request content":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:10.957261Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.382270488s","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-01-28T15:00:10.957279Z","caller":"traceutil/trace.go:171","msg":"trace[636493810] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:807; }","duration":"2.382326209s","start":"2026-01-28T15:00:08.574947Z","end":"2026-01-28T15:00:10.957273Z","steps":["trace[636493810] 'agreement among raft nodes before linearized reading'  (duration: 2.196497437s)","trace[636493810] 'range keys from in-memory index tree'  (duration: 185.752819ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:10.957294Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:08.574925Z","time spent":"2.382365269s","remote":"127.0.0.1:39972","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-01-28T15:00:10.95749Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"492.520058ms","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-01-28T15:00:10.957506Z","caller":"traceutil/trace.go:171","msg":"trace[87423064] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:807; }","duration":"492.561689ms","start":"2026-01-28T15:00:10.46494Z","end":"2026-01-28T15:00:10.957501Z","steps":["trace[87423064] 'agreement among raft nodes before linearized reading'  (duration: 492.510848ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:10.957519Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:10.464923Z","time spent":"492.592799ms","remote":"127.0.0.1:39972","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-01-28T15:00:10.957599Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"842.319195ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/\" range_end:\"/registry/deployments0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:10.957614Z","caller":"traceutil/trace.go:171","msg":"trace[1479582537] range","detail":"{range_begin:/registry/deployments/; range_end:/registry/deployments0; response_count:0; response_revision:807; }","duration":"842.334245ms","start":"2026-01-28T15:00:10.115274Z","end":"2026-01-28T15:00:10.957608Z","steps":["trace[1479582537] 'agreement among raft nodes before linearized reading'  (duration: 842.310275ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:10.957627Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:10.115211Z","time spent":"842.412347ms","remote":"127.0.0.1:40148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":2,"response size":30,"request content":"key:\"/registry/deployments/\" range_end:\"/registry/deployments0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:10.957724Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.149715526s","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-01-28T15:00:10.957737Z","caller":"traceutil/trace.go:171","msg":"trace[1146957686] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:807; }","duration":"1.149762566s","start":"2026-01-28T15:00:09.80797Z","end":"2026-01-28T15:00:10.957733Z","steps":["trace[1146957686] 'agreement among raft nodes before linearized reading'  (duration: 1.149720775s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:10.95775Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:09.807952Z","time spent":"1.149795087s","remote":"127.0.0.1:39972","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-01-28T15:00:10.957815Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.610350243s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:10.957828Z","caller":"traceutil/trace.go:171","msg":"trace[973115569] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:807; }","duration":"1.610386703s","start":"2026-01-28T15:00:09.347438Z","end":"2026-01-28T15:00:10.957824Z","steps":["trace[973115569] 'agreement among raft nodes before linearized reading'  (duration: 1.610362852s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:10.95784Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:09.347424Z","time spent":"1.610413784s","remote":"127.0.0.1:39684","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-01-28T15:00:10.959021Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.888197895s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:10.959049Z","caller":"traceutil/trace.go:171","msg":"trace[116791881] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:807; }","duration":"1.888253157s","start":"2026-01-28T15:00:09.070789Z","end":"2026-01-28T15:00:10.959042Z","steps":["trace[116791881] 'agreement among raft nodes before linearized reading'  (duration: 1.888208866s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:10.959064Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:09.070773Z","time spent":"1.888287657s","remote":"127.0.0.1:39682","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-01-28T15:00:11.119088Z","caller":"traceutil/trace.go:171","msg":"trace[1042860691] transaction","detail":"{read_only:false; response_revision:808; number_of_response:1; }","duration":"147.882276ms","start":"2026-01-28T15:00:10.971188Z","end":"2026-01-28T15:00:11.119071Z","steps":["trace[1042860691] 'process raft request'  (duration: 147.737163ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:11.154103Z","caller":"traceutil/trace.go:171","msg":"trace[926430325] transaction","detail":"{read_only:false; response_revision:809; number_of_response:1; }","duration":"182.848185ms","start":"2026-01-28T15:00:10.971238Z","end":"2026-01-28T15:00:11.154086Z","steps":["trace[926430325] 'process raft request'  (duration: 182.708492ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:11.154349Z","caller":"traceutil/trace.go:171","msg":"trace[582666793] transaction","detail":"{read_only:false; response_revision:810; number_of_response:1; }","duration":"183.026089ms","start":"2026-01-28T15:00:10.971312Z","end":"2026-01-28T15:00:11.154338Z","steps":["trace[582666793] 'process raft request'  (duration: 182.748043ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:11.67639Z","caller":"traceutil/trace.go:171","msg":"trace[1870762472] transaction","detail":"{read_only:false; response_revision:811; number_of_response:1; }","duration":"228.007403ms","start":"2026-01-28T15:00:11.448357Z","end":"2026-01-28T15:00:11.676364Z","steps":["trace[1870762472] 'process raft request'  (duration: 227.840399ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:23.544149Z","caller":"traceutil/trace.go:171","msg":"trace[435614028] linearizableReadLoop","detail":"{readStateIndex:929; appliedIndex:928; }","duration":"282.891925ms","start":"2026-01-28T15:00:23.261241Z","end":"2026-01-28T15:00:23.544133Z","steps":["trace[435614028] 'read index received'  (duration: 282.697951ms)","trace[435614028] 'applied index is now lower than readState.Index'  (duration: 193.364µs)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:23.544377Z","caller":"traceutil/trace.go:171","msg":"trace[946279744] transaction","detail":"{read_only:false; response_revision:892; number_of_response:1; }","duration":"349.229004ms","start":"2026-01-28T15:00:23.195141Z","end":"2026-01-28T15:00:23.54437Z","steps":["trace[946279744] 'process raft request'  (duration: 348.858716ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:23.544463Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:23.195132Z","time spent":"349.261645ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:887 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:370 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:23.544638Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"283.395586ms","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-01-28T15:00:23.544657Z","caller":"traceutil/trace.go:171","msg":"trace[551602079] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:892; }","duration":"283.448468ms","start":"2026-01-28T15:00:23.261203Z","end":"2026-01-28T15:00:23.544651Z","steps":["trace[551602079] 'agreement among raft nodes before linearized reading'  (duration: 283.362176ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:23.544771Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.814942ms","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-01-28T15:00:23.544784Z","caller":"traceutil/trace.go:171","msg":"trace[1156886436] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:892; }","duration":"229.829782ms","start":"2026-01-28T15:00:23.314951Z","end":"2026-01-28T15:00:23.544781Z","steps":["trace[1156886436] 'agreement among raft nodes before linearized reading'  (duration: 229.776651ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:23.544904Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.788778ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:23.544917Z","caller":"traceutil/trace.go:171","msg":"trace[1266257925] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:892; }","duration":"201.837288ms","start":"2026-01-28T15:00:23.343075Z","end":"2026-01-28T15:00:23.544913Z","steps":["trace[1266257925] 'agreement among raft nodes before linearized reading'  (duration: 201.801768ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:25.078989Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.012408165s","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643867 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:889 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:25.079113Z","caller":"traceutil/trace.go:171","msg":"trace[747129714] linearizableReadLoop","detail":"{readStateIndex:931; appliedIndex:929; }","duration":"1.359944561s","start":"2026-01-28T15:00:23.719157Z","end":"2026-01-28T15:00:25.079101Z","steps":["trace[747129714] 'read index received'  (duration: 347.370262ms)","trace[747129714] 'applied index is now lower than readState.Index'  (duration: 1.012573659s)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:25.07928Z","caller":"traceutil/trace.go:171","msg":"trace[1828785928] transaction","detail":"{read_only:false; response_revision:893; number_of_response:1; }","duration":"1.521721957s","start":"2026-01-28T15:00:23.55755Z","end":"2026-01-28T15:00:25.079272Z","steps":["trace[1828785928] 'process raft request'  (duration: 508.966344ms)","trace[1828785928] 'compare'  (duration: 1.012270942s)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:25.079323Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:23.557538Z","time spent":"1.521761638s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:889 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:25.079474Z","caller":"traceutil/trace.go:171","msg":"trace[1481098484] transaction","detail":"{read_only:false; response_revision:894; number_of_response:1; }","duration":"1.519730313s","start":"2026-01-28T15:00:23.559737Z","end":"2026-01-28T15:00:25.079467Z","steps":["trace[1481098484] 'process raft request'  (duration: 1.519332504s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:25.07951Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:23.559721Z","time spent":"1.519769053s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:888 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:25.07964Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.360481443s","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-01-28T15:00:25.079667Z","caller":"traceutil/trace.go:171","msg":"trace[238613129] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:894; }","duration":"1.360520874s","start":"2026-01-28T15:00:23.719132Z","end":"2026-01-28T15:00:25.079653Z","steps":["trace[238613129] 'agreement among raft nodes before linearized reading'  (duration: 1.360449802s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:25.079685Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:23.719119Z","time spent":"1.360562125s","remote":"127.0.0.1:39972","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-01-28T15:00:25.07978Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.249594192s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/\" range_end:\"/registry/minions0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:25.079797Z","caller":"traceutil/trace.go:171","msg":"trace[1397159243] range","detail":"{range_begin:/registry/minions/; range_end:/registry/minions0; response_count:0; response_revision:894; }","duration":"1.249634793s","start":"2026-01-28T15:00:23.830158Z","end":"2026-01-28T15:00:25.079792Z","steps":["trace[1397159243] 'agreement among raft nodes before linearized reading'  (duration: 1.249606892s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:25.079814Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:23.830144Z","time spent":"1.249666093s","remote":"127.0.0.1:39882","response type":"/etcdserverpb.KV/Range","request count":0,"request size":42,"response count":1,"response size":30,"request content":"key:\"/registry/minions/\" range_end:\"/registry/minions0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:25.080238Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"264.343702ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:25.080261Z","caller":"traceutil/trace.go:171","msg":"trace[1522133595] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:894; }","duration":"264.413663ms","start":"2026-01-28T15:00:24.815841Z","end":"2026-01-28T15:00:25.080255Z","steps":["trace[1522133595] 'agreement among raft nodes before linearized reading'  (duration: 264.344232ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:25.080389Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.210660094s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.5\" ","response":"range_response_count:1 size:131"}
{"level":"info","ts":"2026-01-28T15:00:25.080416Z","caller":"traceutil/trace.go:171","msg":"trace[797034630] range","detail":"{range_begin:/registry/masterleases/199.19.213.5; range_end:; response_count:1; response_revision:894; }","duration":"1.210712796s","start":"2026-01-28T15:00:23.869696Z","end":"2026-01-28T15:00:25.080409Z","steps":["trace[797034630] 'agreement among raft nodes before linearized reading'  (duration: 1.210634174s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:25.080436Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:23.869681Z","time spent":"1.210750346s","remote":"127.0.0.1:39724","response type":"/etcdserverpb.KV/Range","request count":0,"request size":37,"response count":1,"response size":154,"request content":"key:\"/registry/masterleases/199.19.213.5\" "}
{"level":"warn","ts":"2026-01-28T15:00:25.744772Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.082375Z","time spent":"662.392584ms","remote":"127.0.0.1:39724","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""}
{"level":"info","ts":"2026-01-28T15:00:26.089394Z","caller":"traceutil/trace.go:171","msg":"trace[1389038672] linearizableReadLoop","detail":"{readStateIndex:934; appliedIndex:931; }","duration":"820.756254ms","start":"2026-01-28T15:00:25.268615Z","end":"2026-01-28T15:00:26.089371Z","steps":["trace[1389038672] 'read index received'  (duration: 396.685361ms)","trace[1389038672] 'applied index is now lower than readState.Index'  (duration: 424.070113ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:26.089489Z","caller":"traceutil/trace.go:171","msg":"trace[1490569447] transaction","detail":"{read_only:false; response_revision:896; number_of_response:1; }","duration":"1.004748265s","start":"2026-01-28T15:00:25.084731Z","end":"2026-01-28T15:00:26.089479Z","steps":["trace[1490569447] 'process raft request'  (duration: 1.004603522s)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:26.089494Z","caller":"traceutil/trace.go:171","msg":"trace[2078849267] transaction","detail":"{read_only:false; response_revision:895; number_of_response:1; }","duration":"1.004801176s","start":"2026-01-28T15:00:25.084679Z","end":"2026-01-28T15:00:26.08948Z","steps":["trace[2078849267] 'process raft request'  (duration: 1.004492049s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:26.08961Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.084724Z","time spent":"1.004791816s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:891 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:26.08976Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"821.115972ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/daemonsets/\" range_end:\"/registry/daemonsets0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:26.089793Z","caller":"traceutil/trace.go:171","msg":"trace[1824016864] range","detail":"{range_begin:/registry/daemonsets/; range_end:/registry/daemonsets0; response_count:0; response_revision:896; }","duration":"821.175673ms","start":"2026-01-28T15:00:25.268607Z","end":"2026-01-28T15:00:26.089782Z","steps":["trace[1824016864] 'agreement among raft nodes before linearized reading'  (duration: 821.095541ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:26.089823Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.268591Z","time spent":"821.222284ms","remote":"127.0.0.1:40170","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":3,"response size":30,"request content":"key:\"/registry/daemonsets/\" range_end:\"/registry/daemonsets0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:26.090023Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.084667Z","time spent":"1.004868117s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:890 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:26.111109Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"766.613906ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:26.111177Z","caller":"traceutil/trace.go:171","msg":"trace[522124481] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:898; }","duration":"766.705039ms","start":"2026-01-28T15:00:25.344448Z","end":"2026-01-28T15:00:26.111153Z","steps":["trace[522124481] 'agreement among raft nodes before linearized reading'  (duration: 766.545765ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:26.111208Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.344435Z","time spent":"766.76517ms","remote":"127.0.0.1:39682","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-01-28T15:00:26.1115Z","caller":"traceutil/trace.go:171","msg":"trace[739226310] transaction","detail":"{read_only:false; response_revision:897; number_of_response:1; }","duration":"383.020517ms","start":"2026-01-28T15:00:25.72847Z","end":"2026-01-28T15:00:26.11149Z","steps":["trace[739226310] 'process raft request'  (duration: 382.392282ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:26.111561Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.728454Z","time spent":"383.064309ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:822 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:600 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >"}
{"level":"info","ts":"2026-01-28T15:00:26.111654Z","caller":"traceutil/trace.go:171","msg":"trace[966427887] transaction","detail":"{read_only:false; response_revision:898; number_of_response:1; }","duration":"365.835824ms","start":"2026-01-28T15:00:25.745811Z","end":"2026-01-28T15:00:26.111647Z","steps":["trace[966427887] 'process raft request'  (duration: 365.142568ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:26.111691Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.745798Z","time spent":"365.872115ms","remote":"127.0.0.1:39724","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":116,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/masterleases/199.19.213.5\" mod_revision:817 > success:<request_put:<key:\"/registry/masterleases/199.19.213.5\" value_size:65 lease:2120522545338643871 >> failure:<request_range:<key:\"/registry/masterleases/199.19.213.5\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:26.111843Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"502.655225ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:26.111862Z","caller":"traceutil/trace.go:171","msg":"trace[982371884] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:898; }","duration":"502.706885ms","start":"2026-01-28T15:00:25.609149Z","end":"2026-01-28T15:00:26.111856Z","steps":["trace[982371884] 'agreement among raft nodes before linearized reading'  (duration: 502.621423ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:26.111881Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.609132Z","time spent":"502.743766ms","remote":"127.0.0.1:39778","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":109,"response size":30,"request content":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:26.112019Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"550.767326ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-01-28T15:00:26.112041Z","caller":"traceutil/trace.go:171","msg":"trace[1682605798] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:898; }","duration":"550.804008ms","start":"2026-01-28T15:00:25.561229Z","end":"2026-01-28T15:00:26.112033Z","steps":["trace[1682605798] 'agreement among raft nodes before linearized reading'  (duration: 550.738026ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:26.112059Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:25.561217Z","time spent":"550.837558ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"info","ts":"2026-01-28T15:00:26.258178Z","caller":"traceutil/trace.go:171","msg":"trace[651609558] transaction","detail":"{read_only:false; response_revision:899; number_of_response:1; }","duration":"124.768522ms","start":"2026-01-28T15:00:26.133391Z","end":"2026-01-28T15:00:26.258159Z","steps":["trace[651609558] 'process raft request'  (duration: 102.960835ms)","trace[651609558] 'compare'  (duration: 21.727905ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:28.248874Z","caller":"traceutil/trace.go:171","msg":"trace[1970444639] transaction","detail":"{read_only:false; response_revision:902; number_of_response:1; }","duration":"153.663894ms","start":"2026-01-28T15:00:28.095201Z","end":"2026-01-28T15:00:28.248865Z","steps":["trace[1970444639] 'process raft request'  (duration: 153.350168ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:28.248674Z","caller":"traceutil/trace.go:171","msg":"trace[1953595956] linearizableReadLoop","detail":"{readStateIndex:940; appliedIndex:939; }","duration":"152.761875ms","start":"2026-01-28T15:00:28.095897Z","end":"2026-01-28T15:00:28.248658Z","steps":["trace[1953595956] 'read index received'  (duration: 152.600821ms)","trace[1953595956] 'applied index is now lower than readState.Index'  (duration: 160.344µs)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:28.249144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.232386ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:28.249161Z","caller":"traceutil/trace.go:171","msg":"trace[1203507593] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:902; }","duration":"153.270657ms","start":"2026-01-28T15:00:28.095885Z","end":"2026-01-28T15:00:28.249156Z","steps":["trace[1203507593] 'agreement among raft nodes before linearized reading'  (duration: 153.177775ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:32.544774Z","caller":"traceutil/trace.go:171","msg":"trace[2010338369] transaction","detail":"{read_only:false; response_revision:913; number_of_response:1; }","duration":"232.358889ms","start":"2026-01-28T15:00:32.312396Z","end":"2026-01-28T15:00:32.544755Z","steps":["trace[2010338369] 'process raft request'  (duration: 232.231606ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:32.545186Z","caller":"traceutil/trace.go:171","msg":"trace[1758342652] linearizableReadLoop","detail":"{readStateIndex:952; appliedIndex:952; }","duration":"231.278494ms","start":"2026-01-28T15:00:32.313897Z","end":"2026-01-28T15:00:32.545176Z","steps":["trace[1758342652] 'read index received'  (duration: 231.275784ms)","trace[1758342652] 'applied index is now lower than readState.Index'  (duration: 2.21µs)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:32.545318Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.13063ms","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-01-28T15:00:32.545346Z","caller":"traceutil/trace.go:171","msg":"trace[1605999722] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:913; }","duration":"226.180022ms","start":"2026-01-28T15:00:32.319158Z","end":"2026-01-28T15:00:32.545338Z","steps":["trace[1605999722] 'agreement among raft nodes before linearized reading'  (duration: 226.0724ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:32.545572Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"231.667713ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:32.545607Z","caller":"traceutil/trace.go:171","msg":"trace[623933726] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:913; }","duration":"231.716334ms","start":"2026-01-28T15:00:32.313882Z","end":"2026-01-28T15:00:32.545598Z","steps":["trace[623933726] 'agreement among raft nodes before linearized reading'  (duration: 231.56816ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:32.545713Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"197.332488ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:32.545745Z","caller":"traceutil/trace.go:171","msg":"trace[1677594448] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:913; }","duration":"197.38146ms","start":"2026-01-28T15:00:32.348348Z","end":"2026-01-28T15:00:32.54573Z","steps":["trace[1677594448] 'agreement among raft nodes before linearized reading'  (duration: 197.349499ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:32.749253Z","caller":"traceutil/trace.go:171","msg":"trace[517145667] transaction","detail":"{read_only:false; response_revision:914; number_of_response:1; }","duration":"192.669745ms","start":"2026-01-28T15:00:32.55656Z","end":"2026-01-28T15:00:32.74923Z","steps":["trace[517145667] 'process raft request'  (duration: 192.502681ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:32.758202Z","caller":"traceutil/trace.go:171","msg":"trace[1667787025] transaction","detail":"{read_only:false; response_revision:915; number_of_response:1; }","duration":"198.989075ms","start":"2026-01-28T15:00:32.559199Z","end":"2026-01-28T15:00:32.758188Z","steps":["trace[1667787025] 'process raft request'  (duration: 198.913743ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:33.456415Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"281.445862ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"}
{"level":"info","ts":"2026-01-28T15:00:33.456481Z","caller":"traceutil/trace.go:171","msg":"trace[436681372] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:915; }","duration":"281.547554ms","start":"2026-01-28T15:00:33.174912Z","end":"2026-01-28T15:00:33.45646Z","steps":["trace[436681372] 'range keys from in-memory index tree'  (duration: 281.312589ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:33.456722Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"312.832463ms","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-01-28T15:00:33.456772Z","caller":"traceutil/trace.go:171","msg":"trace[31383786] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:915; }","duration":"312.891324ms","start":"2026-01-28T15:00:33.143869Z","end":"2026-01-28T15:00:33.45676Z","steps":["trace[31383786] 'range keys from in-memory index tree'  (duration: 312.71551ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:33.456795Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:33.143824Z","time spent":"312.966065ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-01-28T15:00:33.4568Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"360.124048ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:33.456854Z","caller":"traceutil/trace.go:171","msg":"trace[802603025] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:915; }","duration":"360.175609ms","start":"2026-01-28T15:00:33.096668Z","end":"2026-01-28T15:00:33.456843Z","steps":["trace[802603025] 'range keys from in-memory index tree'  (duration: 360.117787ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:33.68221Z","caller":"traceutil/trace.go:171","msg":"trace[1296592693] transaction","detail":"{read_only:false; response_revision:916; number_of_response:1; }","duration":"221.102998ms","start":"2026-01-28T15:00:33.46092Z","end":"2026-01-28T15:00:33.682023Z","steps":["trace[1296592693] 'process raft request'  (duration: 221.008536ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:34.229073Z","caller":"traceutil/trace.go:171","msg":"trace[76254869] linearizableReadLoop","detail":"{readStateIndex:956; appliedIndex:955; }","duration":"358.316727ms","start":"2026-01-28T15:00:33.870739Z","end":"2026-01-28T15:00:34.229056Z","steps":["trace[76254869] 'read index received'  (duration: 300.207781ms)","trace[76254869] 'applied index is now lower than readState.Index'  (duration: 58.108126ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:34.229239Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"358.486311ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.5\" ","response":"range_response_count:1 size:131"}
{"level":"info","ts":"2026-01-28T15:00:34.229261Z","caller":"traceutil/trace.go:171","msg":"trace[1736601328] range","detail":"{range_begin:/registry/masterleases/199.19.213.5; range_end:; response_count:1; response_revision:917; }","duration":"358.542612ms","start":"2026-01-28T15:00:33.870711Z","end":"2026-01-28T15:00:34.229254Z","steps":["trace[1736601328] 'agreement among raft nodes before linearized reading'  (duration: 358.405899ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:34.229315Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:33.870699Z","time spent":"358.578373ms","remote":"127.0.0.1:39724","response type":"/etcdserverpb.KV/Range","request count":0,"request size":37,"response count":1,"response size":154,"request content":"key:\"/registry/masterleases/199.19.213.5\" "}
{"level":"info","ts":"2026-01-28T15:00:34.229502Z","caller":"traceutil/trace.go:171","msg":"trace[425589104] transaction","detail":"{read_only:false; response_revision:917; number_of_response:1; }","duration":"768.426068ms","start":"2026-01-28T15:00:33.461066Z","end":"2026-01-28T15:00:34.229493Z","steps":["trace[425589104] 'process raft request'  (duration: 709.903674ms)","trace[425589104] 'compare'  (duration: 57.815358ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:34.229558Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:33.46106Z","time spent":"768.460848ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:911 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:34.61058Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"266.146282ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:34.610629Z","caller":"traceutil/trace.go:171","msg":"trace[747929907] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:918; }","duration":"266.229864ms","start":"2026-01-28T15:00:34.344388Z","end":"2026-01-28T15:00:34.610617Z","steps":["trace[747929907] 'range keys from in-memory index tree'  (duration: 266.060911ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:34.822363Z","caller":"traceutil/trace.go:171","msg":"trace[782242528] transaction","detail":"{read_only:false; response_revision:919; number_of_response:1; }","duration":"208.979928ms","start":"2026-01-28T15:00:34.613369Z","end":"2026-01-28T15:00:34.822349Z","steps":["trace[782242528] 'process raft request'  (duration: 208.716182ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:34.952698Z","caller":"traceutil/trace.go:171","msg":"trace[879948823] transaction","detail":"{read_only:false; response_revision:921; number_of_response:1; }","duration":"126.162502ms","start":"2026-01-28T15:00:34.82652Z","end":"2026-01-28T15:00:34.952683Z","steps":["trace[879948823] 'process raft request'  (duration: 126.131221ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:34.952831Z","caller":"traceutil/trace.go:171","msg":"trace[34621033] transaction","detail":"{read_only:false; response_revision:920; number_of_response:1; }","duration":"126.465109ms","start":"2026-01-28T15:00:34.826349Z","end":"2026-01-28T15:00:34.952814Z","steps":["trace[34621033] 'process raft request'  (duration: 124.474814ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:36.268236Z","caller":"traceutil/trace.go:171","msg":"trace[2057432258] transaction","detail":"{read_only:false; response_revision:922; number_of_response:1; }","duration":"581.201944ms","start":"2026-01-28T15:00:35.687012Z","end":"2026-01-28T15:00:36.268214Z","steps":["trace[2057432258] 'process raft request'  (duration: 580.935228ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:36.268331Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:35.687004Z","time spent":"581.273065ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:916 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:36.843512Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2120522545338643951,"retry-timeout":"500ms"}
{"level":"info","ts":"2026-01-28T15:00:37.210423Z","caller":"traceutil/trace.go:171","msg":"trace[1446495471] linearizableReadLoop","detail":"{readStateIndex:964; appliedIndex:962; }","duration":"867.057645ms","start":"2026-01-28T15:00:36.34335Z","end":"2026-01-28T15:00:37.210408Z","steps":["trace[1446495471] 'read index received'  (duration: 789.887726ms)","trace[1446495471] 'applied index is now lower than readState.Index'  (duration: 77.169299ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:37.210502Z","caller":"traceutil/trace.go:171","msg":"trace[85222815] transaction","detail":"{read_only:false; response_revision:924; number_of_response:1; }","duration":"775.186188ms","start":"2026-01-28T15:00:36.43531Z","end":"2026-01-28T15:00:37.210496Z","steps":["trace[85222815] 'process raft request'  (duration: 775.074055ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:37.210475Z","caller":"traceutil/trace.go:171","msg":"trace[14255130] transaction","detail":"{read_only:false; response_revision:923; number_of_response:1; }","duration":"939.209164ms","start":"2026-01-28T15:00:36.271237Z","end":"2026-01-28T15:00:37.210446Z","steps":["trace[14255130] 'process raft request'  (duration: 861.993033ms)","trace[14255130] 'compare'  (duration: 77.069358ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:37.210576Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:36.435294Z","time spent":"775.22268ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:897 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:600 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:37.210607Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:36.271218Z","time spent":"939.315677ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:917 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:37.210721Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"867.370813ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:37.21074Z","caller":"traceutil/trace.go:171","msg":"trace[52390817] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:924; }","duration":"867.420644ms","start":"2026-01-28T15:00:36.343314Z","end":"2026-01-28T15:00:37.210734Z","steps":["trace[52390817] 'agreement among raft nodes before linearized reading'  (duration: 867.373573ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:37.210753Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:36.343285Z","time spent":"867.465775ms","remote":"127.0.0.1:39682","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-01-28T15:00:37.210847Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"831.35618ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:37.210862Z","caller":"traceutil/trace.go:171","msg":"trace[940952024] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:924; }","duration":"831.396861ms","start":"2026-01-28T15:00:36.37946Z","end":"2026-01-28T15:00:37.210857Z","steps":["trace[940952024] 'agreement among raft nodes before linearized reading'  (duration: 831.36353ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:37.210876Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:36.379446Z","time spent":"831.426732ms","remote":"127.0.0.1:40118","response type":"/etcdserverpb.KV/Range","request count":0,"request size":82,"response count":8,"response size":30,"request content":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:37.211112Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"385.822111ms","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-01-28T15:00:37.211157Z","caller":"traceutil/trace.go:171","msg":"trace[99832170] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:924; }","duration":"385.884441ms","start":"2026-01-28T15:00:36.825258Z","end":"2026-01-28T15:00:37.211142Z","steps":["trace[99832170] 'agreement among raft nodes before linearized reading'  (duration: 385.765899ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:37.211192Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:36.825245Z","time spent":"385.939912ms","remote":"127.0.0.1:39972","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-01-28T15:00:37.211368Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.491402ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:37.211396Z","caller":"traceutil/trace.go:171","msg":"trace[393171071] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:924; }","duration":"254.526804ms","start":"2026-01-28T15:00:36.95686Z","end":"2026-01-28T15:00:37.211387Z","steps":["trace[393171071] 'agreement among raft nodes before linearized reading'  (duration: 254.450402ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:37.211528Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"255.519245ms","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-01-28T15:00:37.211551Z","caller":"traceutil/trace.go:171","msg":"trace[721375854] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:924; }","duration":"255.568246ms","start":"2026-01-28T15:00:36.955976Z","end":"2026-01-28T15:00:37.211544Z","steps":["trace[721375854] 'agreement among raft nodes before linearized reading'  (duration: 255.504355ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:37.46652Z","caller":"traceutil/trace.go:171","msg":"trace[1997151365] linearizableReadLoop","detail":"{readStateIndex:967; appliedIndex:965; }","duration":"122.118992ms","start":"2026-01-28T15:00:37.344386Z","end":"2026-01-28T15:00:37.466505Z","steps":["trace[1997151365] 'read index received'  (duration: 121.978849ms)","trace[1997151365] 'applied index is now lower than readState.Index'  (duration: 139.303µs)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:37.466608Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.206304ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:37.466625Z","caller":"traceutil/trace.go:171","msg":"trace[263276278] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:927; }","duration":"122.263385ms","start":"2026-01-28T15:00:37.344356Z","end":"2026-01-28T15:00:37.466619Z","steps":["trace[263276278] 'agreement among raft nodes before linearized reading'  (duration: 122.205474ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:37.46661Z","caller":"traceutil/trace.go:171","msg":"trace[1895515164] transaction","detail":"{read_only:false; response_revision:926; number_of_response:1; }","duration":"244.608101ms","start":"2026-01-28T15:00:37.221976Z","end":"2026-01-28T15:00:37.466585Z","steps":["trace[1895515164] 'process raft request'  (duration: 244.429677ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:37.466816Z","caller":"traceutil/trace.go:171","msg":"trace[1920663906] transaction","detail":"{read_only:false; response_revision:927; number_of_response:1; }","duration":"244.793105ms","start":"2026-01-28T15:00:37.222015Z","end":"2026-01-28T15:00:37.466808Z","steps":["trace[1920663906] 'process raft request'  (duration: 244.472398ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:38.56634Z","caller":"traceutil/trace.go:171","msg":"trace[284549712] linearizableReadLoop","detail":"{readStateIndex:968; appliedIndex:967; }","duration":"224.519025ms","start":"2026-01-28T15:00:38.341804Z","end":"2026-01-28T15:00:38.566323Z","steps":["trace[284549712] 'read index received'  (duration: 224.36965ms)","trace[284549712] 'applied index is now lower than readState.Index'  (duration: 148.705µs)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:38.566455Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"224.631778ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:38.566484Z","caller":"traceutil/trace.go:171","msg":"trace[214424827] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:928; }","duration":"224.699079ms","start":"2026-01-28T15:00:38.341777Z","end":"2026-01-28T15:00:38.566476Z","steps":["trace[214424827] 'agreement among raft nodes before linearized reading'  (duration: 224.612577ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:38.566732Z","caller":"traceutil/trace.go:171","msg":"trace[895337600] transaction","detail":"{read_only:false; response_revision:928; number_of_response:1; }","duration":"293.9045ms","start":"2026-01-28T15:00:38.27282Z","end":"2026-01-28T15:00:38.566724Z","steps":["trace[895337600] 'process raft request'  (duration: 293.408789ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:39.79261Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"415.223955ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643969 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:925 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:39.792721Z","caller":"traceutil/trace.go:171","msg":"trace[1391078938] linearizableReadLoop","detail":"{readStateIndex:971; appliedIndex:969; }","duration":"449.877496ms","start":"2026-01-28T15:00:39.342832Z","end":"2026-01-28T15:00:39.792709Z","steps":["trace[1391078938] 'read index received'  (duration: 34.509318ms)","trace[1391078938] 'applied index is now lower than readState.Index'  (duration: 415.367428ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:39.792881Z","caller":"traceutil/trace.go:171","msg":"trace[347869774] transaction","detail":"{read_only:false; response_revision:930; number_of_response:1; }","duration":"467.059679ms","start":"2026-01-28T15:00:39.325813Z","end":"2026-01-28T15:00:39.792873Z","steps":["trace[347869774] 'process raft request'  (duration: 51.519617ms)","trace[347869774] 'compare'  (duration: 414.673863ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:39.792923Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:39.325801Z","time spent":"467.10091ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:925 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:39.793042Z","caller":"traceutil/trace.go:171","msg":"trace[1658835399] transaction","detail":"{read_only:false; response_revision:931; number_of_response:1; }","duration":"462.353795ms","start":"2026-01-28T15:00:39.330676Z","end":"2026-01-28T15:00:39.79303Z","steps":["trace[1658835399] 'process raft request'  (duration: 461.999347ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:39.793082Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:39.330661Z","time spent":"462.397696ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:905 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:472 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:39.793215Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"450.382337ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:39.793238Z","caller":"traceutil/trace.go:171","msg":"trace[109699715] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:931; }","duration":"450.427049ms","start":"2026-01-28T15:00:39.342804Z","end":"2026-01-28T15:00:39.793231Z","steps":["trace[109699715] 'agreement among raft nodes before linearized reading'  (duration: 450.387378ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:39.793255Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:39.342789Z","time spent":"450.462249ms","remote":"127.0.0.1:39684","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-01-28T15:00:39.794404Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"324.208646ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:39.794431Z","caller":"traceutil/trace.go:171","msg":"trace[1116972772] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:931; }","duration":"324.264858ms","start":"2026-01-28T15:00:39.470159Z","end":"2026-01-28T15:00:39.794424Z","steps":["trace[1116972772] 'agreement among raft nodes before linearized reading'  (duration: 324.162196ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:39.79445Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:39.470134Z","time spent":"324.311618ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-01-28T15:00:39.794628Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.885611ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/networkpolicies/\" range_end:\"/registry/networkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:39.79465Z","caller":"traceutil/trace.go:171","msg":"trace[363216152] range","detail":"{range_begin:/registry/networkpolicies/; range_end:/registry/networkpolicies0; response_count:0; response_revision:931; }","duration":"171.906652ms","start":"2026-01-28T15:00:39.622734Z","end":"2026-01-28T15:00:39.794641Z","steps":["trace[363216152] 'agreement among raft nodes before linearized reading'  (duration: 171.875011ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:39.79475Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.926237ms","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-01-28T15:00:39.794768Z","caller":"traceutil/trace.go:171","msg":"trace[1741439291] range","detail":"{range_begin:/registry/certificatesigningrequests/; range_end:/registry/certificatesigningrequests0; response_count:0; response_revision:931; }","duration":"208.970858ms","start":"2026-01-28T15:00:39.585791Z","end":"2026-01-28T15:00:39.794762Z","steps":["trace[1741439291] 'agreement among raft nodes before linearized reading'  (duration: 208.933937ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:39.794887Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"323.873689ms","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-01-28T15:00:39.794919Z","caller":"traceutil/trace.go:171","msg":"trace[1608997027] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:931; }","duration":"323.92619ms","start":"2026-01-28T15:00:39.470984Z","end":"2026-01-28T15:00:39.79491Z","steps":["trace[1608997027] 'agreement among raft nodes before linearized reading'  (duration: 323.855349ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:39.79494Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:39.470971Z","time spent":"323.963301ms","remote":"127.0.0.1:39972","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-01-28T15:00:40.452218Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2120522545338643972,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-01-28T15:00:40.875592Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"210.047212ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643973 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:927 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:40.876361Z","caller":"traceutil/trace.go:171","msg":"trace[323477027] transaction","detail":"{read_only:false; response_revision:932; number_of_response:1; }","duration":"1.076898883s","start":"2026-01-28T15:00:39.799414Z","end":"2026-01-28T15:00:40.876313Z","steps":["trace[323477027] 'process raft request'  (duration: 866.035383ms)","trace[323477027] 'compare'  (duration: 209.894148ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:40.876627Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:39.799399Z","time spent":"1.077047836s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:927 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-01-28T15:00:40.953767Z","caller":"traceutil/trace.go:171","msg":"trace[1764060425] linearizableReadLoop","detail":"{readStateIndex:973; appliedIndex:971; }","duration":"1.001584894s","start":"2026-01-28T15:00:39.95216Z","end":"2026-01-28T15:00:40.953745Z","steps":["trace[1764060425] 'read index received'  (duration: 713.297468ms)","trace[1764060425] 'applied index is now lower than readState.Index'  (duration: 288.286126ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:40.954131Z","caller":"traceutil/trace.go:171","msg":"trace[724815699] transaction","detail":"{read_only:false; response_revision:933; number_of_response:1; }","duration":"1.154333439s","start":"2026-01-28T15:00:39.799787Z","end":"2026-01-28T15:00:40.95412Z","steps":["trace[724815699] 'process raft request'  (duration: 1.153832318s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:40.954217Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:39.799778Z","time spent":"1.15437788s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:926 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:40.954429Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.002263549s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:40.954464Z","caller":"traceutil/trace.go:171","msg":"trace[1454176793] range","detail":"{range_begin:/registry/ingressclasses/; range_end:/registry/ingressclasses0; response_count:0; response_revision:933; }","duration":"1.002333591s","start":"2026-01-28T15:00:39.952122Z","end":"2026-01-28T15:00:40.954456Z","steps":["trace[1454176793] 'agreement among raft nodes before linearized reading'  (duration: 1.002274109s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:40.954489Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:39.952104Z","time spent":"1.002378382s","remote":"127.0.0.1:40016","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":0,"response size":28,"request content":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:40.954831Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"609.135307ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:40.954866Z","caller":"traceutil/trace.go:171","msg":"trace[1709888419] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:933; }","duration":"609.197827ms","start":"2026-01-28T15:00:40.345661Z","end":"2026-01-28T15:00:40.954859Z","steps":["trace[1709888419] 'agreement among raft nodes before linearized reading'  (duration: 609.142546ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:40.954891Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:40.34563Z","time spent":"609.253979ms","remote":"127.0.0.1:39682","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-01-28T15:00:40.955077Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"384.377057ms","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-01-28T15:00:40.955129Z","caller":"traceutil/trace.go:171","msg":"trace[1788921537] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:933; }","duration":"384.450599ms","start":"2026-01-28T15:00:40.570647Z","end":"2026-01-28T15:00:40.955097Z","steps":["trace[1788921537] 'agreement among raft nodes before linearized reading'  (duration: 384.349956ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:40.955158Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:40.570627Z","time spent":"384.52513ms","remote":"127.0.0.1:39972","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-01-28T15:00:41.633099Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.979928ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643978 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:928 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:41.633405Z","caller":"traceutil/trace.go:171","msg":"trace[285037121] transaction","detail":"{read_only:false; response_revision:934; number_of_response:1; }","duration":"671.859565ms","start":"2026-01-28T15:00:40.961511Z","end":"2026-01-28T15:00:41.633371Z","steps":["trace[285037121] 'process raft request'  (duration: 475.535589ms)","trace[285037121] 'compare'  (duration: 195.761533ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:41.633581Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:40.961495Z","time spent":"672.014938ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:928 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:42.744706Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.038391996s","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338643979 > lease_revoke:<id:1d6d9c051d1df59f>","response":"size:28"}
{"level":"info","ts":"2026-01-28T15:00:42.744836Z","caller":"traceutil/trace.go:171","msg":"trace[283196628] linearizableReadLoop","detail":"{readStateIndex:975; appliedIndex:973; }","duration":"1.418296032s","start":"2026-01-28T15:00:41.326491Z","end":"2026-01-28T15:00:42.744787Z","steps":["trace[283196628] 'read index received'  (duration: 110.563904ms)","trace[283196628] 'applied index is now lower than readState.Index'  (duration: 1.307730758s)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:42.746668Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.420168764s","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-01-28T15:00:42.74672Z","caller":"traceutil/trace.go:171","msg":"trace[1181146448] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:934; }","duration":"1.420248886s","start":"2026-01-28T15:00:41.326454Z","end":"2026-01-28T15:00:42.746703Z","steps":["trace[1181146448] 'agreement among raft nodes before linearized reading'  (duration: 1.420065602s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:42.746813Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:41.32644Z","time spent":"1.420361918s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-01-28T15:00:42.747114Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"946.767513ms","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-01-28T15:00:42.747154Z","caller":"traceutil/trace.go:171","msg":"trace[677564607] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:934; }","duration":"946.972107ms","start":"2026-01-28T15:00:41.800168Z","end":"2026-01-28T15:00:42.74714Z","steps":["trace[677564607] 'agreement among raft nodes before linearized reading'  (duration: 946.855814ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:42.747185Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:41.800148Z","time spent":"947.030488ms","remote":"127.0.0.1:39972","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-01-28T15:00:42.74755Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"401.947818ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:42.747584Z","caller":"traceutil/trace.go:171","msg":"trace[625263836] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:934; }","duration":"402.0062ms","start":"2026-01-28T15:00:42.345566Z","end":"2026-01-28T15:00:42.747572Z","steps":["trace[625263836] 'agreement among raft nodes before linearized reading'  (duration: 401.958209ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:42.747612Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:42.345552Z","time spent":"402.053331ms","remote":"127.0.0.1:39682","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-01-28T15:00:42.869655Z","caller":"traceutil/trace.go:171","msg":"trace[1729654338] transaction","detail":"{read_only:false; response_revision:935; number_of_response:1; }","duration":"117.726243ms","start":"2026-01-28T15:00:42.751887Z","end":"2026-01-28T15:00:42.869613Z","steps":["trace[1729654338] 'process raft request'  (duration: 117.506309ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:42.875114Z","caller":"traceutil/trace.go:171","msg":"trace[789094364] transaction","detail":"{read_only:false; response_revision:936; number_of_response:1; }","duration":"121.683093ms","start":"2026-01-28T15:00:42.753408Z","end":"2026-01-28T15:00:42.875091Z","steps":["trace[789094364] 'process raft request'  (duration: 121.496869ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:45.379736Z","caller":"traceutil/trace.go:171","msg":"trace[490128659] transaction","detail":"{read_only:false; response_revision:943; number_of_response:1; }","duration":"500.511455ms","start":"2026-01-28T15:00:44.879203Z","end":"2026-01-28T15:00:45.379715Z","steps":["trace[490128659] 'process raft request'  (duration: 500.382832ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.379915Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:44.879187Z","time spent":"500.619588ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:935 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"info","ts":"2026-01-28T15:00:45.380526Z","caller":"traceutil/trace.go:171","msg":"trace[122877519] linearizableReadLoop","detail":"{readStateIndex:985; appliedIndex:985; }","duration":"498.621133ms","start":"2026-01-28T15:00:44.881892Z","end":"2026-01-28T15:00:45.380513Z","steps":["trace[122877519] 'read index received'  (duration: 498.608612ms)","trace[122877519] 'applied index is now lower than readState.Index'  (duration: 11.631µs)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:45.380671Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"498.771046ms","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-01-28T15:00:45.380706Z","caller":"traceutil/trace.go:171","msg":"trace[1004761359] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:943; }","duration":"498.858329ms","start":"2026-01-28T15:00:44.881839Z","end":"2026-01-28T15:00:45.380698Z","steps":["trace[1004761359] 'agreement among raft nodes before linearized reading'  (duration: 498.744646ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.380739Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:44.88183Z","time spent":"498.90294ms","remote":"127.0.0.1:39972","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-01-28T15:00:45.951413Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.130133ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338644006 username:\"kube-apiserver-etcd-client\" auth_revision:1 > lease_grant:<ttl:3660-second id:1d6d9c051d1df625>","response":"size:41"}
{"level":"info","ts":"2026-01-28T15:00:45.951478Z","caller":"traceutil/trace.go:171","msg":"trace[66441491] linearizableReadLoop","detail":"{readStateIndex:986; appliedIndex:985; }","duration":"570.899714ms","start":"2026-01-28T15:00:45.380567Z","end":"2026-01-28T15:00:45.951467Z","steps":["trace[66441491] 'read index received'  (duration: 461.720671ms)","trace[66441491] 'applied index is now lower than readState.Index'  (duration: 109.178233ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:45.951523Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.356366Z","time spent":"595.154836ms","remote":"127.0.0.1:39778","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""}
{"level":"warn","ts":"2026-01-28T15:00:45.951645Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"597.391104ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:45.951666Z","caller":"traceutil/trace.go:171","msg":"trace[736349496] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:943; }","duration":"597.442966ms","start":"2026-01-28T15:00:45.354216Z","end":"2026-01-28T15:00:45.951659Z","steps":["trace[736349496] 'agreement among raft nodes before linearized reading'  (duration: 597.404525ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.951697Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.3542Z","time spent":"597.491326ms","remote":"127.0.0.1:39682","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-01-28T15:00:45.951825Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"750.249612ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:45.951844Z","caller":"traceutil/trace.go:171","msg":"trace[146284371] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:943; }","duration":"750.307344ms","start":"2026-01-28T15:00:45.201531Z","end":"2026-01-28T15:00:45.951839Z","steps":["trace[146284371] 'agreement among raft nodes before linearized reading'  (duration: 750.239502ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.951857Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.201514Z","time spent":"750.339264ms","remote":"127.0.0.1:40224","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":111,"response size":30,"request content":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:45.951937Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"891.878019ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:45.951955Z","caller":"traceutil/trace.go:171","msg":"trace[199945985] range","detail":"{range_begin:/registry/volumeattachments/; range_end:/registry/volumeattachments0; response_count:0; response_revision:943; }","duration":"891.93745ms","start":"2026-01-28T15:00:45.060012Z","end":"2026-01-28T15:00:45.95195Z","steps":["trace[199945985] 'agreement among raft nodes before linearized reading'  (duration: 891.910929ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.951967Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.059996Z","time spent":"891.968141ms","remote":"127.0.0.1:40066","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":0,"response size":28,"request content":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" "}
{"level":"warn","ts":"2026-01-28T15:00:45.952074Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"968.772134ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-01-28T15:00:45.95209Z","caller":"traceutil/trace.go:171","msg":"trace[1517896188] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:943; }","duration":"968.817734ms","start":"2026-01-28T15:00:44.983268Z","end":"2026-01-28T15:00:45.952086Z","steps":["trace[1517896188] 'agreement among raft nodes before linearized reading'  (duration: 968.756173ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.952101Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:44.983255Z","time spent":"968.843665ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-01-28T15:00:45.952183Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.051581129s","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-01-28T15:00:45.952199Z","caller":"traceutil/trace.go:171","msg":"trace[445883138] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:943; }","duration":"1.051623709s","start":"2026-01-28T15:00:44.900572Z","end":"2026-01-28T15:00:45.952196Z","steps":["trace[445883138] 'agreement among raft nodes before linearized reading'  (duration: 1.051584009s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.952211Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:44.90056Z","time spent":"1.051648001s","remote":"127.0.0.1:39972","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-01-28T15:00:45.986659Z","caller":"traceutil/trace.go:171","msg":"trace[937970377] transaction","detail":"{read_only:false; response_revision:944; number_of_response:1; }","duration":"589.057079ms","start":"2026-01-28T15:00:45.397584Z","end":"2026-01-28T15:00:45.986641Z","steps":["trace[937970377] 'process raft request'  (duration: 588.947896ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.986768Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.397561Z","time spent":"589.15052ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:936 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:45.986965Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"342.903162ms","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-01-28T15:00:45.987033Z","caller":"traceutil/trace.go:171","msg":"trace[155177912] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:944; }","duration":"343.037865ms","start":"2026-01-28T15:00:45.643977Z","end":"2026-01-28T15:00:45.987015Z","steps":["trace[155177912] 'agreement among raft nodes before linearized reading'  (duration: 342.739428ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:45.987076Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.643955Z","time spent":"343.111647ms","remote":"127.0.0.1:39972","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-01-28T15:00:46.410084Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"288.050768ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338644010 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/events/kube-system/ceph-csi-rbd-nodeplugin-g96qz.188eed24ab6ac563\" mod_revision:0 > success:<request_put:<key:\"/registry/events/kube-system/ceph-csi-rbd-nodeplugin-g96qz.188eed24ab6ac563\" value_size:657 lease:2120522545338644005 >> failure:<>>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:46.410234Z","caller":"traceutil/trace.go:171","msg":"trace[914543108] linearizableReadLoop","detail":"{readStateIndex:990; appliedIndex:987; }","duration":"423.52574ms","start":"2026-01-28T15:00:45.986697Z","end":"2026-01-28T15:00:46.410223Z","steps":["trace[914543108] 'read index received'  (duration: 135.221835ms)","trace[914543108] 'applied index is now lower than readState.Index'  (duration: 288.303175ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:46.410307Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"454.95215ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:46.410322Z","caller":"traceutil/trace.go:171","msg":"trace[1068551283] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:947; }","duration":"454.999281ms","start":"2026-01-28T15:00:45.955318Z","end":"2026-01-28T15:00:46.410317Z","steps":["trace[1068551283] 'agreement among raft nodes before linearized reading'  (duration: 454.934429ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:46.410343Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.955307Z","time spent":"455.030592ms","remote":"127.0.0.1:39684","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-01-28T15:00:46.410514Z","caller":"traceutil/trace.go:171","msg":"trace[1967042728] transaction","detail":"{read_only:false; response_revision:945; number_of_response:1; }","duration":"455.553123ms","start":"2026-01-28T15:00:45.954952Z","end":"2026-01-28T15:00:46.410506Z","steps":["trace[1967042728] 'process raft request'  (duration: 167.014063ms)","trace[1967042728] 'compare'  (duration: 287.840094ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:46.410543Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.954928Z","time spent":"455.600214ms","remote":"127.0.0.1:39778","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":750,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/events/kube-system/ceph-csi-rbd-nodeplugin-g96qz.188eed24ab6ac563\" mod_revision:0 > success:<request_put:<key:\"/registry/events/kube-system/ceph-csi-rbd-nodeplugin-g96qz.188eed24ab6ac563\" value_size:657 lease:2120522545338644005 >> failure:<>"}
{"level":"info","ts":"2026-01-28T15:00:46.410661Z","caller":"traceutil/trace.go:171","msg":"trace[1831882848] transaction","detail":"{read_only:false; response_revision:946; number_of_response:1; }","duration":"451.631816ms","start":"2026-01-28T15:00:45.959024Z","end":"2026-01-28T15:00:46.410656Z","steps":["trace[1831882848] 'process raft request'  (duration: 451.135294ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:46.410691Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.959014Z","time spent":"451.657927ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:937 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-01-28T15:00:46.410766Z","caller":"traceutil/trace.go:171","msg":"trace[779595488] transaction","detail":"{read_only:false; response_revision:947; number_of_response:1; }","duration":"451.727368ms","start":"2026-01-28T15:00:45.959032Z","end":"2026-01-28T15:00:46.410759Z","steps":["trace[779595488] 'process raft request'  (duration: 451.168146ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:46.410794Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.959014Z","time spent":"451.764789ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:938 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:46.919289Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2120522545338644015,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-01-28T15:00:47.219403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"245.022361ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338644014 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:939 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:47.219576Z","caller":"traceutil/trace.go:171","msg":"trace[747275544] linearizableReadLoop","detail":"{readStateIndex:992; appliedIndex:990; }","duration":"801.367731ms","start":"2026-01-28T15:00:46.418189Z","end":"2026-01-28T15:00:47.219557Z","steps":["trace[747275544] 'read index received'  (duration: 556.121676ms)","trace[747275544] 'applied index is now lower than readState.Index'  (duration: 245.245215ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:47.219654Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"801.460843ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:47.219685Z","caller":"traceutil/trace.go:171","msg":"trace[1719863513] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:949; }","duration":"801.505904ms","start":"2026-01-28T15:00:46.41817Z","end":"2026-01-28T15:00:47.219676Z","steps":["trace[1719863513] 'agreement among raft nodes before linearized reading'  (duration: 801.439883ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:47.21972Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:46.418162Z","time spent":"801.551515ms","remote":"127.0.0.1:39682","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-01-28T15:00:47.219986Z","caller":"traceutil/trace.go:171","msg":"trace[1770783618] transaction","detail":"{read_only:false; response_revision:948; number_of_response:1; }","duration":"1.228524782s","start":"2026-01-28T15:00:45.991448Z","end":"2026-01-28T15:00:47.219973Z","steps":["trace[1770783618] 'process raft request'  (duration: 982.856616ms)","trace[1770783618] 'compare'  (duration: 244.832136ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:47.220051Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:45.991433Z","time spent":"1.228587003s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:939 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:47.22018Z","caller":"traceutil/trace.go:171","msg":"trace[482627364] transaction","detail":"{read_only:false; response_revision:949; number_of_response:1; }","duration":"805.32219ms","start":"2026-01-28T15:00:46.414849Z","end":"2026-01-28T15:00:47.220171Z","steps":["trace[482627364] 'process raft request'  (duration: 804.637714ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:47.220227Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:46.414834Z","time spent":"805.373681ms","remote":"127.0.0.1:39778","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":799,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/events/kube-system/ceph-csi-rbd-nodeplugin-g96qz.188eed24ab7a5bd5\" mod_revision:0 > success:<request_put:<key:\"/registry/events/kube-system/ceph-csi-rbd-nodeplugin-g96qz.188eed24ab7a5bd5\" value_size:706 lease:2120522545338644005 >> failure:<>"}
{"level":"warn","ts":"2026-01-28T15:00:48.481743Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"656.927072ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338644019 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:924 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:600 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:48.481806Z","caller":"traceutil/trace.go:171","msg":"trace[1808278481] linearizableReadLoop","detail":"{readStateIndex:993; appliedIndex:992; }","duration":"1.09654842s","start":"2026-01-28T15:00:47.385246Z","end":"2026-01-28T15:00:48.481795Z","steps":["trace[1808278481] 'read index received'  (duration: 439.463304ms)","trace[1808278481] 'applied index is now lower than readState.Index'  (duration: 657.084376ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:48.482004Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.096758604s","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-01-28T15:00:48.482015Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.081472544s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:48.482034Z","caller":"traceutil/trace.go:171","msg":"trace[1539802572] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:950; }","duration":"1.096815836s","start":"2026-01-28T15:00:47.385209Z","end":"2026-01-28T15:00:48.482024Z","steps":["trace[1539802572] 'agreement among raft nodes before linearized reading'  (duration: 1.096709433s)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:00:48.482039Z","caller":"traceutil/trace.go:171","msg":"trace[1584935223] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:950; }","duration":"1.081521295s","start":"2026-01-28T15:00:47.40051Z","end":"2026-01-28T15:00:48.482031Z","steps":["trace[1584935223] 'agreement among raft nodes before linearized reading'  (duration: 1.081479704s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:48.482057Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:47.385194Z","time spent":"1.096858296s","remote":"127.0.0.1:39972","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-01-28T15:00:48.482059Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:47.400496Z","time spent":"1.081557395s","remote":"127.0.0.1:40146","response type":"/etcdserverpb.KV/Range","request count":0,"request size":82,"response count":8,"response size":30,"request content":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true "}
{"level":"info","ts":"2026-01-28T15:00:48.482172Z","caller":"traceutil/trace.go:171","msg":"trace[168932787] transaction","detail":"{read_only:false; response_revision:950; number_of_response:1; }","duration":"1.121987517s","start":"2026-01-28T15:00:47.360176Z","end":"2026-01-28T15:00:48.482163Z","steps":["trace[168932787] 'process raft request'  (duration: 464.586925ms)","trace[168932787] 'compare'  (duration: 656.592944ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:48.482209Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:47.360157Z","time spent":"1.122029547s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:924 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:600 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:48.482309Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.940403ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:48.482327Z","caller":"traceutil/trace.go:171","msg":"trace[526902441] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:950; }","duration":"136.994064ms","start":"2026-01-28T15:00:48.345328Z","end":"2026-01-28T15:00:48.482322Z","steps":["trace[526902441] 'agreement among raft nodes before linearized reading'  (duration: 136.967874ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:48.482429Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"178.090269ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/\" range_end:\"/registry/services/endpoints0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:48.482445Z","caller":"traceutil/trace.go:171","msg":"trace[710320863] range","detail":"{range_begin:/registry/services/endpoints/; range_end:/registry/services/endpoints0; response_count:0; response_revision:950; }","duration":"178.144621ms","start":"2026-01-28T15:00:48.304296Z","end":"2026-01-28T15:00:48.482441Z","steps":["trace[710320863] 'agreement among raft nodes before linearized reading'  (duration: 178.10336ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:48.482541Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"490.776718ms","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-01-28T15:00:48.482561Z","caller":"traceutil/trace.go:171","msg":"trace[87589010] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:950; }","duration":"490.933621ms","start":"2026-01-28T15:00:47.991622Z","end":"2026-01-28T15:00:48.482555Z","steps":["trace[87589010] 'agreement among raft nodes before linearized reading'  (duration: 490.87661ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:48.482578Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:47.991603Z","time spent":"490.971023ms","remote":"127.0.0.1:39972","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-01-28T15:00:48.989884Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":2120522545338644021,"retry-timeout":"500ms"}
{"level":"warn","ts":"2026-01-28T15:00:49.879564Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"579.558327ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338644022 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:946 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >>","response":"size:16"}
{"level":"info","ts":"2026-01-28T15:00:49.879632Z","caller":"traceutil/trace.go:171","msg":"trace[637613336] transaction","detail":"{read_only:false; response_revision:951; number_of_response:1; }","duration":"1.390663776s","start":"2026-01-28T15:00:48.488957Z","end":"2026-01-28T15:00:49.879621Z","steps":["trace[637613336] 'process raft request'  (duration: 810.991836ms)","trace[637613336] 'compare'  (duration: 579.150158ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:49.879675Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:48.488939Z","time spent":"1.390717688s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:946 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-01-28T15:00:49.885637Z","caller":"traceutil/trace.go:171","msg":"trace[1241145968] transaction","detail":"{read_only:false; response_revision:952; number_of_response:1; }","duration":"1.392989478s","start":"2026-01-28T15:00:48.492615Z","end":"2026-01-28T15:00:49.885605Z","steps":["trace[1241145968] 'process raft request'  (duration: 1.391363772s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:49.88575Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:48.492594Z","time spent":"1.39309399s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:943 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"info","ts":"2026-01-28T15:00:49.886026Z","caller":"traceutil/trace.go:171","msg":"trace[143644088] transaction","detail":"{read_only:false; response_revision:953; number_of_response:1; }","duration":"1.393346206s","start":"2026-01-28T15:00:48.492671Z","end":"2026-01-28T15:00:49.886017Z","steps":["trace[143644088] 'process raft request'  (duration: 1.391408584s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:49.886075Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:48.492665Z","time spent":"1.393381077s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:944 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:49.886154Z","caller":"traceutil/trace.go:171","msg":"trace[1452606291] transaction","detail":"{read_only:false; response_revision:954; number_of_response:1; }","duration":"1.393446648s","start":"2026-01-28T15:00:48.492702Z","end":"2026-01-28T15:00:49.886148Z","steps":["trace[1452606291] 'process raft request'  (duration: 1.391401513s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:49.886188Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:48.492698Z","time spent":"1.393473638s","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:947 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:49.886494Z","caller":"traceutil/trace.go:171","msg":"trace[349469174] transaction","detail":"{read_only:false; response_revision:955; number_of_response:1; }","duration":"1.347852872s","start":"2026-01-28T15:00:48.538624Z","end":"2026-01-28T15:00:49.886477Z","steps":["trace[349469174] 'process raft request'  (duration: 1.345498611s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:49.890197Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:48.538605Z","time spent":"1.351110446s","remote":"127.0.0.1:39882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4906,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:744 > success:<request_put:<key:\"/registry/minions/instance\" value_size:4872 >> failure:<request_range:<key:\"/registry/minions/instance\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:50.274047Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"389.88067ms","expected-duration":"100ms","prefix":"","request":"header:<ID:2120522545338644027 > lease_revoke:<id:1d6d9c051d1df5df>","response":"size:28"}
{"level":"info","ts":"2026-01-28T15:00:50.274184Z","caller":"traceutil/trace.go:171","msg":"trace[1823093858] linearizableReadLoop","detail":"{readStateIndex:998; appliedIndex:993; }","duration":"1.7851976s","start":"2026-01-28T15:00:48.488975Z","end":"2026-01-28T15:00:50.274173Z","steps":["trace[1823093858] 'read index received'  (duration: 811.027007ms)","trace[1823093858] 'applied index is now lower than readState.Index'  (duration: 974.169913ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:50.274502Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.785517307s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:50.274525Z","caller":"traceutil/trace.go:171","msg":"trace[1302695787] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:955; }","duration":"1.785563697s","start":"2026-01-28T15:00:48.488954Z","end":"2026-01-28T15:00:50.274518Z","steps":["trace[1302695787] 'agreement among raft nodes before linearized reading'  (duration: 1.785517716s)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:50.274559Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:48.488943Z","time spent":"1.785609199s","remote":"127.0.0.1:39684","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-01-28T15:00:50.274954Z","caller":"traceutil/trace.go:171","msg":"trace[1641813214] transaction","detail":"{read_only:false; response_revision:956; number_of_response:1; }","duration":"412.596736ms","start":"2026-01-28T15:00:49.862336Z","end":"2026-01-28T15:00:50.274933Z","steps":["trace[1641813214] 'process raft request'  (duration: 411.775488ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:50.275551Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:49.862312Z","time spent":"413.070276ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-node-lease/instance\" mod_revision:931 > success:<request_put:<key:\"/registry/leases/kube-node-lease/instance\" value_size:472 >> failure:<request_range:<key:\"/registry/leases/kube-node-lease/instance\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:50.694266Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"406.759566ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:50.694343Z","caller":"traceutil/trace.go:171","msg":"trace[46316901] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:956; }","duration":"406.871319ms","start":"2026-01-28T15:00:50.287454Z","end":"2026-01-28T15:00:50.694325Z","steps":["trace[46316901] 'range keys from in-memory index tree'  (duration: 406.693714ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:50.694383Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:50.287441Z","time spent":"406.93227ms","remote":"127.0.0.1:39682","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-01-28T15:00:50.694647Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.468999281s","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-01-28T15:00:50.694653Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.156732052s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/replicasets/\" range_end:\"/registry/replicasets0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:50.694679Z","caller":"traceutil/trace.go:171","msg":"trace[1962293710] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:956; }","duration":"1.469067113s","start":"2026-01-28T15:00:49.225599Z","end":"2026-01-28T15:00:50.694666Z","steps":["trace[1962293710] 'agreement among raft nodes before linearized reading'  (duration: 1.049310527s)","trace[1962293710] 'range keys from in-memory index tree'  (duration: 419.648504ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:50.694697Z","caller":"traceutil/trace.go:171","msg":"trace[685971384] range","detail":"{range_begin:/registry/replicasets/; range_end:/registry/replicasets0; response_count:0; response_revision:956; }","duration":"1.156812563s","start":"2026-01-28T15:00:49.53787Z","end":"2026-01-28T15:00:50.694683Z","steps":["trace[685971384] 'agreement among raft nodes before linearized reading'  (duration: 737.858845ms)","trace[685971384] 'count revisions from in-memory index tree'  (duration: 418.890737ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:50.694707Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:49.22557Z","time spent":"1.469131565s","remote":"127.0.0.1:39972","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-01-28T15:00:50.694733Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:49.537837Z","time spent":"1.156884005s","remote":"127.0.0.1:40178","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":4,"response size":30,"request content":"key:\"/registry/replicasets/\" range_end:\"/registry/replicasets0\" count_only:true "}
{"level":"warn","ts":"2026-01-28T15:00:50.694848Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.40072752s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:00:50.694878Z","caller":"traceutil/trace.go:171","msg":"trace[1590045528] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:956; }","duration":"1.400780371s","start":"2026-01-28T15:00:49.294086Z","end":"2026-01-28T15:00:50.694866Z","steps":["trace[1590045528] 'agreement among raft nodes before linearized reading'  (duration: 981.653519ms)","trace[1590045528] 'count revisions from in-memory index tree'  (duration: 419.084272ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:50.694911Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:49.294072Z","time spent":"1.400830592s","remote":"127.0.0.1:57006","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":1,"response size":30,"request content":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true "}
{"level":"info","ts":"2026-01-28T15:00:52.698432Z","caller":"traceutil/trace.go:171","msg":"trace[1740863036] transaction","detail":"{read_only:false; response_revision:958; number_of_response:1; }","duration":"760.649445ms","start":"2026-01-28T15:00:51.937766Z","end":"2026-01-28T15:00:52.698416Z","steps":["trace[1740863036] 'process raft request'  (duration: 760.552813ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:52.698802Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:51.937746Z","time spent":"760.987193ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:951 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-01-28T15:00:52.864809Z","caller":"traceutil/trace.go:171","msg":"trace[276372249] linearizableReadLoop","detail":"{readStateIndex:1005; appliedIndex:1002; }","duration":"302.253517ms","start":"2026-01-28T15:00:52.562539Z","end":"2026-01-28T15:00:52.864792Z","steps":["trace[276372249] 'read index received'  (duration: 135.998791ms)","trace[276372249] 'applied index is now lower than readState.Index'  (duration: 166.253946ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:00:52.865012Z","caller":"traceutil/trace.go:171","msg":"trace[1213257326] transaction","detail":"{read_only:false; response_revision:959; number_of_response:1; }","duration":"927.057565ms","start":"2026-01-28T15:00:51.937945Z","end":"2026-01-28T15:00:52.865002Z","steps":["trace[1213257326] 'process raft request'  (duration: 863.308354ms)","trace[1213257326] 'compare'  (duration: 63.395623ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:00:52.865088Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:51.937938Z","time spent":"927.099636ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:953 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:52.865207Z","caller":"traceutil/trace.go:171","msg":"trace[98776050] transaction","detail":"{read_only:false; response_revision:960; number_of_response:1; }","duration":"927.177567ms","start":"2026-01-28T15:00:51.938024Z","end":"2026-01-28T15:00:52.865201Z","steps":["trace[98776050] 'process raft request'  (duration: 926.707197ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:52.865246Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:51.938019Z","time spent":"927.207569ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:954 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-01-28T15:00:52.865328Z","caller":"traceutil/trace.go:171","msg":"trace[8833229] transaction","detail":"{read_only:false; response_revision:961; number_of_response:1; }","duration":"927.262ms","start":"2026-01-28T15:00:51.938059Z","end":"2026-01-28T15:00:52.865321Z","steps":["trace[8833229] 'process raft request'  (duration: 926.709128ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:52.865363Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:51.938055Z","time spent":"927.292201ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:952 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-01-28T15:00:52.865451Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"302.911742ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:00:52.865476Z","caller":"traceutil/trace.go:171","msg":"trace[1987512633] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:961; }","duration":"302.965673ms","start":"2026-01-28T15:00:52.562504Z","end":"2026-01-28T15:00:52.86547Z","steps":["trace[1987512633] 'agreement among raft nodes before linearized reading'  (duration: 302.929432ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:00:52.865493Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:00:52.562485Z","time spent":"303.004314ms","remote":"127.0.0.1:39682","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-01-28T15:00:52.865638Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.124726ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"}
{"level":"info","ts":"2026-01-28T15:00:52.86566Z","caller":"traceutil/trace.go:171","msg":"trace[521574746] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:961; }","duration":"115.175867ms","start":"2026-01-28T15:00:52.750479Z","end":"2026-01-28T15:00:52.865655Z","steps":["trace[521574746] 'agreement among raft nodes before linearized reading'  (duration: 115.099006ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:01:04.952954Z","caller":"traceutil/trace.go:171","msg":"trace[333337779] transaction","detail":"{read_only:false; response_revision:1015; number_of_response:1; }","duration":"178.855056ms","start":"2026-01-28T15:01:04.774075Z","end":"2026-01-28T15:01:04.95293Z","steps":["trace[333337779] 'process raft request'  (duration: 178.735324ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:01:08.082105Z","caller":"traceutil/trace.go:171","msg":"trace[804918245] transaction","detail":"{read_only:false; response_revision:1032; number_of_response:1; }","duration":"274.247423ms","start":"2026-01-28T15:01:07.807689Z","end":"2026-01-28T15:01:08.081936Z","steps":["trace[804918245] 'process raft request'  (duration: 274.06545ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:01:08.547544Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.102302ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:01:08.547618Z","caller":"traceutil/trace.go:171","msg":"trace[483701075] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1032; }","duration":"200.220785ms","start":"2026-01-28T15:01:08.347379Z","end":"2026-01-28T15:01:08.5476Z","steps":["trace[483701075] 'range keys from in-memory index tree'  (duration: 200.003481ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:01:08.547757Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.59796ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/\" range_end:\"/registry/serviceaccounts0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:01:08.547826Z","caller":"traceutil/trace.go:171","msg":"trace[628453722] range","detail":"{range_begin:/registry/serviceaccounts/; range_end:/registry/serviceaccounts0; response_count:0; response_revision:1032; }","duration":"171.694512ms","start":"2026-01-28T15:01:08.376114Z","end":"2026-01-28T15:01:08.547809Z","steps":["trace[628453722] 'count revisions from in-memory index tree'  (duration: 171.554759ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:01:13.162715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.473227ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumexternalworkloads/\" range_end:\"/registry/cilium.io/ciliumexternalworkloads0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:01:13.162773Z","caller":"traceutil/trace.go:171","msg":"trace[1784410161] range","detail":"{range_begin:/registry/cilium.io/ciliumexternalworkloads/; range_end:/registry/cilium.io/ciliumexternalworkloads0; response_count:0; response_revision:1053; }","duration":"198.57959ms","start":"2026-01-28T15:01:12.964183Z","end":"2026-01-28T15:01:13.162762Z","steps":["trace[1784410161] 'count revisions from in-memory index tree'  (duration: 198.346225ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:01:47.506196Z","caller":"traceutil/trace.go:171","msg":"trace[1740274819] transaction","detail":"{read_only:false; response_revision:1215; number_of_response:1; }","duration":"126.240378ms","start":"2026-01-28T15:01:47.379932Z","end":"2026-01-28T15:01:47.506173Z","steps":["trace[1740274819] 'process raft request'  (duration: 124.874228ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:03:21.095873Z","caller":"traceutil/trace.go:171","msg":"trace[1599676164] transaction","detail":"{read_only:false; response_revision:1595; number_of_response:1; }","duration":"120.771581ms","start":"2026-01-28T15:03:20.975082Z","end":"2026-01-28T15:03:21.095854Z","steps":["trace[1599676164] 'process raft request'  (duration: 120.632668ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:03:22.924724Z","caller":"traceutil/trace.go:171","msg":"trace[1756298646] transaction","detail":"{read_only:false; response_revision:1602; number_of_response:1; }","duration":"112.35872ms","start":"2026-01-28T15:03:22.812323Z","end":"2026-01-28T15:03:22.924682Z","steps":["trace[1756298646] 'process raft request'  (duration: 112.215307ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:03:24.316276Z","caller":"traceutil/trace.go:171","msg":"trace[1516269258] linearizableReadLoop","detail":"{readStateIndex:1681; appliedIndex:1680; }","duration":"363.005329ms","start":"2026-01-28T15:03:23.95325Z","end":"2026-01-28T15:03:24.316256Z","steps":["trace[1516269258] 'read index received'  (duration: 362.829515ms)","trace[1516269258] 'applied index is now lower than readState.Index'  (duration: 175.044µs)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:03:24.316398Z","caller":"traceutil/trace.go:171","msg":"trace[561817629] transaction","detail":"{read_only:false; response_revision:1606; number_of_response:1; }","duration":"423.524207ms","start":"2026-01-28T15:03:23.892851Z","end":"2026-01-28T15:03:24.316376Z","steps":["trace[561817629] 'process raft request'  (duration: 423.281462ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:24.316505Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:03:23.892835Z","time spent":"423.598158ms","remote":"127.0.0.1:39724","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":116,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/masterleases/199.19.213.5\" mod_revision:1567 > success:<request_put:<key:\"/registry/masterleases/199.19.213.5\" value_size:65 lease:2120522545338645645 >> failure:<request_range:<key:\"/registry/masterleases/199.19.213.5\" > >"}
{"level":"warn","ts":"2026-01-28T15:03:24.316849Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"363.593731ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-01-28T15:03:24.316938Z","caller":"traceutil/trace.go:171","msg":"trace[1599849372] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1606; }","duration":"363.704603ms","start":"2026-01-28T15:03:23.953222Z","end":"2026-01-28T15:03:24.316926Z","steps":["trace[1599849372] 'agreement among raft nodes before linearized reading'  (duration: 363.482579ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:24.317393Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:03:23.953208Z","time spent":"363.763775ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-01-28T15:03:24.317902Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"349.769925ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"}
{"level":"info","ts":"2026-01-28T15:03:24.317943Z","caller":"traceutil/trace.go:171","msg":"trace[780586818] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1606; }","duration":"349.836616ms","start":"2026-01-28T15:03:23.968096Z","end":"2026-01-28T15:03:24.317933Z","steps":["trace[780586818] 'agreement among raft nodes before linearized reading'  (duration: 349.669522ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:24.318286Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:03:23.968084Z","time spent":"350.188714ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-01-28T15:03:24.319117Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.953921ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" ","response":"range_response_count:1 size:532"}
{"level":"info","ts":"2026-01-28T15:03:24.319165Z","caller":"traceutil/trace.go:171","msg":"trace[552198907] range","detail":"{range_begin:/registry/leases/kube-system/rbd.csi.ceph.com-kube-system; range_end:; response_count:1; response_revision:1606; }","duration":"187.037323ms","start":"2026-01-28T15:03:24.132112Z","end":"2026-01-28T15:03:24.31915Z","steps":["trace[552198907] 'agreement among raft nodes before linearized reading'  (duration: 186.926131ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:24.319771Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.943058ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:03:24.319839Z","caller":"traceutil/trace.go:171","msg":"trace[566112295] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:1606; }","duration":"206.04003ms","start":"2026-01-28T15:03:24.113788Z","end":"2026-01-28T15:03:24.319828Z","steps":["trace[566112295] 'agreement among raft nodes before linearized reading'  (duration: 205.892686ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:24.320445Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"293.335843ms","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-01-28T15:03:24.320675Z","caller":"traceutil/trace.go:171","msg":"trace[1412000554] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1606; }","duration":"293.440305ms","start":"2026-01-28T15:03:24.02706Z","end":"2026-01-28T15:03:24.3205Z","steps":["trace[1412000554] 'agreement among raft nodes before linearized reading'  (duration: 293.276891ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:24.321208Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"319.002624ms","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-01-28T15:03:24.321274Z","caller":"traceutil/trace.go:171","msg":"trace[1680455727] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1606; }","duration":"319.068246ms","start":"2026-01-28T15:03:24.002194Z","end":"2026-01-28T15:03:24.321262Z","steps":["trace[1680455727] 'agreement among raft nodes before linearized reading'  (duration: 318.884602ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:24.321681Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:03:24.002168Z","time spent":"319.356442ms","remote":"127.0.0.1:39972","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-01-28T15:03:24.322185Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"327.792953ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"info","ts":"2026-01-28T15:03:24.32226Z","caller":"traceutil/trace.go:171","msg":"trace[865932731] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1606; }","duration":"327.869745ms","start":"2026-01-28T15:03:23.99438Z","end":"2026-01-28T15:03:24.32225Z","steps":["trace[865932731] 'agreement among raft nodes before linearized reading'  (duration: 327.709391ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:24.322623Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-01-28T15:03:23.994346Z","time spent":"328.261773ms","remote":"127.0.0.1:39972","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"info","ts":"2026-01-28T15:03:40.637619Z","caller":"traceutil/trace.go:171","msg":"trace[1691317442] transaction","detail":"{read_only:false; response_revision:1674; number_of_response:1; }","duration":"121.001956ms","start":"2026-01-28T15:03:40.516596Z","end":"2026-01-28T15:03:40.637598Z","steps":["trace[1691317442] 'process raft request'  (duration: 120.967675ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:03:40.637668Z","caller":"traceutil/trace.go:171","msg":"trace[548064120] transaction","detail":"{read_only:false; response_revision:1673; number_of_response:1; }","duration":"145.022392ms","start":"2026-01-28T15:03:40.492599Z","end":"2026-01-28T15:03:40.637621Z","steps":["trace[548064120] 'process raft request'  (duration: 47.207254ms)","trace[548064120] 'compare'  (duration: 97.643915ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:03:40.637943Z","caller":"traceutil/trace.go:171","msg":"trace[485037584] linearizableReadLoop","detail":"{readStateIndex:1751; appliedIndex:1750; }","duration":"136.383436ms","start":"2026-01-28T15:03:40.501549Z","end":"2026-01-28T15:03:40.637932Z","steps":["trace[485037584] 'read index received'  (duration: 38.20842ms)","trace[485037584] 'applied index is now lower than readState.Index'  (duration: 98.173706ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:03:40.638177Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.615611ms","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-01-28T15:03:40.638201Z","caller":"traceutil/trace.go:171","msg":"trace[1148010794] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1674; }","duration":"136.713502ms","start":"2026-01-28T15:03:40.501482Z","end":"2026-01-28T15:03:40.638195Z","steps":["trace[1148010794] 'agreement among raft nodes before linearized reading'  (duration: 136.556309ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:40.638524Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.400703ms","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-01-28T15:03:40.638547Z","caller":"traceutil/trace.go:171","msg":"trace[2135220845] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1674; }","duration":"127.437404ms","start":"2026-01-28T15:03:40.511103Z","end":"2026-01-28T15:03:40.638541Z","steps":["trace[2135220845] 'agreement among raft nodes before linearized reading'  (duration: 127.378643ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:40.63901Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.514811ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"info","ts":"2026-01-28T15:03:40.639106Z","caller":"traceutil/trace.go:171","msg":"trace[1584549486] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1674; }","duration":"130.649044ms","start":"2026-01-28T15:03:40.508448Z","end":"2026-01-28T15:03:40.639097Z","steps":["trace[1584549486] 'agreement among raft nodes before linearized reading'  (duration: 129.865136ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:03:54.162266Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.238915ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/validatingwebhookconfigurations/\" range_end:\"/registry/validatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:03:54.162355Z","caller":"traceutil/trace.go:171","msg":"trace[929130655] range","detail":"{range_begin:/registry/validatingwebhookconfigurations/; range_end:/registry/validatingwebhookconfigurations0; response_count:0; response_revision:1729; }","duration":"172.332727ms","start":"2026-01-28T15:03:53.989989Z","end":"2026-01-28T15:03:54.162321Z","steps":["trace[929130655] 'count revisions from in-memory index tree'  (duration: 172.163213ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:04:03.079914Z","caller":"traceutil/trace.go:171","msg":"trace[1472795934] linearizableReadLoop","detail":"{readStateIndex:1847; appliedIndex:1846; }","duration":"154.862262ms","start":"2026-01-28T15:04:02.925033Z","end":"2026-01-28T15:04:03.079895Z","steps":["trace[1472795934] 'read index received'  (duration: 69.665755ms)","trace[1472795934] 'applied index is now lower than readState.Index'  (duration: 85.195277ms)"],"step_count":2}
{"level":"warn","ts":"2026-01-28T15:04:03.080081Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.031975ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"}
{"level":"info","ts":"2026-01-28T15:04:03.080107Z","caller":"traceutil/trace.go:171","msg":"trace[1052970804] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1765; }","duration":"155.086517ms","start":"2026-01-28T15:04:02.925014Z","end":"2026-01-28T15:04:03.080101Z","steps":["trace[1052970804] 'agreement among raft nodes before linearized reading'  (duration: 154.947664ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:04:03.080287Z","caller":"traceutil/trace.go:171","msg":"trace[1310103647] transaction","detail":"{read_only:false; response_revision:1765; number_of_response:1; }","duration":"158.702454ms","start":"2026-01-28T15:04:02.921575Z","end":"2026-01-28T15:04:03.080277Z","steps":["trace[1310103647] 'process raft request'  (duration: 73.18632ms)","trace[1310103647] 'compare'  (duration: 84.887761ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:04:10.860201Z","caller":"traceutil/trace.go:171","msg":"trace[1143137977] transaction","detail":"{read_only:false; response_revision:1813; number_of_response:1; }","duration":"112.509764ms","start":"2026-01-28T15:04:10.747668Z","end":"2026-01-28T15:04:10.860178Z","steps":["trace[1143137977] 'process raft request'  (duration: 63.218286ms)","trace[1143137977] 'compare'  (duration: 48.950731ms)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:04:20.325645Z","caller":"traceutil/trace.go:171","msg":"trace[1482887594] linearizableReadLoop","detail":"{readStateIndex:1950; appliedIndex:1949; }","duration":"138.271847ms","start":"2026-01-28T15:04:20.187356Z","end":"2026-01-28T15:04:20.325628Z","steps":["trace[1482887594] 'read index received'  (duration: 138.106133ms)","trace[1482887594] 'applied index is now lower than readState.Index'  (duration: 164.874µs)"],"step_count":2}
{"level":"info","ts":"2026-01-28T15:04:20.325965Z","caller":"traceutil/trace.go:171","msg":"trace[308032752] transaction","detail":"{read_only:false; response_revision:1863; number_of_response:1; }","duration":"231.882615ms","start":"2026-01-28T15:04:20.094072Z","end":"2026-01-28T15:04:20.325955Z","steps":["trace[308032752] 'process raft request'  (duration: 231.430015ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:04:20.326204Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.846979ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/default/test-pvc\" ","response":"range_response_count:1 size:1243"}
{"level":"info","ts":"2026-01-28T15:04:20.326226Z","caller":"traceutil/trace.go:171","msg":"trace[880850175] range","detail":"{range_begin:/registry/persistentvolumeclaims/default/test-pvc; range_end:; response_count:1; response_revision:1863; }","duration":"138.918521ms","start":"2026-01-28T15:04:20.187302Z","end":"2026-01-28T15:04:20.32622Z","steps":["trace[880850175] 'agreement among raft nodes before linearized reading'  (duration: 138.39215ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:04:20.560545Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.36769ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/pvc-5d6ce8dd-37ef-4100-847e-45b5e7aa11a5\" ","response":"range_response_count:1 size:2174"}
{"level":"info","ts":"2026-01-28T15:04:20.560657Z","caller":"traceutil/trace.go:171","msg":"trace[1468932356] range","detail":"{range_begin:/registry/persistentvolumes/pvc-5d6ce8dd-37ef-4100-847e-45b5e7aa11a5; range_end:; response_count:1; response_revision:1863; }","duration":"229.489964ms","start":"2026-01-28T15:04:20.331129Z","end":"2026-01-28T15:04:20.560619Z","steps":["trace[1468932356] 'range keys from in-memory index tree'  (duration: 229.072313ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:04:20.560897Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"212.688703ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-01-28T15:04:20.561019Z","caller":"traceutil/trace.go:171","msg":"trace[1436927733] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1863; }","duration":"212.822466ms","start":"2026-01-28T15:04:20.34818Z","end":"2026-01-28T15:04:20.561003Z","steps":["trace[1436927733] 'range keys from in-memory index tree'  (duration: 212.647933ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:04:57.389795Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.975639ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-01-28T15:04:57.390139Z","caller":"traceutil/trace.go:171","msg":"trace[906942003] range","detail":"{range_begin:/registry/pods/; range_end:/registry/pods0; response_count:0; response_revision:2027; }","duration":"106.347207ms","start":"2026-01-28T15:04:57.283772Z","end":"2026-01-28T15:04:57.390119Z","steps":["trace[906942003] 'count revisions from in-memory index tree'  (duration: 105.937958ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:04:57.390491Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.111697ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/node-controller\" ","response":"range_response_count:1 size:195"}
{"level":"info","ts":"2026-01-28T15:04:57.390571Z","caller":"traceutil/trace.go:171","msg":"trace[59501661] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/node-controller; range_end:; response_count:1; response_revision:2027; }","duration":"103.21189ms","start":"2026-01-28T15:04:57.28734Z","end":"2026-01-28T15:04:57.390552Z","steps":["trace[59501661] 'range keys from in-memory index tree'  (duration: 103.026475ms)"],"step_count":1}
{"level":"info","ts":"2026-01-28T15:05:04.088344Z","caller":"traceutil/trace.go:171","msg":"trace[215492448] transaction","detail":"{read_only:false; response_revision:2054; number_of_response:1; }","duration":"130.199397ms","start":"2026-01-28T15:05:03.95812Z","end":"2026-01-28T15:05:04.08832Z","steps":["trace[215492448] 'process raft request'  (duration: 129.204706ms)"],"step_count":1}
{"level":"warn","ts":"2026-01-28T15:05:04.333468Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.343696ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-operator-7fcd8d6ffd-rxc2n\" ","response":"range_response_count:1 size:4620"}
{"level":"info","ts":"2026-01-28T15:05:04.333533Z","caller":"traceutil/trace.go:171","msg":"trace[1381658265] range","detail":"{range_begin:/registry/pods/kube-system/cilium-operator-7fcd8d6ffd-rxc2n; range_end:; response_count:1; response_revision:2054; }","duration":"112.443987ms","start":"2026-01-28T15:05:04.221072Z","end":"2026-01-28T15:05:04.333516Z","steps":["trace[1381658265] 'range keys from in-memory index tree'  (duration: 112.210412ms)"],"step_count":1}