{"level":"warn","ts":"2026-07-25T07:40:14.923418Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-07-25T07:40:14.923526Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.235:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.235:2380","--initial-cluster=instance=https://199.204.45.235:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.235:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.235: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-07-25T07:40:14.923607Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-07-25T07:40:14.923621Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.235:2380"]} {"level":"info","ts":"2026-07-25T07:40:14.923652Z","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-07-25T07:40:14.924277Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.235:2379"]} {"level":"info","ts":"2026-07-25T07:40:14.924352Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.235:2380"],"listen-peer-urls":["https://199.204.45.235:2380"],"advertise-client-urls":["https://199.204.45.235:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.235:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.235: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-07-25T07:40:14.931524Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"6.972654ms"} {"level":"info","ts":"2026-07-25T07:40:14.93652Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"aab6040abcf11","cluster-id":"2bae7d3d8857c059"} {"level":"info","ts":"2026-07-25T07:40:14.936578Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 switched to configuration voters=()"} {"level":"info","ts":"2026-07-25T07:40:14.936597Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became follower at term 0"} {"level":"info","ts":"2026-07-25T07:40:14.936608Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft aab6040abcf11 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-07-25T07:40:14.936616Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became follower at term 1"} {"level":"info","ts":"2026-07-25T07:40:14.936643Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 switched to configuration voters=(3003179657318161)"} {"level":"warn","ts":"2026-07-25T07:40:14.941335Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-07-25T07:40:14.942344Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-07-25T07:40:14.943428Z","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-07-25T07:40:14.946085Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"aab6040abcf11","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-07-25T07:40:14.94661Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"aab6040abcf11","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-07-25T07:40:14.946836Z","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-07-25T07:40:14.946877Z","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-07-25T07:40:14.946892Z","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-07-25T07:40:14.947055Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 switched to configuration voters=(3003179657318161)"} {"level":"info","ts":"2026-07-25T07:40:14.947178Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"2bae7d3d8857c059","local-member-id":"aab6040abcf11","added-peer-id":"aab6040abcf11","added-peer-peer-urls":["https://199.204.45.235:2380"]} {"level":"info","ts":"2026-07-25T07:40:14.954933Z","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-07-25T07:40:14.955171Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.235:2380"} {"level":"info","ts":"2026-07-25T07:40:14.955493Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"aab6040abcf11","initial-advertise-peer-urls":["https://199.204.45.235:2380"],"listen-peer-urls":["https://199.204.45.235:2380"],"advertise-client-urls":["https://199.204.45.235:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.235:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-07-25T07:40:14.955548Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-07-25T07:40:14.955233Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.235:2380"} {"level":"info","ts":"2026-07-25T07:40:15.237391Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 is starting a new election at term 1"} {"level":"info","ts":"2026-07-25T07:40:15.237456Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became pre-candidate at term 1"} {"level":"info","ts":"2026-07-25T07:40:15.237497Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 received MsgPreVoteResp from aab6040abcf11 at term 1"} {"level":"info","ts":"2026-07-25T07:40:15.237535Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became candidate at term 2"} {"level":"info","ts":"2026-07-25T07:40:15.237552Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 received MsgVoteResp from aab6040abcf11 at term 2"} {"level":"info","ts":"2026-07-25T07:40:15.237573Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became leader at term 2"} {"level":"info","ts":"2026-07-25T07:40:15.237591Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: aab6040abcf11 elected leader aab6040abcf11 at term 2"} {"level":"info","ts":"2026-07-25T07:40:15.238803Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-07-25T07:40:15.239376Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-25T07:40:15.239837Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"2bae7d3d8857c059","local-member-id":"aab6040abcf11","cluster-version":"3.5"} {"level":"info","ts":"2026-07-25T07:40:15.239367Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"aab6040abcf11","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.235:2379]}","request-path":"/0/members/aab6040abcf11/attributes","cluster-id":"2bae7d3d8857c059","publish-timeout":"7s"} {"level":"info","ts":"2026-07-25T07:40:15.240037Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-25T07:40:15.240106Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-07-25T07:40:15.240159Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-07-25T07:40:15.240416Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-07-25T07:40:15.240508Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-07-25T07:40:15.242842Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-07-25T07:40:15.243317Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.235:2379"} {"level":"info","ts":"2026-07-25T07:40:53.00072Z","caller":"traceutil/trace.go:171","msg":"trace[762545444] transaction","detail":"{read_only:false; response_revision:533; number_of_response:1; }","duration":"109.648443ms","start":"2026-07-25T07:40:52.891044Z","end":"2026-07-25T07:40:53.000692Z","steps":["trace[762545444] 'process raft request' (duration: 109.459698ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:53.010132Z","caller":"traceutil/trace.go:171","msg":"trace[14836328] transaction","detail":"{read_only:false; response_revision:537; number_of_response:1; }","duration":"108.159977ms","start":"2026-07-25T07:40:52.90196Z","end":"2026-07-25T07:40:53.01012Z","steps":["trace[14836328] 'process raft request' (duration: 107.984793ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:53.010242Z","caller":"traceutil/trace.go:171","msg":"trace[1023162458] transaction","detail":"{read_only:false; response_revision:534; number_of_response:1; }","duration":"118.621537ms","start":"2026-07-25T07:40:52.891615Z","end":"2026-07-25T07:40:53.010237Z","steps":["trace[1023162458] 'process raft request' (duration: 118.179326ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:53.010283Z","caller":"traceutil/trace.go:171","msg":"trace[539746390] transaction","detail":"{read_only:false; response_revision:535; number_of_response:1; }","duration":"117.658393ms","start":"2026-07-25T07:40:52.892622Z","end":"2026-07-25T07:40:53.01028Z","steps":["trace[539746390] 'process raft request' (duration: 117.264573ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:53.010342Z","caller":"traceutil/trace.go:171","msg":"trace[1901994572] transaction","detail":"{read_only:false; response_revision:536; number_of_response:1; }","duration":"108.416693ms","start":"2026-07-25T07:40:52.901921Z","end":"2026-07-25T07:40:53.010338Z","steps":["trace[1901994572] 'process raft request' (duration: 107.994943ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:53.010372Z","caller":"traceutil/trace.go:171","msg":"trace[1871112966] transaction","detail":"{read_only:false; response_revision:538; number_of_response:1; }","duration":"105.242607ms","start":"2026-07-25T07:40:52.905098Z","end":"2026-07-25T07:40:53.010341Z","steps":["trace[1871112966] 'process raft request' (duration: 104.874768ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:53.010494Z","caller":"traceutil/trace.go:171","msg":"trace[2078157404] transaction","detail":"{read_only:false; response_revision:539; number_of_response:1; }","duration":"103.344701ms","start":"2026-07-25T07:40:52.907145Z","end":"2026-07-25T07:40:53.01049Z","steps":["trace[2078157404] 'process raft request' (duration: 102.86657ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:40:56.80044Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"278.164439ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-07-25T07:40:56.800556Z","caller":"traceutil/trace.go:171","msg":"trace[2076088839] linearizableReadLoop","detail":"{readStateIndex:642; appliedIndex:641; }","duration":"294.875005ms","start":"2026-07-25T07:40:56.505665Z","end":"2026-07-25T07:40:56.80054Z","steps":["trace[2076088839] 'read index received' (duration: 16.054041ms)","trace[2076088839] 'applied index is now lower than readState.Index' (duration: 278.819564ms)"],"step_count":2} {"level":"warn","ts":"2026-07-25T07:40:56.800739Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.07254ms","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-07-25T07:40:56.800773Z","caller":"traceutil/trace.go:171","msg":"trace[805621943] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:617; }","duration":"295.149841ms","start":"2026-07-25T07:40:56.505614Z","end":"2026-07-25T07:40:56.800764Z","steps":["trace[805621943] 'agreement among raft nodes before linearized reading' (duration: 294.968267ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:56.80082Z","caller":"traceutil/trace.go:171","msg":"trace[655730826] transaction","detail":"{read_only:false; response_revision:617; number_of_response:1; }","duration":"413.540427ms","start":"2026-07-25T07:40:56.387224Z","end":"2026-07-25T07:40:56.800765Z","steps":["trace[655730826] 'process raft request' (duration: 134.56883ms)","trace[655730826] 'compare' (duration: 277.766869ms)"],"step_count":2} {"level":"warn","ts":"2026-07-25T07:40:56.800956Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:40:56.387198Z","time spent":"413.700271ms","remote":"127.0.0.1:55962","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":818,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-25T07:40:59.225688Z","caller":"traceutil/trace.go:171","msg":"trace[931235393] linearizableReadLoop","detail":"{readStateIndex:665; appliedIndex:664; }","duration":"119.567242ms","start":"2026-07-25T07:40:59.106099Z","end":"2026-07-25T07:40:59.225666Z","steps":["trace[931235393] 'read index received' (duration: 118.944828ms)","trace[931235393] 'applied index is now lower than readState.Index' (duration: 621.754µs)"],"step_count":2} {"level":"info","ts":"2026-07-25T07:40:59.225752Z","caller":"traceutil/trace.go:171","msg":"trace[248129609] transaction","detail":"{read_only:false; response_revision:639; number_of_response:1; }","duration":"134.11257ms","start":"2026-07-25T07:40:59.091614Z","end":"2026-07-25T07:40:59.225726Z","steps":["trace[248129609] 'process raft request' (duration: 133.65606ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:40:59.225805Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.692454ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-94ldl\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-07-25T07:40:59.22583Z","caller":"traceutil/trace.go:171","msg":"trace[1693279797] range","detail":"{range_begin:/registry/pods/kube-system/cilium-94ldl; range_end:; response_count:1; response_revision:639; }","duration":"119.753925ms","start":"2026-07-25T07:40:59.106068Z","end":"2026-07-25T07:40:59.225822Z","steps":["trace[1693279797] 'agreement among raft nodes before linearized reading' (duration: 119.685254ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:59.881527Z","caller":"traceutil/trace.go:171","msg":"trace[1214223744] linearizableReadLoop","detail":"{readStateIndex:667; appliedIndex:666; }","duration":"253.003178ms","start":"2026-07-25T07:40:59.628494Z","end":"2026-07-25T07:40:59.881497Z","steps":["trace[1214223744] 'read index received' (duration: 227.933771ms)","trace[1214223744] 'applied index is now lower than readState.Index' (duration: 25.067827ms)"],"step_count":2} {"level":"warn","ts":"2026-07-25T07:40:59.881696Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.192593ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-25T07:40:59.88173Z","caller":"traceutil/trace.go:171","msg":"trace[717421252] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:641; }","duration":"253.295515ms","start":"2026-07-25T07:40:59.628424Z","end":"2026-07-25T07:40:59.881719Z","steps":["trace[717421252] 'agreement among raft nodes before linearized reading' (duration: 253.204373ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:40:59.88172Z","caller":"traceutil/trace.go:171","msg":"trace[108420246] transaction","detail":"{read_only:false; response_revision:641; number_of_response:1; }","duration":"583.743722ms","start":"2026-07-25T07:40:59.297946Z","end":"2026-07-25T07:40:59.88169Z","steps":["trace[108420246] 'process raft request' (duration: 558.563273ms)","trace[108420246] 'compare' (duration: 24.837911ms)"],"step_count":2} {"level":"warn","ts":"2026-07-25T07:40:59.881816Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:40:59.297921Z","time spent":"583.848025ms","remote":"127.0.0.1:56228","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1627,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-25T07:42:09.219748Z","caller":"traceutil/trace.go:171","msg":"trace[46297129] transaction","detail":"{read_only:false; response_revision:1077; number_of_response:1; }","duration":"114.459567ms","start":"2026-07-25T07:42:09.105265Z","end":"2026-07-25T07:42:09.219725Z","steps":["trace[46297129] 'process raft request' (duration: 114.323576ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:42:09.58307Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"277.108626ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"warn","ts":"2026-07-25T07:42:09.583108Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"341.134286ms","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-07-25T07:42:09.583166Z","caller":"traceutil/trace.go:171","msg":"trace[226826401] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1077; }","duration":"277.245808ms","start":"2026-07-25T07:42:09.305891Z","end":"2026-07-25T07:42:09.583136Z","steps":["trace[226826401] 'range keys from in-memory index tree' (duration: 276.897603ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:42:09.583176Z","caller":"traceutil/trace.go:171","msg":"trace[943800808] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1077; }","duration":"341.238897ms","start":"2026-07-25T07:42:09.24192Z","end":"2026-07-25T07:42:09.583159Z","steps":["trace[943800808] 'range keys from in-memory index tree' (duration: 341.002975ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:42:09.583238Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:42:09.241909Z","time spent":"341.312029ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-07-25T07:42:09.583229Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.751232ms","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-07-25T07:42:09.583285Z","caller":"traceutil/trace.go:171","msg":"trace[1406382785] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1077; }","duration":"276.838132ms","start":"2026-07-25T07:42:09.306434Z","end":"2026-07-25T07:42:09.583272Z","steps":["trace[1406382785] 'range keys from in-memory index tree' (duration: 276.61375ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:42:09.583408Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.383135ms","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-07-25T07:42:09.58344Z","caller":"traceutil/trace.go:171","msg":"trace[37968106] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1077; }","duration":"295.451596ms","start":"2026-07-25T07:42:09.287978Z","end":"2026-07-25T07:42:09.583429Z","steps":["trace[37968106] 'range keys from in-memory index tree' (duration: 295.199273ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:42:09.583409Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.677659ms","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-07-25T07:42:09.583482Z","caller":"traceutil/trace.go:171","msg":"trace[146426830] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1077; }","duration":"295.807071ms","start":"2026-07-25T07:42:09.28766Z","end":"2026-07-25T07:42:09.583468Z","steps":["trace[146426830] 'range keys from in-memory index tree' (duration: 295.525327ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:42:09.71369Z","caller":"traceutil/trace.go:171","msg":"trace[1883487218] transaction","detail":"{read_only:false; response_revision:1079; number_of_response:1; }","duration":"126.432391ms","start":"2026-07-25T07:42:09.58722Z","end":"2026-07-25T07:42:09.713653Z","steps":["trace[1883487218] 'process raft request' (duration: 126.262529ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:42:09.713907Z","caller":"traceutil/trace.go:171","msg":"trace[107171518] transaction","detail":"{read_only:false; response_revision:1080; number_of_response:1; }","duration":"126.531173ms","start":"2026-07-25T07:42:09.587364Z","end":"2026-07-25T07:42:09.713896Z","steps":["trace[107171518] 'process raft request' (duration: 126.2487ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:42:09.714063Z","caller":"traceutil/trace.go:171","msg":"trace[164751728] transaction","detail":"{read_only:false; response_revision:1081; number_of_response:1; }","duration":"126.486892ms","start":"2026-07-25T07:42:09.587568Z","end":"2026-07-25T07:42:09.714054Z","steps":["trace[164751728] 'process raft request' (duration: 126.29393ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:42:09.71442Z","caller":"traceutil/trace.go:171","msg":"trace[1935613506] transaction","detail":"{read_only:false; response_revision:1082; number_of_response:1; }","duration":"126.728815ms","start":"2026-07-25T07:42:09.587663Z","end":"2026-07-25T07:42:09.714392Z","steps":["trace[1935613506] 'process raft request' (duration: 126.362591ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:42:36.7506Z","caller":"traceutil/trace.go:171","msg":"trace[718565181] linearizableReadLoop","detail":"{readStateIndex:1217; appliedIndex:1216; }","duration":"122.657636ms","start":"2026-07-25T07:42:36.627912Z","end":"2026-07-25T07:42:36.750569Z","steps":["trace[718565181] 'read index received' (duration: 122.416273ms)","trace[718565181] 'applied index is now lower than readState.Index' (duration: 240.313µs)"],"step_count":2} {"level":"warn","ts":"2026-07-25T07:42:36.751045Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.849828ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-25T07:42:36.751112Z","caller":"traceutil/trace.go:171","msg":"trace[2047197265] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1168; }","duration":"123.269603ms","start":"2026-07-25T07:42:36.627826Z","end":"2026-07-25T07:42:36.751096Z","steps":["trace[2047197265] 'agreement among raft nodes before linearized reading' (duration: 122.884309ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:42:36.751037Z","caller":"traceutil/trace.go:171","msg":"trace[369232952] transaction","detail":"{read_only:false; response_revision:1168; number_of_response:1; }","duration":"144.66895ms","start":"2026-07-25T07:42:36.606322Z","end":"2026-07-25T07:42:36.750991Z","steps":["trace[369232952] 'process raft request' (duration: 144.072513ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:42:38.915929Z","caller":"traceutil/trace.go:171","msg":"trace[2016886784] transaction","detail":"{read_only:false; response_revision:1175; number_of_response:1; }","duration":"158.962923ms","start":"2026-07-25T07:42:38.756923Z","end":"2026-07-25T07:42:38.915886Z","steps":["trace[2016886784] 'process raft request' (duration: 158.775791ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:44:02.403484Z","caller":"traceutil/trace.go:171","msg":"trace[894100827] transaction","detail":"{read_only:false; response_revision:1447; number_of_response:1; }","duration":"219.376138ms","start":"2026-07-25T07:44:02.184056Z","end":"2026-07-25T07:44:02.403432Z","steps":["trace[894100827] 'process raft request' (duration: 219.196263ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:44:02.584166Z","caller":"traceutil/trace.go:171","msg":"trace[873898082] transaction","detail":"{read_only:false; response_revision:1451; number_of_response:1; }","duration":"175.807925ms","start":"2026-07-25T07:44:02.408332Z","end":"2026-07-25T07:44:02.58414Z","steps":["trace[873898082] 'process raft request' (duration: 175.764203ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:44:02.584294Z","caller":"traceutil/trace.go:171","msg":"trace[1361712454] transaction","detail":"{read_only:false; response_revision:1448; number_of_response:1; }","duration":"176.638547ms","start":"2026-07-25T07:44:02.407621Z","end":"2026-07-25T07:44:02.584259Z","steps":["trace[1361712454] 'process raft request' (duration: 139.240381ms)","trace[1361712454] 'compare' (duration: 37.004065ms)"],"step_count":2} {"level":"info","ts":"2026-07-25T07:44:02.584473Z","caller":"traceutil/trace.go:171","msg":"trace[87645110] transaction","detail":"{read_only:false; response_revision:1449; number_of_response:1; }","duration":"176.677068ms","start":"2026-07-25T07:44:02.407781Z","end":"2026-07-25T07:44:02.584458Z","steps":["trace[87645110] 'process raft request' (duration: 176.215856ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:44:02.58463Z","caller":"traceutil/trace.go:171","msg":"trace[687008257] transaction","detail":"{read_only:false; response_revision:1450; number_of_response:1; }","duration":"176.746009ms","start":"2026-07-25T07:44:02.407872Z","end":"2026-07-25T07:44:02.584618Z","steps":["trace[687008257] 'process raft request' (duration: 176.181854ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:49:18.066955Z","caller":"traceutil/trace.go:171","msg":"trace[2076210368] transaction","detail":"{read_only:false; response_revision:2483; number_of_response:1; }","duration":"163.031249ms","start":"2026-07-25T07:49:17.903898Z","end":"2026-07-25T07:49:18.06693Z","steps":["trace[2076210368] 'process raft request' (duration: 162.850805ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:49:52.497894Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.006831ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-25T07:49:52.49815Z","caller":"traceutil/trace.go:171","msg":"trace[1915433054] transaction","detail":"{read_only:false; response_revision:2673; number_of_response:1; }","duration":"187.911677ms","start":"2026-07-25T07:49:52.31022Z","end":"2026-07-25T07:49:52.498132Z","steps":["trace[1915433054] 'process raft request' (duration: 187.871736ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:49:52.498324Z","caller":"traceutil/trace.go:171","msg":"trace[1387663811] transaction","detail":"{read_only:false; response_revision:2672; number_of_response:1; }","duration":"188.080051ms","start":"2026-07-25T07:49:52.310233Z","end":"2026-07-25T07:49:52.498313Z","steps":["trace[1387663811] 'process raft request' (duration: 187.825445ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:49:52.498377Z","caller":"traceutil/trace.go:171","msg":"trace[2130872200] transaction","detail":"{read_only:false; response_revision:2670; number_of_response:1; }","duration":"189.690942ms","start":"2026-07-25T07:49:52.308648Z","end":"2026-07-25T07:49:52.498339Z","steps":["trace[2130872200] 'process raft request' (duration: 54.574842ms)","trace[2130872200] 'compare' (duration: 133.897359ms)"],"step_count":2} {"level":"info","ts":"2026-07-25T07:49:52.498406Z","caller":"traceutil/trace.go:171","msg":"trace[1921333643] transaction","detail":"{read_only:false; response_revision:2671; number_of_response:1; }","duration":"188.198054ms","start":"2026-07-25T07:49:52.3101Z","end":"2026-07-25T07:49:52.498298Z","steps":["trace[1921333643] 'process raft request' (duration: 187.892846ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:49:52.512861Z","caller":"traceutil/trace.go:171","msg":"trace[1077971963] transaction","detail":"{read_only:false; response_revision:2674; number_of_response:1; }","duration":"148.342992ms","start":"2026-07-25T07:49:52.36449Z","end":"2026-07-25T07:49:52.512833Z","steps":["trace[1077971963] 'process raft request' (duration: 148.205048ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:49:54.222926Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"649.50229ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-07-25T07:49:54.223182Z","caller":"traceutil/trace.go:171","msg":"trace[1212939079] linearizableReadLoop","detail":"{readStateIndex:2818; appliedIndex:2817; }","duration":"987.066411ms","start":"2026-07-25T07:49:53.236098Z","end":"2026-07-25T07:49:54.223165Z","steps":["trace[1212939079] 'read index received' (duration: 337.031548ms)","trace[1212939079] 'applied index is now lower than readState.Index' (duration: 650.033673ms)"],"step_count":2} {"level":"info","ts":"2026-07-25T07:49:54.223324Z","caller":"traceutil/trace.go:171","msg":"trace[189770114] transaction","detail":"{read_only:false; response_revision:2681; number_of_response:1; }","duration":"985.393209ms","start":"2026-07-25T07:49:53.2379Z","end":"2026-07-25T07:49:54.223293Z","steps":["trace[189770114] 'process raft request' (duration: 985.209165ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:49:54.223339Z","caller":"traceutil/trace.go:171","msg":"trace[1442259390] transaction","detail":"{read_only:false; response_revision:2680; number_of_response:1; }","duration":"1.079233551s","start":"2026-07-25T07:49:53.143871Z","end":"2026-07-25T07:49:54.223104Z","steps":["trace[1442259390] 'process raft request' (duration: 429.30203ms)","trace[1442259390] 'compare' (duration: 649.271204ms)"],"step_count":2} {"level":"warn","ts":"2026-07-25T07:49:54.223419Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:49:53.237875Z","time spent":"985.508091ms","remote":"127.0.0.1:55830","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":773,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-25T07:49:54.223425Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"987.307428ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:472"} {"level":"info","ts":"2026-07-25T07:49:54.223489Z","caller":"traceutil/trace.go:171","msg":"trace[1659777211] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:2681; }","duration":"987.423622ms","start":"2026-07-25T07:49:53.23605Z","end":"2026-07-25T07:49:54.223473Z","steps":["trace[1659777211] 'agreement among raft nodes before linearized reading' (duration: 987.199935ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:49:54.22353Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:49:53.236029Z","time spent":"987.494413ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":493,"request content":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" "} {"level":"warn","ts":"2026-07-25T07:49:54.223775Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:49:53.143847Z","time spent":"1.079837176s","remote":"127.0.0.1:55830","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":836,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-25T07:49:54.292756Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"664.075046ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-25T07:49:54.292816Z","caller":"traceutil/trace.go:171","msg":"trace[870932418] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2681; }","duration":"664.184439ms","start":"2026-07-25T07:49:53.628618Z","end":"2026-07-25T07:49:54.292803Z","steps":["trace[870932418] 'agreement among raft nodes before linearized reading' (duration: 664.077697ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:49:54.292848Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:49:53.628575Z","time spent":"664.267351ms","remote":"127.0.0.1:55776","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":26,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-07-25T07:49:54.341082Z","caller":"traceutil/trace.go:171","msg":"trace[1932518511] transaction","detail":"{read_only:false; response_revision:2682; number_of_response:1; }","duration":"111.906044ms","start":"2026-07-25T07:49:54.229124Z","end":"2026-07-25T07:49:54.34103Z","steps":["trace[1932518511] 'process raft request' (duration: 111.019382ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:50:08.19248Z","caller":"traceutil/trace.go:171","msg":"trace[99262053] transaction","detail":"{read_only:false; response_revision:2771; number_of_response:1; }","duration":"338.747312ms","start":"2026-07-25T07:50:07.853706Z","end":"2026-07-25T07:50:08.192453Z","steps":["trace[99262053] 'process raft request' (duration: 338.297581ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:08.192626Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:07.853688Z","time spent":"338.864205ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":520,"response count":0,"response size":37,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-25T07:50:09.491221Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.222064154s","expected-duration":"100ms","prefix":"","request":"header: lease_grant:","response":"size:38"} {"level":"info","ts":"2026-07-25T07:50:09.491369Z","caller":"traceutil/trace.go:171","msg":"trace[588298143] linearizableReadLoop","detail":"{readStateIndex:2913; appliedIndex:2912; }","duration":"1.073824795s","start":"2026-07-25T07:50:08.41752Z","end":"2026-07-25T07:50:09.491345Z","steps":["trace[588298143] 'read index received' (duration: 65.212µs)","trace[588298143] 'applied index is now lower than readState.Index' (duration: 1.073757633s)"],"step_count":2} {"level":"warn","ts":"2026-07-25T07:50:09.491438Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:08.194149Z","time spent":"1.297285426s","remote":"127.0.0.1:55796","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"warn","ts":"2026-07-25T07:50:09.491727Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.074201724s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-25T07:50:09.491766Z","caller":"traceutil/trace.go:171","msg":"trace[1850137221] range","detail":"{range_begin:/registry/volumeattachments/; range_end:/registry/volumeattachments0; response_count:0; response_revision:2771; }","duration":"1.074248825s","start":"2026-07-25T07:50:08.417503Z","end":"2026-07-25T07:50:09.491752Z","steps":["trace[1850137221] 'agreement among raft nodes before linearized reading' (duration: 1.074173423s)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.491798Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:08.417444Z","time spent":"1.074345858s","remote":"127.0.0.1:56122","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":0,"response size":26,"request content":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true "} {"level":"info","ts":"2026-07-25T07:50:09.538685Z","caller":"traceutil/trace.go:171","msg":"trace[629990851] transaction","detail":"{read_only:false; response_revision:2772; number_of_response:1; }","duration":"942.03273ms","start":"2026-07-25T07:50:08.596631Z","end":"2026-07-25T07:50:09.538663Z","steps":["trace[629990851] 'process raft request' (duration: 941.805963ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.53883Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:08.596615Z","time spent":"942.133972ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":37,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-25T07:50:09.539931Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.088897193s","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-07-25T07:50:09.540097Z","caller":"traceutil/trace.go:171","msg":"trace[1645669285] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2774; }","duration":"1.089023367s","start":"2026-07-25T07:50:08.450967Z","end":"2026-07-25T07:50:09.53999Z","steps":["trace[1645669285] 'agreement among raft nodes before linearized reading' (duration: 1.088789391s)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.540439Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"475.573464ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:524"} {"level":"warn","ts":"2026-07-25T07:50:09.541117Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:08.450947Z","time spent":"1.090123124s","remote":"127.0.0.1:56010","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":"info","ts":"2026-07-25T07:50:09.541196Z","caller":"traceutil/trace.go:171","msg":"trace[1339140087] range","detail":"{range_begin:/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:2774; }","duration":"476.375244ms","start":"2026-07-25T07:50:09.064797Z","end":"2026-07-25T07:50:09.541172Z","steps":["trace[1339140087] 'agreement among raft nodes before linearized reading' (duration: 475.502462ms)"],"step_count":1} {"level":"info","ts":"2026-07-25T07:50:09.540504Z","caller":"traceutil/trace.go:171","msg":"trace[623110367] transaction","detail":"{read_only:false; response_revision:2773; number_of_response:1; }","duration":"506.941573ms","start":"2026-07-25T07:50:09.033517Z","end":"2026-07-25T07:50:09.540458Z","steps":["trace[623110367] 'process raft request' (duration: 506.054031ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.541337Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:09.064774Z","time spent":"476.547279ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":1,"response size":545,"request content":"key:\"/registry/leases/kube-system/external-attacher-leader-rbd-csi-ceph-com\" "} {"level":"warn","ts":"2026-07-25T07:50:09.541409Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:09.03348Z","time spent":"507.860376ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":672,"response count":0,"response size":37,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-25T07:50:09.540561Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.642828ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:473"} {"level":"info","ts":"2026-07-25T07:50:09.54149Z","caller":"traceutil/trace.go:171","msg":"trace[1986489059] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:2774; }","duration":"172.595832ms","start":"2026-07-25T07:50:09.368875Z","end":"2026-07-25T07:50:09.541471Z","steps":["trace[1986489059] 'agreement among raft nodes before linearized reading' (duration: 171.599347ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.540701Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"936.614392ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"} {"level":"info","ts":"2026-07-25T07:50:09.541649Z","caller":"traceutil/trace.go:171","msg":"trace[1034025236] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:2774; }","duration":"937.604968ms","start":"2026-07-25T07:50:08.604035Z","end":"2026-07-25T07:50:09.54164Z","steps":["trace[1034025236] 'agreement among raft nodes before linearized reading' (duration: 936.566841ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.541694Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:08.604018Z","time spent":"937.660558ms","remote":"127.0.0.1:56010","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-07-25T07:50:09.540695Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"352.96934ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" ","response":"range_response_count:1 size:530"} {"level":"info","ts":"2026-07-25T07:50:09.542191Z","caller":"traceutil/trace.go:171","msg":"trace[1793568130] range","detail":"{range_begin:/registry/leases/kube-system/rbd.csi.ceph.com-kube-system; range_end:; response_count:1; response_revision:2774; }","duration":"354.488768ms","start":"2026-07-25T07:50:09.187665Z","end":"2026-07-25T07:50:09.542153Z","steps":["trace[1793568130] 'agreement among raft nodes before linearized reading' (duration: 352.901448ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.542358Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:09.187644Z","time spent":"354.691994ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":59,"response count":1,"response size":551,"request content":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" "} {"level":"warn","ts":"2026-07-25T07:50:09.540798Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"935.921974ms","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":"warn","ts":"2026-07-25T07:50:09.540905Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"962.639567ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-07-25T07:50:09.543094Z","caller":"traceutil/trace.go:171","msg":"trace[1946038238] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2774; }","duration":"964.846802ms","start":"2026-07-25T07:50:08.578232Z","end":"2026-07-25T07:50:09.543079Z","steps":["trace[1946038238] 'agreement among raft nodes before linearized reading' (duration: 962.602366ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.543142Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:08.578216Z","time spent":"964.913954ms","remote":"127.0.0.1:56010","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-07-25T07:50:09.540797Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"940.179591ms","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-07-25T07:50:09.543357Z","caller":"traceutil/trace.go:171","msg":"trace[1705550225] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2774; }","duration":"942.753937ms","start":"2026-07-25T07:50:08.600584Z","end":"2026-07-25T07:50:09.543337Z","steps":["trace[1705550225] 'agreement among raft nodes before linearized reading' (duration: 940.156851ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.543472Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:08.600566Z","time spent":"942.885159ms","remote":"127.0.0.1:56010","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":"info","ts":"2026-07-25T07:50:09.543165Z","caller":"traceutil/trace.go:171","msg":"trace[1387832070] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2774; }","duration":"938.188772ms","start":"2026-07-25T07:50:08.604844Z","end":"2026-07-25T07:50:09.543033Z","steps":["trace[1387832070] 'agreement among raft nodes before linearized reading' (duration: 935.882034ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:50:09.543943Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:50:08.604831Z","time spent":"939.091804ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":514,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-07-25T07:50:15.380008Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":1690} {"level":"info","ts":"2026-07-25T07:50:15.413897Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":1690,"took":"33.198765ms","hash":3471331555,"current-db-size-bytes":22790144,"current-db-size":"23 MB","current-db-size-in-use-bytes":6107136,"current-db-size-in-use":"6.1 MB"} {"level":"info","ts":"2026-07-25T07:50:15.413973Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3471331555,"revision":1690,"compact-revision":-1} {"level":"info","ts":"2026-07-25T07:53:15.722504Z","caller":"traceutil/trace.go:171","msg":"trace[1244738029] transaction","detail":"{read_only:false; response_revision:3630; number_of_response:1; }","duration":"516.291649ms","start":"2026-07-25T07:53:15.206186Z","end":"2026-07-25T07:53:15.722477Z","steps":["trace[1244738029] 'process raft request' (duration: 516.129865ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:53:15.722709Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:53:15.206177Z","time spent":"516.406582ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":458,"response count":0,"response size":37,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-25T07:53:15.724659Z","caller":"traceutil/trace.go:171","msg":"trace[1771256660] linearizableReadLoop","detail":"{readStateIndex:3811; appliedIndex:3810; }","duration":"404.434028ms","start":"2026-07-25T07:53:15.320144Z","end":"2026-07-25T07:53:15.724578Z","steps":["trace[1771256660] 'read index received' (duration: 402.617492ms)","trace[1771256660] 'applied index is now lower than readState.Index' (duration: 1.815646ms)"],"step_count":2} {"level":"info","ts":"2026-07-25T07:53:15.724843Z","caller":"traceutil/trace.go:171","msg":"trace[2125350693] transaction","detail":"{read_only:false; response_revision:3631; number_of_response:1; }","duration":"518.096955ms","start":"2026-07-25T07:53:15.206729Z","end":"2026-07-25T07:53:15.724826Z","steps":["trace[2125350693] 'process raft request' (duration: 517.680015ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:53:15.724927Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:53:15.206712Z","time spent":"518.173886ms","remote":"127.0.0.1:56010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":37,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-25T07:53:15.72519Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"300.636078ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-07-25T07:53:15.725207Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"405.025362ms","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-07-25T07:53:15.725233Z","caller":"traceutil/trace.go:171","msg":"trace[320499078] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:3631; }","duration":"300.710029ms","start":"2026-07-25T07:53:15.424511Z","end":"2026-07-25T07:53:15.725221Z","steps":["trace[320499078] 'agreement among raft nodes before linearized reading' (duration: 300.641757ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:53:15.725278Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:53:15.424495Z","time spent":"300.774571ms","remote":"127.0.0.1:38318","response type":"/etcdserverpb.KV/Range","request count":0,"request size":104,"response count":0,"response size":26,"request content":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" count_only:true "} {"level":"info","ts":"2026-07-25T07:53:15.725447Z","caller":"traceutil/trace.go:171","msg":"trace[1471765666] range","detail":"{range_begin:/registry/roles/; range_end:/registry/roles0; response_count:0; response_revision:3631; }","duration":"405.141625ms","start":"2026-07-25T07:53:15.320099Z","end":"2026-07-25T07:53:15.725241Z","steps":["trace[1471765666] 'agreement among raft nodes before linearized reading' (duration: 405.016162ms)"],"step_count":1} {"level":"warn","ts":"2026-07-25T07:53:15.725732Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T07:53:15.320081Z","time spent":"405.422332ms","remote":"127.0.0.1:56066","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":17,"response size":28,"request content":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" count_only:true "} {"level":"info","ts":"2026-07-25T07:55:15.385277Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2802} {"level":"info","ts":"2026-07-25T07:55:15.405179Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2802,"took":"19.454883ms","hash":276840227,"current-db-size-bytes":22790144,"current-db-size":"23 MB","current-db-size-in-use-bytes":6553600,"current-db-size-in-use":"6.6 MB"} {"level":"info","ts":"2026-07-25T07:55:15.405244Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":276840227,"revision":2802,"compact-revision":1690}