{"level":"warn","ts":"2026-06-24T11:00:21.622252Z","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-24T11:00:21.622363Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.130:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.130:2380","--initial-cluster=instance=https://199.19.213.130:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.130:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.130: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-24T11:00:21.622442Z","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-24T11:00:21.622451Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.130:2380"]} {"level":"info","ts":"2026-06-24T11:00:21.622469Z","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-24T11:00:21.62314Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.130:2379"]} {"level":"info","ts":"2026-06-24T11:00:21.623223Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.130:2380"],"listen-peer-urls":["https://199.19.213.130:2380"],"advertise-client-urls":["https://199.19.213.130:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.130:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.130: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-24T11:00:21.628766Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"5.317882ms"} {"level":"info","ts":"2026-06-24T11:00:21.635824Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"a727d7e7ce5fe36a","cluster-id":"db8a5e7d54164af4"} {"level":"info","ts":"2026-06-24T11:00:21.63593Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a switched to configuration voters=()"} {"level":"info","ts":"2026-06-24T11:00:21.635996Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a became follower at term 0"} {"level":"info","ts":"2026-06-24T11:00:21.636024Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft a727d7e7ce5fe36a [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-06-24T11:00:21.636045Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a became follower at term 1"} {"level":"info","ts":"2026-06-24T11:00:21.636103Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a switched to configuration voters=(12044833119025488746)"} {"level":"warn","ts":"2026-06-24T11:00:21.649295Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-06-24T11:00:21.651264Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-06-24T11:00:21.653096Z","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-24T11:00:21.656041Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"a727d7e7ce5fe36a","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-06-24T11:00:21.6563Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"a727d7e7ce5fe36a","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-06-24T11:00:21.656654Z","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-24T11:00:21.656797Z","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-24T11:00:21.656822Z","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-24T11:00:21.657427Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a switched to configuration voters=(12044833119025488746)"} {"level":"info","ts":"2026-06-24T11:00:21.659272Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"db8a5e7d54164af4","local-member-id":"a727d7e7ce5fe36a","added-peer-id":"a727d7e7ce5fe36a","added-peer-peer-urls":["https://199.19.213.130:2380"]} {"level":"info","ts":"2026-06-24T11:00:21.660703Z","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-24T11:00:21.660816Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.130:2380"} {"level":"info","ts":"2026-06-24T11:00:21.66084Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.130:2380"} {"level":"info","ts":"2026-06-24T11:00:21.660955Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"a727d7e7ce5fe36a","initial-advertise-peer-urls":["https://199.19.213.130:2380"],"listen-peer-urls":["https://199.19.213.130:2380"],"advertise-client-urls":["https://199.19.213.130:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.130:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-06-24T11:00:21.661Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-06-24T11:00:22.036657Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a is starting a new election at term 1"} {"level":"info","ts":"2026-06-24T11:00:22.03672Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a became pre-candidate at term 1"} {"level":"info","ts":"2026-06-24T11:00:22.03676Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a received MsgPreVoteResp from a727d7e7ce5fe36a at term 1"} {"level":"info","ts":"2026-06-24T11:00:22.036782Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a became candidate at term 2"} {"level":"info","ts":"2026-06-24T11:00:22.036793Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a received MsgVoteResp from a727d7e7ce5fe36a at term 2"} {"level":"info","ts":"2026-06-24T11:00:22.036814Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a727d7e7ce5fe36a became leader at term 2"} {"level":"info","ts":"2026-06-24T11:00:22.036838Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: a727d7e7ce5fe36a elected leader a727d7e7ce5fe36a at term 2"} {"level":"info","ts":"2026-06-24T11:00:22.038565Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"a727d7e7ce5fe36a","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.130:2379]}","request-path":"/0/members/a727d7e7ce5fe36a/attributes","cluster-id":"db8a5e7d54164af4","publish-timeout":"7s"} {"level":"info","ts":"2026-06-24T11:00:22.038821Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-24T11:00:22.038827Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-24T11:00:22.039107Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-06-24T11:00:22.039168Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-06-24T11:00:22.039241Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-06-24T11:00:22.04192Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"db8a5e7d54164af4","local-member-id":"a727d7e7ce5fe36a","cluster-version":"3.5"} {"level":"info","ts":"2026-06-24T11:00:22.042108Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-06-24T11:00:22.042153Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-06-24T11:00:22.043319Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.130:2379"} {"level":"info","ts":"2026-06-24T11:00:22.04332Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"warn","ts":"2026-06-24T11:00:28.25394Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"369.409634ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:00:28.254132Z","caller":"traceutil/trace.go:171","msg":"trace[1704033519] linearizableReadLoop","detail":"{readStateIndex:313; appliedIndex:311; }","duration":"396.901367ms","start":"2026-06-24T11:00:27.857215Z","end":"2026-06-24T11:00:28.254116Z","steps":["trace[1704033519] 'read index received' (duration: 26.902926ms)","trace[1704033519] 'applied index is now lower than readState.Index' (duration: 369.997021ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:00:28.254263Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"397.028289ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:00:28.254287Z","caller":"traceutil/trace.go:171","msg":"trace[1616005872] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:0; response_revision:305; }","duration":"397.101899ms","start":"2026-06-24T11:00:27.857177Z","end":"2026-06-24T11:00:28.254278Z","steps":["trace[1616005872] 'agreement among raft nodes before linearized reading' (duration: 396.988088ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:00:28.254313Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:00:27.857157Z","time spent":"397.14908ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":0,"response size":29,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-06-24T11:00:28.254473Z","caller":"traceutil/trace.go:171","msg":"trace[1444525530] transaction","detail":"{read_only:false; response_revision:304; number_of_response:1; }","duration":"519.089433ms","start":"2026-06-24T11:00:27.735373Z","end":"2026-06-24T11:00:28.254462Z","steps":["trace[1444525530] 'process raft request' (duration: 148.730216ms)","trace[1444525530] 'compare' (duration: 369.196922ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:00:28.254491Z","caller":"traceutil/trace.go:171","msg":"trace[2137738414] transaction","detail":"{read_only:false; response_revision:305; number_of_response:1; }","duration":"479.245426ms","start":"2026-06-24T11:00:27.775227Z","end":"2026-06-24T11:00:28.254473Z","steps":["trace[2137738414] 'process raft request' (duration: 478.845141ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:00:28.254512Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:00:27.735351Z","time spent":"519.140364ms","remote":"127.0.0.1:53644","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":170,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-24T11:00:28.254572Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:00:27.775205Z","time spent":"479.330188ms","remote":"127.0.0.1:53644","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":205,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-24T11:00:28.562245Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.795858ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:00:28.562344Z","caller":"traceutil/trace.go:171","msg":"trace[805737139] linearizableReadLoop","detail":"{readStateIndex:314; appliedIndex:313; }","duration":"303.916055ms","start":"2026-06-24T11:00:28.258414Z","end":"2026-06-24T11:00:28.56233Z","steps":["trace[805737139] 'read index received' (duration: 155.919105ms)","trace[805737139] 'applied index is now lower than readState.Index' (duration: 147.99577ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:00:28.562405Z","caller":"traceutil/trace.go:171","msg":"trace[1306769185] transaction","detail":"{read_only:false; response_revision:306; number_of_response:1; }","duration":"304.259479ms","start":"2026-06-24T11:00:28.258136Z","end":"2026-06-24T11:00:28.562395Z","steps":["trace[1306769185] 'process raft request' (duration: 156.245878ms)","trace[1306769185] 'compare' (duration: 147.654637ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:00:28.562457Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:00:28.258115Z","time spent":"304.322341ms","remote":"127.0.0.1:53780","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":420,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-24T11:00:28.562515Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"304.082737ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/resourcequota-controller\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:00:28.562607Z","caller":"traceutil/trace.go:171","msg":"trace[1795981750] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/resourcequota-controller; range_end:; response_count:0; response_revision:306; }","duration":"304.22557ms","start":"2026-06-24T11:00:28.25836Z","end":"2026-06-24T11:00:28.562586Z","steps":["trace[1795981750] 'agreement among raft nodes before linearized reading' (duration: 304.035977ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:00:28.562656Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:00:28.258342Z","time spent":"304.30556ms","remote":"127.0.0.1:53644","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":0,"response size":29,"request content":"key:\"/registry/serviceaccounts/kube-system/resourcequota-controller\" "} {"level":"info","ts":"2026-06-24T11:00:28.591592Z","caller":"traceutil/trace.go:171","msg":"trace[1067373465] transaction","detail":"{read_only:false; response_revision:307; number_of_response:1; }","duration":"332.959378ms","start":"2026-06-24T11:00:28.258606Z","end":"2026-06-24T11:00:28.591566Z","steps":["trace[1067373465] 'process raft request' (duration: 332.795066ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:00:28.591675Z","caller":"traceutil/trace.go:171","msg":"trace[1599841236] transaction","detail":"{read_only:false; number_of_response:0; response_revision:307; }","duration":"205.754162ms","start":"2026-06-24T11:00:28.385906Z","end":"2026-06-24T11:00:28.59166Z","steps":["trace[1599841236] 'process raft request' (duration: 205.729712ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:00:28.591724Z","caller":"traceutil/trace.go:171","msg":"trace[1421265693] transaction","detail":"{read_only:false; number_of_response:0; response_revision:307; }","duration":"205.811493ms","start":"2026-06-24T11:00:28.38589Z","end":"2026-06-24T11:00:28.591702Z","steps":["trace[1421265693] 'process raft request' (duration: 205.667061ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:00:28.591724Z","caller":"traceutil/trace.go:171","msg":"trace[405577959] transaction","detail":"{read_only:false; number_of_response:0; response_revision:307; }","duration":"207.509005ms","start":"2026-06-24T11:00:28.384194Z","end":"2026-06-24T11:00:28.591703Z","steps":["trace[405577959] 'process raft request' (duration: 207.305932ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:00:28.591749Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:00:28.25859Z","time spent":"333.096701ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T11:00:28.591767Z","caller":"traceutil/trace.go:171","msg":"trace[902327378] transaction","detail":"{read_only:false; number_of_response:0; response_revision:307; }","duration":"205.835373ms","start":"2026-06-24T11:00:28.385897Z","end":"2026-06-24T11:00:28.591732Z","steps":["trace[902327378] 'process raft request' (duration: 205.684571ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:00:28.591921Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"210.989391ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-06-24T11:00:28.591929Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"249.383387ms","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-24T11:00:28.591909Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.156973ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-controller-manager-instance\" ","response":"range_response_count:1 size:5513"} {"level":"info","ts":"2026-06-24T11:00:28.591961Z","caller":"traceutil/trace.go:171","msg":"trace[1150780986] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:307; }","duration":"211.059271ms","start":"2026-06-24T11:00:28.38089Z","end":"2026-06-24T11:00:28.591949Z","steps":["trace[1150780986] 'agreement among raft nodes before linearized reading' (duration: 210.98134ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:00:28.591659Z","caller":"traceutil/trace.go:171","msg":"trace[2088764916] transaction","detail":"{read_only:false; number_of_response:0; response_revision:307; }","duration":"206.245848ms","start":"2026-06-24T11:00:28.385391Z","end":"2026-06-24T11:00:28.591636Z","steps":["trace[2088764916] 'process raft request' (duration: 206.144647ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:00:28.592016Z","caller":"traceutil/trace.go:171","msg":"trace[1763056206] range","detail":"{range_begin:/registry/pods/kube-system/kube-controller-manager-instance; range_end:; response_count:1; response_revision:307; }","duration":"208.320276ms","start":"2026-06-24T11:00:28.383673Z","end":"2026-06-24T11:00:28.591993Z","steps":["trace[1763056206] 'agreement among raft nodes before linearized reading' (duration: 208.089963ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:00:28.591961Z","caller":"traceutil/trace.go:171","msg":"trace[1933429020] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:307; }","duration":"249.440497ms","start":"2026-06-24T11:00:28.34251Z","end":"2026-06-24T11:00:28.591951Z","steps":["trace[1933429020] 'agreement among raft nodes before linearized reading' (duration: 249.356656ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:00:28.591958Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"249.65883ms","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-24T11:00:28.592094Z","caller":"traceutil/trace.go:171","msg":"trace[455491028] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:307; }","duration":"249.831353ms","start":"2026-06-24T11:00:28.342249Z","end":"2026-06-24T11:00:28.59208Z","steps":["trace[455491028] 'agreement among raft nodes before linearized reading' (duration: 249.64575ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:00:55.048807Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.537433ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:00:55.048959Z","caller":"traceutil/trace.go:171","msg":"trace[766757953] transaction","detail":"{read_only:false; response_revision:486; number_of_response:1; }","duration":"226.788231ms","start":"2026-06-24T11:00:54.822153Z","end":"2026-06-24T11:00:55.048941Z","steps":["trace[766757953] 'process raft request' (duration: 54.923694ms)","trace[766757953] 'compare' (duration: 171.395971ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:00:55.053222Z","caller":"traceutil/trace.go:171","msg":"trace[2057406968] transaction","detail":"{read_only:false; response_revision:487; number_of_response:1; }","duration":"230.461616ms","start":"2026-06-24T11:00:54.822738Z","end":"2026-06-24T11:00:55.053199Z","steps":["trace[2057406968] 'process raft request' (duration: 230.133172ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:00:55.053228Z","caller":"traceutil/trace.go:171","msg":"trace[757830654] transaction","detail":"{read_only:false; response_revision:488; number_of_response:1; }","duration":"230.446226ms","start":"2026-06-24T11:00:54.822741Z","end":"2026-06-24T11:00:55.053188Z","steps":["trace[757830654] 'process raft request' (duration: 230.364775ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.104107Z","caller":"traceutil/trace.go:171","msg":"trace[1533409841] transaction","detail":"{read_only:false; response_revision:534; number_of_response:1; }","duration":"112.358577ms","start":"2026-06-24T11:00:59.991722Z","end":"2026-06-24T11:01:00.10408Z","steps":["trace[1533409841] 'process raft request' (duration: 112.136134ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.104171Z","caller":"traceutil/trace.go:171","msg":"trace[1511838605] transaction","detail":"{read_only:false; response_revision:535; number_of_response:1; }","duration":"102.05192ms","start":"2026-06-24T11:01:00.002091Z","end":"2026-06-24T11:01:00.104143Z","steps":["trace[1511838605] 'process raft request' (duration: 101.874588ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.406973Z","caller":"traceutil/trace.go:171","msg":"trace[1386259528] transaction","detail":"{read_only:false; response_revision:543; number_of_response:1; }","duration":"354.494976ms","start":"2026-06-24T11:01:00.052453Z","end":"2026-06-24T11:01:00.406948Z","steps":["trace[1386259528] 'process raft request' (duration: 349.124949ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.406994Z","caller":"traceutil/trace.go:171","msg":"trace[1492649037] transaction","detail":"{read_only:false; response_revision:544; number_of_response:1; }","duration":"351.191064ms","start":"2026-06-24T11:01:00.055771Z","end":"2026-06-24T11:01:00.406962Z","steps":["trace[1492649037] 'process raft request' (duration: 351.068072ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:01:00.407087Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:01:00.052431Z","time spent":"354.598616ms","remote":"127.0.0.1:53944","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":995,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-24T11:01:00.407192Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:01:00.055749Z","time spent":"351.329035ms","remote":"127.0.0.1:53490","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":6888,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:01:00.407385Z","caller":"traceutil/trace.go:171","msg":"trace[181877578] transaction","detail":"{read_only:false; number_of_response:1; response_revision:544; }","duration":"351.487947ms","start":"2026-06-24T11:01:00.055884Z","end":"2026-06-24T11:01:00.407372Z","steps":["trace[181877578] 'process raft request' (duration: 351.045021ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:01:00.407479Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:01:00.055849Z","time spent":"351.590908ms","remote":"127.0.0.1:53490","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":102,"response count":0,"response size":6938,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:01:00.407797Z","caller":"traceutil/trace.go:171","msg":"trace[1317064456] transaction","detail":"{read_only:false; response_revision:545; number_of_response:1; }","duration":"346.928782ms","start":"2026-06-24T11:01:00.06085Z","end":"2026-06-24T11:01:00.407779Z","steps":["trace[1317064456] 'process raft request' (duration: 346.400325ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:01:00.40789Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:01:00.060841Z","time spent":"347.005272ms","remote":"127.0.0.1:53490","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":79374,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T11:01:00.418103Z","caller":"traceutil/trace.go:171","msg":"trace[1553220050] transaction","detail":"{read_only:false; response_revision:552; number_of_response:1; }","duration":"292.100345ms","start":"2026-06-24T11:01:00.12597Z","end":"2026-06-24T11:01:00.41807Z","steps":["trace[1553220050] 'process raft request' (duration: 288.841845ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.418313Z","caller":"traceutil/trace.go:171","msg":"trace[1696174650] transaction","detail":"{read_only:false; response_revision:549; number_of_response:1; }","duration":"298.787168ms","start":"2026-06-24T11:01:00.119496Z","end":"2026-06-24T11:01:00.418283Z","steps":["trace[1696174650] 'process raft request' (duration: 295.170693ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.418294Z","caller":"traceutil/trace.go:171","msg":"trace[1315171101] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"298.874139ms","start":"2026-06-24T11:01:00.119383Z","end":"2026-06-24T11:01:00.418257Z","steps":["trace[1315171101] 'process raft request' (duration: 295.241324ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.418639Z","caller":"traceutil/trace.go:171","msg":"trace[1955988305] transaction","detail":"{read_only:false; response_revision:550; number_of_response:1; }","duration":"296.199816ms","start":"2026-06-24T11:01:00.12234Z","end":"2026-06-24T11:01:00.41854Z","steps":["trace[1955988305] 'process raft request' (duration: 292.368098ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.418871Z","caller":"traceutil/trace.go:171","msg":"trace[279523211] transaction","detail":"{read_only:false; response_revision:547; number_of_response:1; }","duration":"305.802994ms","start":"2026-06-24T11:01:00.112922Z","end":"2026-06-24T11:01:00.418725Z","steps":["trace[279523211] 'process raft request' (duration: 301.643833ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:01:00.418952Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:01:00.112912Z","time spent":"305.979026ms","remote":"127.0.0.1:53944","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1004,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T11:01:00.41877Z","caller":"traceutil/trace.go:171","msg":"trace[117677636] transaction","detail":"{read_only:false; response_revision:546; number_of_response:1; }","duration":"305.989566ms","start":"2026-06-24T11:01:00.112395Z","end":"2026-06-24T11:01:00.418385Z","steps":["trace[117677636] 'process raft request' (duration: 302.089018ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:01:00.419574Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:01:00.112372Z","time spent":"307.055019ms","remote":"127.0.0.1:53944","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":980,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T11:01:00.419643Z","caller":"traceutil/trace.go:171","msg":"trace[823105473] transaction","detail":"{read_only:false; response_revision:551; number_of_response:1; }","duration":"296.499469ms","start":"2026-06-24T11:01:00.123132Z","end":"2026-06-24T11:01:00.419632Z","steps":["trace[823105473] 'process raft request' (duration: 291.602459ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.419872Z","caller":"traceutil/trace.go:171","msg":"trace[1163607674] transaction","detail":"{read_only:false; response_revision:553; number_of_response:1; }","duration":"291.70678ms","start":"2026-06-24T11:01:00.128105Z","end":"2026-06-24T11:01:00.419812Z","steps":["trace[1163607674] 'process raft request' (duration: 287.712391ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.421585Z","caller":"traceutil/trace.go:171","msg":"trace[1440959909] transaction","detail":"{read_only:false; response_revision:554; number_of_response:1; }","duration":"255.803187ms","start":"2026-06-24T11:01:00.165752Z","end":"2026-06-24T11:01:00.421556Z","steps":["trace[1440959909] 'process raft request' (duration: 252.82398ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.763317Z","caller":"traceutil/trace.go:171","msg":"trace[1664429552] transaction","detail":"{read_only:false; response_revision:571; number_of_response:1; }","duration":"202.792142ms","start":"2026-06-24T11:01:00.560504Z","end":"2026-06-24T11:01:00.763296Z","steps":["trace[1664429552] 'process raft request' (duration: 194.070384ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.764999Z","caller":"traceutil/trace.go:171","msg":"trace[917560047] transaction","detail":"{read_only:false; response_revision:572; number_of_response:1; }","duration":"173.550892ms","start":"2026-06-24T11:01:00.59143Z","end":"2026-06-24T11:01:00.764981Z","steps":["trace[917560047] 'process raft request' (duration: 173.34137ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:00.765118Z","caller":"traceutil/trace.go:171","msg":"trace[738790952] transaction","detail":"{read_only:false; response_revision:573; number_of_response:1; }","duration":"165.962158ms","start":"2026-06-24T11:01:00.599142Z","end":"2026-06-24T11:01:00.765104Z","steps":["trace[738790952] 'process raft request' (duration: 165.820156ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:01.049723Z","caller":"traceutil/trace.go:171","msg":"trace[824018982] transaction","detail":"{read_only:false; response_revision:581; number_of_response:1; }","duration":"144.663834ms","start":"2026-06-24T11:01:00.905029Z","end":"2026-06-24T11:01:01.049693Z","steps":["trace[824018982] 'process raft request' (duration: 135.311179ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:01.049991Z","caller":"traceutil/trace.go:171","msg":"trace[2104282935] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"134.850744ms","start":"2026-06-24T11:01:00.91513Z","end":"2026-06-24T11:01:01.04998Z","steps":["trace[2104282935] 'process raft request' (duration: 134.570511ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:01.04999Z","caller":"traceutil/trace.go:171","msg":"trace[1512262232] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"102.079899ms","start":"2026-06-24T11:01:00.947885Z","end":"2026-06-24T11:01:01.049964Z","steps":["trace[1512262232] 'process raft request' (duration: 101.910797ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:06.902586Z","caller":"traceutil/trace.go:171","msg":"trace[2139878897] transaction","detail":"{read_only:false; response_revision:639; number_of_response:1; }","duration":"215.05064ms","start":"2026-06-24T11:01:06.68751Z","end":"2026-06-24T11:01:06.902561Z","steps":["trace[2139878897] 'process raft request' (duration: 214.34553ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:07.083182Z","caller":"traceutil/trace.go:171","msg":"trace[2095382240] transaction","detail":"{read_only:false; response_revision:640; number_of_response:1; }","duration":"172.270606ms","start":"2026-06-24T11:01:06.910849Z","end":"2026-06-24T11:01:07.083119Z","steps":["trace[2095382240] 'process raft request' (duration: 172.07635ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:07.155085Z","caller":"traceutil/trace.go:171","msg":"trace[281364861] transaction","detail":"{read_only:false; response_revision:641; number_of_response:1; }","duration":"178.146252ms","start":"2026-06-24T11:01:06.976917Z","end":"2026-06-24T11:01:07.155064Z","steps":["trace[281364861] 'process raft request' (duration: 177.906165ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:07.270308Z","caller":"traceutil/trace.go:171","msg":"trace[1668554683] transaction","detail":"{read_only:false; response_revision:644; number_of_response:1; }","duration":"110.155411ms","start":"2026-06-24T11:01:07.160142Z","end":"2026-06-24T11:01:07.270297Z","steps":["trace[1668554683] 'process raft request' (duration: 110.014397ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:01:07.270267Z","caller":"traceutil/trace.go:171","msg":"trace[1978450161] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"110.203612ms","start":"2026-06-24T11:01:07.160036Z","end":"2026-06-24T11:01:07.270239Z","steps":["trace[1978450161] 'process raft request' (duration: 26.732645ms)","trace[1978450161] 'compare' (duration: 83.170779ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:01:07.270771Z","caller":"traceutil/trace.go:171","msg":"trace[606334635] linearizableReadLoop","detail":"{readStateIndex:672; appliedIndex:669; }","duration":"103.413365ms","start":"2026-06-24T11:01:07.167333Z","end":"2026-06-24T11:01:07.270746Z","steps":["trace[606334635] 'read index received' (duration: 2.484588ms)","trace[606334635] 'applied index is now lower than readState.Index' (duration: 100.926797ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:01:07.270868Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.513168ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:01:07.270916Z","caller":"traceutil/trace.go:171","msg":"trace[711754634] range","detail":"{range_begin:/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:644; }","duration":"103.58452ms","start":"2026-06-24T11:01:07.167313Z","end":"2026-06-24T11:01:07.270898Z","steps":["trace[711754634] 'agreement among raft nodes before linearized reading' (duration: 103.502578ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:01:07.8289Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"343.249573ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-sb9gc\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-06-24T11:01:07.828967Z","caller":"traceutil/trace.go:171","msg":"trace[1474936264] range","detail":"{range_begin:/registry/pods/kube-system/cilium-sb9gc; range_end:; response_count:1; response_revision:644; }","duration":"343.372696ms","start":"2026-06-24T11:01:07.485578Z","end":"2026-06-24T11:01:07.828951Z","steps":["trace[1474936264] 'range keys from in-memory index tree' (duration: 343.072788ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:01:07.829002Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:01:07.485558Z","time spent":"343.436279ms","remote":"127.0.0.1:53626","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16989,"request content":"key:\"/registry/pods/kube-system/cilium-sb9gc\" "} {"level":"warn","ts":"2026-06-24T11:01:07.828892Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"342.383919ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:01:07.829144Z","caller":"traceutil/trace.go:171","msg":"trace[9439979] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:644; }","duration":"342.677748ms","start":"2026-06-24T11:01:07.486441Z","end":"2026-06-24T11:01:07.829119Z","steps":["trace[9439979] 'range keys from in-memory index tree' (duration: 342.328288ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:01:07.829249Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:01:07.486432Z","time spent":"342.800981ms","remote":"127.0.0.1:53444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-24T11:01:07.855216Z","caller":"traceutil/trace.go:171","msg":"trace[1199641660] transaction","detail":"{read_only:false; response_revision:645; number_of_response:1; }","duration":"194.543532ms","start":"2026-06-24T11:01:07.660636Z","end":"2026-06-24T11:01:07.85518Z","steps":["trace[1199641660] 'process raft request' (duration: 189.852413ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:02:09.894783Z","caller":"traceutil/trace.go:171","msg":"trace[276746861] transaction","detail":"{read_only:false; response_revision:1350; number_of_response:1; }","duration":"101.90087ms","start":"2026-06-24T11:02:09.792863Z","end":"2026-06-24T11:02:09.894764Z","steps":["trace[276746861] 'process raft request' (duration: 101.765798ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:02:33.92454Z","caller":"traceutil/trace.go:171","msg":"trace[2008179261] transaction","detail":"{read_only:false; response_revision:1771; number_of_response:1; }","duration":"129.809083ms","start":"2026-06-24T11:02:33.794707Z","end":"2026-06-24T11:02:33.924516Z","steps":["trace[2008179261] 'process raft request' (duration: 122.350794ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:02:41.181264Z","caller":"traceutil/trace.go:171","msg":"trace[939882692] transaction","detail":"{read_only:false; response_revision:1880; number_of_response:1; }","duration":"220.064551ms","start":"2026-06-24T11:02:40.961168Z","end":"2026-06-24T11:02:41.181233Z","steps":["trace[939882692] 'process raft request' (duration: 219.877198ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:02:41.181505Z","caller":"traceutil/trace.go:171","msg":"trace[970751248] linearizableReadLoop","detail":"{readStateIndex:1956; appliedIndex:1956; }","duration":"171.2001ms","start":"2026-06-24T11:02:41.010267Z","end":"2026-06-24T11:02:41.181467Z","steps":["trace[970751248] 'read index received' (duration: 171.18099ms)","trace[970751248] 'applied index is now lower than readState.Index' (duration: 16.76µs)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:02:41.218573Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.267681ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-24T11:02:41.218642Z","caller":"traceutil/trace.go:171","msg":"trace[492921428] transaction","detail":"{read_only:false; response_revision:1881; number_of_response:1; }","duration":"179.480581ms","start":"2026-06-24T11:02:41.039135Z","end":"2026-06-24T11:02:41.218615Z","steps":["trace[492921428] 'process raft request' (duration: 154.631434ms)","trace[492921428] 'compare' (duration: 24.723974ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:02:41.218681Z","caller":"traceutil/trace.go:171","msg":"trace[1668886808] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/; range_end:/registry/mutatingwebhookconfigurations0; response_count:0; response_revision:1880; }","duration":"208.408015ms","start":"2026-06-24T11:02:41.010231Z","end":"2026-06-24T11:02:41.218639Z","steps":["trace[1668886808] 'agreement among raft nodes before linearized reading' (duration: 171.370653ms)","trace[1668886808] 'count revisions from in-memory index tree' (duration: 36.891918ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:02:41.653826Z","caller":"traceutil/trace.go:171","msg":"trace[886102420] transaction","detail":"{read_only:false; response_revision:1882; number_of_response:1; }","duration":"214.02066ms","start":"2026-06-24T11:02:41.43977Z","end":"2026-06-24T11:02:41.65379Z","steps":["trace[886102420] 'process raft request' (duration: 213.787906ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:02:55.513097Z","caller":"traceutil/trace.go:171","msg":"trace[232715239] linearizableReadLoop","detail":"{readStateIndex:2075; appliedIndex:2074; }","duration":"198.761789ms","start":"2026-06-24T11:02:55.314301Z","end":"2026-06-24T11:02:55.513063Z","steps":["trace[232715239] 'read index received' (duration: 198.637437ms)","trace[232715239] 'applied index is now lower than readState.Index' (duration: 123.212µs)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:02:55.51321Z","caller":"traceutil/trace.go:171","msg":"trace[1290262883] transaction","detail":"{read_only:false; response_revision:1997; number_of_response:1; }","duration":"246.56066ms","start":"2026-06-24T11:02:55.266612Z","end":"2026-06-24T11:02:55.513173Z","steps":["trace[1290262883] 'process raft request' (duration: 246.264515ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:02:55.513296Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.970653ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-24T11:02:55.51336Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.251954ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.130\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-06-24T11:02:55.513375Z","caller":"traceutil/trace.go:171","msg":"trace[1995968673] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:1997; }","duration":"199.097534ms","start":"2026-06-24T11:02:55.314258Z","end":"2026-06-24T11:02:55.513355Z","steps":["trace[1995968673] 'agreement among raft nodes before linearized reading' (duration: 198.958602ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:02:55.513399Z","caller":"traceutil/trace.go:171","msg":"trace[2138079699] range","detail":"{range_begin:/registry/masterleases/199.19.213.130; range_end:; response_count:1; response_revision:1997; }","duration":"179.330615ms","start":"2026-06-24T11:02:55.334058Z","end":"2026-06-24T11:02:55.513388Z","steps":["trace[2138079699] 'agreement among raft nodes before linearized reading' (duration: 179.166333ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:12.099451Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.921349ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-06-24T11:03:12.099529Z","caller":"traceutil/trace.go:171","msg":"trace[2045745339] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2108; }","duration":"126.04515ms","start":"2026-06-24T11:03:11.973465Z","end":"2026-06-24T11:03:12.09951Z","steps":["trace[2045745339] 'range keys from in-memory index tree' (duration: 125.754317ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:03:12.210001Z","caller":"traceutil/trace.go:171","msg":"trace[1134726029] transaction","detail":"{read_only:false; response_revision:2109; number_of_response:1; }","duration":"105.965447ms","start":"2026-06-24T11:03:12.104015Z","end":"2026-06-24T11:03:12.20998Z","steps":["trace[1134726029] 'process raft request' (duration: 105.855474ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:03:12.227491Z","caller":"traceutil/trace.go:171","msg":"trace[823769321] transaction","detail":"{read_only:false; response_revision:2111; number_of_response:1; }","duration":"122.926192ms","start":"2026-06-24T11:03:12.104527Z","end":"2026-06-24T11:03:12.227453Z","steps":["trace[823769321] 'process raft request' (duration: 122.81284ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:03:12.227475Z","caller":"traceutil/trace.go:171","msg":"trace[1746695537] transaction","detail":"{read_only:false; response_revision:2110; number_of_response:1; }","duration":"123.349108ms","start":"2026-06-24T11:03:12.104066Z","end":"2026-06-24T11:03:12.227415Z","steps":["trace[1746695537] 'process raft request' (duration: 123.218436ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:03:12.607093Z","caller":"traceutil/trace.go:171","msg":"trace[1268698640] transaction","detail":"{read_only:false; response_revision:2113; number_of_response:1; }","duration":"150.047112ms","start":"2026-06-24T11:03:12.457017Z","end":"2026-06-24T11:03:12.607064Z","steps":["trace[1268698640] 'process raft request' (duration: 101.308095ms)","trace[1268698640] 'compare' (duration: 48.641536ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:03:13.703927Z","caller":"traceutil/trace.go:171","msg":"trace[1002856823] transaction","detail":"{read_only:false; response_revision:2115; number_of_response:1; }","duration":"133.788516ms","start":"2026-06-24T11:03:13.570112Z","end":"2026-06-24T11:03:13.703901Z","steps":["trace[1002856823] 'process raft request' (duration: 133.630413ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.117084Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.452069ms","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-24T11:03:14.117186Z","caller":"traceutil/trace.go:171","msg":"trace[1569840522] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:2116; }","duration":"244.612151ms","start":"2026-06-24T11:03:13.872554Z","end":"2026-06-24T11:03:14.117166Z","steps":["trace[1569840522] 'range keys from in-memory index tree' (duration: 244.247066ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.117309Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"249.787541ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-06-24T11:03:14.117385Z","caller":"traceutil/trace.go:171","msg":"trace[1310265171] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2116; }","duration":"249.892303ms","start":"2026-06-24T11:03:13.867466Z","end":"2026-06-24T11:03:14.117358Z","steps":["trace[1310265171] 'range keys from in-memory index tree' (duration: 249.566558ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:03:14.544691Z","caller":"traceutil/trace.go:171","msg":"trace[163957965] linearizableReadLoop","detail":"{readStateIndex:2201; appliedIndex:2199; }","duration":"330.306135ms","start":"2026-06-24T11:03:14.214363Z","end":"2026-06-24T11:03:14.544669Z","steps":["trace[163957965] 'read index received' (duration: 314.085833ms)","trace[163957965] 'applied index is now lower than readState.Index' (duration: 16.219002ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:03:14.544696Z","caller":"traceutil/trace.go:171","msg":"trace[669762968] transaction","detail":"{read_only:false; response_revision:2119; number_of_response:1; }","duration":"421.65719ms","start":"2026-06-24T11:03:14.123006Z","end":"2026-06-24T11:03:14.544664Z","steps":["trace[669762968] 'process raft request' (duration: 421.568318ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.54486Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.122988Z","time spent":"421.792981ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:03:14.544936Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.562849ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-06-24T11:03:14.545038Z","caller":"traceutil/trace.go:171","msg":"trace[392384202] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2119; }","duration":"330.691671ms","start":"2026-06-24T11:03:14.214289Z","end":"2026-06-24T11:03:14.54498Z","steps":["trace[392384202] 'agreement among raft nodes before linearized reading' (duration: 330.506418ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.545094Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.214261Z","time spent":"330.820323ms","remote":"127.0.0.1:53676","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-24T11:03:14.544682Z","caller":"traceutil/trace.go:171","msg":"trace[2130878546] transaction","detail":"{read_only:false; response_revision:2118; number_of_response:1; }","duration":"421.658039ms","start":"2026-06-24T11:03:14.122988Z","end":"2026-06-24T11:03:14.544646Z","steps":["trace[2130878546] 'process raft request' (duration: 405.448048ms)","trace[2130878546] 'compare' (duration: 15.837366ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:03:14.545385Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.122975Z","time spent":"422.32789ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:03:14.902487Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"415.414384ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:03:14.90256Z","caller":"traceutil/trace.go:171","msg":"trace[1269241547] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2120; }","duration":"415.542596ms","start":"2026-06-24T11:03:14.487001Z","end":"2026-06-24T11:03:14.902544Z","steps":["trace[1269241547] 'agreement among raft nodes before linearized reading' (duration: 415.416134ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.902599Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.48698Z","time spent":"415.611067ms","remote":"127.0.0.1:53444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-24T11:03:14.902724Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"656.811602ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5412"} {"level":"info","ts":"2026-06-24T11:03:14.902887Z","caller":"traceutil/trace.go:171","msg":"trace[157125933] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2120; }","duration":"657.033015ms","start":"2026-06-24T11:03:14.245793Z","end":"2026-06-24T11:03:14.902826Z","steps":["trace[157125933] 'agreement among raft nodes before linearized reading' (duration: 656.638729ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.90301Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.245772Z","time spent":"657.193758ms","remote":"127.0.0.1:37168","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":5436,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" "} {"level":"info","ts":"2026-06-24T11:03:14.903135Z","caller":"traceutil/trace.go:171","msg":"trace[1134995913] transaction","detail":"{read_only:false; response_revision:2120; number_of_response:1; }","duration":"459.799331ms","start":"2026-06-24T11:03:14.443319Z","end":"2026-06-24T11:03:14.903118Z","steps":["trace[1134995913] 'process raft request' (duration: 415.798249ms)","trace[1134995913] 'compare' (duration: 42.894454ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:03:14.903293Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.443286Z","time spent":"459.916462ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:03:14.903384Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"671.132473ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-06-24T11:03:14.903463Z","caller":"traceutil/trace.go:171","msg":"trace[378028025] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2120; }","duration":"671.237645ms","start":"2026-06-24T11:03:14.232205Z","end":"2026-06-24T11:03:14.903443Z","steps":["trace[378028025] 'agreement among raft nodes before linearized reading' (duration: 671.016471ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.903462Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"401.185313ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cert-manager.io/issuers/\" range_end:\"/registry/cert-manager.io/issuers0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-06-24T11:03:14.903511Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.232198Z","time spent":"671.304057ms","remote":"127.0.0.1:53676","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":"info","ts":"2026-06-24T11:03:14.903529Z","caller":"traceutil/trace.go:171","msg":"trace[1116487242] range","detail":"{range_begin:/registry/cert-manager.io/issuers/; range_end:/registry/cert-manager.io/issuers0; response_count:0; response_revision:2120; }","duration":"401.281554ms","start":"2026-06-24T11:03:14.502233Z","end":"2026-06-24T11:03:14.903514Z","steps":["trace[1116487242] 'agreement among raft nodes before linearized reading' (duration: 401.189912ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.903541Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"532.187621ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/openstack/percona-xtradb-haproxy-0.18bbff7c5cd0c0c8\" ","response":"range_response_count:1 size:846"} {"level":"warn","ts":"2026-06-24T11:03:14.903589Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.502213Z","time spent":"401.340885ms","remote":"127.0.0.1:55704","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":31,"request content":"key:\"/registry/cert-manager.io/issuers/\" range_end:\"/registry/cert-manager.io/issuers0\" count_only:true "} {"level":"info","ts":"2026-06-24T11:03:14.903664Z","caller":"traceutil/trace.go:171","msg":"trace[1482683266] range","detail":"{range_begin:/registry/events/openstack/percona-xtradb-haproxy-0.18bbff7c5cd0c0c8; range_end:; response_count:1; response_revision:2120; }","duration":"532.356504ms","start":"2026-06-24T11:03:14.37129Z","end":"2026-06-24T11:03:14.903647Z","steps":["trace[1482683266] 'agreement among raft nodes before linearized reading' (duration: 532.10881ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.903795Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.371263Z","time spent":"532.482176ms","remote":"127.0.0.1:53524","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":1,"response size":870,"request content":"key:\"/registry/events/openstack/percona-xtradb-haproxy-0.18bbff7c5cd0c0c8\" "} {"level":"warn","ts":"2026-06-24T11:03:14.904383Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"672.331841ms","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-24T11:03:14.904425Z","caller":"traceutil/trace.go:171","msg":"trace[1394829125] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2120; }","duration":"672.463393ms","start":"2026-06-24T11:03:14.231948Z","end":"2026-06-24T11:03:14.904411Z","steps":["trace[1394829125] 'agreement among raft nodes before linearized reading' (duration: 672.25724ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.90447Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.231918Z","time spent":"672.543855ms","remote":"127.0.0.1:53676","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-24T11:03:14.90471Z","caller":"traceutil/trace.go:171","msg":"trace[1645463666] linearizableReadLoop","detail":"{readStateIndex:2202; appliedIndex:2201; }","duration":"357.629189ms","start":"2026-06-24T11:03:14.544764Z","end":"2026-06-24T11:03:14.902393Z","steps":["trace[1645463666] 'read index received' (duration: 314.363768ms)","trace[1645463666] 'applied index is now lower than readState.Index' (duration: 43.264441ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:03:14.916553Z","caller":"traceutil/trace.go:171","msg":"trace[1228585989] transaction","detail":"{read_only:false; response_revision:2121; number_of_response:1; }","duration":"367.143416ms","start":"2026-06-24T11:03:14.5494Z","end":"2026-06-24T11:03:14.916543Z","steps":["trace[1228585989] 'process raft request' (duration: 367.016704ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.916654Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.549381Z","time spent":"367.195806ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:03:14.916754Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.313009ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12385"} {"level":"info","ts":"2026-06-24T11:03:14.916872Z","caller":"traceutil/trace.go:171","msg":"trace[1847206499] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:2122; }","duration":"143.469391ms","start":"2026-06-24T11:03:14.773392Z","end":"2026-06-24T11:03:14.916861Z","steps":["trace[1847206499] 'agreement among raft nodes before linearized reading' (duration: 143.233908ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:03:14.917199Z","caller":"traceutil/trace.go:171","msg":"trace[1023856621] transaction","detail":"{read_only:false; response_revision:2122; number_of_response:1; }","duration":"304.260372ms","start":"2026-06-24T11:03:14.612927Z","end":"2026-06-24T11:03:14.917187Z","steps":["trace[1023856621] 'process raft request' (duration: 303.570342ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:03:14.917314Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:03:14.6129Z","time spent":"304.362263ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:04:15.300621Z","caller":"traceutil/trace.go:171","msg":"trace[1677571161] transaction","detail":"{read_only:false; response_revision:2494; number_of_response:1; }","duration":"101.079297ms","start":"2026-06-24T11:04:15.199497Z","end":"2026-06-24T11:04:15.300577Z","steps":["trace[1677571161] 'process raft request' (duration: 100.751573ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:04:57.19789Z","caller":"traceutil/trace.go:171","msg":"trace[451912107] transaction","detail":"{read_only:false; response_revision:2775; number_of_response:1; }","duration":"148.559907ms","start":"2026-06-24T11:04:57.049306Z","end":"2026-06-24T11:04:57.197866Z","steps":["trace[451912107] 'process raft request' (duration: 148.354274ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:04:57.337669Z","caller":"traceutil/trace.go:171","msg":"trace[393282169] linearizableReadLoop","detail":"{readStateIndex:2882; appliedIndex:2881; }","duration":"243.421292ms","start":"2026-06-24T11:04:57.094226Z","end":"2026-06-24T11:04:57.337647Z","steps":["trace[393282169] 'read index received' (duration: 103.843381ms)","trace[393282169] 'applied index is now lower than readState.Index' (duration: 139.577091ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:04:57.337863Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"243.620605ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/auth-system/keycloak-0.18bbff914d89041e\" ","response":"range_response_count:1 size:781"} {"level":"info","ts":"2026-06-24T11:04:57.337901Z","caller":"traceutil/trace.go:171","msg":"trace[707290354] range","detail":"{range_begin:/registry/events/auth-system/keycloak-0.18bbff914d89041e; range_end:; response_count:1; response_revision:2776; }","duration":"243.694075ms","start":"2026-06-24T11:04:57.094197Z","end":"2026-06-24T11:04:57.337891Z","steps":["trace[707290354] 'agreement among raft nodes before linearized reading' (duration: 243.532053ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:04:57.3381Z","caller":"traceutil/trace.go:171","msg":"trace[177962499] transaction","detail":"{read_only:false; response_revision:2776; number_of_response:1; }","duration":"287.59819ms","start":"2026-06-24T11:04:57.050461Z","end":"2026-06-24T11:04:57.338059Z","steps":["trace[177962499] 'process raft request' (duration: 206.80488ms)","trace[177962499] 'compare' (duration: 80.042849ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:08:36.576674Z","caller":"traceutil/trace.go:171","msg":"trace[248581154] linearizableReadLoop","detail":"{readStateIndex:4812; appliedIndex:4811; }","duration":"121.403718ms","start":"2026-06-24T11:08:36.455253Z","end":"2026-06-24T11:08:36.576657Z","steps":["trace[248581154] 'read index received' (duration: 121.266485ms)","trace[248581154] 'applied index is now lower than readState.Index' (duration: 136.633µs)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:08:36.576883Z","caller":"traceutil/trace.go:171","msg":"trace[246400187] transaction","detail":"{read_only:false; response_revision:4635; number_of_response:1; }","duration":"186.784845ms","start":"2026-06-24T11:08:36.390089Z","end":"2026-06-24T11:08:36.576874Z","steps":["trace[246400187] 'process raft request' (duration: 186.48177ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:36.577089Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.832534ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-24T11:08:36.577115Z","caller":"traceutil/trace.go:171","msg":"trace[81429878] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:4635; }","duration":"121.902095ms","start":"2026-06-24T11:08:36.455207Z","end":"2026-06-24T11:08:36.577109Z","steps":["trace[81429878] 'agreement among raft nodes before linearized reading' (duration: 121.799064ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:50.94688Z","caller":"traceutil/trace.go:171","msg":"trace[1262992791] transaction","detail":"{read_only:false; response_revision:4872; number_of_response:1; }","duration":"166.736166ms","start":"2026-06-24T11:08:50.780111Z","end":"2026-06-24T11:08:50.946847Z","steps":["trace[1262992791] 'process raft request' (duration: 164.773366ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:50.958408Z","caller":"traceutil/trace.go:171","msg":"trace[1767657881] linearizableReadLoop","detail":"{readStateIndex:5057; appliedIndex:5055; }","duration":"167.158253ms","start":"2026-06-24T11:08:50.791232Z","end":"2026-06-24T11:08:50.95839Z","steps":["trace[1767657881] 'read index received' (duration: 153.730354ms)","trace[1767657881] 'applied index is now lower than readState.Index' (duration: 13.426849ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:08:50.95859Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.350666ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"info","ts":"2026-06-24T11:08:50.958618Z","caller":"traceutil/trace.go:171","msg":"trace[75042427] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4873; }","duration":"167.414277ms","start":"2026-06-24T11:08:50.791197Z","end":"2026-06-24T11:08:50.958612Z","steps":["trace[75042427] 'agreement among raft nodes before linearized reading' (duration: 167.303405ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:50.958649Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.660951ms","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-24T11:08:50.958715Z","caller":"traceutil/trace.go:171","msg":"trace[658281955] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4873; }","duration":"158.752242ms","start":"2026-06-24T11:08:50.799948Z","end":"2026-06-24T11:08:50.9587Z","steps":["trace[658281955] 'agreement among raft nodes before linearized reading' (duration: 158.6011ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:50.958732Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.199082ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:08:50.95878Z","caller":"traceutil/trace.go:171","msg":"trace[35894369] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4873; }","duration":"120.300713ms","start":"2026-06-24T11:08:50.838467Z","end":"2026-06-24T11:08:50.958768Z","steps":["trace[35894369] 'agreement among raft nodes before linearized reading' (duration: 120.212552ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:50.95884Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.663096ms","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-24T11:08:50.958866Z","caller":"traceutil/trace.go:171","msg":"trace[484140098] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:4873; }","duration":"150.712706ms","start":"2026-06-24T11:08:50.808147Z","end":"2026-06-24T11:08:50.958859Z","steps":["trace[484140098] 'agreement among raft nodes before linearized reading' (duration: 150.647425ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:51.243998Z","caller":"traceutil/trace.go:171","msg":"trace[1348238560] transaction","detail":"{read_only:false; response_revision:4880; number_of_response:1; }","duration":"247.123406ms","start":"2026-06-24T11:08:50.996837Z","end":"2026-06-24T11:08:51.24396Z","steps":["trace[1348238560] 'process raft request' (duration: 237.391604ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:51.244234Z","caller":"traceutil/trace.go:171","msg":"trace[146184346] transaction","detail":"{read_only:false; response_revision:4884; number_of_response:1; }","duration":"121.949178ms","start":"2026-06-24T11:08:51.122256Z","end":"2026-06-24T11:08:51.244206Z","steps":["trace[146184346] 'process raft request' (duration: 121.884287ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:51.24452Z","caller":"traceutil/trace.go:171","msg":"trace[1542750469] transaction","detail":"{read_only:false; response_revision:4882; number_of_response:1; }","duration":"247.661764ms","start":"2026-06-24T11:08:50.996839Z","end":"2026-06-24T11:08:51.244501Z","steps":["trace[1542750469] 'process raft request' (duration: 247.063134ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:51.244565Z","caller":"traceutil/trace.go:171","msg":"trace[1076321154] transaction","detail":"{read_only:false; response_revision:4883; number_of_response:1; }","duration":"246.77141ms","start":"2026-06-24T11:08:50.997776Z","end":"2026-06-24T11:08:51.244547Z","steps":["trace[1076321154] 'process raft request' (duration: 246.193931ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:51.244666Z","caller":"traceutil/trace.go:171","msg":"trace[1977954152] transaction","detail":"{read_only:false; response_revision:4881; number_of_response:1; }","duration":"247.812006ms","start":"2026-06-24T11:08:50.996837Z","end":"2026-06-24T11:08:51.244649Z","steps":["trace[1977954152] 'process raft request' (duration: 246.972743ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:51.244776Z","caller":"traceutil/trace.go:171","msg":"trace[1547137619] linearizableReadLoop","detail":"{readStateIndex:5068; appliedIndex:5064; }","duration":"189.035792ms","start":"2026-06-24T11:08:51.055719Z","end":"2026-06-24T11:08:51.244754Z","steps":["trace[1547137619] 'read index received' (duration: 178.516498ms)","trace[1547137619] 'applied index is now lower than readState.Index' (duration: 10.513164ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:08:51.244933Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.194334ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/endpointslices/\" range_end:\"/registry/endpointslices0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-24T11:08:51.244993Z","caller":"traceutil/trace.go:171","msg":"trace[80568942] range","detail":"{range_begin:/registry/endpointslices/; range_end:/registry/endpointslices0; response_count:0; response_revision:4884; }","duration":"189.313216ms","start":"2026-06-24T11:08:51.055665Z","end":"2026-06-24T11:08:51.244979Z","steps":["trace[80568942] 'agreement among raft nodes before linearized reading' (duration: 189.170664ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:56.346747Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16387084987662610237,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-24T11:08:56.358672Z","caller":"traceutil/trace.go:171","msg":"trace[1633613785] linearizableReadLoop","detail":"{readStateIndex:5100; appliedIndex:5099; }","duration":"512.693305ms","start":"2026-06-24T11:08:55.845961Z","end":"2026-06-24T11:08:56.358654Z","steps":["trace[1633613785] 'read index received' (duration: 512.548163ms)","trace[1633613785] 'applied index is now lower than readState.Index' (duration: 144.132µs)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:08:56.358708Z","caller":"traceutil/trace.go:171","msg":"trace[1345666002] transaction","detail":"{read_only:false; response_revision:4914; number_of_response:1; }","duration":"535.465948ms","start":"2026-06-24T11:08:55.823218Z","end":"2026-06-24T11:08:56.358684Z","steps":["trace[1345666002] 'process raft request' (duration: 535.289036ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:56.358818Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:08:55.8232Z","time spent":"535.55921ms","remote":"127.0.0.1:53626","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":10664,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:08:56.358827Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"512.852697ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:1865"} {"level":"info","ts":"2026-06-24T11:08:56.358857Z","caller":"traceutil/trace.go:171","msg":"trace[1849566541] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:4914; }","duration":"512.927429ms","start":"2026-06-24T11:08:55.84592Z","end":"2026-06-24T11:08:56.358847Z","steps":["trace[1849566541] 'agreement among raft nodes before linearized reading' (duration: 512.813847ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:56.358889Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:08:55.845905Z","time spent":"512.976749ms","remote":"127.0.0.1:53594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":83,"response count":1,"response size":1889,"request content":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" "} {"level":"warn","ts":"2026-06-24T11:08:56.363333Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"303.891846ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:08:56.363391Z","caller":"traceutil/trace.go:171","msg":"trace[604401996] range","detail":"{range_begin:/registry/cilium.io/ciliuml2announcementpolicies/; range_end:/registry/cilium.io/ciliuml2announcementpolicies0; response_count:0; response_revision:4915; }","duration":"303.996407ms","start":"2026-06-24T11:08:56.059378Z","end":"2026-06-24T11:08:56.363375Z","steps":["trace[604401996] 'agreement among raft nodes before linearized reading' (duration: 303.892875ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:56.363418Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:08:56.059356Z","time spent":"304.054077ms","remote":"127.0.0.1:34252","response type":"/etcdserverpb.KV/Range","request count":0,"request size":104,"response count":0,"response size":29,"request content":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" count_only:true "} {"level":"warn","ts":"2026-06-24T11:08:56.60034Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.479168ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:08:56.60064Z","caller":"traceutil/trace.go:171","msg":"trace[1025054254] linearizableReadLoop","detail":"{readStateIndex:5108; appliedIndex:5102; }","duration":"114.266383ms","start":"2026-06-24T11:08:56.486361Z","end":"2026-06-24T11:08:56.600627Z","steps":["trace[1025054254] 'read index received' (duration: 13.376728ms)","trace[1025054254] 'applied index is now lower than readState.Index' (duration: 100.888715ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:08:56.600675Z","caller":"traceutil/trace.go:171","msg":"trace[608587246] transaction","detail":"{read_only:false; response_revision:4921; number_of_response:1; }","duration":"227.318687ms","start":"2026-06-24T11:08:56.37332Z","end":"2026-06-24T11:08:56.600639Z","steps":["trace[608587246] 'process raft request' (duration: 227.240156ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:56.600673Z","caller":"traceutil/trace.go:171","msg":"trace[1739018839] transaction","detail":"{read_only:false; response_revision:4919; number_of_response:1; }","duration":"231.544103ms","start":"2026-06-24T11:08:56.369095Z","end":"2026-06-24T11:08:56.600639Z","steps":["trace[1739018839] 'process raft request' (duration: 231.3892ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:56.600715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.357044ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:08:56.600745Z","caller":"traceutil/trace.go:171","msg":"trace[1106689518] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4922; }","duration":"114.428635ms","start":"2026-06-24T11:08:56.486308Z","end":"2026-06-24T11:08:56.600736Z","steps":["trace[1106689518] 'agreement among raft nodes before linearized reading' (duration: 114.360874ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:56.60084Z","caller":"traceutil/trace.go:171","msg":"trace[391482672] transaction","detail":"{read_only:false; response_revision:4918; number_of_response:1; }","duration":"232.092391ms","start":"2026-06-24T11:08:56.36874Z","end":"2026-06-24T11:08:56.600833Z","steps":["trace[391482672] 'process raft request' (duration: 231.694085ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:56.600826Z","caller":"traceutil/trace.go:171","msg":"trace[797554400] transaction","detail":"{read_only:false; response_revision:4917; number_of_response:1; }","duration":"232.203792ms","start":"2026-06-24T11:08:56.368593Z","end":"2026-06-24T11:08:56.600797Z","steps":["trace[797554400] 'process raft request' (duration: 131.156615ms)","trace[797554400] 'compare' (duration: 100.384977ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:08:56.600891Z","caller":"traceutil/trace.go:171","msg":"trace[458415686] transaction","detail":"{read_only:false; response_revision:4920; number_of_response:1; }","duration":"231.530962ms","start":"2026-06-24T11:08:56.369345Z","end":"2026-06-24T11:08:56.600876Z","steps":["trace[458415686] 'process raft request' (duration: 231.189237ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:56.601032Z","caller":"traceutil/trace.go:171","msg":"trace[959004140] transaction","detail":"{read_only:false; response_revision:4922; number_of_response:1; }","duration":"160.286427ms","start":"2026-06-24T11:08:56.440738Z","end":"2026-06-24T11:08:56.601025Z","steps":["trace[959004140] 'process raft request' (duration: 159.8598ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:56.831657Z","caller":"traceutil/trace.go:171","msg":"trace[926019962] linearizableReadLoop","detail":"{readStateIndex:5113; appliedIndex:5111; }","duration":"128.599845ms","start":"2026-06-24T11:08:56.70304Z","end":"2026-06-24T11:08:56.83164Z","steps":["trace[926019962] 'read index received' (duration: 928.915µs)","trace[926019962] 'applied index is now lower than readState.Index' (duration: 127.67012ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:08:56.831781Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.723247ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:08:56.831834Z","caller":"traceutil/trace.go:171","msg":"trace[1233712096] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:4927; }","duration":"128.824269ms","start":"2026-06-24T11:08:56.703Z","end":"2026-06-24T11:08:56.831825Z","steps":["trace[1233712096] 'agreement among raft nodes before linearized reading' (duration: 128.738568ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:56.831896Z","caller":"traceutil/trace.go:171","msg":"trace[90511329] transaction","detail":"{read_only:false; response_revision:4927; number_of_response:1; }","duration":"138.123353ms","start":"2026-06-24T11:08:56.693688Z","end":"2026-06-24T11:08:56.831812Z","steps":["trace[90511329] 'process raft request' (duration: 137.819498ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:08:56.961292Z","caller":"traceutil/trace.go:171","msg":"trace[189920884] transaction","detail":"{read_only:false; response_revision:4929; number_of_response:1; }","duration":"108.660985ms","start":"2026-06-24T11:08:56.852585Z","end":"2026-06-24T11:08:56.961246Z","steps":["trace[189920884] 'process raft request' (duration: 25.268002ms)","trace[189920884] 'compare' (duration: 83.208941ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:08:57.155832Z","caller":"traceutil/trace.go:171","msg":"trace[757355119] linearizableReadLoop","detail":"{readStateIndex:5117; appliedIndex:5115; }","duration":"167.62242ms","start":"2026-06-24T11:08:56.988175Z","end":"2026-06-24T11:08:57.155797Z","steps":["trace[757355119] 'read index received' (duration: 113.877987ms)","trace[757355119] 'applied index is now lower than readState.Index' (duration: 53.707152ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:08:57.155892Z","caller":"traceutil/trace.go:171","msg":"trace[1279245726] transaction","detail":"{read_only:false; response_revision:4930; number_of_response:1; }","duration":"175.839737ms","start":"2026-06-24T11:08:56.980016Z","end":"2026-06-24T11:08:57.155856Z","steps":["trace[1279245726] 'process raft request' (duration: 122.022893ms)","trace[1279245726] 'compare' (duration: 53.398828ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:08:57.156016Z","caller":"traceutil/trace.go:171","msg":"trace[834337681] transaction","detail":"{read_only:false; response_revision:4931; number_of_response:1; }","duration":"175.220008ms","start":"2026-06-24T11:08:56.980778Z","end":"2026-06-24T11:08:57.155998Z","steps":["trace[834337681] 'process raft request' (duration: 174.906533ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:57.157018Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.821638ms","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-24T11:08:57.157093Z","caller":"traceutil/trace.go:171","msg":"trace[989549850] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4931; }","duration":"168.909929ms","start":"2026-06-24T11:08:56.988164Z","end":"2026-06-24T11:08:57.157074Z","steps":["trace[989549850] 'agreement among raft nodes before linearized reading' (duration: 168.188368ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:57.157171Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.995844ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"info","ts":"2026-06-24T11:08:57.157263Z","caller":"traceutil/trace.go:171","msg":"trace[1363848998] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4931; }","duration":"166.120986ms","start":"2026-06-24T11:08:56.99112Z","end":"2026-06-24T11:08:57.157241Z","steps":["trace[1363848998] 'agreement among raft nodes before linearized reading' (duration: 165.821671ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:08:57.157255Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.887798ms","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-24T11:08:57.157415Z","caller":"traceutil/trace.go:171","msg":"trace[1752211621] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:4931; }","duration":"167.08043ms","start":"2026-06-24T11:08:56.990312Z","end":"2026-06-24T11:08:57.157392Z","steps":["trace[1752211621] 'agreement among raft nodes before linearized reading' (duration: 166.578293ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:09:33.054944Z","caller":"traceutil/trace.go:171","msg":"trace[2024499148] transaction","detail":"{read_only:false; response_revision:5244; number_of_response:1; }","duration":"104.456791ms","start":"2026-06-24T11:09:32.950467Z","end":"2026-06-24T11:09:33.054923Z","steps":["trace[2024499148] 'process raft request' (duration: 104.322349ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:09:43.410057Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.634873ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/kube-prometheus-stack-admission\" ","response":"range_response_count:1 size:1817"} {"level":"info","ts":"2026-06-24T11:09:43.410917Z","caller":"traceutil/trace.go:171","msg":"trace[1041388616] range","detail":"{range_begin:/registry/secrets/monitoring/kube-prometheus-stack-admission; range_end:; response_count:1; response_revision:5300; }","duration":"180.509157ms","start":"2026-06-24T11:09:43.230348Z","end":"2026-06-24T11:09:43.410857Z","steps":["trace[1041388616] 'range keys from in-memory index tree' (duration: 179.467171ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:09:58.753269Z","caller":"traceutil/trace.go:171","msg":"trace[490631864] transaction","detail":"{read_only:false; response_revision:5425; number_of_response:1; }","duration":"124.295843ms","start":"2026-06-24T11:09:58.628945Z","end":"2026-06-24T11:09:58.753241Z","steps":["trace[490631864] 'process raft request' (duration: 124.231052ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:09:58.753574Z","caller":"traceutil/trace.go:171","msg":"trace[2111306498] transaction","detail":"{read_only:false; response_revision:5424; number_of_response:1; }","duration":"156.302095ms","start":"2026-06-24T11:09:58.597236Z","end":"2026-06-24T11:09:58.753538Z","steps":["trace[2111306498] 'process raft request' (duration: 59.402915ms)","trace[2111306498] 'compare' (duration: 96.248211ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:09:58.963092Z","caller":"traceutil/trace.go:171","msg":"trace[388244510] transaction","detail":"{read_only:false; response_revision:5426; number_of_response:1; }","duration":"106.055579ms","start":"2026-06-24T11:09:58.857018Z","end":"2026-06-24T11:09:58.963074Z","steps":["trace[388244510] 'process raft request' (duration: 40.756125ms)","trace[388244510] 'compare' (duration: 65.04236ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:10:22.299567Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2914} {"level":"info","ts":"2026-06-24T11:10:22.412968Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2914,"took":"110.645804ms","hash":723734421,"current-db-size-bytes":54247424,"current-db-size":"54 MB","current-db-size-in-use-bytes":29192192,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-06-24T11:10:22.413114Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":723734421,"revision":2914,"compact-revision":-1} {"level":"info","ts":"2026-06-24T11:12:35.532214Z","caller":"traceutil/trace.go:171","msg":"trace[1587812951] transaction","detail":"{read_only:false; response_revision:6510; number_of_response:1; }","duration":"135.611446ms","start":"2026-06-24T11:12:35.396579Z","end":"2026-06-24T11:12:35.53219Z","steps":["trace[1587812951] 'process raft request' (duration: 128.092336ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:12:58.221659Z","caller":"traceutil/trace.go:171","msg":"trace[1107834668] linearizableReadLoop","detail":"{readStateIndex:6926; appliedIndex:6925; }","duration":"498.655029ms","start":"2026-06-24T11:12:57.722974Z","end":"2026-06-24T11:12:58.221629Z","steps":["trace[1107834668] 'read index received' (duration: 498.487467ms)","trace[1107834668] 'applied index is now lower than readState.Index' (duration: 166.332µs)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:12:58.221832Z","caller":"traceutil/trace.go:171","msg":"trace[1320008274] transaction","detail":"{read_only:false; response_revision:6680; number_of_response:1; }","duration":"557.357823ms","start":"2026-06-24T11:12:57.664411Z","end":"2026-06-24T11:12:58.221769Z","steps":["trace[1320008274] 'process raft request' (duration: 557.002608ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:58.222001Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"499.008485ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/cert-manager/\" range_end:\"/registry/secrets/cert-manager0\" ","response":"range_response_count:4 size:218498"} {"level":"info","ts":"2026-06-24T11:12:58.222067Z","caller":"traceutil/trace.go:171","msg":"trace[1587953660] range","detail":"{range_begin:/registry/secrets/cert-manager/; range_end:/registry/secrets/cert-manager0; response_count:4; response_revision:6680; }","duration":"499.112296ms","start":"2026-06-24T11:12:57.722927Z","end":"2026-06-24T11:12:58.222039Z","steps":["trace[1587953660] 'agreement among raft nodes before linearized reading' (duration: 498.815802ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:58.222065Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:57.664389Z","time spent":"557.530936ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:12:58.222217Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:57.722908Z","time spent":"499.194547ms","remote":"127.0.0.1:53544","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":4,"response size":218522,"request content":"key:\"/registry/secrets/cert-manager/\" range_end:\"/registry/secrets/cert-manager0\" "} {"level":"warn","ts":"2026-06-24T11:12:58.84471Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"234.094744ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:12:58.844801Z","caller":"traceutil/trace.go:171","msg":"trace[27808865] transaction","detail":"{read_only:false; response_revision:6681; number_of_response:1; }","duration":"1.070753686s","start":"2026-06-24T11:12:57.774033Z","end":"2026-06-24T11:12:58.844787Z","steps":["trace[27808865] 'process raft request' (duration: 836.508031ms)","trace[27808865] 'compare' (duration: 234.018742ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:12:58.844843Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:57.774015Z","time spent":"1.070808227s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:12:59.369581Z","caller":"traceutil/trace.go:171","msg":"trace[1747241082] linearizableReadLoop","detail":"{readStateIndex:6929; appliedIndex:6926; }","duration":"1.005407766s","start":"2026-06-24T11:12:58.364152Z","end":"2026-06-24T11:12:59.369559Z","steps":["trace[1747241082] 'read index received' (duration: 246.413423ms)","trace[1747241082] 'applied index is now lower than readState.Index' (duration: 758.993163ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:12:59.369795Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.005630539s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-24T11:12:59.369899Z","caller":"traceutil/trace.go:171","msg":"trace[117296959] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:6683; }","duration":"1.005780352s","start":"2026-06-24T11:12:58.364095Z","end":"2026-06-24T11:12:59.369876Z","steps":["trace[117296959] 'agreement among raft nodes before linearized reading' (duration: 1.005600759s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.369955Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.364076Z","time spent":"1.005868563s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":462,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-06-24T11:12:59.369805Z","caller":"traceutil/trace.go:171","msg":"trace[940217907] transaction","detail":"{read_only:false; response_revision:6683; number_of_response:1; }","duration":"1.019960787s","start":"2026-06-24T11:12:58.34965Z","end":"2026-06-24T11:12:59.369611Z","steps":["trace[940217907] 'process raft request' (duration: 1.019795875s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.370535Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.34963Z","time spent":"1.020658707s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":541,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:12:59.370994Z","caller":"traceutil/trace.go:171","msg":"trace[650364019] transaction","detail":"{read_only:false; response_revision:6682; number_of_response:1; }","duration":"1.079789207s","start":"2026-06-24T11:12:58.291179Z","end":"2026-06-24T11:12:59.370968Z","steps":["trace[650364019] 'process raft request' (duration: 1.007344074s)","trace[650364019] 'compare' (duration: 70.535435ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:12:59.371164Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.291157Z","time spent":"1.07993894s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:12:59.464266Z","caller":"traceutil/trace.go:171","msg":"trace[2077067125] transaction","detail":"{read_only:false; response_revision:6684; number_of_response:1; }","duration":"311.398406ms","start":"2026-06-24T11:12:59.15285Z","end":"2026-06-24T11:12:59.464248Z","steps":["trace[2077067125] 'process raft request' (duration: 311.285485ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.464384Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.152808Z","time spent":"311.514028ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":474,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:12:59.464502Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.062053389s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"} {"level":"info","ts":"2026-06-24T11:12:59.464584Z","caller":"traceutil/trace.go:171","msg":"trace[1705803148] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:6685; }","duration":"1.062240622s","start":"2026-06-24T11:12:58.402323Z","end":"2026-06-24T11:12:59.464564Z","steps":["trace[1705803148] 'agreement among raft nodes before linearized reading' (duration: 1.06210481s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.464622Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.402295Z","time spent":"1.062319713s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":531,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-06-24T11:12:59.464638Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"547.920206ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12215"} {"level":"info","ts":"2026-06-24T11:12:59.464658Z","caller":"traceutil/trace.go:171","msg":"trace[632846274] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:6685; }","duration":"547.986036ms","start":"2026-06-24T11:12:58.916666Z","end":"2026-06-24T11:12:59.464652Z","steps":["trace[632846274] 'agreement among raft nodes before linearized reading' (duration: 547.903265ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.464676Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.916651Z","time spent":"548.022037ms","remote":"127.0.0.1:53626","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":12239,"request content":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" "} {"level":"info","ts":"2026-06-24T11:12:59.464789Z","caller":"traceutil/trace.go:171","msg":"trace[676355591] transaction","detail":"{read_only:false; response_revision:6685; number_of_response:1; }","duration":"266.027258ms","start":"2026-06-24T11:12:59.198755Z","end":"2026-06-24T11:12:59.464783Z","steps":["trace[676355591] 'process raft request' (duration: 265.46359ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.464897Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"980.633705ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-24T11:12:59.464907Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"705.235392ms","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-24T11:12:59.464933Z","caller":"traceutil/trace.go:171","msg":"trace[46246951] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6685; }","duration":"980.702457ms","start":"2026-06-24T11:12:58.484222Z","end":"2026-06-24T11:12:59.464925Z","steps":["trace[46246951] 'agreement among raft nodes before linearized reading' (duration: 980.643976ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.464942Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"486.320749ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/cert-manager/\" range_end:\"/registry/secrets/cert-manager0\" ","response":"range_response_count:4 size:218498"} {"level":"warn","ts":"2026-06-24T11:12:59.464957Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.484206Z","time spent":"980.746747ms","remote":"127.0.0.1:53444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-24T11:12:59.464962Z","caller":"traceutil/trace.go:171","msg":"trace[1215071430] range","detail":"{range_begin:/registry/secrets/cert-manager/; range_end:/registry/secrets/cert-manager0; response_count:4; response_revision:6685; }","duration":"486.375381ms","start":"2026-06-24T11:12:58.97858Z","end":"2026-06-24T11:12:59.464955Z","steps":["trace[1215071430] 'agreement among raft nodes before linearized reading' (duration: 486.27315ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.465089Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.97856Z","time spent":"486.523933ms","remote":"127.0.0.1:53544","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":4,"response size":218522,"request content":"key:\"/registry/secrets/cert-manager/\" range_end:\"/registry/secrets/cert-manager0\" "} {"level":"warn","ts":"2026-06-24T11:12:59.465101Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"708.321937ms","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-24T11:12:59.465121Z","caller":"traceutil/trace.go:171","msg":"trace[585929878] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:6685; }","duration":"708.375208ms","start":"2026-06-24T11:12:58.756739Z","end":"2026-06-24T11:12:59.465115Z","steps":["trace[585929878] 'agreement among raft nodes before linearized reading' (duration: 708.319428ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.465144Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.756722Z","time spent":"708.416259ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-06-24T11:12:59.464937Z","caller":"traceutil/trace.go:171","msg":"trace[37186813] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:6685; }","duration":"705.285693ms","start":"2026-06-24T11:12:58.759642Z","end":"2026-06-24T11:12:59.464928Z","steps":["trace[37186813] 'agreement among raft nodes before linearized reading' (duration: 705.177851ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.465225Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"873.995715ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"} {"level":"warn","ts":"2026-06-24T11:12:59.465225Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.759633Z","time spent":"705.582107ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":516,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-06-24T11:12:59.465239Z","caller":"traceutil/trace.go:171","msg":"trace[924735591] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:6685; }","duration":"874.037176ms","start":"2026-06-24T11:12:58.591198Z","end":"2026-06-24T11:12:59.465235Z","steps":["trace[924735591] 'agreement among raft nodes before linearized reading' (duration: 873.995426ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.465339Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:58.591183Z","time spent":"874.148718ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":504,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-06-24T11:12:59.876541Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.947223ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:12:59.876625Z","caller":"traceutil/trace.go:171","msg":"trace[877373733] linearizableReadLoop","detail":"{readStateIndex:6932; appliedIndex:6931; }","duration":"409.847507ms","start":"2026-06-24T11:12:59.466763Z","end":"2026-06-24T11:12:59.87661Z","steps":["trace[877373733] 'read index received' (duration: 212.770663ms)","trace[877373733] 'applied index is now lower than readState.Index' (duration: 197.075714ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:12:59.876898Z","caller":"traceutil/trace.go:171","msg":"trace[905341163] transaction","detail":"{read_only:false; response_revision:6686; number_of_response:1; }","duration":"498.04903ms","start":"2026-06-24T11:12:59.378835Z","end":"2026-06-24T11:12:59.876884Z","steps":["trace[905341163] 'process raft request' (duration: 300.685092ms)","trace[905341163] 'compare' (duration: 196.771759ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:12:59.876911Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"410.115521ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-24T11:12:59.87696Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.378806Z","time spent":"498.12121ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:12:59.876997Z","caller":"traceutil/trace.go:171","msg":"trace[355813503] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6686; }","duration":"410.226802ms","start":"2026-06-24T11:12:59.466749Z","end":"2026-06-24T11:12:59.876976Z","steps":["trace[355813503] 'agreement among raft nodes before linearized reading' (duration: 410.07983ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.877035Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.466738Z","time spent":"410.290154ms","remote":"127.0.0.1:53456","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-24T11:12:59.974471Z","caller":"traceutil/trace.go:171","msg":"trace[1353230563] transaction","detail":"{read_only:false; response_revision:6687; number_of_response:1; }","duration":"503.442778ms","start":"2026-06-24T11:12:59.471003Z","end":"2026-06-24T11:12:59.974446Z","steps":["trace[1353230563] 'process raft request' (duration: 503.258866ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.974687Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.470972Z","time spent":"503.57198ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:12:59.974943Z","caller":"traceutil/trace.go:171","msg":"trace[627427030] transaction","detail":"{read_only:false; response_revision:6688; number_of_response:1; }","duration":"503.801333ms","start":"2026-06-24T11:12:59.471113Z","end":"2026-06-24T11:12:59.974915Z","steps":["trace[627427030] 'process raft request' (duration: 503.286966ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.975108Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.471106Z","time spent":"503.909505ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:12:59.975203Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"319.962121ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-cainjector-leader-election\" ","response":"range_response_count:1 size:559"} {"level":"info","ts":"2026-06-24T11:12:59.975246Z","caller":"traceutil/trace.go:171","msg":"trace[1617771878] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-cainjector-leader-election; range_end:; response_count:1; response_revision:6690; }","duration":"320.033432ms","start":"2026-06-24T11:12:59.655196Z","end":"2026-06-24T11:12:59.97523Z","steps":["trace[1617771878] 'agreement among raft nodes before linearized reading' (duration: 319.82575ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.975276Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.655179Z","time spent":"320.090683ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":71,"response count":1,"response size":583,"request content":"key:\"/registry/leases/cert-manager/cert-manager-cainjector-leader-election\" "} {"level":"info","ts":"2026-06-24T11:12:59.975416Z","caller":"traceutil/trace.go:171","msg":"trace[286563320] transaction","detail":"{read_only:false; response_revision:6689; number_of_response:1; }","duration":"504.131878ms","start":"2026-06-24T11:12:59.471273Z","end":"2026-06-24T11:12:59.975405Z","steps":["trace[286563320] 'process raft request' (duration: 503.425768ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.975442Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"503.227694ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12215"} {"level":"info","ts":"2026-06-24T11:12:59.97547Z","caller":"traceutil/trace.go:171","msg":"trace[629089031] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:6690; }","duration":"503.265435ms","start":"2026-06-24T11:12:59.472196Z","end":"2026-06-24T11:12:59.975461Z","steps":["trace[629089031] 'agreement among raft nodes before linearized reading' (duration: 503.126563ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.975473Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.47126Z","time spent":"504.177888ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:12:59.975496Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.472191Z","time spent":"503.299945ms","remote":"127.0.0.1:53626","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":12239,"request content":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" "} {"level":"info","ts":"2026-06-24T11:12:59.975586Z","caller":"traceutil/trace.go:171","msg":"trace[245437200] transaction","detail":"{read_only:false; response_revision:6690; number_of_response:1; }","duration":"501.366488ms","start":"2026-06-24T11:12:59.47421Z","end":"2026-06-24T11:12:59.975576Z","steps":["trace[245437200] 'process raft request' (duration: 500.596527ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:12:59.975694Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:12:59.474204Z","time spent":"501.4604ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:13:00.201451Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"220.928611ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:12170"} {"level":"info","ts":"2026-06-24T11:13:00.204884Z","caller":"traceutil/trace.go:171","msg":"trace[1534108455] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:6690; }","duration":"224.412851ms","start":"2026-06-24T11:12:59.980458Z","end":"2026-06-24T11:13:00.204871Z","steps":["trace[1534108455] 'range keys from in-memory index tree' (duration: 220.686297ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:13:00.204406Z","caller":"traceutil/trace.go:171","msg":"trace[1971462435] transaction","detail":"{read_only:false; response_revision:6691; number_of_response:1; }","duration":"220.612376ms","start":"2026-06-24T11:12:59.983766Z","end":"2026-06-24T11:13:00.204378Z","steps":["trace[1971462435] 'process raft request' (duration: 177.156675ms)","trace[1971462435] 'compare' (duration: 41.789237ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:00.606145Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.633175ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:13:00.606588Z","caller":"traceutil/trace.go:171","msg":"trace[2934389] linearizableReadLoop","detail":"{readStateIndex:6938; appliedIndex:6937; }","duration":"277.103978ms","start":"2026-06-24T11:13:00.329468Z","end":"2026-06-24T11:13:00.606572Z","steps":["trace[2934389] 'read index received' (duration: 82.972435ms)","trace[2934389] 'applied index is now lower than readState.Index' (duration: 194.130153ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:13:00.606719Z","caller":"traceutil/trace.go:171","msg":"trace[2115451058] transaction","detail":"{read_only:false; response_revision:6692; number_of_response:1; }","duration":"377.021871ms","start":"2026-06-24T11:13:00.229687Z","end":"2026-06-24T11:13:00.606709Z","steps":["trace[2115451058] 'process raft request' (duration: 182.761406ms)","trace[2115451058] 'compare' (duration: 193.530793ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:00.606797Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:00.229655Z","time spent":"377.114162ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":508,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:13:00.607127Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"277.541664ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:13:00.608537Z","caller":"traceutil/trace.go:171","msg":"trace[222670220] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:6692; }","duration":"279.078166ms","start":"2026-06-24T11:13:00.329419Z","end":"2026-06-24T11:13:00.608497Z","steps":["trace[222670220] 'agreement among raft nodes before linearized reading' (duration: 277.554404ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:00.861642Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.432478ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-06-24T11:13:00.861721Z","caller":"traceutil/trace.go:171","msg":"trace[1721147595] linearizableReadLoop","detail":"{readStateIndex:6939; appliedIndex:6938; }","duration":"255.019847ms","start":"2026-06-24T11:13:00.606688Z","end":"2026-06-24T11:13:00.861708Z","steps":["trace[1721147595] 'read index received' (duration: 106.444987ms)","trace[1721147595] 'applied index is now lower than readState.Index' (duration: 148.5738ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:00.8618Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"402.45483ms","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":"info","ts":"2026-06-24T11:13:00.861823Z","caller":"traceutil/trace.go:171","msg":"trace[321808132] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:6692; }","duration":"402.528942ms","start":"2026-06-24T11:13:00.459285Z","end":"2026-06-24T11:13:00.861814Z","steps":["trace[321808132] 'agreement among raft nodes before linearized reading' (duration: 402.482711ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:00.86181Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"374.665796ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-24T11:13:00.861848Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:00.45926Z","time spent":"402.581252ms","remote":"127.0.0.1:57606","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":29,"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-24T11:13:00.861876Z","caller":"traceutil/trace.go:171","msg":"trace[1526718856] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6692; }","duration":"374.773567ms","start":"2026-06-24T11:13:00.487082Z","end":"2026-06-24T11:13:00.861855Z","steps":["trace[1526718856] 'agreement among raft nodes before linearized reading' (duration: 374.655296ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:00.861916Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:00.487055Z","time spent":"374.852399ms","remote":"127.0.0.1:53456","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-24T11:13:00.862032Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"438.566815ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-controller\" ","response":"range_response_count:1 size:530"} {"level":"info","ts":"2026-06-24T11:13:00.862147Z","caller":"traceutil/trace.go:171","msg":"trace[1299695083] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-controller; range_end:; response_count:1; response_revision:6692; }","duration":"438.736007ms","start":"2026-06-24T11:13:00.423385Z","end":"2026-06-24T11:13:00.862121Z","steps":["trace[1299695083] 'agreement among raft nodes before linearized reading' (duration: 438.405262ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:00.862201Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:00.42336Z","time spent":"438.832059ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":55,"response count":1,"response size":554,"request content":"key:\"/registry/leases/cert-manager/cert-manager-controller\" "} {"level":"warn","ts":"2026-06-24T11:13:00.933332Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"321.730896ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:13:00.933412Z","caller":"traceutil/trace.go:171","msg":"trace[126313333] range","detail":"{range_begin:/registry/services/specs/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:6693; }","duration":"321.861699ms","start":"2026-06-24T11:13:00.611532Z","end":"2026-06-24T11:13:00.933393Z","steps":["trace[126313333] 'agreement among raft nodes before linearized reading' (duration: 321.450353ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:00.933449Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:00.611511Z","time spent":"321.929559ms","remote":"127.0.0.1:53634","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":0,"response size":29,"request content":"key:\"/registry/services/specs/openstack/percona-xtradb-pitr\" "} {"level":"info","ts":"2026-06-24T11:13:03.520005Z","caller":"traceutil/trace.go:171","msg":"trace[871738259] transaction","detail":"{read_only:false; response_revision:6705; number_of_response:1; }","duration":"111.710863ms","start":"2026-06-24T11:13:03.408266Z","end":"2026-06-24T11:13:03.519977Z","steps":["trace[871738259] 'process raft request' (duration: 111.48913ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:13:03.569852Z","caller":"traceutil/trace.go:171","msg":"trace[760107608] transaction","detail":"{read_only:false; response_revision:6706; number_of_response:1; }","duration":"141.624088ms","start":"2026-06-24T11:13:03.428203Z","end":"2026-06-24T11:13:03.569827Z","steps":["trace[760107608] 'process raft request' (duration: 140.969219ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:13:04.703949Z","caller":"traceutil/trace.go:171","msg":"trace[2029796831] transaction","detail":"{read_only:false; response_revision:6712; number_of_response:1; }","duration":"120.996768ms","start":"2026-06-24T11:13:04.582921Z","end":"2026-06-24T11:13:04.703918Z","steps":["trace[2029796831] 'process raft request' (duration: 120.836096ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:06.887254Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"662.863169ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:13:06.887374Z","caller":"traceutil/trace.go:171","msg":"trace[1282380919] transaction","detail":"{read_only:false; response_revision:6721; number_of_response:1; }","duration":"687.66527ms","start":"2026-06-24T11:13:06.199689Z","end":"2026-06-24T11:13:06.887354Z","steps":["trace[1282380919] 'process raft request' (duration: 24.629818ms)","trace[1282380919] 'compare' (duration: 661.915215ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:06.887439Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:06.199667Z","time spent":"687.742712ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:13:06.984088Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16387084987662614782,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-06-24T11:13:07.408702Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.184437626s","expected-duration":"1s"} {"level":"warn","ts":"2026-06-24T11:13:08.483743Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.999948541s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"","error":"context deadline exceeded"} {"level":"info","ts":"2026-06-24T11:13:08.483858Z","caller":"traceutil/trace.go:171","msg":"trace[915098534] range","detail":"{range_begin:/registry/health; range_end:; }","duration":"2.000100673s","start":"2026-06-24T11:13:06.483733Z","end":"2026-06-24T11:13:08.483834Z","steps":["trace[915098534] 'agreement among raft nodes before linearized reading' (duration: 1.999960511s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:08.483928Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:06.483689Z","time spent":"2.000225145s","remote":"127.0.0.1:53444","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":0,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-24T11:13:08.986243Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.577065917s","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:13:08.986427Z","caller":"traceutil/trace.go:171","msg":"trace[1954883623] transaction","detail":"{read_only:false; response_revision:6722; number_of_response:1; }","duration":"2.785600523s","start":"2026-06-24T11:13:06.200796Z","end":"2026-06-24T11:13:08.986396Z","steps":["trace[1954883623] 'process raft request' (duration: 1.208316863s)","trace[1954883623] 'compare' (duration: 1.574378778s)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:08.987991Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:06.200745Z","time spent":"2.785746315s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:13:08.988122Z","caller":"traceutil/trace.go:171","msg":"trace[2047483825] transaction","detail":"{read_only:false; response_revision:6726; number_of_response:1; }","duration":"1.451611926s","start":"2026-06-24T11:13:07.536451Z","end":"2026-06-24T11:13:08.988063Z","steps":["trace[2047483825] 'process raft request' (duration: 1.451576356s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:08.988266Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:07.536416Z","time spent":"1.451807918s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:13:08.988623Z","caller":"traceutil/trace.go:171","msg":"trace[1947515397] transaction","detail":"{read_only:false; response_revision:6725; number_of_response:1; }","duration":"1.93176036s","start":"2026-06-24T11:13:07.056836Z","end":"2026-06-24T11:13:08.988597Z","steps":["trace[1947515397] 'process raft request' (duration: 1.931157121s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:08.988752Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:07.056801Z","time spent":"1.931885622s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:13:08.988876Z","caller":"traceutil/trace.go:171","msg":"trace[508562848] transaction","detail":"{read_only:false; response_revision:6723; number_of_response:1; }","duration":"2.256654629s","start":"2026-06-24T11:13:06.732211Z","end":"2026-06-24T11:13:08.988866Z","steps":["trace[508562848] 'process raft request' (duration: 2.254121202s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:08.988928Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:06.732189Z","time spent":"2.256712371s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:13:08.988996Z","caller":"traceutil/trace.go:171","msg":"trace[920169399] linearizableReadLoop","detail":"{readStateIndex:6972; appliedIndex:6969; }","duration":"2.50522047s","start":"2026-06-24T11:13:06.483761Z","end":"2026-06-24T11:13:08.988981Z","steps":["trace[920169399] 'read index received' (duration: 925.308232ms)","trace[920169399] 'applied index is now lower than readState.Index' (duration: 1.579910588s)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:13:08.989068Z","caller":"traceutil/trace.go:171","msg":"trace[1684238751] transaction","detail":"{read_only:false; response_revision:6724; number_of_response:1; }","duration":"2.005760315s","start":"2026-06-24T11:13:06.983298Z","end":"2026-06-24T11:13:08.989058Z","steps":["trace[1684238751] 'process raft request' (duration: 2.004649169s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:08.989125Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:06.983277Z","time spent":"2.005820886s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":475,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:13:09.161968Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.102966451s","expected-duration":"1s"} {"level":"warn","ts":"2026-06-24T11:13:09.397497Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.323028ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-24T11:13:09.397599Z","caller":"traceutil/trace.go:171","msg":"trace[744163331] linearizableReadLoop","detail":"{readStateIndex:6975; appliedIndex:6974; }","duration":"408.523613ms","start":"2026-06-24T11:13:08.989058Z","end":"2026-06-24T11:13:09.397582Z","steps":["trace[744163331] 'read index received' (duration: 173.030563ms)","trace[744163331] 'applied index is now lower than readState.Index' (duration: 235.49192ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:09.397821Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.656884307s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/\" range_end:\"/registry/pxc.percona.com/perconaxtradbclusters0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-06-24T11:13:09.397851Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.21862009s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-06-24T11:13:09.397867Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"469.077583ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/monitoring.coreos.com/alertmanagers/\" range_end:\"/registry/monitoring.coreos.com/alertmanagers0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-24T11:13:09.397975Z","caller":"traceutil/trace.go:171","msg":"trace[1061025241] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:6727; }","duration":"1.218760361s","start":"2026-06-24T11:13:08.179169Z","end":"2026-06-24T11:13:09.397929Z","steps":["trace[1061025241] 'agreement among raft nodes before linearized reading' (duration: 1.218522038s)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:13:09.397978Z","caller":"traceutil/trace.go:171","msg":"trace[369535617] range","detail":"{range_begin:/registry/monitoring.coreos.com/alertmanagers/; range_end:/registry/monitoring.coreos.com/alertmanagers0; response_count:0; response_revision:6727; }","duration":"469.210545ms","start":"2026-06-24T11:13:08.928751Z","end":"2026-06-24T11:13:09.397961Z","steps":["trace[369535617] 'agreement among raft nodes before linearized reading' (duration: 469.057173ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.398007Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:08.17915Z","time spent":"1.218851333s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-06-24T11:13:09.398025Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:08.928741Z","time spent":"469.272517ms","remote":"127.0.0.1:34154","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":1,"response size":31,"request content":"key:\"/registry/monitoring.coreos.com/alertmanagers/\" range_end:\"/registry/monitoring.coreos.com/alertmanagers0\" count_only:true "} {"level":"warn","ts":"2026-06-24T11:13:09.398066Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.251404086s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-06-24T11:13:09.398132Z","caller":"traceutil/trace.go:171","msg":"trace[1971775035] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:6727; }","duration":"1.251497888s","start":"2026-06-24T11:13:08.14662Z","end":"2026-06-24T11:13:09.398118Z","steps":["trace[1971775035] 'agreement among raft nodes before linearized reading' (duration: 1.251333246s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.398172Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.107376359s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/ingress-nginx/\" range_end:\"/registry/secrets/ingress-nginx0\" ","response":"range_response_count:2 size:107259"} {"level":"warn","ts":"2026-06-24T11:13:09.398221Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"505.764686ms","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-24T11:13:09.39827Z","caller":"traceutil/trace.go:171","msg":"trace[2106153] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:6727; }","duration":"505.802167ms","start":"2026-06-24T11:13:08.892448Z","end":"2026-06-24T11:13:09.39825Z","steps":["trace[2106153] 'agreement among raft nodes before linearized reading' (duration: 505.730436ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.398291Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:08.892394Z","time spent":"505.892727ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-06-24T11:13:09.398245Z","caller":"traceutil/trace.go:171","msg":"trace[846379408] range","detail":"{range_begin:/registry/secrets/ingress-nginx/; range_end:/registry/secrets/ingress-nginx0; response_count:2; response_revision:6727; }","duration":"2.107516822s","start":"2026-06-24T11:13:07.290715Z","end":"2026-06-24T11:13:09.398232Z","steps":["trace[846379408] 'agreement among raft nodes before linearized reading' (duration: 2.107095846s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.398304Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.393999698s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-24T11:13:09.398387Z","caller":"traceutil/trace.go:171","msg":"trace[2059362313] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:6727; }","duration":"1.394115709s","start":"2026-06-24T11:13:08.004261Z","end":"2026-06-24T11:13:09.398377Z","steps":["trace[2059362313] 'agreement among raft nodes before linearized reading' (duration: 1.393961646s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.398396Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:07.290697Z","time spent":"2.107648083s","remote":"127.0.0.1:53544","response type":"/etcdserverpb.KV/Range","request count":0,"request size":68,"response count":2,"response size":107283,"request content":"key:\"/registry/secrets/ingress-nginx/\" range_end:\"/registry/secrets/ingress-nginx0\" "} {"level":"warn","ts":"2026-06-24T11:13:09.398421Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:08.004243Z","time spent":"1.3941709s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":462,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-06-24T11:13:09.398463Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"914.271489ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:13:09.398485Z","caller":"traceutil/trace.go:171","msg":"trace[648094126] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6727; }","duration":"914.331049ms","start":"2026-06-24T11:13:08.484149Z","end":"2026-06-24T11:13:09.39848Z","steps":["trace[648094126] 'agreement among raft nodes before linearized reading' (duration: 914.281398ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.398499Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:08.48413Z","time spent":"914.36658ms","remote":"127.0.0.1:53456","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-24T11:13:09.398317Z","caller":"traceutil/trace.go:171","msg":"trace[2027395906] transaction","detail":"{read_only:false; response_revision:6727; number_of_response:1; }","duration":"1.748471636s","start":"2026-06-24T11:13:07.649831Z","end":"2026-06-24T11:13:09.398302Z","steps":["trace[2027395906] 'process raft request' (duration: 1.512250845s)","trace[2027395906] 'compare' (duration: 235.212916ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:09.39859Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:07.649799Z","time spent":"1.74872819s","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":541,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:13:09.39788Z","caller":"traceutil/trace.go:171","msg":"trace[1657640555] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/; range_end:/registry/pxc.percona.com/perconaxtradbclusters0; response_count:0; response_revision:6727; }","duration":"1.656994437s","start":"2026-06-24T11:13:07.740869Z","end":"2026-06-24T11:13:09.397864Z","steps":["trace[1657640555] 'agreement among raft nodes before linearized reading' (duration: 1.656888616s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.398691Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:07.740849Z","time spent":"1.65783253s","remote":"127.0.0.1:37130","response type":"/etcdserverpb.KV/Range","request count":0,"request size":102,"response count":1,"response size":31,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/\" range_end:\"/registry/pxc.percona.com/perconaxtradbclusters0\" count_only:true "} {"level":"warn","ts":"2026-06-24T11:13:09.39871Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.968602ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:13:09.398727Z","caller":"traceutil/trace.go:171","msg":"trace[1432402510] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6727; }","duration":"255.016433ms","start":"2026-06-24T11:13:09.143704Z","end":"2026-06-24T11:13:09.39872Z","steps":["trace[1432402510] 'agreement among raft nodes before linearized reading' (duration: 254.988143ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.39883Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.81508407s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-24T11:13:09.398866Z","caller":"traceutil/trace.go:171","msg":"trace[1935955947] range","detail":"{range_begin:/registry/ingressclasses/; range_end:/registry/ingressclasses0; response_count:0; response_revision:6727; }","duration":"2.815144761s","start":"2026-06-24T11:13:06.583716Z","end":"2026-06-24T11:13:09.39886Z","steps":["trace[1935955947] 'agreement among raft nodes before linearized reading' (duration: 2.815097601s)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.398881Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:06.583703Z","time spent":"2.815173372s","remote":"127.0.0.1:53716","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":1,"response size":31,"request content":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true "} {"level":"warn","ts":"2026-06-24T11:13:09.398201Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:08.146605Z","time spent":"1.251583839s","remote":"127.0.0.1:53676","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":"info","ts":"2026-06-24T11:13:09.823266Z","caller":"traceutil/trace.go:171","msg":"trace[1492250002] transaction","detail":"{read_only:false; response_revision:6729; number_of_response:1; }","duration":"416.211945ms","start":"2026-06-24T11:13:09.407031Z","end":"2026-06-24T11:13:09.823243Z","steps":["trace[1492250002] 'process raft request' (duration: 318.420185ms)","trace[1492250002] 'compare' (duration: 97.601618ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:09.823389Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:09.407014Z","time spent":"416.309167ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-24T11:13:09.823452Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"398.555078ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/vhosts/\" range_end:\"/registry/rabbitmq.com/vhosts0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:13:09.823485Z","caller":"traceutil/trace.go:171","msg":"trace[1088815048] range","detail":"{range_begin:/registry/rabbitmq.com/vhosts/; range_end:/registry/rabbitmq.com/vhosts0; response_count:0; response_revision:6732; }","duration":"398.617749ms","start":"2026-06-24T11:13:09.424859Z","end":"2026-06-24T11:13:09.823477Z","steps":["trace[1088815048] 'agreement among raft nodes before linearized reading' (duration: 398.556028ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.823509Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:09.424843Z","time spent":"398.66028ms","remote":"127.0.0.1:37030","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":0,"response size":29,"request content":"key:\"/registry/rabbitmq.com/vhosts/\" range_end:\"/registry/rabbitmq.com/vhosts0\" count_only:true "} {"level":"info","ts":"2026-06-24T11:13:09.823394Z","caller":"traceutil/trace.go:171","msg":"trace[1485381744] linearizableReadLoop","detail":"{readStateIndex:6980; appliedIndex:6976; }","duration":"398.493277ms","start":"2026-06-24T11:13:09.42489Z","end":"2026-06-24T11:13:09.823383Z","steps":["trace[1485381744] 'read index received' (duration: 33.171881ms)","trace[1485381744] 'applied index is now lower than readState.Index' (duration: 365.320666ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:13:09.823643Z","caller":"traceutil/trace.go:171","msg":"trace[461348959] transaction","detail":"{read_only:false; response_revision:6730; number_of_response:1; }","duration":"416.459399ms","start":"2026-06-24T11:13:09.407177Z","end":"2026-06-24T11:13:09.823636Z","steps":["trace[461348959] 'process raft request' (duration: 416.019743ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.823682Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:09.407171Z","time spent":"416.493309ms","remote":"127.0.0.1:53524","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":759,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-24T11:13:09.823755Z","caller":"traceutil/trace.go:171","msg":"trace[288725105] transaction","detail":"{read_only:false; response_revision:6732; number_of_response:1; }","duration":"414.560671ms","start":"2026-06-24T11:13:09.409183Z","end":"2026-06-24T11:13:09.823744Z","steps":["trace[288725105] 'process raft request' (duration: 414.176365ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.823826Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:09.409177Z","time spent":"414.611621ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:13:09.823947Z","caller":"traceutil/trace.go:171","msg":"trace[1114698742] transaction","detail":"{read_only:false; response_revision:6731; number_of_response:1; }","duration":"414.980976ms","start":"2026-06-24T11:13:09.408959Z","end":"2026-06-24T11:13:09.82394Z","steps":["trace[1114698742] 'process raft request' (duration: 414.358258ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.823992Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:09.408949Z","time spent":"415.021928ms","remote":"127.0.0.1:53676","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":475,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-24T11:13:09.985137Z","caller":"traceutil/trace.go:171","msg":"trace[1342225745] linearizableReadLoop","detail":"{readStateIndex:6981; appliedIndex:6980; }","duration":"161.521557ms","start":"2026-06-24T11:13:09.823587Z","end":"2026-06-24T11:13:09.985109Z","steps":["trace[1342225745] 'read index received' (duration: 139.873612ms)","trace[1342225745] 'applied index is now lower than readState.Index' (duration: 21.646465ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:09.985417Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"500.153805ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:13:09.985496Z","caller":"traceutil/trace.go:171","msg":"trace[381754845] transaction","detail":"{read_only:false; response_revision:6733; number_of_response:1; }","duration":"271.036967ms","start":"2026-06-24T11:13:09.714422Z","end":"2026-06-24T11:13:09.985459Z","steps":["trace[381754845] 'process raft request' (duration: 249.060437ms)","trace[381754845] 'compare' (duration: 21.232558ms)"],"step_count":2} {"level":"info","ts":"2026-06-24T11:13:09.985524Z","caller":"traceutil/trace.go:171","msg":"trace[2033466000] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6733; }","duration":"500.294106ms","start":"2026-06-24T11:13:09.485212Z","end":"2026-06-24T11:13:09.985506Z","steps":["trace[2033466000] 'agreement among raft nodes before linearized reading' (duration: 500.086603ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.985575Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.545843ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumnetworkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-24T11:13:09.985501Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.76475ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/schemareplications/\" range_end:\"/registry/rabbitmq.com/schemareplications0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-24T11:13:09.985656Z","caller":"traceutil/trace.go:171","msg":"trace[1910135455] range","detail":"{range_begin:/registry/cilium.io/ciliumnetworkpolicies/; range_end:/registry/cilium.io/ciliumnetworkpolicies0; response_count:0; response_revision:6733; }","duration":"189.662155ms","start":"2026-06-24T11:13:09.795972Z","end":"2026-06-24T11:13:09.985634Z","steps":["trace[1910135455] 'agreement among raft nodes before linearized reading' (duration: 189.538033ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.985592Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:09.4852Z","time spent":"500.382197ms","remote":"127.0.0.1:53456","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-24T11:13:09.985788Z","caller":"traceutil/trace.go:171","msg":"trace[1436303164] range","detail":"{range_begin:/registry/rabbitmq.com/schemareplications/; range_end:/registry/rabbitmq.com/schemareplications0; response_count:0; response_revision:6733; }","duration":"109.002324ms","start":"2026-06-24T11:13:09.876668Z","end":"2026-06-24T11:13:09.98567Z","steps":["trace[1436303164] 'agreement among raft nodes before linearized reading' (duration: 108.655359ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.986346Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"513.71885ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/ingress-nginx/\" range_end:\"/registry/secrets/ingress-nginx0\" ","response":"range_response_count:2 size:107259"} {"level":"info","ts":"2026-06-24T11:13:09.9864Z","caller":"traceutil/trace.go:171","msg":"trace[780286829] range","detail":"{range_begin:/registry/secrets/ingress-nginx/; range_end:/registry/secrets/ingress-nginx0; response_count:2; response_revision:6733; }","duration":"513.771691ms","start":"2026-06-24T11:13:09.472612Z","end":"2026-06-24T11:13:09.986384Z","steps":["trace[780286829] 'agreement among raft nodes before linearized reading' (duration: 513.586618ms)"],"step_count":1} {"level":"warn","ts":"2026-06-24T11:13:09.987744Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-24T11:13:09.472577Z","time spent":"513.966304ms","remote":"127.0.0.1:53544","response type":"/etcdserverpb.KV/Range","request count":0,"request size":68,"response count":2,"response size":107283,"request content":"key:\"/registry/secrets/ingress-nginx/\" range_end:\"/registry/secrets/ingress-nginx0\" "} {"level":"info","ts":"2026-06-24T11:13:17.190324Z","caller":"traceutil/trace.go:171","msg":"trace[726463731] linearizableReadLoop","detail":"{readStateIndex:7018; appliedIndex:7015; }","duration":"101.962851ms","start":"2026-06-24T11:13:17.088344Z","end":"2026-06-24T11:13:17.190306Z","steps":["trace[726463731] 'read index received' (duration: 33.226743ms)","trace[726463731] 'applied index is now lower than readState.Index' (duration: 68.732048ms)"],"step_count":2} {"level":"warn","ts":"2026-06-24T11:13:17.190496Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.136013ms","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-24T11:13:17.190523Z","caller":"traceutil/trace.go:171","msg":"trace[558634731] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:6768; }","duration":"102.213454ms","start":"2026-06-24T11:13:17.088301Z","end":"2026-06-24T11:13:17.190514Z","steps":["trace[558634731] 'agreement among raft nodes before linearized reading' (duration: 102.081112ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:13:17.190733Z","caller":"traceutil/trace.go:171","msg":"trace[2032972109] transaction","detail":"{read_only:false; response_revision:6767; number_of_response:1; }","duration":"107.162966ms","start":"2026-06-24T11:13:17.083561Z","end":"2026-06-24T11:13:17.190724Z","steps":["trace[2032972109] 'process raft request' (duration: 106.603528ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:13:17.190826Z","caller":"traceutil/trace.go:171","msg":"trace[1515671603] transaction","detail":"{read_only:false; response_revision:6768; number_of_response:1; }","duration":"106.627657ms","start":"2026-06-24T11:13:17.084193Z","end":"2026-06-24T11:13:17.19082Z","steps":["trace[1515671603] 'process raft request' (duration: 106.078149ms)"],"step_count":1} {"level":"info","ts":"2026-06-24T11:15:22.307672Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5589} {"level":"info","ts":"2026-06-24T11:15:22.413491Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5589,"took":"104.030016ms","hash":3126191070,"current-db-size-bytes":54247424,"current-db-size":"54 MB","current-db-size-in-use-bytes":18206720,"current-db-size-in-use":"18 MB"} {"level":"info","ts":"2026-06-24T11:15:22.413718Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3126191070,"revision":5589,"compact-revision":2914}