{"level":"warn","ts":"2026-06-18T15:09:46.220879Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-18T15:09:46.220961Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.121:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.121:2380","--initial-cluster=instance=https://199.19.213.121:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.121:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.121:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-06-18T15:09:46.221028Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-18T15:09:46.221044Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.121:2380"]} {"level":"info","ts":"2026-06-18T15:09:46.221068Z","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-06-18T15:09:46.221737Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.121:2379"]} {"level":"info","ts":"2026-06-18T15:09:46.221809Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.121:2380"],"listen-peer-urls":["https://199.19.213.121:2380"],"advertise-client-urls":["https://199.19.213.121:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.121:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.121:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-06-18T15:09:46.228319Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"6.272269ms"} {"level":"info","ts":"2026-06-18T15:09:46.235415Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"31541ae44470b70","cluster-id":"8ae2d89c48d1447d"} {"level":"info","ts":"2026-06-18T15:09:46.235489Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 switched to configuration voters=()"} {"level":"info","ts":"2026-06-18T15:09:46.235513Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became follower at term 0"} {"level":"info","ts":"2026-06-18T15:09:46.235531Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 31541ae44470b70 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-06-18T15:09:46.23554Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became follower at term 1"} {"level":"info","ts":"2026-06-18T15:09:46.235579Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 switched to configuration voters=(222155973350329200)"} {"level":"warn","ts":"2026-06-18T15:09:46.247812Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-06-18T15:09:46.24985Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-06-18T15:09:46.251405Z","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-06-18T15:09:46.254325Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"31541ae44470b70","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-06-18T15:09:46.254447Z","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-06-18T15:09:46.254531Z","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-06-18T15:09:46.254541Z","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-06-18T15:09:46.254533Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"31541ae44470b70","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-06-18T15:09:46.255019Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 switched to configuration voters=(222155973350329200)"} {"level":"info","ts":"2026-06-18T15:09:46.255091Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"8ae2d89c48d1447d","local-member-id":"31541ae44470b70","added-peer-id":"31541ae44470b70","added-peer-peer-urls":["https://199.19.213.121:2380"]} {"level":"info","ts":"2026-06-18T15:09:46.261701Z","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-06-18T15:09:46.261896Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"31541ae44470b70","initial-advertise-peer-urls":["https://199.19.213.121:2380"],"listen-peer-urls":["https://199.19.213.121:2380"],"advertise-client-urls":["https://199.19.213.121:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.121:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-06-18T15:09:46.26193Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-06-18T15:09:46.261998Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.121:2380"} {"level":"info","ts":"2026-06-18T15:09:46.262045Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.121:2380"} {"level":"info","ts":"2026-06-18T15:09:46.636674Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 is starting a new election at term 1"} {"level":"info","ts":"2026-06-18T15:09:46.636732Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became pre-candidate at term 1"} {"level":"info","ts":"2026-06-18T15:09:46.636754Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 received MsgPreVoteResp from 31541ae44470b70 at term 1"} {"level":"info","ts":"2026-06-18T15:09:46.636769Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became candidate at term 2"} {"level":"info","ts":"2026-06-18T15:09:46.636817Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 received MsgVoteResp from 31541ae44470b70 at term 2"} {"level":"info","ts":"2026-06-18T15:09:46.63683Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"31541ae44470b70 became leader at term 2"} {"level":"info","ts":"2026-06-18T15:09:46.636844Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 31541ae44470b70 elected leader 31541ae44470b70 at term 2"} {"level":"info","ts":"2026-06-18T15:09:46.637805Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-06-18T15:09:46.638914Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-18T15:09:46.638915Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"31541ae44470b70","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.121:2379]}","request-path":"/0/members/31541ae44470b70/attributes","cluster-id":"8ae2d89c48d1447d","publish-timeout":"7s"} {"level":"info","ts":"2026-06-18T15:09:46.63896Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-18T15:09:46.639193Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-06-18T15:09:46.639214Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-06-18T15:09:46.639208Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"8ae2d89c48d1447d","local-member-id":"31541ae44470b70","cluster-version":"3.5"} {"level":"info","ts":"2026-06-18T15:09:46.63931Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-06-18T15:09:46.639359Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-06-18T15:09:46.642263Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.121:2379"} {"level":"info","ts":"2026-06-18T15:09:46.642775Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-06-18T15:09:48.306333Z","caller":"traceutil/trace.go:171","msg":"trace[1418522746] transaction","detail":"{read_only:false; response_revision:10; number_of_response:1; }","duration":"321.376173ms","start":"2026-06-18T15:09:47.984799Z","end":"2026-06-18T15:09:48.306175Z","steps":["trace[1418522746] 'process raft request' (duration: 245.388397ms)","trace[1418522746] 'compare' (duration: 75.82364ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:09:48.30652Z","caller":"traceutil/trace.go:171","msg":"trace[1796108331] transaction","detail":"{read_only:false; response_revision:12; number_of_response:1; }","duration":"319.684567ms","start":"2026-06-18T15:09:47.98682Z","end":"2026-06-18T15:09:48.306505Z","steps":["trace[1796108331] 'process raft request' (duration: 319.344815ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:48.306649Z","caller":"traceutil/trace.go:171","msg":"trace[1345361679] linearizableReadLoop","detail":"{readStateIndex:14; appliedIndex:7; }","duration":"320.98146ms","start":"2026-06-18T15:09:47.985592Z","end":"2026-06-18T15:09:48.306573Z","steps":["trace[1345361679] 'read index received' (duration: 24.608805ms)","trace[1345361679] 'applied index is now lower than readState.Index' (duration: 296.025223ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:09:48.30669Z","caller":"traceutil/trace.go:171","msg":"trace[1365327176] transaction","detail":"{read_only:false; response_revision:13; number_of_response:1; }","duration":"317.053339ms","start":"2026-06-18T15:09:47.989564Z","end":"2026-06-18T15:09:48.306617Z","steps":["trace[1365327176] 'process raft request' (duration: 316.633866ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:48.306416Z","caller":"traceutil/trace.go:171","msg":"trace[315667497] transaction","detail":"{read_only:false; response_revision:11; number_of_response:1; }","duration":"320.892057ms","start":"2026-06-18T15:09:47.985495Z","end":"2026-06-18T15:09:48.306387Z","steps":["trace[315667497] 'process raft request' (duration: 320.625498ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:48.306479Z","caller":"traceutil/trace.go:171","msg":"trace[1714926729] transaction","detail":"{read_only:false; number_of_response:0; response_revision:11; }","duration":"319.931884ms","start":"2026-06-18T15:09:47.986538Z","end":"2026-06-18T15:09:48.30647Z","steps":["trace[1714926729] 'process raft request' (duration: 319.608884ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.307503Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"321.30923ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-06-18T15:09:48.307578Z","caller":"traceutil/trace.go:171","msg":"trace[1073849248] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:13; }","duration":"322.005154ms","start":"2026-06-18T15:09:47.985561Z","end":"2026-06-18T15:09:48.307566Z","steps":["trace[1073849248] 'agreement among raft nodes before linearized reading' (duration: 321.164046ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.307606Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:47.985553Z","time spent":"322.045795ms","remote":"127.0.0.1:42270","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-18T15:09:48.307903Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:47.984784Z","time spent":"321.750985ms","remote":"127.0.0.1:42472","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3159,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:09:48.30793Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:47.986799Z","time spent":"319.760209ms","remote":"127.0.0.1:42776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":968,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:09:48.308007Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:47.986524Z","time spent":"320.484953ms","remote":"127.0.0.1:42390","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":27,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:09:48.308203Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:47.98548Z","time spent":"321.406243ms","remote":"127.0.0.1:42390","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":338,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:09:48.30826Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:47.989551Z","time spent":"317.196404ms","remote":"127.0.0.1:42530","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":845,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-18T15:09:48.315008Z","caller":"traceutil/trace.go:171","msg":"trace[859515379] transaction","detail":"{read_only:false; response_revision:14; number_of_response:1; }","duration":"301.428571ms","start":"2026-06-18T15:09:48.013566Z","end":"2026-06-18T15:09:48.314995Z","steps":["trace[859515379] 'process raft request' (duration: 301.161153ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.315063Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:48.01355Z","time spent":"301.488674ms","remote":"127.0.0.1:42776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":941,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-18T15:09:48.315147Z","caller":"traceutil/trace.go:171","msg":"trace[168535651] transaction","detail":"{read_only:false; response_revision:18; number_of_response:1; }","duration":"299.948423ms","start":"2026-06-18T15:09:48.015181Z","end":"2026-06-18T15:09:48.31513Z","steps":["trace[168535651] 'process raft request' (duration: 299.687284ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.315221Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:48.015173Z","time spent":"300.009785ms","remote":"127.0.0.1:42776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":965,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-18T15:09:48.315307Z","caller":"traceutil/trace.go:171","msg":"trace[1369909406] transaction","detail":"{read_only:false; response_revision:15; number_of_response:1; }","duration":"301.595058ms","start":"2026-06-18T15:09:48.013705Z","end":"2026-06-18T15:09:48.3153Z","steps":["trace[1369909406] 'process raft request' (duration: 301.085161ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.315282Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.266937ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:350"} {"level":"warn","ts":"2026-06-18T15:09:48.315345Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:48.013697Z","time spent":"301.628118ms","remote":"127.0.0.1:42776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":941,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-18T15:09:48.315372Z","caller":"traceutil/trace.go:171","msg":"trace[737434646] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:18; }","duration":"298.3693ms","start":"2026-06-18T15:09:48.016989Z","end":"2026-06-18T15:09:48.315358Z","steps":["trace[737434646] 'agreement among raft nodes before linearized reading' (duration: 298.158284ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.31541Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"323.395668ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/instance\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-06-18T15:09:48.315446Z","caller":"traceutil/trace.go:171","msg":"trace[1849872547] range","detail":"{range_begin:/registry/csinodes/instance; range_end:; response_count:0; response_revision:18; }","duration":"323.510872ms","start":"2026-06-18T15:09:47.991927Z","end":"2026-06-18T15:09:48.315438Z","steps":["trace[1849872547] 'agreement among raft nodes before linearized reading' (duration: 323.390168ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:48.315503Z","caller":"traceutil/trace.go:171","msg":"trace[241551255] transaction","detail":"{read_only:false; response_revision:16; number_of_response:1; }","duration":"301.433432ms","start":"2026-06-18T15:09:48.014063Z","end":"2026-06-18T15:09:48.315496Z","steps":["trace[241551255] 'process raft request' (duration: 300.75958ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.315534Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:48.014054Z","time spent":"301.465263ms","remote":"127.0.0.1:42688","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":704,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:09:48.315516Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:47.991914Z","time spent":"323.595094ms","remote":"127.0.0.1:42642","response type":"/etcdserverpb.KV/Range","request count":0,"request size":29,"response count":0,"response size":27,"request content":"key:\"/registry/csinodes/instance\" "} {"level":"warn","ts":"2026-06-18T15:09:48.315599Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.060008ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-06-18T15:09:48.315617Z","caller":"traceutil/trace.go:171","msg":"trace[1516627226] transaction","detail":"{read_only:false; response_revision:17; number_of_response:1; }","duration":"300.805591ms","start":"2026-06-18T15:09:48.014806Z","end":"2026-06-18T15:09:48.315611Z","steps":["trace[1516627226] 'process raft request' (duration: 300.044826ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:48.315625Z","caller":"traceutil/trace.go:171","msg":"trace[1660096164] range","detail":"{range_begin:/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te; range_end:; response_count:0; response_revision:18; }","duration":"163.12847ms","start":"2026-06-18T15:09:48.152488Z","end":"2026-06-18T15:09:48.315616Z","steps":["trace[1660096164] 'agreement among raft nodes before linearized reading' (duration: 163.089149ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.315653Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:48.014787Z","time spent":"300.852683ms","remote":"127.0.0.1:42776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":923,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:09:48.315785Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"292.076983ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/default\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-06-18T15:09:48.315812Z","caller":"traceutil/trace.go:171","msg":"trace[1144437191] range","detail":"{range_begin:/registry/namespaces/default; range_end:; response_count:0; response_revision:18; }","duration":"292.124375ms","start":"2026-06-18T15:09:48.02368Z","end":"2026-06-18T15:09:48.315804Z","steps":["trace[1144437191] 'agreement among raft nodes before linearized reading' (duration: 292.066823ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.536879Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.228471ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:14"} {"level":"info","ts":"2026-06-18T15:09:48.537055Z","caller":"traceutil/trace.go:171","msg":"trace[1830943360] transaction","detail":"{read_only:false; response_revision:45; number_of_response:1; }","duration":"130.887237ms","start":"2026-06-18T15:09:48.406152Z","end":"2026-06-18T15:09:48.537039Z","steps":["trace[1830943360] 'process raft request' (duration: 130.829215ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:48.537426Z","caller":"traceutil/trace.go:171","msg":"trace[1263277617] transaction","detail":"{read_only:false; response_revision:44; number_of_response:1; }","duration":"138.003602ms","start":"2026-06-18T15:09:48.399404Z","end":"2026-06-18T15:09:48.537407Z","steps":["trace[1263277617] 'process raft request' (duration: 14.768438ms)","trace[1263277617] 'compare' (duration: 122.110707ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:09:48.54469Z","caller":"traceutil/trace.go:171","msg":"trace[1072871155] linearizableReadLoop","detail":"{readStateIndex:50; appliedIndex:49; }","duration":"109.893974ms","start":"2026-06-18T15:09:48.43478Z","end":"2026-06-18T15:09:48.544674Z","steps":["trace[1072871155] 'read index received' (duration: 109.862483ms)","trace[1072871155] 'applied index is now lower than readState.Index' (duration: 30.451µs)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:09:48.544797Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.002228ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/kube-system/\" range_end:\"/registry/limitranges/kube-system0\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-06-18T15:09:48.544909Z","caller":"traceutil/trace.go:171","msg":"trace[558675790] range","detail":"{range_begin:/registry/limitranges/kube-system/; range_end:/registry/limitranges/kube-system0; response_count:0; response_revision:45; }","duration":"110.141262ms","start":"2026-06-18T15:09:48.43475Z","end":"2026-06-18T15:09:48.544891Z","steps":["trace[558675790] 'agreement among raft nodes before linearized reading' (duration: 109.992257ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:48.862572Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.35058ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:14"} {"level":"info","ts":"2026-06-18T15:09:48.86269Z","caller":"traceutil/trace.go:171","msg":"trace[1651570672] transaction","detail":"{read_only:false; response_revision:48; number_of_response:1; }","duration":"316.860151ms","start":"2026-06-18T15:09:48.545812Z","end":"2026-06-18T15:09:48.862672Z","steps":["trace[1651570672] 'process raft request' (duration: 105.336705ms)","trace[1651570672] 'compare' (duration: 211.130233ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:09:48.86281Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:09:48.545799Z","time spent":"316.983815ms","remote":"127.0.0.1:42352","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":642,"response count":0,"response size":37,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-18T15:09:48.866514Z","caller":"traceutil/trace.go:171","msg":"trace[567729435] transaction","detail":"{read_only:false; response_revision:50; number_of_response:1; }","duration":"268.229577ms","start":"2026-06-18T15:09:48.598255Z","end":"2026-06-18T15:09:48.866485Z","steps":["trace[567729435] 'process raft request' (duration: 268.111463ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:48.867325Z","caller":"traceutil/trace.go:171","msg":"trace[362888066] transaction","detail":"{read_only:false; response_revision:49; number_of_response:1; }","duration":"269.750487ms","start":"2026-06-18T15:09:48.59755Z","end":"2026-06-18T15:09:48.867301Z","steps":["trace[362888066] 'process raft request' (duration: 268.722873ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:49.110639Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.06967ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:14"} {"level":"info","ts":"2026-06-18T15:09:49.110905Z","caller":"traceutil/trace.go:171","msg":"trace[100518618] transaction","detail":"{read_only:false; response_revision:52; number_of_response:1; }","duration":"241.18432ms","start":"2026-06-18T15:09:48.86965Z","end":"2026-06-18T15:09:49.110835Z","steps":["trace[100518618] 'process raft request' (duration: 125.876222ms)","trace[100518618] 'compare' (duration: 114.967317ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:09:49.11095Z","caller":"traceutil/trace.go:171","msg":"trace[184289646] linearizableReadLoop","detail":"{readStateIndex:59; appliedIndex:56; }","duration":"182.899148ms","start":"2026-06-18T15:09:48.928038Z","end":"2026-06-18T15:09:49.110937Z","steps":["trace[184289646] 'read index received' (duration: 67.509317ms)","trace[184289646] 'applied index is now lower than readState.Index' (duration: 115.389151ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:09:49.110998Z","caller":"traceutil/trace.go:171","msg":"trace[161130291] transaction","detail":"{read_only:false; response_revision:53; number_of_response:1; }","duration":"240.800777ms","start":"2026-06-18T15:09:48.870156Z","end":"2026-06-18T15:09:49.110957Z","steps":["trace[161130291] 'process raft request' (duration: 240.549849ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:49.111052Z","caller":"traceutil/trace.go:171","msg":"trace[497675373] transaction","detail":"{read_only:false; response_revision:54; number_of_response:1; }","duration":"239.65672ms","start":"2026-06-18T15:09:48.871381Z","end":"2026-06-18T15:09:49.111038Z","steps":["trace[497675373] 'process raft request' (duration: 239.477864ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:49.111366Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.917632ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-06-18T15:09:49.111427Z","caller":"traceutil/trace.go:171","msg":"trace[1938513405] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:55; }","duration":"201.029885ms","start":"2026-06-18T15:09:48.910381Z","end":"2026-06-18T15:09:49.111411Z","steps":["trace[1938513405] 'agreement among raft nodes before linearized reading' (duration: 200.684894ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:49.111402Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.146049ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:aggregate-to-admin\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-06-18T15:09:49.111381Z","caller":"traceutil/trace.go:171","msg":"trace[693179182] transaction","detail":"{read_only:false; response_revision:55; number_of_response:1; }","duration":"180.085485ms","start":"2026-06-18T15:09:48.931286Z","end":"2026-06-18T15:09:49.111372Z","steps":["trace[693179182] 'process raft request' (duration: 179.62085ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:49.111505Z","caller":"traceutil/trace.go:171","msg":"trace[1501426463] range","detail":"{range_begin:/registry/clusterroles/system:aggregate-to-admin; range_end:; response_count:0; response_revision:55; }","duration":"181.302925ms","start":"2026-06-18T15:09:48.930182Z","end":"2026-06-18T15:09:49.111485Z","steps":["trace[1501426463] 'agreement among raft nodes before linearized reading' (duration: 181.116349ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:49.366572Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.870275ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:14"} {"level":"info","ts":"2026-06-18T15:09:49.366798Z","caller":"traceutil/trace.go:171","msg":"trace[1049284103] transaction","detail":"{read_only:false; response_revision:57; number_of_response:1; }","duration":"251.663545ms","start":"2026-06-18T15:09:49.115106Z","end":"2026-06-18T15:09:49.36677Z","steps":["trace[1049284103] 'process raft request' (duration: 121.520851ms)","trace[1049284103] 'compare' (duration: 129.743651ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:09:49.3669Z","caller":"traceutil/trace.go:171","msg":"trace[674163236] transaction","detail":"{read_only:false; response_revision:58; number_of_response:1; }","duration":"250.537719ms","start":"2026-06-18T15:09:49.116341Z","end":"2026-06-18T15:09:49.366879Z","steps":["trace[674163236] 'process raft request' (duration: 250.331782ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:49.36729Z","caller":"traceutil/trace.go:171","msg":"trace[48736179] transaction","detail":"{read_only:false; response_revision:60; number_of_response:1; }","duration":"211.29626ms","start":"2026-06-18T15:09:49.155983Z","end":"2026-06-18T15:09:49.367279Z","steps":["trace[48736179] 'process raft request' (duration: 211.257739ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:49.367321Z","caller":"traceutil/trace.go:171","msg":"trace[728710259] transaction","detail":"{read_only:false; response_revision:59; number_of_response:1; }","duration":"250.176487ms","start":"2026-06-18T15:09:49.117133Z","end":"2026-06-18T15:09:49.367309Z","steps":["trace[728710259] 'process raft request' (duration: 249.592988ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:49.367338Z","caller":"traceutil/trace.go:171","msg":"trace[2009258297] linearizableReadLoop","detail":"{readStateIndex:62; appliedIndex:60; }","duration":"251.586363ms","start":"2026-06-18T15:09:49.115722Z","end":"2026-06-18T15:09:49.367308Z","steps":["trace[2009258297] 'read index received' (duration: 37.207162ms)","trace[2009258297] 'applied index is now lower than readState.Index' (duration: 214.377661ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:09:49.367483Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"251.735618ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:aggregate-to-edit\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-06-18T15:09:49.367541Z","caller":"traceutil/trace.go:171","msg":"trace[1242062613] range","detail":"{range_begin:/registry/clusterroles/system:aggregate-to-edit; range_end:; response_count:0; response_revision:60; }","duration":"251.831431ms","start":"2026-06-18T15:09:49.115698Z","end":"2026-06-18T15:09:49.367529Z","steps":["trace[1242062613] 'agreement among raft nodes before linearized reading' (duration: 251.673166ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:09:49.71181Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.691979ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:14"} {"level":"info","ts":"2026-06-18T15:09:49.712044Z","caller":"traceutil/trace.go:171","msg":"trace[278564598] linearizableReadLoop","detail":"{readStateIndex:81; appliedIndex:78; }","duration":"155.472886ms","start":"2026-06-18T15:09:49.556551Z","end":"2026-06-18T15:09:49.712024Z","steps":["trace[278564598] 'read index received' (duration: 43.504139ms)","trace[278564598] 'applied index is now lower than readState.Index' (duration: 111.967537ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:09:49.712129Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.57874ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/default/instance.18ba3576649ad09c\" ","response":"range_response_count:1 size:648"} {"level":"info","ts":"2026-06-18T15:09:49.712164Z","caller":"traceutil/trace.go:171","msg":"trace[455272906] range","detail":"{range_begin:/registry/events/default/instance.18ba3576649ad09c; range_end:; response_count:1; response_revision:76; }","duration":"155.663293ms","start":"2026-06-18T15:09:49.556492Z","end":"2026-06-18T15:09:49.712155Z","steps":["trace[455272906] 'agreement among raft nodes before linearized reading' (duration: 155.58868ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:49.712282Z","caller":"traceutil/trace.go:171","msg":"trace[896594330] transaction","detail":"{read_only:false; response_revision:74; number_of_response:1; }","duration":"196.211344ms","start":"2026-06-18T15:09:49.516046Z","end":"2026-06-18T15:09:49.712257Z","steps":["trace[896594330] 'process raft request' (duration: 84.000478ms)","trace[896594330] 'compare' (duration: 111.542504ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:09:49.712451Z","caller":"traceutil/trace.go:171","msg":"trace[1818682567] transaction","detail":"{read_only:false; response_revision:75; number_of_response:1; }","duration":"195.825472ms","start":"2026-06-18T15:09:49.516612Z","end":"2026-06-18T15:09:49.712437Z","steps":["trace[1818682567] 'process raft request' (duration: 195.299405ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:09:49.712557Z","caller":"traceutil/trace.go:171","msg":"trace[139377101] transaction","detail":"{read_only:false; response_revision:76; number_of_response:1; }","duration":"156.339055ms","start":"2026-06-18T15:09:49.556173Z","end":"2026-06-18T15:09:49.712512Z","steps":["trace[139377101] 'process raft request' (duration: 155.809108ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:06.028717Z","caller":"traceutil/trace.go:171","msg":"trace[2112476644] linearizableReadLoop","detail":"{readStateIndex:427; appliedIndex:426; }","duration":"279.198083ms","start":"2026-06-18T15:10:05.749492Z","end":"2026-06-18T15:10:06.02869Z","steps":["trace[2112476644] 'read index received' (duration: 279.012747ms)","trace[2112476644] 'applied index is now lower than readState.Index' (duration: 184.276µs)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:06.028772Z","caller":"traceutil/trace.go:171","msg":"trace[233475154] transaction","detail":"{read_only:false; response_revision:416; number_of_response:1; }","duration":"422.215891ms","start":"2026-06-18T15:10:05.606533Z","end":"2026-06-18T15:10:06.028749Z","steps":["trace[233475154] 'process raft request' (duration: 421.973513ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:06.028855Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"279.344908ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T15:10:06.028902Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:05.606517Z","time spent":"422.310304ms","remote":"127.0.0.1:42542","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:10:06.028939Z","caller":"traceutil/trace.go:171","msg":"trace[111126549] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:416; }","duration":"279.445301ms","start":"2026-06-18T15:10:05.749483Z","end":"2026-06-18T15:10:06.028928Z","steps":["trace[111126549] 'agreement among raft nodes before linearized reading' (duration: 279.330078ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:06.529145Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824333396450967202,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-06-18T15:10:07.808605Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.017690348s","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-06-18T15:10:07.808754Z","caller":"traceutil/trace.go:171","msg":"trace[1347105470] linearizableReadLoop","detail":"{readStateIndex:428; appliedIndex:427; }","duration":"1.77994627s","start":"2026-06-18T15:10:06.028789Z","end":"2026-06-18T15:10:07.808735Z","steps":["trace[1347105470] 'read index received' (duration: 762.046625ms)","trace[1347105470] 'applied index is now lower than readState.Index' (duration: 1.017898015s)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:10:07.809013Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.963674817s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T15:10:07.809037Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.777598158s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/etcd-instance\" ","response":"range_response_count:1 size:5336"} {"level":"info","ts":"2026-06-18T15:10:07.809137Z","caller":"traceutil/trace.go:171","msg":"trace[274930469] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:416; }","duration":"1.96378428s","start":"2026-06-18T15:10:05.845285Z","end":"2026-06-18T15:10:07.809069Z","steps":["trace[274930469] 'agreement among raft nodes before linearized reading' (duration: 1.963666047s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:07.809031Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"782.915489ms","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-06-18T15:10:07.809146Z","caller":"traceutil/trace.go:171","msg":"trace[494579233] range","detail":"{range_begin:/registry/pods/kube-system/etcd-instance; range_end:; response_count:1; response_revision:416; }","duration":"1.777785724s","start":"2026-06-18T15:10:06.031302Z","end":"2026-06-18T15:10:07.809088Z","steps":["trace[494579233] 'agreement among raft nodes before linearized reading' (duration: 1.777622369s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:07.80918Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:05.845268Z","time spent":"1.963902694s","remote":"127.0.0.1:42260","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-06-18T15:10:07.809206Z","caller":"traceutil/trace.go:171","msg":"trace[398360926] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:416; }","duration":"783.120075ms","start":"2026-06-18T15:10:07.026067Z","end":"2026-06-18T15:10:07.809187Z","steps":["trace[398360926] 'agreement among raft nodes before linearized reading' (duration: 782.865067ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:07.809213Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.01772815s","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-06-18T15:10:07.809246Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:07.026049Z","time spent":"783.186817ms","remote":"127.0.0.1:42542","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-06-18T15:10:07.809255Z","caller":"traceutil/trace.go:171","msg":"trace[1731633279] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:416; }","duration":"1.017826372s","start":"2026-06-18T15:10:06.791415Z","end":"2026-06-18T15:10:07.809242Z","steps":["trace[1731633279] 'agreement among raft nodes before linearized reading' (duration: 1.017522133s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:07.809292Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:06.791397Z","time spent":"1.017885115s","remote":"127.0.0.1:42542","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-06-18T15:10:07.809415Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"778.324509ms","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-06-18T15:10:07.809444Z","caller":"traceutil/trace.go:171","msg":"trace[2115513098] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:416; }","duration":"778.390161ms","start":"2026-06-18T15:10:07.031044Z","end":"2026-06-18T15:10:07.809435Z","steps":["trace[2115513098] 'agreement among raft nodes before linearized reading' (duration: 777.882256ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:07.80947Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:07.031Z","time spent":"778.463413ms","remote":"127.0.0.1:42542","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-06-18T15:10:07.810376Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:06.031282Z","time spent":"1.779040763s","remote":"127.0.0.1:42478","response type":"/etcdserverpb.KV/Range","request count":0,"request size":42,"response count":1,"response size":5359,"request content":"key:\"/registry/pods/kube-system/etcd-instance\" "} {"level":"info","ts":"2026-06-18T15:10:08.054526Z","caller":"traceutil/trace.go:171","msg":"trace[1506986848] transaction","detail":"{read_only:false; response_revision:418; number_of_response:1; }","duration":"233.985034ms","start":"2026-06-18T15:10:07.820504Z","end":"2026-06-18T15:10:08.054489Z","steps":["trace[1506986848] 'process raft request' (duration: 231.117487ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:08.054592Z","caller":"traceutil/trace.go:171","msg":"trace[1022023031] transaction","detail":"{read_only:false; response_revision:419; number_of_response:1; }","duration":"233.957893ms","start":"2026-06-18T15:10:07.820595Z","end":"2026-06-18T15:10:08.054553Z","steps":["trace[1022023031] 'process raft request' (duration: 233.773537ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:08.054655Z","caller":"traceutil/trace.go:171","msg":"trace[288001913] linearizableReadLoop","detail":"{readStateIndex:431; appliedIndex:428; }","duration":"230.327222ms","start":"2026-06-18T15:10:07.824312Z","end":"2026-06-18T15:10:08.054639Z","steps":["trace[288001913] 'read index received' (duration: 29.15189ms)","trace[288001913] 'applied index is now lower than readState.Index' (duration: 201.174562ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:08.054762Z","caller":"traceutil/trace.go:171","msg":"trace[1560081773] transaction","detail":"{read_only:false; response_revision:420; number_of_response:1; }","duration":"220.924485ms","start":"2026-06-18T15:10:07.833813Z","end":"2026-06-18T15:10:08.054737Z","steps":["trace[1560081773] 'process raft request' (duration: 220.683708ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:08.054834Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"230.503418ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T15:10:08.054872Z","caller":"traceutil/trace.go:171","msg":"trace[300749065] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:420; }","duration":"230.573899ms","start":"2026-06-18T15:10:07.824289Z","end":"2026-06-18T15:10:08.054863Z","steps":["trace[300749065] 'agreement among raft nodes before linearized reading' (duration: 230.452045ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:08.175559Z","caller":"traceutil/trace.go:171","msg":"trace[612477076] transaction","detail":"{read_only:false; response_revision:421; number_of_response:1; }","duration":"116.13605ms","start":"2026-06-18T15:10:08.059399Z","end":"2026-06-18T15:10:08.175535Z","steps":["trace[612477076] 'process raft request' (duration: 113.867381ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:08.330347Z","caller":"traceutil/trace.go:171","msg":"trace[741050942] transaction","detail":"{read_only:false; response_revision:422; number_of_response:1; }","duration":"266.092227ms","start":"2026-06-18T15:10:08.064222Z","end":"2026-06-18T15:10:08.330314Z","steps":["trace[741050942] 'process raft request' (duration: 261.672803ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:13.087238Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.015078033s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-06-18T15:10:13.087285Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.01831006s","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-06-18T15:10:13.087339Z","caller":"traceutil/trace.go:171","msg":"trace[1832864814] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:429; }","duration":"1.015195637s","start":"2026-06-18T15:10:12.072124Z","end":"2026-06-18T15:10:13.08732Z","steps":["trace[1832864814] 'range keys from in-memory index tree' (duration: 1.014943948s)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:13.087354Z","caller":"traceutil/trace.go:171","msg":"trace[1308783513] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:429; }","duration":"1.018425153s","start":"2026-06-18T15:10:12.068911Z","end":"2026-06-18T15:10:13.087336Z","steps":["trace[1308783513] 'range keys from in-memory index tree' (duration: 1.018190906s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:13.087388Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:12.072063Z","time spent":"1.015314109s","remote":"127.0.0.1:42542","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-06-18T15:10:13.087403Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:12.068892Z","time spent":"1.018502215s","remote":"127.0.0.1:42542","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-06-18T15:10:13.087384Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"896.537076ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"warn","ts":"2026-06-18T15:10:13.08699Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.605923ms","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-06-18T15:10:13.088425Z","caller":"traceutil/trace.go:171","msg":"trace[1003856711] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:429; }","duration":"896.652309ms","start":"2026-06-18T15:10:12.190788Z","end":"2026-06-18T15:10:13.08744Z","steps":["trace[1003856711] 'range keys from in-memory index tree' (duration: 896.410612ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:13.088513Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:12.190587Z","time spent":"897.905467ms","remote":"127.0.0.1:42542","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-06-18T15:10:13.08863Z","caller":"traceutil/trace.go:171","msg":"trace[1711318460] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:429; }","duration":"205.607603ms","start":"2026-06-18T15:10:12.882284Z","end":"2026-06-18T15:10:13.087892Z","steps":["trace[1711318460] 'range keys from in-memory index tree' (duration: 204.573651ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:13.089149Z","caller":"traceutil/trace.go:171","msg":"trace[415658671] linearizableReadLoop","detail":"{readStateIndex:443; appliedIndex:442; }","duration":"243.629669ms","start":"2026-06-18T15:10:12.845494Z","end":"2026-06-18T15:10:13.089124Z","steps":["trace[415658671] 'read index received' (duration: 210.369868ms)","trace[415658671] 'applied index is now lower than readState.Index' (duration: 33.258011ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:13.089379Z","caller":"traceutil/trace.go:171","msg":"trace[1345577677] transaction","detail":"{read_only:false; response_revision:430; number_of_response:1; }","duration":"681.208833ms","start":"2026-06-18T15:10:12.408151Z","end":"2026-06-18T15:10:13.089359Z","steps":["trace[1345577677] 'process raft request' (duration: 647.810347ms)","trace[1345577677] 'compare' (duration: 30.85408ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:10:13.089548Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:12.408123Z","time spent":"681.346737ms","remote":"127.0.0.1:42542","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-18T15:10:13.090165Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.104444ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T15:10:13.090238Z","caller":"traceutil/trace.go:171","msg":"trace[695378850] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:430; }","duration":"244.807675ms","start":"2026-06-18T15:10:12.845411Z","end":"2026-06-18T15:10:13.090219Z","steps":["trace[695378850] 'agreement among raft nodes before linearized reading' (duration: 243.801415ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:21.292114Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.230153ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-18T15:10:21.292199Z","caller":"traceutil/trace.go:171","msg":"trace[1983026570] transaction","detail":"{read_only:false; response_revision:450; number_of_response:1; }","duration":"156.132894ms","start":"2026-06-18T15:10:21.136036Z","end":"2026-06-18T15:10:21.292169Z","steps":["trace[1983026570] 'process raft request' (duration: 32.794808ms)","trace[1983026570] 'compare' (duration: 123.163641ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:21.293355Z","caller":"traceutil/trace.go:171","msg":"trace[2086117367] transaction","detail":"{read_only:false; response_revision:451; number_of_response:1; }","duration":"144.309482ms","start":"2026-06-18T15:10:21.149038Z","end":"2026-06-18T15:10:21.293347Z","steps":["trace[2086117367] 'process raft request' (duration: 144.265171ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:23.638053Z","caller":"traceutil/trace.go:171","msg":"trace[786001676] transaction","detail":"{read_only:false; response_revision:457; number_of_response:1; }","duration":"183.027242ms","start":"2026-06-18T15:10:23.455003Z","end":"2026-06-18T15:10:23.63803Z","steps":["trace[786001676] 'process raft request' (duration: 182.892968ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.217956Z","caller":"traceutil/trace.go:171","msg":"trace[1156641101] transaction","detail":"{read_only:false; response_revision:550; number_of_response:1; }","duration":"104.444041ms","start":"2026-06-18T15:10:37.113483Z","end":"2026-06-18T15:10:37.217927Z","steps":["trace[1156641101] 'process raft request' (duration: 102.57324ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.245969Z","caller":"traceutil/trace.go:171","msg":"trace[797707491] transaction","detail":"{read_only:false; response_revision:551; number_of_response:1; }","duration":"127.89983ms","start":"2026-06-18T15:10:37.118046Z","end":"2026-06-18T15:10:37.245946Z","steps":["trace[797707491] 'process raft request' (duration: 126.927734ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.246126Z","caller":"traceutil/trace.go:171","msg":"trace[1093886996] transaction","detail":"{read_only:false; response_revision:552; number_of_response:1; }","duration":"127.106079ms","start":"2026-06-18T15:10:37.119009Z","end":"2026-06-18T15:10:37.246115Z","steps":["trace[1093886996] 'process raft request' (duration: 126.0573ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.246231Z","caller":"traceutil/trace.go:171","msg":"trace[929681551] transaction","detail":"{read_only:false; response_revision:553; number_of_response:1; }","duration":"117.166618ms","start":"2026-06-18T15:10:37.129057Z","end":"2026-06-18T15:10:37.246223Z","steps":["trace[929681551] 'process raft request' (duration: 116.230982ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.24646Z","caller":"traceutil/trace.go:171","msg":"trace[1754998912] transaction","detail":"{read_only:false; response_revision:554; number_of_response:1; }","duration":"117.328822ms","start":"2026-06-18T15:10:37.129121Z","end":"2026-06-18T15:10:37.24645Z","steps":["trace[1754998912] 'process raft request' (duration: 116.202791ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.246785Z","caller":"traceutil/trace.go:171","msg":"trace[1375804357] transaction","detail":"{read_only:false; response_revision:555; number_of_response:1; }","duration":"113.513287ms","start":"2026-06-18T15:10:37.133238Z","end":"2026-06-18T15:10:37.246751Z","steps":["trace[1375804357] 'process raft request' (duration: 112.118849ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.247064Z","caller":"traceutil/trace.go:171","msg":"trace[1507761485] transaction","detail":"{read_only:false; response_revision:558; number_of_response:1; }","duration":"102.638841ms","start":"2026-06-18T15:10:37.144415Z","end":"2026-06-18T15:10:37.247054Z","steps":["trace[1507761485] 'process raft request' (duration: 101.048627ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.247155Z","caller":"traceutil/trace.go:171","msg":"trace[2033043178] transaction","detail":"{read_only:false; response_revision:556; number_of_response:1; }","duration":"113.23464ms","start":"2026-06-18T15:10:37.133911Z","end":"2026-06-18T15:10:37.247146Z","steps":["trace[2033043178] 'process raft request' (duration: 111.476962ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.247219Z","caller":"traceutil/trace.go:171","msg":"trace[1981341892] transaction","detail":"{read_only:false; response_revision:557; number_of_response:1; }","duration":"111.807921ms","start":"2026-06-18T15:10:37.135404Z","end":"2026-06-18T15:10:37.247212Z","steps":["trace[1981341892] 'process raft request' (duration: 110.013992ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.247364Z","caller":"traceutil/trace.go:171","msg":"trace[2061716108] transaction","detail":"{read_only:false; response_revision:559; number_of_response:1; }","duration":"102.906578ms","start":"2026-06-18T15:10:37.144437Z","end":"2026-06-18T15:10:37.247343Z","steps":["trace[2061716108] 'process raft request' (duration: 101.071558ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:37.919502Z","caller":"traceutil/trace.go:171","msg":"trace[1455352472] transaction","detail":"{read_only:false; response_revision:598; number_of_response:1; }","duration":"360.149158ms","start":"2026-06-18T15:10:37.559332Z","end":"2026-06-18T15:10:37.919482Z","steps":["trace[1455352472] 'process raft request' (duration: 359.84785ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:37.919669Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:37.559311Z","time spent":"360.265671ms","remote":"127.0.0.1:42316","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":80679,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:10:37.928471Z","caller":"traceutil/trace.go:171","msg":"trace[2027578920] transaction","detail":"{read_only:false; response_revision:599; number_of_response:1; }","duration":"361.73525ms","start":"2026-06-18T15:10:37.566708Z","end":"2026-06-18T15:10:37.928443Z","steps":["trace[2027578920] 'process raft request' (duration: 360.675582ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:37.928606Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:37.566683Z","time spent":"361.854804ms","remote":"127.0.0.1:42316","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":59616,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:10:37.92878Z","caller":"traceutil/trace.go:171","msg":"trace[923316231] transaction","detail":"{read_only:false; response_revision:600; number_of_response:1; }","duration":"331.935058ms","start":"2026-06-18T15:10:37.596814Z","end":"2026-06-18T15:10:37.928749Z","steps":["trace[923316231] 'process raft request' (duration: 331.081975ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:37.92888Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:37.59679Z","time spent":"332.037441ms","remote":"127.0.0.1:42316","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":73770,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:10:39.270868Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.197943765s","expected-duration":"1s"} {"level":"info","ts":"2026-06-18T15:10:39.302627Z","caller":"traceutil/trace.go:171","msg":"trace[1857793389] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"1.229747717s","start":"2026-06-18T15:10:38.072849Z","end":"2026-06-18T15:10:39.302596Z","steps":["trace[1857793389] 'process raft request' (duration: 1.198279444s)","trace[1857793389] 'compare' (duration: 30.839806ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:39.303183Z","caller":"traceutil/trace.go:171","msg":"trace[1085454646] transaction","detail":"{read_only:false; response_revision:609; number_of_response:1; }","duration":"1.217327379s","start":"2026-06-18T15:10:38.085741Z","end":"2026-06-18T15:10:39.303069Z","steps":["trace[1085454646] 'process raft request' (duration: 1.216462245s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:39.303327Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:38.085722Z","time spent":"1.217567326s","remote":"127.0.0.1:42316","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":18032,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-18T15:10:39.302772Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:38.07283Z","time spent":"1.22987329s","remote":"127.0.0.1:42542","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:10:39.304271Z","caller":"traceutil/trace.go:171","msg":"trace[897083690] transaction","detail":"{read_only:false; response_revision:610; number_of_response:1; }","duration":"1.17215039s","start":"2026-06-18T15:10:38.130703Z","end":"2026-06-18T15:10:39.302854Z","steps":["trace[897083690] 'process raft request' (duration: 1.171765589s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:39.304354Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:38.130683Z","time spent":"1.17361578s","remote":"127.0.0.1:42316","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":151221,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:10:39.309789Z","caller":"traceutil/trace.go:171","msg":"trace[85994190] transaction","detail":"{read_only:false; response_revision:611; number_of_response:1; }","duration":"1.019694643s","start":"2026-06-18T15:10:38.290073Z","end":"2026-06-18T15:10:39.309768Z","steps":["trace[85994190] 'process raft request' (duration: 1.015191851s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:39.310028Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:38.290048Z","time spent":"1.019892799s","remote":"127.0.0.1:42316","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":569094,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:10:43.551032Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.122027ms","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-06-18T15:10:43.551129Z","caller":"traceutil/trace.go:171","msg":"trace[1619206194] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:639; }","duration":"112.281062ms","start":"2026-06-18T15:10:43.438826Z","end":"2026-06-18T15:10:43.551107Z","steps":["trace[1619206194] 'range keys from in-memory index tree' (duration: 111.952733ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:43.990943Z","caller":"traceutil/trace.go:171","msg":"trace[899461789] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"268.536989ms","start":"2026-06-18T15:10:43.722361Z","end":"2026-06-18T15:10:43.990898Z","steps":["trace[899461789] 'process raft request' (duration: 250.946169ms)","trace[899461789] 'compare' (duration: 17.417565ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:44.020037Z","caller":"traceutil/trace.go:171","msg":"trace[1733596143] linearizableReadLoop","detail":"{readStateIndex:668; appliedIndex:666; }","duration":"173.822855ms","start":"2026-06-18T15:10:43.846193Z","end":"2026-06-18T15:10:44.020016Z","steps":["trace[1733596143] 'read index received' (duration: 127.223882ms)","trace[1733596143] 'applied index is now lower than readState.Index' (duration: 46.597753ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:10:44.020167Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.971399ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T15:10:44.020205Z","caller":"traceutil/trace.go:171","msg":"trace[1138036620] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:644; }","duration":"174.068801ms","start":"2026-06-18T15:10:43.846127Z","end":"2026-06-18T15:10:44.020196Z","steps":["trace[1138036620] 'agreement among raft nodes before linearized reading' (duration: 173.971869ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:44.02015Z","caller":"traceutil/trace.go:171","msg":"trace[82779140] transaction","detail":"{read_only:false; response_revision:644; number_of_response:1; }","duration":"297.386668ms","start":"2026-06-18T15:10:43.722727Z","end":"2026-06-18T15:10:44.020113Z","steps":["trace[82779140] 'process raft request' (duration: 297.180733ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:46.868342Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824333396450967695,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-06-18T15:10:47.368849Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824333396450967695,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-06-18T15:10:47.597533Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.268585238s","expected-duration":"1s"} {"level":"info","ts":"2026-06-18T15:10:47.5987Z","caller":"traceutil/trace.go:171","msg":"trace[710607923] linearizableReadLoop","detail":"{readStateIndex:685; appliedIndex:684; }","duration":"1.230695015s","start":"2026-06-18T15:10:46.367982Z","end":"2026-06-18T15:10:47.598677Z","steps":["trace[710607923] 'read index received' (duration: 1.229698679s)","trace[710607923] 'applied index is now lower than readState.Index' (duration: 995.056µs)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:10:47.599235Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.231237119s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-5chmp\" ","response":"range_response_count:1 size:16965"} {"level":"warn","ts":"2026-06-18T15:10:47.599251Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"754.309068ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T15:10:47.599289Z","caller":"traceutil/trace.go:171","msg":"trace[1118752600] range","detail":"{range_begin:/registry/pods/kube-system/cilium-5chmp; range_end:; response_count:1; response_revision:660; }","duration":"1.231336492s","start":"2026-06-18T15:10:46.367936Z","end":"2026-06-18T15:10:47.599273Z","steps":["trace[1118752600] 'agreement among raft nodes before linearized reading' (duration: 1.231151807s)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:47.599314Z","caller":"traceutil/trace.go:171","msg":"trace[1845365360] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:660; }","duration":"754.428242ms","start":"2026-06-18T15:10:46.844869Z","end":"2026-06-18T15:10:47.599298Z","steps":["trace[1845365360] 'agreement among raft nodes before linearized reading' (duration: 754.301758ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:47.599328Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:46.36792Z","time spent":"1.231400084s","remote":"127.0.0.1:42478","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16988,"request content":"key:\"/registry/pods/kube-system/cilium-5chmp\" "} {"level":"warn","ts":"2026-06-18T15:10:47.599348Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:46.844846Z","time spent":"754.498133ms","remote":"127.0.0.1:42260","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-06-18T15:10:47.599196Z","caller":"traceutil/trace.go:171","msg":"trace[68652606] transaction","detail":"{read_only:false; response_revision:660; number_of_response:1; }","duration":"1.272008669s","start":"2026-06-18T15:10:46.327146Z","end":"2026-06-18T15:10:47.599155Z","steps":["trace[68652606] 'process raft request' (duration: 1.270976082s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:47.599411Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.197611ms","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-06-18T15:10:47.599501Z","caller":"traceutil/trace.go:171","msg":"trace[1882249068] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:660; }","duration":"172.339844ms","start":"2026-06-18T15:10:47.427141Z","end":"2026-06-18T15:10:47.599481Z","steps":["trace[1882249068] 'agreement among raft nodes before linearized reading' (duration: 172.085348ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:47.60084Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.94015ms","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-06-18T15:10:47.600979Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:46.327104Z","time spent":"1.273710753s","remote":"127.0.0.1:42384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036225,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:10:47.601341Z","caller":"traceutil/trace.go:171","msg":"trace[1010152117] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:660; }","duration":"176.080123ms","start":"2026-06-18T15:10:47.424846Z","end":"2026-06-18T15:10:47.600926Z","steps":["trace[1010152117] 'agreement among raft nodes before linearized reading' (duration: 174.511892ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:47.731593Z","caller":"traceutil/trace.go:171","msg":"trace[1997054156] transaction","detail":"{read_only:false; response_revision:661; number_of_response:1; }","duration":"126.867606ms","start":"2026-06-18T15:10:47.604702Z","end":"2026-06-18T15:10:47.731569Z","steps":["trace[1997054156] 'process raft request' (duration: 126.552918ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:47.777822Z","caller":"traceutil/trace.go:171","msg":"trace[843697582] transaction","detail":"{read_only:false; response_revision:662; number_of_response:1; }","duration":"167.136968ms","start":"2026-06-18T15:10:47.610658Z","end":"2026-06-18T15:10:47.777795Z","steps":["trace[843697582] 'process raft request' (duration: 166.949223ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:47.778101Z","caller":"traceutil/trace.go:171","msg":"trace[353018218] linearizableReadLoop","detail":"{readStateIndex:688; appliedIndex:685; }","duration":"160.072692ms","start":"2026-06-18T15:10:47.618004Z","end":"2026-06-18T15:10:47.778076Z","steps":["trace[353018218] 'read index received' (duration: 113.261837ms)","trace[353018218] 'applied index is now lower than readState.Index' (duration: 46.809845ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:47.778171Z","caller":"traceutil/trace.go:171","msg":"trace[1601793957] transaction","detail":"{read_only:false; response_revision:663; number_of_response:1; }","duration":"165.389643ms","start":"2026-06-18T15:10:47.612762Z","end":"2026-06-18T15:10:47.778152Z","steps":["trace[1601793957] 'process raft request' (duration: 164.978032ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:47.778193Z","caller":"traceutil/trace.go:171","msg":"trace[1982442733] transaction","detail":"{read_only:false; response_revision:664; number_of_response:1; }","duration":"120.166079ms","start":"2026-06-18T15:10:47.658014Z","end":"2026-06-18T15:10:47.77818Z","steps":["trace[1982442733] 'process raft request' (duration: 119.944994ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:47.778363Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.339889ms","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-06-18T15:10:47.7784Z","caller":"traceutil/trace.go:171","msg":"trace[1833548297] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:664; }","duration":"160.402801ms","start":"2026-06-18T15:10:47.617985Z","end":"2026-06-18T15:10:47.778388Z","steps":["trace[1833548297] 'agreement among raft nodes before linearized reading' (duration: 160.241627ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:48.180248Z","caller":"traceutil/trace.go:171","msg":"trace[829518305] transaction","detail":"{read_only:false; response_revision:665; number_of_response:1; }","duration":"397.572322ms","start":"2026-06-18T15:10:47.782644Z","end":"2026-06-18T15:10:48.180216Z","steps":["trace[829518305] 'process raft request' (duration: 310.39729ms)","trace[829518305] 'compare' (duration: 86.812422ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:48.18055Z","caller":"traceutil/trace.go:171","msg":"trace[2046855816] linearizableReadLoop","detail":"{readStateIndex:691; appliedIndex:689; }","duration":"392.354684ms","start":"2026-06-18T15:10:47.787989Z","end":"2026-06-18T15:10:48.180343Z","steps":["trace[2046855816] 'read index received' (duration: 305.067659ms)","trace[2046855816] 'applied index is now lower than readState.Index' (duration: 87.285875ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:48.180583Z","caller":"traceutil/trace.go:171","msg":"trace[1279230084] transaction","detail":"{read_only:false; response_revision:666; number_of_response:1; }","duration":"396.919364ms","start":"2026-06-18T15:10:47.783583Z","end":"2026-06-18T15:10:48.180503Z","steps":["trace[1279230084] 'process raft request' (duration: 396.548065ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:48.180581Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:47.782623Z","time spent":"397.818588ms","remote":"127.0.0.1:42542","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-18T15:10:48.180717Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"359.2348ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-18T15:10:48.18076Z","caller":"traceutil/trace.go:171","msg":"trace[1909049113] range","detail":"{range_begin:/registry/controllerrevisions/; range_end:/registry/controllerrevisions0; response_count:0; response_revision:666; }","duration":"359.347254ms","start":"2026-06-18T15:10:47.821401Z","end":"2026-06-18T15:10:48.180748Z","steps":["trace[1909049113] 'agreement among raft nodes before linearized reading' (duration: 359.267062ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:48.180793Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:47.821389Z","time spent":"359.394735ms","remote":"127.0.0.1:42732","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":2,"response size":30,"request content":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" count_only:true "} {"level":"warn","ts":"2026-06-18T15:10:48.18085Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"392.850737ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/envoy-gateway-gateway-helm-certgen:envoy-gateway-system\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T15:10:48.18086Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:47.783569Z","time spent":"397.100109ms","remote":"127.0.0.1:42542","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:10:48.180929Z","caller":"traceutil/trace.go:171","msg":"trace[517404364] range","detail":"{range_begin:/registry/clusterrolebindings/envoy-gateway-gateway-helm-certgen:envoy-gateway-system; range_end:; response_count:0; response_revision:666; }","duration":"392.94612ms","start":"2026-06-18T15:10:47.787959Z","end":"2026-06-18T15:10:48.180905Z","steps":["trace[517404364] 'agreement among raft nodes before linearized reading' (duration: 392.698273ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:48.181019Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:47.787951Z","time spent":"393.052593ms","remote":"127.0.0.1:42620","response type":"/etcdserverpb.KV/Range","request count":0,"request size":87,"response count":0,"response size":28,"request content":"key:\"/registry/clusterrolebindings/envoy-gateway-gateway-helm-certgen:envoy-gateway-system\" "} {"level":"warn","ts":"2026-06-18T15:10:49.346897Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824333396450967709,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-18T15:10:49.389346Z","caller":"traceutil/trace.go:171","msg":"trace[868640195] linearizableReadLoop","detail":"{readStateIndex:692; appliedIndex:691; }","duration":"543.127413ms","start":"2026-06-18T15:10:48.846191Z","end":"2026-06-18T15:10:49.389319Z","steps":["trace[868640195] 'read index received' (duration: 542.23372ms)","trace[868640195] 'applied index is now lower than readState.Index' (duration: 892.373µs)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:49.38941Z","caller":"traceutil/trace.go:171","msg":"trace[446573511] transaction","detail":"{read_only:false; response_revision:667; number_of_response:1; }","duration":"823.907764ms","start":"2026-06-18T15:10:48.565477Z","end":"2026-06-18T15:10:49.389385Z","steps":["trace[446573511] 'process raft request' (duration: 823.112313ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:49.389483Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"543.270067ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T15:10:49.389522Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:48.565446Z","time spent":"824.013977ms","remote":"127.0.0.1:42384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036261,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:10:49.389545Z","caller":"traceutil/trace.go:171","msg":"trace[22563853] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:667; }","duration":"543.3706ms","start":"2026-06-18T15:10:48.84616Z","end":"2026-06-18T15:10:49.38953Z","steps":["trace[22563853] 'agreement among raft nodes before linearized reading' (duration: 543.259427ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:49.389587Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:48.846141Z","time spent":"543.440081ms","remote":"127.0.0.1:42260","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-06-18T15:10:51.824482Z","caller":"traceutil/trace.go:171","msg":"trace[1978786256] transaction","detail":"{read_only:false; response_revision:700; number_of_response:1; }","duration":"298.882809ms","start":"2026-06-18T15:10:51.525565Z","end":"2026-06-18T15:10:51.824448Z","steps":["trace[1978786256] 'process raft request' (duration: 287.243056ms)","trace[1978786256] 'compare' (duration: 11.464308ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:51.824523Z","caller":"traceutil/trace.go:171","msg":"trace[1031612559] transaction","detail":"{read_only:false; response_revision:702; number_of_response:1; }","duration":"289.117014ms","start":"2026-06-18T15:10:51.53538Z","end":"2026-06-18T15:10:51.824497Z","steps":["trace[1031612559] 'process raft request' (duration: 289.071183ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:51.824599Z","caller":"traceutil/trace.go:171","msg":"trace[345748164] transaction","detail":"{read_only:false; response_revision:701; number_of_response:1; }","duration":"298.94988ms","start":"2026-06-18T15:10:51.525612Z","end":"2026-06-18T15:10:51.824562Z","steps":["trace[345748164] 'process raft request' (duration: 298.783866ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:51.830707Z","caller":"traceutil/trace.go:171","msg":"trace[810072552] transaction","detail":"{read_only:false; response_revision:703; number_of_response:1; }","duration":"132.658602ms","start":"2026-06-18T15:10:51.698024Z","end":"2026-06-18T15:10:51.830683Z","steps":["trace[810072552] 'process raft request' (duration: 132.537229ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:52.553425Z","caller":"traceutil/trace.go:171","msg":"trace[686263905] transaction","detail":"{read_only:false; response_revision:724; number_of_response:1; }","duration":"145.516436ms","start":"2026-06-18T15:10:52.40789Z","end":"2026-06-18T15:10:52.553407Z","steps":["trace[686263905] 'process raft request' (duration: 142.527448ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:55.102301Z","caller":"traceutil/trace.go:171","msg":"trace[447964501] linearizableReadLoop","detail":"{readStateIndex:778; appliedIndex:777; }","duration":"257.268423ms","start":"2026-06-18T15:10:54.845005Z","end":"2026-06-18T15:10:55.102273Z","steps":["trace[447964501] 'read index received' (duration: 257.007876ms)","trace[447964501] 'applied index is now lower than readState.Index' (duration: 259.236µs)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:10:55.102436Z","caller":"traceutil/trace.go:171","msg":"trace[1440465408] transaction","detail":"{read_only:false; response_revision:751; number_of_response:1; }","duration":"402.429135ms","start":"2026-06-18T15:10:54.699994Z","end":"2026-06-18T15:10:55.102423Z","steps":["trace[1440465408] 'process raft request' (duration: 402.115817ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:55.102555Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:10:54.699961Z","time spent":"402.503916ms","remote":"127.0.0.1:42316","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":23277,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T15:10:55.102657Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"257.633102ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T15:10:55.102666Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.102358ms","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-06-18T15:10:55.102722Z","caller":"traceutil/trace.go:171","msg":"trace[1273115670] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:751; }","duration":"257.745115ms","start":"2026-06-18T15:10:54.844959Z","end":"2026-06-18T15:10:55.102704Z","steps":["trace[1273115670] 'agreement among raft nodes before linearized reading' (duration: 257.547779ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:10:55.102764Z","caller":"traceutil/trace.go:171","msg":"trace[311166992] range","detail":"{range_begin:/registry/services/endpoints/; range_end:/registry/services/endpoints0; response_count:0; response_revision:751; }","duration":"165.24256ms","start":"2026-06-18T15:10:54.937498Z","end":"2026-06-18T15:10:55.102741Z","steps":["trace[311166992] 'agreement among raft nodes before linearized reading' (duration: 165.063406ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:10:55.102691Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"207.741557ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" ","response":"range_response_count:1 size:13229"} {"level":"info","ts":"2026-06-18T15:10:55.102918Z","caller":"traceutil/trace.go:171","msg":"trace[34699682] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io; range_end:; response_count:1; response_revision:751; }","duration":"207.984282ms","start":"2026-06-18T15:10:54.894908Z","end":"2026-06-18T15:10:55.102892Z","steps":["trace[34699682] 'agreement among raft nodes before linearized reading' (duration: 207.568862ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:11:06.312745Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"846.024041ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-fq7nt\" ","response":"range_response_count:1 size:3965"} {"level":"info","ts":"2026-06-18T15:11:06.312911Z","caller":"traceutil/trace.go:171","msg":"trace[1572097990] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-fq7nt; range_end:; response_count:1; response_revision:836; }","duration":"846.222506ms","start":"2026-06-18T15:11:05.466667Z","end":"2026-06-18T15:11:06.312889Z","steps":["trace[1572097990] 'range keys from in-memory index tree' (duration: 845.806946ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:11:06.313017Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:11:05.466644Z","time spent":"846.358449ms","remote":"127.0.0.1:42478","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":1,"response size":3988,"request content":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-fq7nt\" "} {"level":"warn","ts":"2026-06-18T15:11:06.312727Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"745.397046ms","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-06-18T15:11:06.313258Z","caller":"traceutil/trace.go:171","msg":"trace[259624694] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:836; }","duration":"745.9609ms","start":"2026-06-18T15:11:05.56726Z","end":"2026-06-18T15:11:06.313221Z","steps":["trace[259624694] 'range keys from in-memory index tree' (duration: 745.195731ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:11:06.313348Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:11:05.567239Z","time spent":"746.077942ms","remote":"127.0.0.1:42542","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-06-18T15:11:06.483973Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"217.113809ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-06-18T15:11:06.484234Z","caller":"traceutil/trace.go:171","msg":"trace[1270516407] transaction","detail":"{read_only:false; response_revision:837; number_of_response:1; }","duration":"166.892332ms","start":"2026-06-18T15:11:06.317325Z","end":"2026-06-18T15:11:06.484218Z","steps":["trace[1270516407] 'process raft request' (duration: 166.752279ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:11:06.484298Z","caller":"traceutil/trace.go:171","msg":"trace[1265038227] linearizableReadLoop","detail":"{readStateIndex:867; appliedIndex:866; }","duration":"563.161455ms","start":"2026-06-18T15:11:05.921068Z","end":"2026-06-18T15:11:06.48423Z","steps":["trace[1265038227] 'read index received' (duration: 345.727509ms)","trace[1265038227] 'applied index is now lower than readState.Index' (duration: 217.432696ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:11:06.487541Z","caller":"traceutil/trace.go:171","msg":"trace[872116949] transaction","detail":"{read_only:false; response_revision:838; number_of_response:1; }","duration":"166.162664ms","start":"2026-06-18T15:11:06.321331Z","end":"2026-06-18T15:11:06.487493Z","steps":["trace[872116949] 'process raft request' (duration: 165.752324ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:11:06.487566Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"566.439547ms","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-06-18T15:11:06.487614Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"563.520584ms","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-06-18T15:11:06.487646Z","caller":"traceutil/trace.go:171","msg":"trace[512205821] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:837; }","duration":"566.606321ms","start":"2026-06-18T15:11:05.921019Z","end":"2026-06-18T15:11:06.487625Z","steps":["trace[512205821] 'agreement among raft nodes before linearized reading' (duration: 563.321539ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:11:06.487685Z","caller":"traceutil/trace.go:171","msg":"trace[581790191] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:838; }","duration":"563.616977ms","start":"2026-06-18T15:11:05.924049Z","end":"2026-06-18T15:11:06.487666Z","steps":["trace[581790191] 'agreement among raft nodes before linearized reading' (duration: 563.370121ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:11:06.487735Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:11:05.924042Z","time spent":"563.684778ms","remote":"127.0.0.1:42542","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-06-18T15:11:06.487983Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.278569ms","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-06-18T15:11:06.488037Z","caller":"traceutil/trace.go:171","msg":"trace[607546341] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:838; }","duration":"154.375832ms","start":"2026-06-18T15:11:06.333647Z","end":"2026-06-18T15:11:06.488023Z","steps":["trace[607546341] 'agreement among raft nodes before linearized reading' (duration: 154.242208ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:11:06.488306Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"152.973437ms","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-06-18T15:11:06.488358Z","caller":"traceutil/trace.go:171","msg":"trace[1365834383] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:838; }","duration":"153.060839ms","start":"2026-06-18T15:11:06.335286Z","end":"2026-06-18T15:11:06.488346Z","steps":["trace[1365834383] 'agreement among raft nodes before linearized reading' (duration: 152.929165ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:11:06.488468Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:11:05.921Z","time spent":"566.683703ms","remote":"127.0.0.1:42542","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-06-18T15:11:14.036672Z","caller":"traceutil/trace.go:171","msg":"trace[509091214] transaction","detail":"{read_only:false; response_revision:910; number_of_response:1; }","duration":"113.564438ms","start":"2026-06-18T15:11:13.92309Z","end":"2026-06-18T15:11:14.036655Z","steps":["trace[509091214] 'process raft request' (duration: 113.435025ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:11:14.03667Z","caller":"traceutil/trace.go:171","msg":"trace[819659650] transaction","detail":"{read_only:false; response_revision:909; number_of_response:1; }","duration":"118.682742ms","start":"2026-06-18T15:11:13.917958Z","end":"2026-06-18T15:11:14.03664Z","steps":["trace[819659650] 'process raft request' (duration: 106.400654ms)","trace[819659650] 'compare' (duration: 12.044632ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:11:14.512042Z","caller":"traceutil/trace.go:171","msg":"trace[573154724] transaction","detail":"{read_only:false; response_revision:915; number_of_response:1; }","duration":"106.836768ms","start":"2026-06-18T15:11:14.405186Z","end":"2026-06-18T15:11:14.512022Z","steps":["trace[573154724] 'process raft request' (duration: 106.718235ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:11:15.784498Z","caller":"traceutil/trace.go:171","msg":"trace[1654284762] transaction","detail":"{read_only:false; response_revision:941; number_of_response:1; }","duration":"110.709485ms","start":"2026-06-18T15:11:15.67376Z","end":"2026-06-18T15:11:15.78447Z","steps":["trace[1654284762] 'process raft request' (duration: 110.631943ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:11:15.784531Z","caller":"traceutil/trace.go:171","msg":"trace[1921467500] transaction","detail":"{read_only:false; response_revision:940; number_of_response:1; }","duration":"112.6014ms","start":"2026-06-18T15:11:15.671895Z","end":"2026-06-18T15:11:15.784496Z","steps":["trace[1921467500] 'process raft request' (duration: 106.406611ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:11:15.914287Z","caller":"traceutil/trace.go:171","msg":"trace[744276906] transaction","detail":"{read_only:false; response_revision:943; number_of_response:1; }","duration":"122.963221ms","start":"2026-06-18T15:11:15.791303Z","end":"2026-06-18T15:11:15.914266Z","steps":["trace[744276906] 'process raft request' (duration: 100.447787ms)","trace[744276906] 'compare' (duration: 22.36135ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:11:15.914767Z","caller":"traceutil/trace.go:171","msg":"trace[924701570] transaction","detail":"{read_only:false; response_revision:944; number_of_response:1; }","duration":"120.121813ms","start":"2026-06-18T15:11:15.79463Z","end":"2026-06-18T15:11:15.914752Z","steps":["trace[924701570] 'process raft request' (duration: 119.58967ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:11:21.358866Z","caller":"traceutil/trace.go:171","msg":"trace[670795962] transaction","detail":"{read_only:false; response_revision:1005; number_of_response:1; }","duration":"439.39192ms","start":"2026-06-18T15:11:20.919441Z","end":"2026-06-18T15:11:21.358833Z","steps":["trace[670795962] 'process raft request' (duration: 439.248107ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:11:21.359044Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:11:20.91942Z","time spent":"439.524424ms","remote":"127.0.0.1:42478","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5472,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:11:59.086772Z","caller":"traceutil/trace.go:171","msg":"trace[1446775123] linearizableReadLoop","detail":"{readStateIndex:1184; appliedIndex:1182; }","duration":"216.096659ms","start":"2026-06-18T15:11:58.870651Z","end":"2026-06-18T15:11:59.086748Z","steps":["trace[1446775123] 'read index received' (duration: 4.259012ms)","trace[1446775123] 'applied index is now lower than readState.Index' (duration: 211.836547ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:11:59.086977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"216.303003ms","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-06-18T15:11:59.08713Z","caller":"traceutil/trace.go:171","msg":"trace[1172217989] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1142; }","duration":"216.452877ms","start":"2026-06-18T15:11:58.870627Z","end":"2026-06-18T15:11:59.08708Z","steps":["trace[1172217989] 'agreement among raft nodes before linearized reading' (duration: 216.218842ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:11:59.087721Z","caller":"traceutil/trace.go:171","msg":"trace[1029452660] transaction","detail":"{read_only:false; response_revision:1142; number_of_response:1; }","duration":"233.143837ms","start":"2026-06-18T15:11:58.854558Z","end":"2026-06-18T15:11:59.087702Z","steps":["trace[1029452660] 'process raft request' (duration: 232.004882ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:12:06.147464Z","caller":"traceutil/trace.go:171","msg":"trace[360606410] transaction","detail":"{read_only:false; response_revision:1165; number_of_response:1; }","duration":"242.666967ms","start":"2026-06-18T15:12:05.904772Z","end":"2026-06-18T15:12:06.147439Z","steps":["trace[360606410] 'process raft request' (duration: 242.523253ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:12:39.501133Z","caller":"traceutil/trace.go:171","msg":"trace[2102700915] transaction","detail":"{read_only:false; response_revision:1275; number_of_response:1; }","duration":"100.606903ms","start":"2026-06-18T15:12:39.400499Z","end":"2026-06-18T15:12:39.501106Z","steps":["trace[2102700915] 'process raft request' (duration: 100.45696ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:12:52.376545Z","caller":"traceutil/trace.go:171","msg":"trace[1912645029] transaction","detail":"{read_only:false; response_revision:1336; number_of_response:1; }","duration":"142.351326ms","start":"2026-06-18T15:12:52.234171Z","end":"2026-06-18T15:12:52.376522Z","steps":["trace[1912645029] 'process raft request' (duration: 142.226324ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:12:53.804401Z","caller":"traceutil/trace.go:171","msg":"trace[822257759] transaction","detail":"{read_only:false; response_revision:1348; number_of_response:1; }","duration":"229.867712ms","start":"2026-06-18T15:12:53.57449Z","end":"2026-06-18T15:12:53.804357Z","steps":["trace[822257759] 'process raft request' (duration: 224.697912ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:12:53.810019Z","caller":"traceutil/trace.go:171","msg":"trace[1330953221] linearizableReadLoop","detail":"{readStateIndex:1404; appliedIndex:1402; }","duration":"128.279339ms","start":"2026-06-18T15:12:53.681722Z","end":"2026-06-18T15:12:53.810002Z","steps":["trace[1330953221] 'read index received' (duration: 117.485761ms)","trace[1330953221] 'applied index is now lower than readState.Index' (duration: 10.792858ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:12:53.810149Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.411941ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/default/test-pvc-pod\" ","response":"range_response_count:1 size:1536"} {"level":"info","ts":"2026-06-18T15:12:53.810181Z","caller":"traceutil/trace.go:171","msg":"trace[1700980593] range","detail":"{range_begin:/registry/pods/default/test-pvc-pod; range_end:; response_count:1; response_revision:1349; }","duration":"128.483233ms","start":"2026-06-18T15:12:53.68169Z","end":"2026-06-18T15:12:53.810174Z","steps":["trace[1700980593] 'agreement among raft nodes before linearized reading' (duration: 128.392732ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:12:53.810289Z","caller":"traceutil/trace.go:171","msg":"trace[1740233653] transaction","detail":"{read_only:false; response_revision:1349; number_of_response:1; }","duration":"144.749467ms","start":"2026-06-18T15:12:53.665521Z","end":"2026-06-18T15:12:53.810271Z","steps":["trace[1740233653] 'process raft request' (duration: 144.36872ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:12:58.587562Z","caller":"traceutil/trace.go:171","msg":"trace[55422493] transaction","detail":"{read_only:false; response_revision:1369; number_of_response:1; }","duration":"428.801708ms","start":"2026-06-18T15:12:58.158728Z","end":"2026-06-18T15:12:58.58753Z","steps":["trace[55422493] 'process raft request' (duration: 428.640425ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:12:58.587849Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:12:58.158703Z","time spent":"428.951061ms","remote":"127.0.0.1:42542","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-18T15:13:05.812894Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":824333396450969470,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-18T15:13:05.875669Z","caller":"traceutil/trace.go:171","msg":"trace[752186732] transaction","detail":"{read_only:false; response_revision:1397; number_of_response:1; }","duration":"564.241373ms","start":"2026-06-18T15:13:05.311399Z","end":"2026-06-18T15:13:05.87564Z","steps":["trace[752186732] 'process raft request' (duration: 564.06685ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:13:05.875878Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:13:05.311378Z","time spent":"564.372565ms","remote":"127.0.0.1:42542","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T15:13:05.92066Z","caller":"traceutil/trace.go:171","msg":"trace[424162073] linearizableReadLoop","detail":"{readStateIndex:1455; appliedIndex:1453; }","duration":"608.571093ms","start":"2026-06-18T15:13:05.312066Z","end":"2026-06-18T15:13:05.920638Z","steps":["trace[424162073] 'read index received' (duration: 563.423337ms)","trace[424162073] 'applied index is now lower than readState.Index' (duration: 45.146386ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:13:05.920874Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"338.505555ms","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-06-18T15:13:05.920915Z","caller":"traceutil/trace.go:171","msg":"trace[921963457] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1397; }","duration":"338.597207ms","start":"2026-06-18T15:13:05.582306Z","end":"2026-06-18T15:13:05.920903Z","steps":["trace[921963457] 'agreement among raft nodes before linearized reading' (duration: 338.478465ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:13:05.920944Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:13:05.582281Z","time spent":"338.655297ms","remote":"127.0.0.1:42542","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-06-18T15:13:05.920874Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"608.793397ms","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-06-18T15:13:05.921183Z","caller":"traceutil/trace.go:171","msg":"trace[642948991] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1397; }","duration":"609.133544ms","start":"2026-06-18T15:13:05.312041Z","end":"2026-06-18T15:13:05.921175Z","steps":["trace[642948991] 'agreement among raft nodes before linearized reading' (duration: 608.731976ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:13:05.921207Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T15:13:05.31203Z","time spent":"609.170974ms","remote":"127.0.0.1:42542","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-06-18T15:13:26.862056Z","caller":"traceutil/trace.go:171","msg":"trace[810164874] linearizableReadLoop","detail":"{readStateIndex:1533; appliedIndex:1532; }","duration":"141.898577ms","start":"2026-06-18T15:13:26.720134Z","end":"2026-06-18T15:13:26.862032Z","steps":["trace[810164874] 'read index received' (duration: 141.815766ms)","trace[810164874] 'applied index is now lower than readState.Index' (duration: 81.281µs)"],"step_count":2} {"level":"info","ts":"2026-06-18T15:13:26.86217Z","caller":"traceutil/trace.go:171","msg":"trace[739487850] transaction","detail":"{read_only:false; response_revision:1471; number_of_response:1; }","duration":"152.162195ms","start":"2026-06-18T15:13:26.709998Z","end":"2026-06-18T15:13:26.86216Z","steps":["trace[739487850] 'process raft request' (duration: 151.88532ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:13:26.862845Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.422207ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/default/default\" ","response":"range_response_count:1 size:171"} {"level":"info","ts":"2026-06-18T15:13:26.86299Z","caller":"traceutil/trace.go:171","msg":"trace[202318838] range","detail":"{range_begin:/registry/serviceaccounts/default/default; range_end:; response_count:1; response_revision:1471; }","duration":"142.868045ms","start":"2026-06-18T15:13:26.720095Z","end":"2026-06-18T15:13:26.862963Z","steps":["trace[202318838] 'agreement among raft nodes before linearized reading' (duration: 142.272194ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:13:27.000281Z","caller":"traceutil/trace.go:171","msg":"trace[918859557] linearizableReadLoop","detail":"{readStateIndex:1534; appliedIndex:1533; }","duration":"138.121717ms","start":"2026-06-18T15:13:26.862132Z","end":"2026-06-18T15:13:27.000254Z","steps":["trace[918859557] 'read index received' (duration: 129.248115ms)","trace[918859557] 'applied index is now lower than readState.Index' (duration: 8.872392ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T15:13:27.000456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.788283ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T15:13:27.000586Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.187371ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/kube-public/\" range_end:\"/registry/deployments/kube-public0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T15:13:27.000593Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.661724ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cronjobs/kube-node-lease/\" range_end:\"/registry/cronjobs/kube-node-lease0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T15:13:27.000668Z","caller":"traceutil/trace.go:171","msg":"trace[1500194585] range","detail":"{range_begin:/registry/deployments/kube-public/; range_end:/registry/deployments/kube-public0; response_count:0; response_revision:1472; }","duration":"204.322304ms","start":"2026-06-18T15:13:26.79633Z","end":"2026-06-18T15:13:27.000652Z","steps":["trace[1500194585] 'agreement among raft nodes before linearized reading' (duration: 204.173931ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:13:27.000648Z","caller":"traceutil/trace.go:171","msg":"trace[1195962901] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1472; }","duration":"156.017786ms","start":"2026-06-18T15:13:26.84461Z","end":"2026-06-18T15:13:27.000628Z","steps":["trace[1195962901] 'agreement among raft nodes before linearized reading' (duration: 155.736701ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:13:27.000719Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.293521ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/default/default\" ","response":"range_response_count:1 size:171"} {"level":"info","ts":"2026-06-18T15:13:27.000732Z","caller":"traceutil/trace.go:171","msg":"trace[1552268215] range","detail":"{range_begin:/registry/cronjobs/kube-node-lease/; range_end:/registry/cronjobs/kube-node-lease0; response_count:0; response_revision:1472; }","duration":"201.871089ms","start":"2026-06-18T15:13:26.798832Z","end":"2026-06-18T15:13:27.000704Z","steps":["trace[1552268215] 'agreement among raft nodes before linearized reading' (duration: 201.604984ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T15:13:27.000609Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.456498ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/default/kubernetes\" ","response":"range_response_count:1 size:704"} {"level":"info","ts":"2026-06-18T15:13:27.000805Z","caller":"traceutil/trace.go:171","msg":"trace[428054917] range","detail":"{range_begin:/registry/serviceaccounts/default/default; range_end:; response_count:1; response_revision:1472; }","duration":"132.434223ms","start":"2026-06-18T15:13:26.868355Z","end":"2026-06-18T15:13:27.000789Z","steps":["trace[428054917] 'agreement among raft nodes before linearized reading' (duration: 132.214239ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:13:27.000864Z","caller":"traceutil/trace.go:171","msg":"trace[751996772] range","detail":"{range_begin:/registry/services/specs/default/kubernetes; range_end:; response_count:1; response_revision:1472; }","duration":"228.718502ms","start":"2026-06-18T15:13:26.772098Z","end":"2026-06-18T15:13:27.000816Z","steps":["trace[751996772] 'agreement among raft nodes before linearized reading' (duration: 228.371125ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T15:13:27.001766Z","caller":"traceutil/trace.go:171","msg":"trace[508007847] transaction","detail":"{read_only:false; response_revision:1472; number_of_response:1; }","duration":"200.964962ms","start":"2026-06-18T15:13:26.800774Z","end":"2026-06-18T15:13:27.001739Z","steps":["trace[508007847] 'process raft request' (duration: 190.482719ms)"],"step_count":1}