{"level":"warn","ts":"2026-06-24T18:01:48.013005Z","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-24T18:01:48.013109Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.132:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.132:2380","--initial-cluster=instance=https://199.204.45.132:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.132:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.132: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-24T18:01:48.013188Z","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-24T18:01:48.013295Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.132:2380"]} {"level":"info","ts":"2026-06-24T18:01:48.013328Z","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-24T18:01:48.014194Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.132:2379"]} {"level":"info","ts":"2026-06-24T18:01:48.014318Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.132:2380"],"listen-peer-urls":["https://199.204.45.132:2380"],"advertise-client-urls":["https://199.204.45.132:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.132:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.132: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-24T18:01:48.018393Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.731595ms"} {"level":"info","ts":"2026-06-24T18:01:48.024727Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"56c01ea8fdc90390","cluster-id":"c930fe821aab8609"} {"level":"info","ts":"2026-06-24T18:01:48.024834Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 switched to configuration voters=()"} {"level":"info","ts":"2026-06-24T18:01:48.024908Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became follower at term 0"} {"level":"info","ts":"2026-06-24T18:01:48.024938Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 56c01ea8fdc90390 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-06-24T18:01:48.024957Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became follower at term 1"} {"level":"info","ts":"2026-06-24T18:01:48.025013Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 switched to configuration voters=(6251029993951396752)"} {"level":"warn","ts":"2026-06-24T18:01:48.032575Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-06-24T18:01:48.036269Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-06-24T18:01:48.043496Z","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-24T18:01:48.045598Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"56c01ea8fdc90390","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-06-24T18:01:48.0461Z","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-24T18:01:48.04635Z","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-24T18:01:48.046214Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"56c01ea8fdc90390","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-06-24T18:01:48.046465Z","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-24T18:01:48.050869Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 switched to configuration voters=(6251029993951396752)"} {"level":"info","ts":"2026-06-24T18:01:48.05163Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"c930fe821aab8609","local-member-id":"56c01ea8fdc90390","added-peer-id":"56c01ea8fdc90390","added-peer-peer-urls":["https://199.204.45.132:2380"]} {"level":"info","ts":"2026-06-24T18:01:48.052137Z","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-24T18:01:48.052262Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.132:2380"} {"level":"info","ts":"2026-06-24T18:01:48.052371Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.132:2380"} {"level":"info","ts":"2026-06-24T18:01:48.053614Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"56c01ea8fdc90390","initial-advertise-peer-urls":["https://199.204.45.132:2380"],"listen-peer-urls":["https://199.204.45.132:2380"],"advertise-client-urls":["https://199.204.45.132:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.132:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-06-24T18:01:48.053644Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-06-24T18:01:48.525241Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 is starting a new election at term 1"} {"level":"info","ts":"2026-06-24T18:01:48.525306Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became pre-candidate at term 1"} {"level":"info","ts":"2026-06-24T18:01:48.525355Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 received MsgPreVoteResp from 56c01ea8fdc90390 at term 1"} {"level":"info","ts":"2026-06-24T18:01:48.525382Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became candidate at term 2"} {"level":"info","ts":"2026-06-24T18:01:48.525399Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 received MsgVoteResp from 56c01ea8fdc90390 at term 2"} {"level":"info","ts":"2026-06-24T18:01:48.52542Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became leader at term 2"} {"level":"info","ts":"2026-06-24T18:01:48.525439Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 56c01ea8fdc90390 elected leader 56c01ea8fdc90390 at term 2"} {"level":"info","ts":"2026-06-24T18:01:48.587365Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-06-24T18:01:48.590111Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"56c01ea8fdc90390","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.132:2379]}","request-path":"/0/members/56c01ea8fdc90390/attributes","cluster-id":"c930fe821aab8609","publish-timeout":"7s"} {"level":"info","ts":"2026-06-24T18:01:48.590167Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-24T18:01:48.590356Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-24T18:01:48.590557Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-06-24T18:01:48.590727Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-06-24T18:01:48.591097Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"c930fe821aab8609","local-member-id":"56c01ea8fdc90390","cluster-version":"3.5"} {"level":"info","ts":"2026-06-24T18:01:48.59128Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-06-24T18:01:48.591427Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-06-24T18:01:48.596114Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.132:2379"} {"level":"info","ts":"2026-06-24T18:01:48.596567Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-06-24T18:01:59.594504Z","caller":"traceutil/trace.go:171","msg":"trace[1058610281] transaction","detail":"{read_only:false; response_revision:352; number_of_response:1; }","duration":"448.080123ms","start":"2026-06-24T18:01:59.146388Z","end":"2026-06-24T18:01:59.594468Z","steps":["trace[1058610281] 'process raft request' (duration: 447.733235ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:01:59.594662Z","caller":"traceutil/trace.go:171","msg":"trace[2522438] linearizableReadLoop","detail":"{readStateIndex:363; appliedIndex:362; }","duration":"419.359206ms","start":"2026-06-24T18:01:59.175274Z","end":"2026-06-24T18:01:59.594633Z","steps":["trace[2522438] 'read index received' (duration: 418.776203ms)","trace[2522438] 'applied index is now lower than readState.Index' (duration: 580.023µs)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:01:59.596259Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"420.958784ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-06-24T18:01:59.59643Z","caller":"traceutil/trace.go:171","msg":"trace[257404418] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:352; }","duration":"421.168768ms","start":"2026-06-24T18:01:59.175217Z","end":"2026-06-24T18:01:59.596386Z","steps":["trace[257404418] 'agreement among raft nodes before linearized reading' (duration: 419.591432ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:01:59.596491Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:01:59.175193Z","time spent":"421.28424ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-06-24T18:01:59.596752Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"245.192813ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-proxy-jbmh6\" ","response":"range_response_count:1 size:4466"} {"level":"info","ts":"2026-06-24T18:01:59.596834Z","caller":"traceutil/trace.go:171","msg":"trace[655257957] range","detail":"{range_begin:/registry/pods/kube-system/kube-proxy-jbmh6; range_end:; response_count:1; response_revision:352; }","duration":"245.284395ms","start":"2026-06-24T18:01:59.35153Z","end":"2026-06-24T18:01:59.596815Z","steps":["trace[655257957] 'agreement among raft nodes before linearized reading' (duration: 244.945807ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:01:59.600628Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:01:59.146378Z","time spent":"448.215477ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":489,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:01:59.838537Z","caller":"traceutil/trace.go:171","msg":"trace[1710561740] transaction","detail":"{read_only:false; response_revision:354; number_of_response:1; }","duration":"233.039569ms","start":"2026-06-24T18:01:59.605453Z","end":"2026-06-24T18:01:59.838493Z","steps":["trace[1710561740] 'process raft request' (duration: 232.814984ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:00.210359Z","caller":"traceutil/trace.go:171","msg":"trace[726905084] transaction","detail":"{read_only:false; response_revision:355; number_of_response:1; }","duration":"363.616194ms","start":"2026-06-24T18:01:59.846715Z","end":"2026-06-24T18:02:00.210331Z","steps":["trace[726905084] 'process raft request' (duration: 323.8218ms)","trace[726905084] 'compare' (duration: 39.680382ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:02:00.2106Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:01:59.84669Z","time spent":"363.787699ms","remote":"127.0.0.1:57286","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2903,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:02:05.873237Z","caller":"traceutil/trace.go:171","msg":"trace[891903335] linearizableReadLoop","detail":"{readStateIndex:384; appliedIndex:383; }","duration":"251.167896ms","start":"2026-06-24T18:02:05.622042Z","end":"2026-06-24T18:02:05.87321Z","steps":["trace[891903335] 'read index received' (duration: 250.91915ms)","trace[891903335] 'applied index is now lower than readState.Index' (duration: 247.746µs)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:02:05.873363Z","caller":"traceutil/trace.go:171","msg":"trace[1247733335] transaction","detail":"{read_only:false; response_revision:372; number_of_response:1; }","duration":"486.946747ms","start":"2026-06-24T18:02:05.386404Z","end":"2026-06-24T18:02:05.873351Z","steps":["trace[1247733335] 'process raft request' (duration: 486.651871ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:05.873471Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:05.386383Z","time spent":"487.006369ms","remote":"127.0.0.1:46020","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5321,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:02:05.873574Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.228425ms","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-24T18:02:05.873629Z","caller":"traceutil/trace.go:171","msg":"trace[1511905346] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:372; }","duration":"177.315186ms","start":"2026-06-24T18:02:05.696299Z","end":"2026-06-24T18:02:05.873614Z","steps":["trace[1511905346] 'agreement among raft nodes before linearized reading' (duration: 177.221274ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:05.87362Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"251.575625ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-06-24T18:02:05.873678Z","caller":"traceutil/trace.go:171","msg":"trace[333197328] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:372; }","duration":"251.670987ms","start":"2026-06-24T18:02:05.621991Z","end":"2026-06-24T18:02:05.873662Z","steps":["trace[333197328] 'agreement among raft nodes before linearized reading' (duration: 251.554424ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:16.369117Z","caller":"traceutil/trace.go:171","msg":"trace[424878267] linearizableReadLoop","detail":"{readStateIndex:443; appliedIndex:442; }","duration":"402.882153ms","start":"2026-06-24T18:02:15.966212Z","end":"2026-06-24T18:02:16.369094Z","steps":["trace[424878267] 'read index received' (duration: 402.707639ms)","trace[424878267] 'applied index is now lower than readState.Index' (duration: 173.164µs)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:02:16.369326Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"403.098987ms","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-24T18:02:16.369273Z","caller":"traceutil/trace.go:171","msg":"trace[895301661] transaction","detail":"{read_only:false; response_revision:429; number_of_response:1; }","duration":"407.574227ms","start":"2026-06-24T18:02:15.961671Z","end":"2026-06-24T18:02:16.369246Z","steps":["trace[895301661] 'process raft request' (duration: 407.26323ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:16.369393Z","caller":"traceutil/trace.go:171","msg":"trace[1239292994] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:429; }","duration":"403.20738ms","start":"2026-06-24T18:02:15.966166Z","end":"2026-06-24T18:02:16.369373Z","steps":["trace[1239292994] 'agreement among raft nodes before linearized reading' (duration: 403.086707ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:16.369443Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:15.96615Z","time spent":"403.277021ms","remote":"127.0.0.1:46084","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-24T18:02:16.369493Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:15.961655Z","time spent":"407.741611ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:02:16.547403Z","caller":"traceutil/trace.go:171","msg":"trace[413501314] transaction","detail":"{read_only:false; response_revision:430; number_of_response:1; }","duration":"172.866144ms","start":"2026-06-24T18:02:16.37449Z","end":"2026-06-24T18:02:16.547357Z","steps":["trace[413501314] 'process raft request' (duration: 157.624244ms)","trace[413501314] 'compare' (duration: 15.144018ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:02:26.692656Z","caller":"traceutil/trace.go:171","msg":"trace[91413216] transaction","detail":"{read_only:false; response_revision:486; number_of_response:1; }","duration":"323.039222ms","start":"2026-06-24T18:02:26.369588Z","end":"2026-06-24T18:02:26.692627Z","steps":["trace[91413216] 'process raft request' (duration: 322.833807ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:26.692878Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:26.369554Z","time spent":"323.202506ms","remote":"127.0.0.1:45902","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":6315,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T18:02:26.70018Z","caller":"traceutil/trace.go:171","msg":"trace[351575633] transaction","detail":"{read_only:false; response_revision:489; number_of_response:1; }","duration":"257.745966ms","start":"2026-06-24T18:02:26.442395Z","end":"2026-06-24T18:02:26.700141Z","steps":["trace[351575633] 'process raft request' (duration: 257.528852ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700198Z","caller":"traceutil/trace.go:171","msg":"trace[1013217667] transaction","detail":"{read_only:false; response_revision:487; number_of_response:1; }","duration":"327.044852ms","start":"2026-06-24T18:02:26.373111Z","end":"2026-06-24T18:02:26.700156Z","steps":["trace[1013217667] 'process raft request' (duration: 326.679444ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700339Z","caller":"traceutil/trace.go:171","msg":"trace[183582175] linearizableReadLoop","detail":"{readStateIndex:504; appliedIndex:501; }","duration":"267.129826ms","start":"2026-06-24T18:02:26.43319Z","end":"2026-06-24T18:02:26.70032Z","steps":["trace[183582175] 'read index received' (duration: 259.127848ms)","trace[183582175] 'applied index is now lower than readState.Index' (duration: 8.001368ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:02:26.700365Z","caller":"traceutil/trace.go:171","msg":"trace[617237706] transaction","detail":"{read_only:false; response_revision:488; number_of_response:1; }","duration":"282.472177ms","start":"2026-06-24T18:02:26.417885Z","end":"2026-06-24T18:02:26.700357Z","steps":["trace[617237706] 'process raft request' (duration: 281.966506ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700406Z","caller":"traceutil/trace.go:171","msg":"trace[2103420373] transaction","detail":"{read_only:false; response_revision:490; number_of_response:1; }","duration":"246.547527ms","start":"2026-06-24T18:02:26.453848Z","end":"2026-06-24T18:02:26.700395Z","steps":["trace[2103420373] 'process raft request' (duration: 246.106967ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:26.700424Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:26.373062Z","time spent":"327.304147ms","remote":"127.0.0.1:45902","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":8162,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T18:02:26.70048Z","caller":"traceutil/trace.go:171","msg":"trace[532355432] transaction","detail":"{read_only:false; response_revision:491; number_of_response:1; }","duration":"245.491054ms","start":"2026-06-24T18:02:26.454982Z","end":"2026-06-24T18:02:26.700473Z","steps":["trace[532355432] 'process raft request' (duration: 245.011003ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700492Z","caller":"traceutil/trace.go:171","msg":"trace[457218707] transaction","detail":"{read_only:false; response_revision:495; number_of_response:1; }","duration":"223.35905ms","start":"2026-06-24T18:02:26.477123Z","end":"2026-06-24T18:02:26.700482Z","steps":["trace[457218707] 'process raft request' (duration: 223.022053ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700501Z","caller":"traceutil/trace.go:171","msg":"trace[2125273876] transaction","detail":"{read_only:false; response_revision:493; number_of_response:1; }","duration":"242.778983ms","start":"2026-06-24T18:02:26.457714Z","end":"2026-06-24T18:02:26.700493Z","steps":["trace[2125273876] 'process raft request' (duration: 242.348114ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700538Z","caller":"traceutil/trace.go:171","msg":"trace[1337032487] transaction","detail":"{read_only:false; response_revision:496; number_of_response:1; }","duration":"209.282436ms","start":"2026-06-24T18:02:26.491246Z","end":"2026-06-24T18:02:26.700528Z","steps":["trace[1337032487] 'process raft request' (duration: 208.955429ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700542Z","caller":"traceutil/trace.go:171","msg":"trace[943065265] transaction","detail":"{read_only:false; response_revision:494; number_of_response:1; }","duration":"231.156574ms","start":"2026-06-24T18:02:26.469378Z","end":"2026-06-24T18:02:26.700534Z","steps":["trace[943065265] 'process raft request' (duration: 230.721875ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700559Z","caller":"traceutil/trace.go:171","msg":"trace[2675837] transaction","detail":"{read_only:false; response_revision:492; number_of_response:1; }","duration":"243.225042ms","start":"2026-06-24T18:02:26.457326Z","end":"2026-06-24T18:02:26.700551Z","steps":["trace[2675837] 'process raft request' (duration: 242.707101ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:26.700597Z","caller":"traceutil/trace.go:171","msg":"trace[146841488] transaction","detail":"{read_only:false; response_revision:497; number_of_response:1; }","duration":"102.473875ms","start":"2026-06-24T18:02:26.598114Z","end":"2026-06-24T18:02:26.700588Z","steps":["trace[146841488] 'process raft request' (duration: 102.153958ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:26.700724Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"267.524635ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-06-24T18:02:26.700745Z","caller":"traceutil/trace.go:171","msg":"trace[897952028] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:497; }","duration":"267.555046ms","start":"2026-06-24T18:02:26.433184Z","end":"2026-06-24T18:02:26.700739Z","steps":["trace[897952028] 'agreement among raft nodes before linearized reading' (duration: 267.405612ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:26.705405Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.659112ms","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-24T18:02:26.705448Z","caller":"traceutil/trace.go:171","msg":"trace[1884873861] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:498; }","duration":"108.763465ms","start":"2026-06-24T18:02:26.596674Z","end":"2026-06-24T18:02:26.705438Z","steps":["trace[1884873861] 'agreement among raft nodes before linearized reading' (duration: 108.584021ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:33.250754Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"532.297238ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-06-24T18:02:33.250821Z","caller":"traceutil/trace.go:171","msg":"trace[732652660] linearizableReadLoop","detail":"{readStateIndex:604; appliedIndex:603; }","duration":"812.972525ms","start":"2026-06-24T18:02:32.437838Z","end":"2026-06-24T18:02:33.250811Z","steps":["trace[732652660] 'read index received' (duration: 280.274319ms)","trace[732652660] 'applied index is now lower than readState.Index' (duration: 532.697666ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:02:33.251071Z","caller":"traceutil/trace.go:171","msg":"trace[1017071149] transaction","detail":"{read_only:false; response_revision:581; number_of_response:1; }","duration":"814.062409ms","start":"2026-06-24T18:02:32.437002Z","end":"2026-06-24T18:02:33.251065Z","steps":["trace[1017071149] 'process raft request' (duration: 281.318171ms)","trace[1017071149] 'compare' (duration: 531.977391ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:02:33.251106Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:32.436971Z","time spent":"814.12222ms","remote":"127.0.0.1:45954","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036019,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-24T18:02:33.25128Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"813.452565ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-85bpb\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-06-24T18:02:33.2513Z","caller":"traceutil/trace.go:171","msg":"trace[1994850023] range","detail":"{range_begin:/registry/pods/kube-system/cilium-85bpb; range_end:; response_count:1; response_revision:581; }","duration":"813.508837ms","start":"2026-06-24T18:02:32.437786Z","end":"2026-06-24T18:02:33.251295Z","steps":["trace[1994850023] 'agreement among raft nodes before linearized reading' (duration: 813.402814ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:33.251314Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:32.43777Z","time spent":"813.540927ms","remote":"127.0.0.1:46020","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-85bpb\" "} {"level":"warn","ts":"2026-06-24T18:02:33.251418Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"515.997474ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-06-24T18:02:33.251435Z","caller":"traceutil/trace.go:171","msg":"trace[803202016] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:581; }","duration":"516.048855ms","start":"2026-06-24T18:02:32.735382Z","end":"2026-06-24T18:02:33.251431Z","steps":["trace[803202016] 'agreement among raft nodes before linearized reading' (duration: 516.003604ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:33.251447Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:32.735363Z","time spent":"516.080646ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-06-24T18:02:33.251985Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"456.865487ms","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-24T18:02:33.253238Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"516.73432ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-06-24T18:02:33.253456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"466.48985ms","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-24T18:02:33.2535Z","caller":"traceutil/trace.go:171","msg":"trace[1946994863] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:581; }","duration":"466.583492ms","start":"2026-06-24T18:02:32.786902Z","end":"2026-06-24T18:02:33.253486Z","steps":["trace[1946994863] 'agreement among raft nodes before linearized reading' (duration: 465.14607ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:33.253534Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:32.786881Z","time spent":"466.648264ms","remote":"127.0.0.1:46084","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-24T18:02:33.253691Z","caller":"traceutil/trace.go:171","msg":"trace[1404285363] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:581; }","duration":"457.01198ms","start":"2026-06-24T18:02:32.79506Z","end":"2026-06-24T18:02:33.252072Z","steps":["trace[1404285363] 'agreement among raft nodes before linearized reading' (duration: 456.677241ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:33.253721Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:32.795049Z","time spent":"458.663747ms","remote":"127.0.0.1:46084","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":"info","ts":"2026-06-24T18:02:33.253352Z","caller":"traceutil/trace.go:171","msg":"trace[602745414] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:581; }","duration":"516.846913ms","start":"2026-06-24T18:02:32.736456Z","end":"2026-06-24T18:02:33.253303Z","steps":["trace[602745414] 'agreement among raft nodes before linearized reading' (duration: 515.522554ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:33.257141Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:32.73645Z","time spent":"520.677118ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-06-24T18:02:33.712323Z","caller":"traceutil/trace.go:171","msg":"trace[504619395] linearizableReadLoop","detail":"{readStateIndex:609; appliedIndex:605; }","duration":"423.383859ms","start":"2026-06-24T18:02:33.288899Z","end":"2026-06-24T18:02:33.712283Z","steps":["trace[504619395] 'read index received' (duration: 364.747962ms)","trace[504619395] 'applied index is now lower than readState.Index' (duration: 58.634697ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:02:33.712529Z","caller":"traceutil/trace.go:171","msg":"trace[927496294] transaction","detail":"{read_only:false; response_revision:585; number_of_response:1; }","duration":"447.256601ms","start":"2026-06-24T18:02:33.265256Z","end":"2026-06-24T18:02:33.712513Z","steps":["trace[927496294] 'process raft request' (duration: 446.908844ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:33.712487Z","caller":"traceutil/trace.go:171","msg":"trace[165143411] transaction","detail":"{read_only:false; response_revision:584; number_of_response:1; }","duration":"447.201221ms","start":"2026-06-24T18:02:33.265234Z","end":"2026-06-24T18:02:33.712435Z","steps":["trace[165143411] 'process raft request' (duration: 446.883114ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:33.712688Z","caller":"traceutil/trace.go:171","msg":"trace[238125538] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"447.473086ms","start":"2026-06-24T18:02:33.265173Z","end":"2026-06-24T18:02:33.712646Z","steps":["trace[238125538] 'process raft request' (duration: 388.381109ms)","trace[238125538] 'compare' (duration: 58.31093ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:02:33.712761Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"387.758445ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-24T18:02:33.712809Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:33.265144Z","time spent":"447.60791ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:02:33.712809Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:33.265203Z","time spent":"447.448165ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:02:33.71287Z","caller":"traceutil/trace.go:171","msg":"trace[575026126] range","detail":"{range_begin:/registry/serviceaccounts/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:586; }","duration":"387.99866ms","start":"2026-06-24T18:02:33.324828Z","end":"2026-06-24T18:02:33.712826Z","steps":["trace[575026126] 'agreement among raft nodes before linearized reading' (duration: 387.854067ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:33.712911Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:33.324807Z","time spent":"388.096282ms","remote":"127.0.0.1:46028","response type":"/etcdserverpb.KV/Range","request count":0,"request size":83,"response count":0,"response size":28,"request content":"key:\"/registry/serviceaccounts/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" "} {"level":"warn","ts":"2026-06-24T18:02:33.712761Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"423.843279ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:02:33.712921Z","caller":"traceutil/trace.go:171","msg":"trace[21855081] transaction","detail":"{read_only:false; response_revision:586; number_of_response:1; }","duration":"443.62598ms","start":"2026-06-24T18:02:33.269203Z","end":"2026-06-24T18:02:33.712829Z","steps":["trace[21855081] 'process raft request' (duration: 443.004637ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:33.712977Z","caller":"traceutil/trace.go:171","msg":"trace[1259633715] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:586; }","duration":"424.099034ms","start":"2026-06-24T18:02:33.288862Z","end":"2026-06-24T18:02:33.712961Z","steps":["trace[1259633715] 'agreement among raft nodes before linearized reading' (duration: 423.782797ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:33.71302Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:33.288817Z","time spent":"424.193716ms","remote":"127.0.0.1:45870","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-24T18:02:33.713052Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:33.269182Z","time spent":"443.800234ms","remote":"127.0.0.1:46020","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:02:33.712765Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:33.265233Z","time spent":"447.335904ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:02:34.796767Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":256879978755063346,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-06-24T18:02:34.968374Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"920.558943ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T18:02:34.968497Z","caller":"traceutil/trace.go:171","msg":"trace[1737459386] transaction","detail":"{read_only:false; response_revision:587; number_of_response:1; }","duration":"1.153332533s","start":"2026-06-24T18:02:33.815142Z","end":"2026-06-24T18:02:34.968475Z","steps":["trace[1737459386] 'process raft request' (duration: 232.584455ms)","trace[1737459386] 'compare' (duration: 920.338879ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:02:34.96856Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:33.815116Z","time spent":"1.153414095s","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:02:34.983967Z","caller":"traceutil/trace.go:171","msg":"trace[413883026] linearizableReadLoop","detail":"{readStateIndex:611; appliedIndex:610; }","duration":"687.977329ms","start":"2026-06-24T18:02:34.295962Z","end":"2026-06-24T18:02:34.983939Z","steps":["trace[413883026] 'read index received' (duration: 684.980242ms)","trace[413883026] 'applied index is now lower than readState.Index' (duration: 2.995957ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:02:34.9841Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"688.130992ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:02:34.984149Z","caller":"traceutil/trace.go:171","msg":"trace[1857868785] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:588; }","duration":"688.197073ms","start":"2026-06-24T18:02:34.295937Z","end":"2026-06-24T18:02:34.984134Z","steps":["trace[1857868785] 'agreement among raft nodes before linearized reading' (duration: 688.105331ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:34.984194Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:34.295857Z","time spent":"688.325056ms","remote":"127.0.0.1:45860","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-24T18:02:34.984189Z","caller":"traceutil/trace.go:171","msg":"trace[2014710504] transaction","detail":"{read_only:false; response_revision:588; number_of_response:1; }","duration":"858.004299ms","start":"2026-06-24T18:02:34.126161Z","end":"2026-06-24T18:02:34.984165Z","steps":["trace[2014710504] 'process raft request' (duration: 855.616015ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:34.98433Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:34.1261Z","time spent":"858.147253ms","remote":"127.0.0.1:45954","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036109,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:02:35.67492Z","caller":"traceutil/trace.go:171","msg":"trace[1840744195] transaction","detail":"{read_only:false; response_revision:596; number_of_response:1; }","duration":"103.093907ms","start":"2026-06-24T18:02:35.571796Z","end":"2026-06-24T18:02:35.67489Z","steps":["trace[1840744195] 'process raft request' (duration: 101.993723ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:36.90922Z","caller":"traceutil/trace.go:171","msg":"trace[495928158] transaction","detail":"{read_only:false; response_revision:625; number_of_response:1; }","duration":"295.002026ms","start":"2026-06-24T18:02:36.614198Z","end":"2026-06-24T18:02:36.9092Z","steps":["trace[495928158] 'process raft request' (duration: 294.235329ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:36.909602Z","caller":"traceutil/trace.go:171","msg":"trace[1418572543] linearizableReadLoop","detail":"{readStateIndex:649; appliedIndex:648; }","duration":"142.714472ms","start":"2026-06-24T18:02:36.766434Z","end":"2026-06-24T18:02:36.909149Z","steps":["trace[1418572543] 'read index received' (duration: 141.774651ms)","trace[1418572543] 'applied index is now lower than readState.Index' (duration: 938.891µs)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:02:36.909852Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.001438ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:02:36.909962Z","caller":"traceutil/trace.go:171","msg":"trace[555459328] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io; range_end:; response_count:0; response_revision:625; }","duration":"143.54908ms","start":"2026-06-24T18:02:36.766384Z","end":"2026-06-24T18:02:36.909933Z","steps":["trace[555459328] 'agreement among raft nodes before linearized reading' (duration: 142.988748ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:39.79371Z","caller":"traceutil/trace.go:171","msg":"trace[765341693] transaction","detail":"{read_only:false; response_revision:674; number_of_response:1; }","duration":"194.492957ms","start":"2026-06-24T18:02:39.599184Z","end":"2026-06-24T18:02:39.793677Z","steps":["trace[765341693] 'process raft request' (duration: 193.030744ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:02:50.80364Z","caller":"traceutil/trace.go:171","msg":"trace[1180708128] transaction","detail":"{read_only:false; response_revision:761; number_of_response:1; }","duration":"365.589211ms","start":"2026-06-24T18:02:50.437733Z","end":"2026-06-24T18:02:50.803322Z","steps":["trace[1180708128] 'process raft request' (duration: 365.385377ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:50.803976Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:50.437701Z","time spent":"366.194975ms","remote":"127.0.0.1:46084","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-24T18:02:50.858646Z","caller":"traceutil/trace.go:171","msg":"trace[525335016] transaction","detail":"{read_only:false; response_revision:762; number_of_response:1; }","duration":"303.745822ms","start":"2026-06-24T18:02:50.55487Z","end":"2026-06-24T18:02:50.858616Z","steps":["trace[525335016] 'process raft request' (duration: 303.603459ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:02:50.858889Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:02:50.554841Z","time spent":"303.907616ms","remote":"127.0.0.1:46070","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2785,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:03:25.331112Z","caller":"traceutil/trace.go:171","msg":"trace[1416298890] transaction","detail":"{read_only:false; response_revision:978; number_of_response:1; }","duration":"327.766256ms","start":"2026-06-24T18:03:25.003312Z","end":"2026-06-24T18:03:25.331078Z","steps":["trace[1416298890] 'process raft request' (duration: 327.280746ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:25.331289Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:25.003285Z","time spent":"327.92057ms","remote":"127.0.0.1:46084","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-24T18:03:25.90403Z","caller":"traceutil/trace.go:171","msg":"trace[1287835588] transaction","detail":"{read_only:false; response_revision:979; number_of_response:1; }","duration":"376.114672ms","start":"2026-06-24T18:03:25.527885Z","end":"2026-06-24T18:03:25.904Z","steps":["trace[1287835588] 'process raft request' (duration: 375.925108ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:25.904216Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:25.527869Z","time spent":"376.251576ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:03:25.904753Z","caller":"traceutil/trace.go:171","msg":"trace[1163928753] transaction","detail":"{read_only:false; response_revision:980; number_of_response:1; }","duration":"223.561439ms","start":"2026-06-24T18:03:25.681172Z","end":"2026-06-24T18:03:25.904733Z","steps":["trace[1163928753] 'process raft request' (duration: 223.449776ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:03:25.905138Z","caller":"traceutil/trace.go:171","msg":"trace[1348097859] transaction","detail":"{read_only:false; response_revision:981; number_of_response:1; }","duration":"176.662765ms","start":"2026-06-24T18:03:25.728412Z","end":"2026-06-24T18:03:25.905075Z","steps":["trace[1348097859] 'process raft request' (duration: 176.284507ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:26.683584Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"617.260044ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:504"} {"level":"info","ts":"2026-06-24T18:03:26.683654Z","caller":"traceutil/trace.go:171","msg":"trace[1602580660] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:981; }","duration":"617.377807ms","start":"2026-06-24T18:03:26.066257Z","end":"2026-06-24T18:03:26.683635Z","steps":["trace[1602580660] 'range keys from in-memory index tree' (duration: 617.09003ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:26.683691Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:26.066233Z","time spent":"617.449708ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":527,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-06-24T18:03:26.683732Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"608.671222ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-06-24T18:03:26.683788Z","caller":"traceutil/trace.go:171","msg":"trace[410079377] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:981; }","duration":"608.751623ms","start":"2026-06-24T18:03:26.075025Z","end":"2026-06-24T18:03:26.683777Z","steps":["trace[410079377] 'range keys from in-memory index tree' (duration: 608.576949ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:26.68381Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:26.075019Z","time spent":"608.786044ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-06-24T18:03:26.683842Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"608.306434ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-24T18:03:26.683915Z","caller":"traceutil/trace.go:171","msg":"trace[708683521] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:981; }","duration":"608.428176ms","start":"2026-06-24T18:03:26.075466Z","end":"2026-06-24T18:03:26.683895Z","steps":["trace[708683521] 'range keys from in-memory index tree' (duration: 608.12379ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:26.683956Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:26.075441Z","time spent":"608.503138ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-06-24T18:03:26.978355Z","caller":"traceutil/trace.go:171","msg":"trace[954039491] transaction","detail":"{read_only:false; response_revision:982; number_of_response:1; }","duration":"290.328616ms","start":"2026-06-24T18:03:26.688Z","end":"2026-06-24T18:03:26.978329Z","steps":["trace[954039491] 'process raft request' (duration: 290.195453ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:03:26.979106Z","caller":"traceutil/trace.go:171","msg":"trace[110897941] transaction","detail":"{read_only:false; response_revision:983; number_of_response:1; }","duration":"290.189763ms","start":"2026-06-24T18:03:26.688892Z","end":"2026-06-24T18:03:26.979082Z","steps":["trace[110897941] 'process raft request' (duration: 289.997668ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:03:26.980011Z","caller":"traceutil/trace.go:171","msg":"trace[1694522489] transaction","detail":"{read_only:false; response_revision:984; number_of_response:1; }","duration":"290.212923ms","start":"2026-06-24T18:03:26.689016Z","end":"2026-06-24T18:03:26.979229Z","steps":["trace[1694522489] 'process raft request' (duration: 290.024099ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:03:50.236781Z","caller":"traceutil/trace.go:171","msg":"trace[1717920665] transaction","detail":"{read_only:false; response_revision:1057; number_of_response:1; }","duration":"777.344541ms","start":"2026-06-24T18:03:49.459411Z","end":"2026-06-24T18:03:50.236755Z","steps":["trace[1717920665] 'process raft request' (duration: 777.201887ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:50.237083Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:49.459395Z","time spent":"777.509024ms","remote":"127.0.0.1:46084","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-24T18:03:50.330041Z","caller":"traceutil/trace.go:171","msg":"trace[375976842] linearizableReadLoop","detail":"{readStateIndex:1100; appliedIndex:1098; }","duration":"309.892946ms","start":"2026-06-24T18:03:50.020105Z","end":"2026-06-24T18:03:50.329998Z","steps":["trace[375976842] 'read index received' (duration: 216.621713ms)","trace[375976842] 'applied index is now lower than readState.Index' (duration: 93.270273ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:03:50.330164Z","caller":"traceutil/trace.go:171","msg":"trace[1914178177] transaction","detail":"{read_only:false; response_revision:1058; number_of_response:1; }","duration":"320.110965ms","start":"2026-06-24T18:03:50.010043Z","end":"2026-06-24T18:03:50.330154Z","steps":["trace[1914178177] 'process raft request' (duration: 315.537502ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:50.33028Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:50.010013Z","time spent":"320.178156ms","remote":"127.0.0.1:46084","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-24T18:03:50.330503Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"310.404778ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-06-24T18:03:50.330532Z","caller":"traceutil/trace.go:171","msg":"trace[238106616] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1058; }","duration":"310.472669ms","start":"2026-06-24T18:03:50.02005Z","end":"2026-06-24T18:03:50.330522Z","steps":["trace[238106616] 'agreement among raft nodes before linearized reading' (duration: 310.351927ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:50.330558Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:50.02003Z","time spent":"310.52267ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-06-24T18:03:51.673309Z","caller":"traceutil/trace.go:171","msg":"trace[1288578578] transaction","detail":"{read_only:false; response_revision:1060; number_of_response:1; }","duration":"498.131071ms","start":"2026-06-24T18:03:51.175154Z","end":"2026-06-24T18:03:51.673285Z","steps":["trace[1288578578] 'process raft request' (duration: 497.933497ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:51.673471Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:51.175139Z","time spent":"498.245494ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":489,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:03:51.71943Z","caller":"traceutil/trace.go:171","msg":"trace[560520419] linearizableReadLoop","detail":"{readStateIndex:1104; appliedIndex:1101; }","duration":"428.106929ms","start":"2026-06-24T18:03:51.291296Z","end":"2026-06-24T18:03:51.719403Z","steps":["trace[560520419] 'read index received' (duration: 381.754949ms)","trace[560520419] 'applied index is now lower than readState.Index' (duration: 46.35107ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:03:51.719518Z","caller":"traceutil/trace.go:171","msg":"trace[722456833] transaction","detail":"{read_only:false; response_revision:1062; number_of_response:1; }","duration":"542.743113ms","start":"2026-06-24T18:03:51.176748Z","end":"2026-06-24T18:03:51.719491Z","steps":["trace[722456833] 'process raft request' (duration: 542.616751ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:03:51.719485Z","caller":"traceutil/trace.go:171","msg":"trace[1337032671] transaction","detail":"{read_only:false; response_revision:1061; number_of_response:1; }","duration":"543.688994ms","start":"2026-06-24T18:03:51.175766Z","end":"2026-06-24T18:03:51.719455Z","steps":["trace[1337032671] 'process raft request' (duration: 543.452748ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:51.72005Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:51.175759Z","time spent":"544.219376ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":421,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:03:51.719625Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"428.314284ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:03:51.720195Z","caller":"traceutil/trace.go:171","msg":"trace[1023331401] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1062; }","duration":"428.917747ms","start":"2026-06-24T18:03:51.291249Z","end":"2026-06-24T18:03:51.720167Z","steps":["trace[1023331401] 'agreement among raft nodes before linearized reading' (duration: 428.285323ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:51.720277Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:51.291236Z","time spent":"429.022239ms","remote":"127.0.0.1:45860","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-24T18:03:51.719678Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:51.176741Z","time spent":"542.843225ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:03:51.719835Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"385.519134ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:03:51.720715Z","caller":"traceutil/trace.go:171","msg":"trace[2075758794] range","detail":"{range_begin:/registry/cilium.io/ciliumcidrgroups/; range_end:/registry/cilium.io/ciliumcidrgroups0; response_count:0; response_revision:1062; }","duration":"386.425044ms","start":"2026-06-24T18:03:51.334269Z","end":"2026-06-24T18:03:51.720694Z","steps":["trace[2075758794] 'agreement among raft nodes before linearized reading' (duration: 385.491233ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:51.719916Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"384.681674ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-24T18:03:51.720837Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:51.334231Z","time spent":"386.586938ms","remote":"127.0.0.1:35862","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":0,"response size":28,"request content":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" count_only:true "} {"level":"info","ts":"2026-06-24T18:03:51.720946Z","caller":"traceutil/trace.go:171","msg":"trace[1349838772] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:1062; }","duration":"385.745728ms","start":"2026-06-24T18:03:51.335162Z","end":"2026-06-24T18:03:51.720908Z","steps":["trace[1349838772] 'agreement among raft nodes before linearized reading' (duration: 384.681274ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:03:51.721019Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:03:51.335119Z","time spent":"385.874841ms","remote":"127.0.0.1:35800","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" count_only:true "} {"level":"info","ts":"2026-06-24T18:03:53.785372Z","caller":"traceutil/trace.go:171","msg":"trace[307368223] transaction","detail":"{read_only:false; response_revision:1068; number_of_response:1; }","duration":"103.137064ms","start":"2026-06-24T18:03:53.682204Z","end":"2026-06-24T18:03:53.785342Z","steps":["trace[307368223] 'process raft request' (duration: 102.94385ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:10.299134Z","caller":"traceutil/trace.go:171","msg":"trace[1242224412] linearizableReadLoop","detail":"{readStateIndex:1219; appliedIndex:1218; }","duration":"423.69252ms","start":"2026-06-24T18:04:09.875417Z","end":"2026-06-24T18:04:10.29911Z","steps":["trace[1242224412] 'read index received' (duration: 423.522976ms)","trace[1242224412] 'applied index is now lower than readState.Index' (duration: 168.204µs)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:10.299352Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"423.914194ms","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-24T18:04:10.29945Z","caller":"traceutil/trace.go:171","msg":"trace[2043352481] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1171; }","duration":"424.082658ms","start":"2026-06-24T18:04:09.875356Z","end":"2026-06-24T18:04:10.299439Z","steps":["trace[2043352481] 'agreement among raft nodes before linearized reading' (duration: 423.898044ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:10.299428Z","caller":"traceutil/trace.go:171","msg":"trace[1146437147] transaction","detail":"{read_only:false; response_revision:1171; number_of_response:1; }","duration":"536.046841ms","start":"2026-06-24T18:04:09.763181Z","end":"2026-06-24T18:04:10.299228Z","steps":["trace[1146437147] 'process raft request' (duration: 535.770625ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:10.299646Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:09.763151Z","time spent":"536.392059ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:04:10.299491Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:09.875328Z","time spent":"424.1518ms","remote":"127.0.0.1:46084","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-24T18:04:10.299485Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"409.604164ms","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-24T18:04:10.299871Z","caller":"traceutil/trace.go:171","msg":"trace[1410201299] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1171; }","duration":"410.005083ms","start":"2026-06-24T18:04:09.889852Z","end":"2026-06-24T18:04:10.299857Z","steps":["trace[1410201299] 'agreement among raft nodes before linearized reading' (duration: 409.556102ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:10.299911Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:09.889844Z","time spent":"410.054004ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-06-24T18:04:22.690421Z","caller":"traceutil/trace.go:171","msg":"trace[1743196117] transaction","detail":"{read_only:false; response_revision:1214; number_of_response:1; }","duration":"290.18799ms","start":"2026-06-24T18:04:22.400191Z","end":"2026-06-24T18:04:22.690379Z","steps":["trace[1743196117] 'process raft request' (duration: 289.946295ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:22.691619Z","caller":"traceutil/trace.go:171","msg":"trace[1682725624] linearizableReadLoop","detail":"{readStateIndex:1266; appliedIndex:1264; }","duration":"183.399269ms","start":"2026-06-24T18:04:22.5082Z","end":"2026-06-24T18:04:22.691599Z","steps":["trace[1682725624] 'read index received' (duration: 181.951447ms)","trace[1682725624] 'applied index is now lower than readState.Index' (duration: 1.446872ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:04:22.691743Z","caller":"traceutil/trace.go:171","msg":"trace[1966254459] transaction","detail":"{read_only:false; response_revision:1215; number_of_response:1; }","duration":"253.047292ms","start":"2026-06-24T18:04:22.438645Z","end":"2026-06-24T18:04:22.691693Z","steps":["trace[1966254459] 'process raft request' (duration: 252.819077ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:22.691847Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"183.635283ms","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-24T18:04:22.691872Z","caller":"traceutil/trace.go:171","msg":"trace[1601709991] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1215; }","duration":"183.747465ms","start":"2026-06-24T18:04:22.508118Z","end":"2026-06-24T18:04:22.691866Z","steps":["trace[1601709991] 'agreement among raft nodes before linearized reading' (duration: 183.584262ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:22.691909Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.790198ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:04:22.691987Z","caller":"traceutil/trace.go:171","msg":"trace[1875901736] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:1215; }","duration":"179.887481ms","start":"2026-06-24T18:04:22.512073Z","end":"2026-06-24T18:04:22.69196Z","steps":["trace[1875901736] 'agreement among raft nodes before linearized reading' (duration: 179.758988ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:26.892015Z","caller":"traceutil/trace.go:171","msg":"trace[1228391292] transaction","detail":"{read_only:false; response_revision:1244; number_of_response:1; }","duration":"445.193524ms","start":"2026-06-24T18:04:26.446796Z","end":"2026-06-24T18:04:26.89199Z","steps":["trace[1228391292] 'process raft request' (duration: 445.037791ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:26.892167Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:26.44678Z","time spent":"445.304947ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:04:26.892203Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"441.420861ms","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-24T18:04:26.892243Z","caller":"traceutil/trace.go:171","msg":"trace[91765425] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1244; }","duration":"441.490244ms","start":"2026-06-24T18:04:26.450743Z","end":"2026-06-24T18:04:26.892234Z","steps":["trace[91765425] 'agreement among raft nodes before linearized reading' (duration: 441.321319ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:26.892021Z","caller":"traceutil/trace.go:171","msg":"trace[1889217598] linearizableReadLoop","detail":"{readStateIndex:1295; appliedIndex:1295; }","duration":"441.233367ms","start":"2026-06-24T18:04:26.450768Z","end":"2026-06-24T18:04:26.892002Z","steps":["trace[1889217598] 'read index received' (duration: 441.225706ms)","trace[1889217598] 'applied index is now lower than readState.Index' (duration: 6.251µs)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:26.892273Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:26.450732Z","time spent":"441.533764ms","remote":"127.0.0.1:46084","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-24T18:04:27.39969Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"404.803045ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T18:04:27.399974Z","caller":"traceutil/trace.go:171","msg":"trace[2012585213] transaction","detail":"{read_only:false; response_revision:1245; number_of_response:1; }","duration":"697.737536ms","start":"2026-06-24T18:04:26.702189Z","end":"2026-06-24T18:04:27.399926Z","steps":["trace[2012585213] 'process raft request' (duration: 292.564483ms)","trace[2012585213] 'compare' (duration: 404.302543ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:27.400167Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:26.70216Z","time spent":"697.897039ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:04:27.976662Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"576.830231ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-06-24T18:04:27.977109Z","caller":"traceutil/trace.go:171","msg":"trace[1840151602] transaction","detail":"{read_only:false; response_revision:1247; number_of_response:1; }","duration":"1.080873707s","start":"2026-06-24T18:04:26.896197Z","end":"2026-06-24T18:04:27.977071Z","steps":["trace[1840151602] 'process raft request' (duration: 1.080821106s)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:27.977113Z","caller":"traceutil/trace.go:171","msg":"trace[1784967097] linearizableReadLoop","detail":"{readStateIndex:1298; appliedIndex:1295; }","duration":"1.084801765s","start":"2026-06-24T18:04:26.892277Z","end":"2026-06-24T18:04:27.977079Z","steps":["trace[1784967097] 'read index received' (duration: 102.492244ms)","trace[1784967097] 'applied index is now lower than readState.Index' (duration: 982.30664ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:27.977264Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:26.896177Z","time spent":"1.0809871s","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:04:27.977375Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.272640803s","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-24T18:04:27.97712Z","caller":"traceutil/trace.go:171","msg":"trace[828049129] transaction","detail":"{read_only:false; response_revision:1246; number_of_response:1; }","duration":"1.19353243s","start":"2026-06-24T18:04:26.783548Z","end":"2026-06-24T18:04:27.977081Z","steps":["trace[828049129] 'process raft request' (duration: 1.193260084s)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:27.97743Z","caller":"traceutil/trace.go:171","msg":"trace[2076401716] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1247; }","duration":"1.272743235s","start":"2026-06-24T18:04:26.704675Z","end":"2026-06-24T18:04:27.977418Z","steps":["trace[2076401716] 'agreement among raft nodes before linearized reading' (duration: 1.272555581s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:27.977467Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:26.704657Z","time spent":"1.272802137s","remote":"127.0.0.1:46084","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-24T18:04:27.977516Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:26.783515Z","time spent":"1.193929008s","remote":"127.0.0.1:46084","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-24T18:04:27.977393Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.522622717s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-06-24T18:04:27.977636Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.268122273s","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-24T18:04:27.977635Z","caller":"traceutil/trace.go:171","msg":"trace[1840903884] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1247; }","duration":"1.522909302s","start":"2026-06-24T18:04:26.454713Z","end":"2026-06-24T18:04:27.977623Z","steps":["trace[1840903884] 'agreement among raft nodes before linearized reading' (duration: 1.522538254s)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:27.977666Z","caller":"traceutil/trace.go:171","msg":"trace[1300832636] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1247; }","duration":"1.268161423s","start":"2026-06-24T18:04:26.709496Z","end":"2026-06-24T18:04:27.977657Z","steps":["trace[1300832636] 'agreement among raft nodes before linearized reading' (duration: 1.268081071s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:27.977681Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:26.454697Z","time spent":"1.522968054s","remote":"127.0.0.1:46084","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-24T18:04:27.977695Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:26.70949Z","time spent":"1.268196255s","remote":"127.0.0.1:46084","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-24T18:04:27.977715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"686.422883ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:04:27.977746Z","caller":"traceutil/trace.go:171","msg":"trace[1003800931] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1247; }","duration":"686.486925ms","start":"2026-06-24T18:04:27.291248Z","end":"2026-06-24T18:04:27.977735Z","steps":["trace[1003800931] 'agreement among raft nodes before linearized reading' (duration: 686.444704ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:27.977772Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:27.291229Z","time spent":"686.537986ms","remote":"127.0.0.1:45860","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-24T18:04:29.33905Z","caller":"traceutil/trace.go:171","msg":"trace[1337385005] transaction","detail":"{read_only:false; response_revision:1252; number_of_response:1; }","duration":"438.605739ms","start":"2026-06-24T18:04:28.900407Z","end":"2026-06-24T18:04:29.339012Z","steps":["trace[1337385005] 'process raft request' (duration: 438.375864ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:29.339543Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:28.900397Z","time spent":"439.067209ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:04:29.890563Z","caller":"traceutil/trace.go:171","msg":"trace[1915830931] transaction","detail":"{read_only:false; response_revision:1253; number_of_response:1; }","duration":"523.832938ms","start":"2026-06-24T18:04:29.36669Z","end":"2026-06-24T18:04:29.890523Z","steps":["trace[1915830931] 'process raft request' (duration: 523.596603ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:29.890825Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:29.366671Z","time spent":"524.003662ms","remote":"127.0.0.1:45936","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":788,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T18:04:29.963888Z","caller":"traceutil/trace.go:171","msg":"trace[1925149584] transaction","detail":"{read_only:false; response_revision:1254; number_of_response:1; }","duration":"551.593238ms","start":"2026-06-24T18:04:29.412269Z","end":"2026-06-24T18:04:29.963862Z","steps":["trace[1925149584] 'process raft request' (duration: 548.742484ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:29.963664Z","caller":"traceutil/trace.go:171","msg":"trace[465711774] linearizableReadLoop","detail":"{readStateIndex:1306; appliedIndex:1304; }","duration":"503.339982ms","start":"2026-06-24T18:04:29.460286Z","end":"2026-06-24T18:04:29.963626Z","steps":["trace[465711774] 'read index received' (duration: 429.940045ms)","trace[465711774] 'applied index is now lower than readState.Index' (duration: 73.398507ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:29.96409Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:29.412247Z","time spent":"551.736441ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:04:29.964401Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"504.052408ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:04:29.964517Z","caller":"traceutil/trace.go:171","msg":"trace[1560947890] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:0; response_revision:1254; }","duration":"504.258662ms","start":"2026-06-24T18:04:29.46024Z","end":"2026-06-24T18:04:29.964499Z","steps":["trace[1560947890] 'agreement among raft nodes before linearized reading' (duration: 503.814162ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:29.964594Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:29.460222Z","time spent":"504.356845ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":0,"response size":28,"request content":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" "} {"level":"info","ts":"2026-06-24T18:04:30.447151Z","caller":"traceutil/trace.go:171","msg":"trace[703523383] transaction","detail":"{read_only:false; response_revision:1255; number_of_response:1; }","duration":"479.202904ms","start":"2026-06-24T18:04:29.967925Z","end":"2026-06-24T18:04:30.447127Z","steps":["trace[703523383] 'process raft request' (duration: 432.196376ms)","trace[703523383] 'compare' (duration: 46.916696ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:30.447254Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:29.967896Z","time spent":"479.309237ms","remote":"127.0.0.1:45936","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":788,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T18:04:30.447652Z","caller":"traceutil/trace.go:171","msg":"trace[276072479] linearizableReadLoop","detail":"{readStateIndex:1308; appliedIndex:1306; }","duration":"465.511598ms","start":"2026-06-24T18:04:29.982131Z","end":"2026-06-24T18:04:30.447642Z","steps":["trace[276072479] 'read index received' (duration: 418.006329ms)","trace[276072479] 'applied index is now lower than readState.Index' (duration: 47.504659ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:04:30.447763Z","caller":"traceutil/trace.go:171","msg":"trace[1376906983] transaction","detail":"{read_only:false; response_revision:1256; number_of_response:1; }","duration":"478.624352ms","start":"2026-06-24T18:04:29.969132Z","end":"2026-06-24T18:04:30.447756Z","steps":["trace[1376906983] 'process raft request' (duration: 478.467178ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:30.447794Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:29.96911Z","time spent":"478.667372ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":459,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-24T18:04:30.447959Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"465.835386ms","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-24T18:04:30.44798Z","caller":"traceutil/trace.go:171","msg":"trace[798565252] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1256; }","duration":"465.895838ms","start":"2026-06-24T18:04:29.982078Z","end":"2026-06-24T18:04:30.447974Z","steps":["trace[798565252] 'agreement among raft nodes before linearized reading' (duration: 465.788686ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:30.447997Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:29.98206Z","time spent":"465.933559ms","remote":"127.0.0.1:46084","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-24T18:04:30.448106Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"399.296613ms","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-24T18:04:30.448122Z","caller":"traceutil/trace.go:171","msg":"trace[388814992] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1256; }","duration":"399.361434ms","start":"2026-06-24T18:04:30.048755Z","end":"2026-06-24T18:04:30.448117Z","steps":["trace[388814992] 'agreement among raft nodes before linearized reading' (duration: 399.313103ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:30.44814Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:30.048741Z","time spent":"399.395395ms","remote":"127.0.0.1:46084","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-24T18:04:30.448278Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.882648ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:04:30.448295Z","caller":"traceutil/trace.go:171","msg":"trace[366971838] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1256; }","duration":"156.930229ms","start":"2026-06-24T18:04:30.29136Z","end":"2026-06-24T18:04:30.44829Z","steps":["trace[366971838] 'agreement among raft nodes before linearized reading' (duration: 156.899939ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:30.44854Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"388.242127ms","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-24T18:04:30.448558Z","caller":"traceutil/trace.go:171","msg":"trace[657296918] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1256; }","duration":"388.274217ms","start":"2026-06-24T18:04:30.060279Z","end":"2026-06-24T18:04:30.448553Z","steps":["trace[657296918] 'agreement among raft nodes before linearized reading' (duration: 388.221846ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:30.448574Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:30.060272Z","time spent":"388.298087ms","remote":"127.0.0.1:46084","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-24T18:04:30.448551Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"388.165424ms","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-24T18:04:30.448622Z","caller":"traceutil/trace.go:171","msg":"trace[1852306922] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1256; }","duration":"388.279457ms","start":"2026-06-24T18:04:30.060324Z","end":"2026-06-24T18:04:30.448604Z","steps":["trace[1852306922] 'agreement among raft nodes before linearized reading' (duration: 388.057072ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:30.448665Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:30.060311Z","time spent":"388.345498ms","remote":"127.0.0.1:46084","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-24T18:04:30.580082Z","caller":"traceutil/trace.go:171","msg":"trace[906338158] transaction","detail":"{read_only:false; response_revision:1257; number_of_response:1; }","duration":"129.63872ms","start":"2026-06-24T18:04:30.450411Z","end":"2026-06-24T18:04:30.58005Z","steps":["trace[906338158] 'process raft request' (duration: 106.591576ms)","trace[906338158] 'compare' (duration: 22.928991ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T18:04:30.617126Z","caller":"traceutil/trace.go:171","msg":"trace[1023547137] transaction","detail":"{read_only:false; response_revision:1259; number_of_response:1; }","duration":"164.429717ms","start":"2026-06-24T18:04:30.452676Z","end":"2026-06-24T18:04:30.617106Z","steps":["trace[1023547137] 'process raft request' (duration: 164.375815ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:30.617238Z","caller":"traceutil/trace.go:171","msg":"trace[810219177] transaction","detail":"{read_only:false; response_revision:1260; number_of_response:1; }","duration":"164.531148ms","start":"2026-06-24T18:04:30.452702Z","end":"2026-06-24T18:04:30.617233Z","steps":["trace[810219177] 'process raft request' (duration: 164.373175ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:30.617128Z","caller":"traceutil/trace.go:171","msg":"trace[1172141669] transaction","detail":"{read_only:false; response_revision:1258; number_of_response:1; }","duration":"164.475187ms","start":"2026-06-24T18:04:30.45264Z","end":"2026-06-24T18:04:30.617115Z","steps":["trace[1172141669] 'process raft request' (duration: 164.273972ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:30.617501Z","caller":"traceutil/trace.go:171","msg":"trace[53220576] transaction","detail":"{read_only:false; response_revision:1261; number_of_response:1; }","duration":"162.84507ms","start":"2026-06-24T18:04:30.454648Z","end":"2026-06-24T18:04:30.617493Z","steps":["trace[53220576] 'process raft request' (duration: 162.540943ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:30.617516Z","caller":"traceutil/trace.go:171","msg":"trace[2095771858] transaction","detail":"{read_only:false; response_revision:1262; number_of_response:1; }","duration":"162.753328ms","start":"2026-06-24T18:04:30.454754Z","end":"2026-06-24T18:04:30.617507Z","steps":["trace[2095771858] 'process raft request' (duration: 162.646386ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:30.617511Z","caller":"traceutil/trace.go:171","msg":"trace[285923027] linearizableReadLoop","detail":"{readStateIndex:1312; appliedIndex:1308; }","duration":"162.873011ms","start":"2026-06-24T18:04:30.454613Z","end":"2026-06-24T18:04:30.617486Z","steps":["trace[285923027] 'read index received' (duration: 102.401493ms)","trace[285923027] 'applied index is now lower than readState.Index' (duration: 60.470408ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:30.617823Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.139047ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:474"} {"level":"info","ts":"2026-06-24T18:04:30.617885Z","caller":"traceutil/trace.go:171","msg":"trace[860764713] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1262; }","duration":"163.271879ms","start":"2026-06-24T18:04:30.454597Z","end":"2026-06-24T18:04:30.617869Z","steps":["trace[860764713] 'agreement among raft nodes before linearized reading' (duration: 162.977633ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:31.772742Z","caller":"traceutil/trace.go:171","msg":"trace[645168804] transaction","detail":"{read_only:false; response_revision:1264; number_of_response:1; }","duration":"425.533908ms","start":"2026-06-24T18:04:31.347163Z","end":"2026-06-24T18:04:31.772697Z","steps":["trace[645168804] 'process raft request' (duration: 425.273572ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:31.773094Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:31.347152Z","time spent":"425.741482ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:04:32.235107Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.79997ms","expected-duration":"100ms","prefix":"","request":"header: lease_grant:","response":"size:40"} {"level":"info","ts":"2026-06-24T18:04:32.235391Z","caller":"traceutil/trace.go:171","msg":"trace[113234626] transaction","detail":"{read_only:false; response_revision:1265; number_of_response:1; }","duration":"265.402587ms","start":"2026-06-24T18:04:31.969968Z","end":"2026-06-24T18:04:32.23537Z","steps":["trace[113234626] 'process raft request' (duration: 265.243074ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:32.235572Z","caller":"traceutil/trace.go:171","msg":"trace[10958549] linearizableReadLoop","detail":"{readStateIndex:1317; appliedIndex:1316; }","duration":"335.136832ms","start":"2026-06-24T18:04:31.900407Z","end":"2026-06-24T18:04:32.235544Z","steps":["trace[10958549] 'read index received' (duration: 197.974114ms)","trace[10958549] 'applied index is now lower than readState.Index' (duration: 137.160738ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:32.235627Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:31.773875Z","time spent":"461.745155ms","remote":"127.0.0.1:45896","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"warn","ts":"2026-06-24T18:04:32.235698Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"335.272425ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:04:32.235724Z","caller":"traceutil/trace.go:171","msg":"trace[1194311115] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:1265; }","duration":"335.372427ms","start":"2026-06-24T18:04:31.900343Z","end":"2026-06-24T18:04:32.235716Z","steps":["trace[1194311115] 'agreement among raft nodes before linearized reading' (duration: 335.287165ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:32.235753Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:31.90032Z","time spent":"335.424468ms","remote":"127.0.0.1:35650","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true "} {"level":"warn","ts":"2026-06-24T18:04:32.838853Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.285061ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-24T18:04:32.838951Z","caller":"traceutil/trace.go:171","msg":"trace[464289063] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:1270; }","duration":"155.445485ms","start":"2026-06-24T18:04:32.68348Z","end":"2026-06-24T18:04:32.838925Z","steps":["trace[464289063] 'count revisions from in-memory index tree' (duration: 155.156189ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:32.839005Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.39943ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-24T18:04:32.839065Z","caller":"traceutil/trace.go:171","msg":"trace[9102822] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:1270; }","duration":"175.499312ms","start":"2026-06-24T18:04:32.663553Z","end":"2026-06-24T18:04:32.839053Z","steps":["trace[9102822] 'count revisions from in-memory index tree' (duration: 175.331359ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:40.095581Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":256879978755064941,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-24T18:04:40.161241Z","caller":"traceutil/trace.go:171","msg":"trace[1462315804] linearizableReadLoop","detail":"{readStateIndex:1380; appliedIndex:1379; }","duration":"565.715653ms","start":"2026-06-24T18:04:39.5955Z","end":"2026-06-24T18:04:40.161216Z","steps":["trace[1462315804] 'read index received' (duration: 565.503688ms)","trace[1462315804] 'applied index is now lower than readState.Index' (duration: 210.895µs)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:04:40.161407Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"565.879186ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-24T18:04:40.161453Z","caller":"traceutil/trace.go:171","msg":"trace[910234603] range","detail":"{range_begin:/registry/csinodes/; range_end:/registry/csinodes0; response_count:0; response_revision:1326; }","duration":"565.986039ms","start":"2026-06-24T18:04:39.595456Z","end":"2026-06-24T18:04:40.161442Z","steps":["trace[910234603] 'agreement among raft nodes before linearized reading' (duration: 565.888647ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:40.161382Z","caller":"traceutil/trace.go:171","msg":"trace[1407302073] transaction","detail":"{read_only:false; response_revision:1326; number_of_response:1; }","duration":"623.132013ms","start":"2026-06-24T18:04:39.538216Z","end":"2026-06-24T18:04:40.161348Z","steps":["trace[1407302073] 'process raft request' (duration: 622.804076ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:40.161545Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:39.595442Z","time spent":"566.090811ms","remote":"127.0.0.1:46184","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":30,"request content":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true "} {"level":"warn","ts":"2026-06-24T18:04:40.161618Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:39.53819Z","time spent":"623.322117ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":517,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T18:04:40.161647Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"355.092486ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-06-24T18:04:40.161709Z","caller":"traceutil/trace.go:171","msg":"trace[271563426] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1326; }","duration":"355.210149ms","start":"2026-06-24T18:04:39.806479Z","end":"2026-06-24T18:04:40.161689Z","steps":["trace[271563426] 'agreement among raft nodes before linearized reading' (duration: 355.024315ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:40.161736Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:39.806458Z","time spent":"355.272551ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-06-24T18:04:40.162072Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"547.599768ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumidentities/\" range_end:\"/registry/cilium.io/ciliumidentities0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-24T18:04:40.162231Z","caller":"traceutil/trace.go:171","msg":"trace[2115233726] range","detail":"{range_begin:/registry/cilium.io/ciliumidentities/; range_end:/registry/cilium.io/ciliumidentities0; response_count:0; response_revision:1326; }","duration":"548.297993ms","start":"2026-06-24T18:04:39.613918Z","end":"2026-06-24T18:04:40.162216Z","steps":["trace[2115233726] 'agreement among raft nodes before linearized reading' (duration: 547.589997ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:40.162299Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:39.6139Z","time spent":"548.383776ms","remote":"127.0.0.1:35856","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":4,"response size":30,"request content":"key:\"/registry/cilium.io/ciliumidentities/\" range_end:\"/registry/cilium.io/ciliumidentities0\" count_only:true "} {"level":"info","ts":"2026-06-24T18:04:40.565883Z","caller":"traceutil/trace.go:171","msg":"trace[1128939437] transaction","detail":"{read_only:false; response_revision:1327; number_of_response:1; }","duration":"400.444158ms","start":"2026-06-24T18:04:40.165406Z","end":"2026-06-24T18:04:40.56585Z","steps":["trace[1128939437] 'process raft request' (duration: 385.152846ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:04:40.560944Z","caller":"traceutil/trace.go:171","msg":"trace[1479239668] transaction","detail":"{read_only:false; response_revision:1328; number_of_response:1; }","duration":"300.436918ms","start":"2026-06-24T18:04:40.260491Z","end":"2026-06-24T18:04:40.560928Z","steps":["trace[1479239668] 'process raft request' (duration: 300.167712ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:04:40.566523Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:40.260462Z","time spent":"306.008292ms","remote":"127.0.0.1:46084","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-24T18:04:40.566503Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:04:40.165389Z","time spent":"400.58501ms","remote":"127.0.0.1:46084","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T18:04:47.600041Z","caller":"traceutil/trace.go:171","msg":"trace[941237949] transaction","detail":"{read_only:false; response_revision:1362; number_of_response:1; }","duration":"146.915416ms","start":"2026-06-24T18:04:47.4531Z","end":"2026-06-24T18:04:47.600015Z","steps":["trace[941237949] 'process raft request' (duration: 146.767111ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:08:33.594457Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"304.695113ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T18:08:33.594579Z","caller":"traceutil/trace.go:171","msg":"trace[2028299382] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2422; }","duration":"304.846096ms","start":"2026-06-24T18:08:33.289706Z","end":"2026-06-24T18:08:33.594552Z","steps":["trace[2028299382] 'range keys from in-memory index tree' (duration: 304.631671ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:08:33.594645Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:08:33.289691Z","time spent":"304.937268ms","remote":"127.0.0.1:45860","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-24T18:08:33.594621Z","caller":"traceutil/trace.go:171","msg":"trace[389472645] transaction","detail":"{read_only:false; response_revision:2423; number_of_response:1; }","duration":"178.347591ms","start":"2026-06-24T18:08:33.416218Z","end":"2026-06-24T18:08:33.594566Z","steps":["trace[389472645] 'process raft request' (duration: 154.345811ms)","trace[389472645] 'compare' (duration: 23.646662ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T18:08:33.594472Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"407.658649ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-24T18:08:33.595045Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"210.593196ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd.csi.ceph.com-kube-system\" ","response":"range_response_count:1 size:532"} {"level":"info","ts":"2026-06-24T18:08:33.595098Z","caller":"traceutil/trace.go:171","msg":"trace[1765413456] range","detail":"{range_begin:/registry/leases/kube-system/rbd.csi.ceph.com-kube-system; range_end:; response_count:1; response_revision:2422; }","duration":"211.303143ms","start":"2026-06-24T18:08:33.383779Z","end":"2026-06-24T18:08:33.595082Z","steps":["trace[1765413456] 'range keys from in-memory index tree' (duration: 210.406362ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T18:08:33.595227Z","caller":"traceutil/trace.go:171","msg":"trace[468556940] range","detail":"{range_begin:/registry/ingress/; range_end:/registry/ingress0; response_count:0; response_revision:2422; }","duration":"408.034647ms","start":"2026-06-24T18:08:33.186735Z","end":"2026-06-24T18:08:33.59477Z","steps":["trace[468556940] 'count revisions from in-memory index tree' (duration: 407.577757ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T18:08:33.595364Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T18:08:33.186721Z","time spent":"408.59469ms","remote":"127.0.0.1:46112","response type":"/etcdserverpb.KV/Range","request count":0,"request size":42,"response count":0,"response size":28,"request content":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true "}