{"level":"warn","ts":"2026-04-20T09:34:23.364156Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-20T09:34:23.364332Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.171: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.171:2380","--initial-cluster=instance=https://199.19.213.171:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.171:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.171: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-04-20T09:34:23.364464Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-20T09:34:23.364513Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.171:2380"]} {"level":"info","ts":"2026-04-20T09:34:23.364549Z","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-04-20T09:34:23.365862Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.171:2379"]} {"level":"info","ts":"2026-04-20T09:34:23.36598Z","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.171:2380"],"listen-peer-urls":["https://199.19.213.171:2380"],"advertise-client-urls":["https://199.19.213.171:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.171:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.171: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-04-20T09:34:23.370381Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.159051ms"} {"level":"info","ts":"2026-04-20T09:34:23.376894Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"837e89131cc6bd81","cluster-id":"8af92e75ab8f3e69"} {"level":"info","ts":"2026-04-20T09:34:23.377016Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 switched to configuration voters=()"} {"level":"info","ts":"2026-04-20T09:34:23.377069Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 became follower at term 0"} {"level":"info","ts":"2026-04-20T09:34:23.377106Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 837e89131cc6bd81 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-20T09:34:23.377135Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 became follower at term 1"} {"level":"info","ts":"2026-04-20T09:34:23.377198Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 switched to configuration voters=(9475161381214272897)"} {"level":"warn","ts":"2026-04-20T09:34:23.383581Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-20T09:34:23.384973Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-20T09:34:23.386186Z","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-04-20T09:34:23.388417Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"837e89131cc6bd81","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-20T09:34:23.389223Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"837e89131cc6bd81","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-20T09:34:23.38945Z","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-04-20T09:34:23.389524Z","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-04-20T09:34:23.389549Z","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-04-20T09:34:23.389815Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 switched to configuration voters=(9475161381214272897)"} {"level":"info","ts":"2026-04-20T09:34:23.38993Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"8af92e75ab8f3e69","local-member-id":"837e89131cc6bd81","added-peer-id":"837e89131cc6bd81","added-peer-peer-urls":["https://199.19.213.171:2380"]} {"level":"info","ts":"2026-04-20T09:34:23.395615Z","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-04-20T09:34:23.395962Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"837e89131cc6bd81","initial-advertise-peer-urls":["https://199.19.213.171:2380"],"listen-peer-urls":["https://199.19.213.171:2380"],"advertise-client-urls":["https://199.19.213.171:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.171:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-20T09:34:23.396018Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-20T09:34:23.396134Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.171:2380"} {"level":"info","ts":"2026-04-20T09:34:23.396157Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.171:2380"} {"level":"info","ts":"2026-04-20T09:34:23.877898Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 is starting a new election at term 1"} {"level":"info","ts":"2026-04-20T09:34:23.877972Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 became pre-candidate at term 1"} {"level":"info","ts":"2026-04-20T09:34:23.878011Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 received MsgPreVoteResp from 837e89131cc6bd81 at term 1"} {"level":"info","ts":"2026-04-20T09:34:23.878034Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 became candidate at term 2"} {"level":"info","ts":"2026-04-20T09:34:23.878045Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 received MsgVoteResp from 837e89131cc6bd81 at term 2"} {"level":"info","ts":"2026-04-20T09:34:23.878062Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"837e89131cc6bd81 became leader at term 2"} {"level":"info","ts":"2026-04-20T09:34:23.878084Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 837e89131cc6bd81 elected leader 837e89131cc6bd81 at term 2"} {"level":"info","ts":"2026-04-20T09:34:23.878988Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-20T09:34:23.879977Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-20T09:34:23.880002Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-20T09:34:23.880219Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"8af92e75ab8f3e69","local-member-id":"837e89131cc6bd81","cluster-version":"3.5"} {"level":"info","ts":"2026-04-20T09:34:23.880357Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-20T09:34:23.880402Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-20T09:34:23.880592Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-20T09:34:23.880678Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-20T09:34:23.883848Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-20T09:34:23.883879Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.171:2379"} {"level":"info","ts":"2026-04-20T09:34:23.885578Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"837e89131cc6bd81","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.171:2379]}","request-path":"/0/members/837e89131cc6bd81/attributes","cluster-id":"8af92e75ab8f3e69","publish-timeout":"7s"} {"level":"warn","ts":"2026-04-20T09:34:36.044782Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.980942ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-20T09:34:36.045119Z","caller":"traceutil/trace.go:171","msg":"trace[1887557247] transaction","detail":"{read_only:false; response_revision:362; number_of_response:1; }","duration":"187.877446ms","start":"2026-04-20T09:34:35.857195Z","end":"2026-04-20T09:34:36.045073Z","steps":["trace[1887557247] 'process raft request' (duration: 29.036689ms)","trace[1887557247] 'compare' (duration: 157.878355ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:34:58.983702Z","caller":"traceutil/trace.go:171","msg":"trace[1697555653] transaction","detail":"{read_only:false; response_revision:578; number_of_response:1; }","duration":"112.256261ms","start":"2026-04-20T09:34:58.871386Z","end":"2026-04-20T09:34:58.983643Z","steps":["trace[1697555653] 'process raft request' (duration: 111.700872ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:34:59.543164Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.393681ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-04-20T09:34:59.543489Z","caller":"traceutil/trace.go:171","msg":"trace[77006977] transaction","detail":"{read_only:false; response_revision:580; number_of_response:1; }","duration":"263.46818ms","start":"2026-04-20T09:34:59.279982Z","end":"2026-04-20T09:34:59.54345Z","steps":["trace[77006977] 'process raft request' (duration: 263.31211ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:34:59.543534Z","caller":"traceutil/trace.go:171","msg":"trace[1472346574] linearizableReadLoop","detail":"{readStateIndex:604; appliedIndex:602; }","duration":"186.575178ms","start":"2026-04-20T09:34:59.356916Z","end":"2026-04-20T09:34:59.543491Z","steps":["trace[1472346574] 'read index received' (duration: 5.523487ms)","trace[1472346574] 'applied index is now lower than readState.Index' (duration: 181.049321ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T09:34:59.544102Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.822827ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-04-20T09:34:59.543992Z","caller":"traceutil/trace.go:171","msg":"trace[1247772498] transaction","detail":"{read_only:false; response_revision:579; number_of_response:1; }","duration":"496.850643ms","start":"2026-04-20T09:34:59.046974Z","end":"2026-04-20T09:34:59.543825Z","steps":["trace[1247772498] 'process raft request' (duration: 315.451173ms)","trace[1247772498] 'compare' (duration: 179.246101ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T09:34:59.544283Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:34:59.046954Z","time spent":"497.263353ms","remote":"127.0.0.1:36304","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1627,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-20T09:34:59.544601Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.16598ms","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-04-20T09:34:59.544689Z","caller":"traceutil/trace.go:171","msg":"trace[1347900310] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:580; }","duration":"142.31988ms","start":"2026-04-20T09:34:59.402334Z","end":"2026-04-20T09:34:59.544654Z","steps":["trace[1347900310] 'agreement among raft nodes before linearized reading' (duration: 141.90273ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:34:59.5471Z","caller":"traceutil/trace.go:171","msg":"trace[1080898596] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:580; }","duration":"190.256716ms","start":"2026-04-20T09:34:59.356786Z","end":"2026-04-20T09:34:59.547043Z","steps":["trace[1080898596] 'agreement among raft nodes before linearized reading' (duration: 186.773168ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:35:02.144355Z","caller":"traceutil/trace.go:171","msg":"trace[666367637] transaction","detail":"{read_only:false; response_revision:635; number_of_response:1; }","duration":"125.815366ms","start":"2026-04-20T09:35:02.018518Z","end":"2026-04-20T09:35:02.144333Z","steps":["trace[666367637] 'process raft request' (duration: 125.685396ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:35:13.800457Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.08129ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"warn","ts":"2026-04-20T09:35:13.800491Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.412828ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T09:35:13.800636Z","caller":"traceutil/trace.go:171","msg":"trace[136283431] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:740; }","duration":"167.594201ms","start":"2026-04-20T09:35:13.633011Z","end":"2026-04-20T09:35:13.800605Z","steps":["trace[136283431] 'range keys from in-memory index tree' (duration: 167.296167ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:35:13.800527Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"197.37596ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-04-20T09:35:13.800718Z","caller":"traceutil/trace.go:171","msg":"trace[755139229] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:740; }","duration":"197.614132ms","start":"2026-04-20T09:35:13.603093Z","end":"2026-04-20T09:35:13.800707Z","steps":["trace[755139229] 'range keys from in-memory index tree' (duration: 197.188668ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:35:13.800555Z","caller":"traceutil/trace.go:171","msg":"trace[383018605] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:740; }","duration":"189.229292ms","start":"2026-04-20T09:35:13.611308Z","end":"2026-04-20T09:35:13.800537Z","steps":["trace[383018605] 'range keys from in-memory index tree' (duration: 188.888428ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:35:40.375413Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.685109ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T09:35:40.3756Z","caller":"traceutil/trace.go:171","msg":"trace[1199907925] range","detail":"{range_begin:/registry/statefulsets/; range_end:/registry/statefulsets0; response_count:0; response_revision:1133; }","duration":"166.906135ms","start":"2026-04-20T09:35:40.208674Z","end":"2026-04-20T09:35:40.37558Z","steps":["trace[1199907925] 'count revisions from in-memory index tree' (duration: 166.563615ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:36:24.157298Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.175953ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-cb69773e-e049-4c69-9f0a-9746c9ba5821\" ","response":"range_response_count:1 size:3627"} {"level":"info","ts":"2026-04-20T09:36:24.157481Z","caller":"traceutil/trace.go:171","msg":"trace[1017685092] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-cb69773e-e049-4c69-9f0a-9746c9ba5821; range_end:; response_count:1; response_revision:1787; }","duration":"202.398793ms","start":"2026-04-20T09:36:23.955063Z","end":"2026-04-20T09:36:24.157462Z","steps":["trace[1017685092] 'range keys from in-memory index tree' (duration: 201.835077ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:36:24.352585Z","caller":"traceutil/trace.go:171","msg":"trace[1198169885] transaction","detail":"{read_only:false; response_revision:1788; number_of_response:1; }","duration":"112.123485ms","start":"2026-04-20T09:36:24.240433Z","end":"2026-04-20T09:36:24.352556Z","steps":["trace[1198169885] 'process raft request' (duration: 111.971838ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:36:24.379308Z","caller":"traceutil/trace.go:171","msg":"trace[903810172] linearizableReadLoop","detail":"{readStateIndex:1859; appliedIndex:1857; }","duration":"104.208237ms","start":"2026-04-20T09:36:24.275028Z","end":"2026-04-20T09:36:24.379236Z","steps":["trace[903810172] 'read index received' (duration: 77.356524ms)","trace[903810172] 'applied index is now lower than readState.Index' (duration: 26.850753ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:36:24.379356Z","caller":"traceutil/trace.go:171","msg":"trace[1358109511] transaction","detail":"{read_only:false; response_revision:1789; number_of_response:1; }","duration":"137.72215ms","start":"2026-04-20T09:36:24.241605Z","end":"2026-04-20T09:36:24.379327Z","steps":["trace[1358109511] 'process raft request' (duration: 130.055345ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:36:24.379513Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.465859ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-cb69773e-e049-4c69-9f0a-9746c9ba5821\" ","response":"range_response_count:1 size:3627"} {"level":"info","ts":"2026-04-20T09:36:24.379556Z","caller":"traceutil/trace.go:171","msg":"trace[1680915192] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-cb69773e-e049-4c69-9f0a-9746c9ba5821; range_end:; response_count:1; response_revision:1789; }","duration":"104.569184ms","start":"2026-04-20T09:36:24.274975Z","end":"2026-04-20T09:36:24.379544Z","steps":["trace[1680915192] 'agreement among raft nodes before linearized reading' (duration: 104.400246ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:36:24.617818Z","caller":"traceutil/trace.go:171","msg":"trace[1560629198] transaction","detail":"{read_only:false; response_revision:1790; number_of_response:1; }","duration":"231.303574ms","start":"2026-04-20T09:36:24.386479Z","end":"2026-04-20T09:36:24.617783Z","steps":["trace[1560629198] 'process raft request' (duration: 212.796887ms)","trace[1560629198] 'compare' (duration: 18.282607ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:36:58.867724Z","caller":"traceutil/trace.go:171","msg":"trace[1179250152] transaction","detail":"{read_only:false; response_revision:2024; number_of_response:1; }","duration":"168.689588ms","start":"2026-04-20T09:36:58.69899Z","end":"2026-04-20T09:36:58.867679Z","steps":["trace[1179250152] 'process raft request' (duration: 120.694604ms)","trace[1179250152] 'compare' (duration: 47.749441ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:36:59.451393Z","caller":"traceutil/trace.go:171","msg":"trace[634265789] transaction","detail":"{read_only:false; response_revision:2029; number_of_response:1; }","duration":"183.667982ms","start":"2026-04-20T09:36:59.267707Z","end":"2026-04-20T09:36:59.451375Z","steps":["trace[634265789] 'process raft request' (duration: 174.592938ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:36:59.762162Z","caller":"traceutil/trace.go:171","msg":"trace[1718231560] linearizableReadLoop","detail":"{readStateIndex:2109; appliedIndex:2108; }","duration":"159.290773ms","start":"2026-04-20T09:36:59.602851Z","end":"2026-04-20T09:36:59.762142Z","steps":["trace[1718231560] 'read index received' (duration: 127.922069ms)","trace[1718231560] 'applied index is now lower than readState.Index' (duration: 31.367364ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:36:59.762372Z","caller":"traceutil/trace.go:171","msg":"trace[524993795] transaction","detail":"{read_only:false; response_revision:2031; number_of_response:1; }","duration":"211.184811ms","start":"2026-04-20T09:36:59.551178Z","end":"2026-04-20T09:36:59.762363Z","steps":["trace[524993795] 'process raft request' (duration: 179.571124ms)","trace[524993795] 'compare' (duration: 30.980504ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T09:36:59.762594Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"159.742467ms","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-04-20T09:36:59.762634Z","caller":"traceutil/trace.go:171","msg":"trace[2007898980] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2031; }","duration":"159.828552ms","start":"2026-04-20T09:36:59.602784Z","end":"2026-04-20T09:36:59.762612Z","steps":["trace[2007898980] 'agreement among raft nodes before linearized reading' (duration: 159.721835ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:36:59.762759Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.564804ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:555"} {"level":"info","ts":"2026-04-20T09:36:59.762782Z","caller":"traceutil/trace.go:171","msg":"trace[258944348] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2031; }","duration":"158.601166ms","start":"2026-04-20T09:36:59.604174Z","end":"2026-04-20T09:36:59.762775Z","steps":["trace[258944348] 'agreement among raft nodes before linearized reading' (duration: 158.544253ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:38:03.177639Z","caller":"traceutil/trace.go:171","msg":"trace[730066570] transaction","detail":"{read_only:false; response_revision:2474; number_of_response:1; }","duration":"171.067572ms","start":"2026-04-20T09:38:03.006552Z","end":"2026-04-20T09:38:03.17762Z","steps":["trace[730066570] 'process raft request' (duration: 170.919224ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:38:37.147038Z","caller":"traceutil/trace.go:171","msg":"trace[317786675] linearizableReadLoop","detail":"{readStateIndex:2765; appliedIndex:2764; }","duration":"232.083264ms","start":"2026-04-20T09:38:36.914932Z","end":"2026-04-20T09:38:37.147015Z","steps":["trace[317786675] 'read index received' (duration: 231.956316ms)","trace[317786675] 'applied index is now lower than readState.Index' (duration: 125.677µs)"],"step_count":2} {"level":"warn","ts":"2026-04-20T09:38:37.147179Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.244943ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cert-manager.io/certificaterequests/\" range_end:\"/registry/cert-manager.io/certificaterequests0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-20T09:38:37.147221Z","caller":"traceutil/trace.go:171","msg":"trace[1382453175] range","detail":"{range_begin:/registry/cert-manager.io/certificaterequests/; range_end:/registry/cert-manager.io/certificaterequests0; response_count:0; response_revision:2664; }","duration":"232.34521ms","start":"2026-04-20T09:38:36.914862Z","end":"2026-04-20T09:38:37.147207Z","steps":["trace[1382453175] 'agreement among raft nodes before linearized reading' (duration: 232.253335ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:38:37.295332Z","caller":"traceutil/trace.go:171","msg":"trace[422328052] transaction","detail":"{read_only:false; response_revision:2665; number_of_response:1; }","duration":"146.965892ms","start":"2026-04-20T09:38:37.148344Z","end":"2026-04-20T09:38:37.29531Z","steps":["trace[422328052] 'process raft request' (duration: 146.578658ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:29.676733Z","caller":"traceutil/trace.go:171","msg":"trace[378210532] transaction","detail":"{read_only:false; response_revision:4600; number_of_response:1; }","duration":"111.662812ms","start":"2026-04-20T09:42:29.565043Z","end":"2026-04-20T09:42:29.676706Z","steps":["trace[378210532] 'process raft request' (duration: 110.940873ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:29.879646Z","caller":"traceutil/trace.go:171","msg":"trace[948605223] linearizableReadLoop","detail":"{readStateIndex:4777; appliedIndex:4776; }","duration":"203.483426ms","start":"2026-04-20T09:42:29.676136Z","end":"2026-04-20T09:42:29.879619Z","steps":["trace[948605223] 'read index received' (duration: 187.304192ms)","trace[948605223] 'applied index is now lower than readState.Index' (duration: 16.176834ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:42:29.8797Z","caller":"traceutil/trace.go:171","msg":"trace[469909900] transaction","detail":"{read_only:false; response_revision:4601; number_of_response:1; }","duration":"249.116863ms","start":"2026-04-20T09:42:29.63055Z","end":"2026-04-20T09:42:29.879667Z","steps":["trace[469909900] 'process raft request' (duration: 232.96061ms)","trace[469909900] 'compare' (duration: 15.900623ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T09:42:29.879839Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.452677ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T09:42:29.879881Z","caller":"traceutil/trace.go:171","msg":"trace[830366118] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4601; }","duration":"235.538411ms","start":"2026-04-20T09:42:29.644333Z","end":"2026-04-20T09:42:29.879871Z","steps":["trace[830366118] 'agreement among raft nodes before linearized reading' (duration: 235.438167ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:29.880145Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.995446ms","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-04-20T09:42:29.880188Z","caller":"traceutil/trace.go:171","msg":"trace[257510764] range","detail":"{range_begin:/registry/rabbitmq.com/vhosts/; range_end:/registry/rabbitmq.com/vhosts0; response_count:0; response_revision:4601; }","duration":"110.067488ms","start":"2026-04-20T09:42:29.770109Z","end":"2026-04-20T09:42:29.880176Z","steps":["trace[257510764] 'agreement among raft nodes before linearized reading' (duration: 110.004026ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:29.880226Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.525259ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12213"} {"level":"info","ts":"2026-04-20T09:42:29.880288Z","caller":"traceutil/trace.go:171","msg":"trace[437278762] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:4601; }","duration":"200.640844ms","start":"2026-04-20T09:42:29.67963Z","end":"2026-04-20T09:42:29.880271Z","steps":["trace[437278762] 'agreement among raft nodes before linearized reading' (duration: 200.440676ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:29.880292Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"257.962029ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:556"} {"level":"info","ts":"2026-04-20T09:42:29.880346Z","caller":"traceutil/trace.go:171","msg":"trace[1016088965] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:4601; }","duration":"258.048342ms","start":"2026-04-20T09:42:29.62228Z","end":"2026-04-20T09:42:29.880328Z","steps":["trace[1016088965] 'agreement among raft nodes before linearized reading' (duration: 257.871145ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.238377Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.463391ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-20T09:42:30.238498Z","caller":"traceutil/trace.go:171","msg":"trace[192871337] linearizableReadLoop","detail":"{readStateIndex:4783; appliedIndex:4782; }","duration":"162.727337ms","start":"2026-04-20T09:42:30.075753Z","end":"2026-04-20T09:42:30.23848Z","steps":["trace[192871337] 'read index received' (duration: 19.002626ms)","trace[192871337] 'applied index is now lower than readState.Index' (duration: 143.723321ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T09:42:30.238788Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.03024ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/monitoring/alertmanager-kube-prometheus-stack-alertmanager-db-alertmanager-kube-prometheus-stack-alertmanager-0\" ","response":"range_response_count:1 size:1935"} {"level":"info","ts":"2026-04-20T09:42:30.23878Z","caller":"traceutil/trace.go:171","msg":"trace[814847546] transaction","detail":"{read_only:false; response_revision:4607; number_of_response:1; }","duration":"193.773396ms","start":"2026-04-20T09:42:30.044968Z","end":"2026-04-20T09:42:30.238741Z","steps":["trace[814847546] 'process raft request' (duration: 49.853497ms)","trace[814847546] 'compare' (duration: 143.232092ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:42:30.238841Z","caller":"traceutil/trace.go:171","msg":"trace[369165869] range","detail":"{range_begin:/registry/persistentvolumeclaims/monitoring/alertmanager-kube-prometheus-stack-alertmanager-db-alertmanager-kube-prometheus-stack-alertmanager-0; range_end:; response_count:1; response_revision:4607; }","duration":"163.130584ms","start":"2026-04-20T09:42:30.075696Z","end":"2026-04-20T09:42:30.238827Z","steps":["trace[369165869] 'agreement among raft nodes before linearized reading' (duration: 162.830442ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.743492Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":13655368899669178884,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-04-20T09:42:30.956605Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"383.265664ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T09:42:30.956734Z","caller":"traceutil/trace.go:171","msg":"trace[1387678655] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:4607; }","duration":"383.40948ms","start":"2026-04-20T09:42:30.573305Z","end":"2026-04-20T09:42:30.956715Z","steps":["trace[1387678655] 'range keys from in-memory index tree' (duration: 383.247883ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.957214Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.83982ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-20T09:42:30.957986Z","caller":"traceutil/trace.go:171","msg":"trace[1771196717] transaction","detail":"{read_only:false; response_revision:4608; number_of_response:1; }","duration":"815.711939ms","start":"2026-04-20T09:42:30.142234Z","end":"2026-04-20T09:42:30.957946Z","steps":["trace[1771196717] 'process raft request' (duration: 608.076019ms)","trace[1771196717] 'compare' (duration: 206.416373ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:42:30.958354Z","caller":"traceutil/trace.go:171","msg":"trace[535212970] transaction","detail":"{read_only:false; response_revision:4610; number_of_response:1; }","duration":"713.499677ms","start":"2026-04-20T09:42:30.244835Z","end":"2026-04-20T09:42:30.958335Z","steps":["trace[535212970] 'process raft request' (duration: 713.405064ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:30.958383Z","caller":"traceutil/trace.go:171","msg":"trace[1181102603] transaction","detail":"{read_only:false; response_revision:4611; number_of_response:1; }","duration":"713.415095ms","start":"2026-04-20T09:42:30.244953Z","end":"2026-04-20T09:42:30.958368Z","steps":["trace[1181102603] 'process raft request' (duration: 713.324911ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:30.958374Z","caller":"traceutil/trace.go:171","msg":"trace[1252858509] transaction","detail":"{read_only:false; response_revision:4609; number_of_response:1; }","duration":"713.55138ms","start":"2026-04-20T09:42:30.244775Z","end":"2026-04-20T09:42:30.958326Z","steps":["trace[1252858509] 'process raft request' (duration: 713.173835ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.958434Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.24483Z","time spent":"713.56187ms","remote":"127.0.0.1:35960","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1283,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-20T09:42:30.958442Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.244926Z","time spent":"713.483677ms","remote":"127.0.0.1:36062","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1869,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-20T09:42:30.958523Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.244763Z","time spent":"713.676604ms","remote":"127.0.0.1:35960","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":906,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-20T09:42:30.958687Z","caller":"traceutil/trace.go:171","msg":"trace[664561363] transaction","detail":"{read_only:false; response_revision:4613; number_of_response:1; }","duration":"409.120179ms","start":"2026-04-20T09:42:30.549549Z","end":"2026-04-20T09:42:30.958669Z","steps":["trace[664561363] 'process raft request' (duration: 408.805457ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:30.958737Z","caller":"traceutil/trace.go:171","msg":"trace[2111399225] transaction","detail":"{read_only:false; response_revision:4614; number_of_response:1; }","duration":"185.590644ms","start":"2026-04-20T09:42:30.773135Z","end":"2026-04-20T09:42:30.958726Z","steps":["trace[2111399225] 'process raft request' (duration: 185.329204ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:30.958744Z","caller":"traceutil/trace.go:171","msg":"trace[1495720446] transaction","detail":"{read_only:false; response_revision:4612; number_of_response:1; }","duration":"712.841851ms","start":"2026-04-20T09:42:30.245892Z","end":"2026-04-20T09:42:30.958733Z","steps":["trace[1495720446] 'process raft request' (duration: 712.430425ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.958145Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.14221Z","time spent":"815.849755ms","remote":"127.0.0.1:43112","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2725,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-20T09:42:30.958795Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.549525Z","time spent":"409.206323ms","remote":"127.0.0.1:36056","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-20T09:42:30.958802Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.245875Z","time spent":"712.895243ms","remote":"127.0.0.1:36062","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1455,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-20T09:42:30.958822Z","caller":"traceutil/trace.go:171","msg":"trace[380602955] linearizableReadLoop","detail":"{readStateIndex:4789; appliedIndex:4783; }","duration":"716.025866ms","start":"2026-04-20T09:42:30.242786Z","end":"2026-04-20T09:42:30.958812Z","steps":["trace[380602955] 'read index received' (duration: 507.583224ms)","trace[380602955] 'applied index is now lower than readState.Index' (duration: 208.441302ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T09:42:30.958965Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"716.175171ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/pvc-186ca6e7-fe57-4194-a650-2314fdd7410a\" ","response":"range_response_count:1 size:1450"} {"level":"info","ts":"2026-04-20T09:42:30.958995Z","caller":"traceutil/trace.go:171","msg":"trace[642768025] range","detail":"{range_begin:/registry/persistentvolumes/pvc-186ca6e7-fe57-4194-a650-2314fdd7410a; range_end:; response_count:1; response_revision:4615; }","duration":"716.245885ms","start":"2026-04-20T09:42:30.242739Z","end":"2026-04-20T09:42:30.958985Z","steps":["trace[642768025] 'agreement among raft nodes before linearized reading' (duration: 716.13253ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.959022Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.242717Z","time spent":"716.297637ms","remote":"127.0.0.1:35944","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":1,"response size":1474,"request content":"key:\"/registry/persistentvolumes/pvc-186ca6e7-fe57-4194-a650-2314fdd7410a\" "} {"level":"warn","ts":"2026-04-20T09:42:30.959046Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.77623ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/horizontalpodautoscalers/\" range_end:\"/registry/horizontalpodautoscalers0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T09:42:30.959074Z","caller":"traceutil/trace.go:171","msg":"trace[173737283] range","detail":"{range_begin:/registry/horizontalpodautoscalers/; range_end:/registry/horizontalpodautoscalers0; response_count:0; response_revision:4615; }","duration":"228.825432ms","start":"2026-04-20T09:42:30.73024Z","end":"2026-04-20T09:42:30.959066Z","steps":["trace[173737283] 'agreement among raft nodes before linearized reading' (duration: 228.77644ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.959148Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.343139ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"} {"level":"info","ts":"2026-04-20T09:42:30.95918Z","caller":"traceutil/trace.go:171","msg":"trace[1900394499] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:4615; }","duration":"153.400391ms","start":"2026-04-20T09:42:30.80577Z","end":"2026-04-20T09:42:30.95917Z","steps":["trace[1900394499] 'agreement among raft nodes before linearized reading' (duration: 153.295097ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.959257Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"321.968078ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/superstreams/\" range_end:\"/registry/rabbitmq.com/superstreams0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-20T09:42:30.95927Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.698856ms","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-04-20T09:42:30.959287Z","caller":"traceutil/trace.go:171","msg":"trace[1724508730] range","detail":"{range_begin:/registry/rabbitmq.com/superstreams/; range_end:/registry/rabbitmq.com/superstreams0; response_count:0; response_revision:4615; }","duration":"322.03995ms","start":"2026-04-20T09:42:30.637239Z","end":"2026-04-20T09:42:30.959279Z","steps":["trace[1724508730] 'agreement among raft nodes before linearized reading' (duration: 321.989688ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:30.959296Z","caller":"traceutil/trace.go:171","msg":"trace[1837896032] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4615; }","duration":"161.774919ms","start":"2026-04-20T09:42:30.797514Z","end":"2026-04-20T09:42:30.959289Z","steps":["trace[1837896032] 'agreement among raft nodes before linearized reading' (duration: 161.674395ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.959318Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.637218Z","time spent":"322.091983ms","remote":"127.0.0.1:43124","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":0,"response size":29,"request content":"key:\"/registry/rabbitmq.com/superstreams/\" range_end:\"/registry/rabbitmq.com/superstreams0\" count_only:true "} {"level":"warn","ts":"2026-04-20T09:42:30.959311Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"288.700193ms","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-04-20T09:42:30.959353Z","caller":"traceutil/trace.go:171","msg":"trace[202375895] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4615; }","duration":"288.767955ms","start":"2026-04-20T09:42:30.670574Z","end":"2026-04-20T09:42:30.959341Z","steps":["trace[202375895] 'agreement among raft nodes before linearized reading' (duration: 288.61683ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.95949Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"240.546323ms","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-04-20T09:42:30.959535Z","caller":"traceutil/trace.go:171","msg":"trace[669904323] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4615; }","duration":"240.612784ms","start":"2026-04-20T09:42:30.718909Z","end":"2026-04-20T09:42:30.959522Z","steps":["trace[669904323] 'agreement among raft nodes before linearized reading' (duration: 240.453457ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.959076Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"716.029157ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/monitoring/prometheus-kube-prometheus-stack-prometheus-0\" ","response":"range_response_count:1 size:16233"} {"level":"info","ts":"2026-04-20T09:42:30.962795Z","caller":"traceutil/trace.go:171","msg":"trace[196532689] range","detail":"{range_begin:/registry/pods/monitoring/prometheus-kube-prometheus-stack-prometheus-0; range_end:; response_count:1; response_revision:4615; }","duration":"719.779074ms","start":"2026-04-20T09:42:30.242999Z","end":"2026-04-20T09:42:30.962778Z","steps":["trace[196532689] 'agreement among raft nodes before linearized reading' (duration: 715.957723ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:30.962874Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-20T09:42:30.242982Z","time spent":"719.863877ms","remote":"127.0.0.1:35980","response type":"/etcdserverpb.KV/Range","request count":0,"request size":73,"response count":1,"response size":16257,"request content":"key:\"/registry/pods/monitoring/prometheus-kube-prometheus-stack-prometheus-0\" "} {"level":"info","ts":"2026-04-20T09:42:31.10424Z","caller":"traceutil/trace.go:171","msg":"trace[127102656] transaction","detail":"{read_only:false; response_revision:4624; number_of_response:1; }","duration":"101.629229ms","start":"2026-04-20T09:42:31.00259Z","end":"2026-04-20T09:42:31.104219Z","steps":["trace[127102656] 'process raft request' (duration: 101.588288ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:31.104705Z","caller":"traceutil/trace.go:171","msg":"trace[1949445904] transaction","detail":"{read_only:false; response_revision:4621; number_of_response:1; }","duration":"127.721234ms","start":"2026-04-20T09:42:30.976975Z","end":"2026-04-20T09:42:31.104696Z","steps":["trace[1949445904] 'process raft request' (duration: 119.929798ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:31.1048Z","caller":"traceutil/trace.go:171","msg":"trace[847585845] linearizableReadLoop","detail":"{readStateIndex:4797; appliedIndex:4796; }","duration":"107.930407ms","start":"2026-04-20T09:42:30.996859Z","end":"2026-04-20T09:42:31.104789Z","steps":["trace[847585845] 'read index received' (duration: 100.016316ms)","trace[847585845] 'applied index is now lower than readState.Index' (duration: 7.912871ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:42:31.104945Z","caller":"traceutil/trace.go:171","msg":"trace[192557830] transaction","detail":"{read_only:false; response_revision:4622; number_of_response:1; }","duration":"104.041604ms","start":"2026-04-20T09:42:31.000897Z","end":"2026-04-20T09:42:31.104938Z","steps":["trace[192557830] 'process raft request' (duration: 103.199992ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:42:31.105091Z","caller":"traceutil/trace.go:171","msg":"trace[1961991240] transaction","detail":"{read_only:false; response_revision:4623; number_of_response:1; }","duration":"102.680502ms","start":"2026-04-20T09:42:31.002404Z","end":"2026-04-20T09:42:31.105084Z","steps":["trace[1961991240] 'process raft request' (duration: 101.741114ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:31.105232Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.397158ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-20T09:42:31.105318Z","caller":"traceutil/trace.go:171","msg":"trace[1086876477] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4624; }","duration":"119.524553ms","start":"2026-04-20T09:42:30.985771Z","end":"2026-04-20T09:42:31.105296Z","steps":["trace[1086876477] 'agreement among raft nodes before linearized reading' (duration: 119.346436ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:42:31.105951Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.068588ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ranges/serviceips\" ","response":"range_response_count:1 size:129369"} {"level":"info","ts":"2026-04-20T09:42:31.105984Z","caller":"traceutil/trace.go:171","msg":"trace[1809962448] range","detail":"{range_begin:/registry/ranges/serviceips; range_end:; response_count:1; response_revision:4624; }","duration":"101.152731ms","start":"2026-04-20T09:42:31.004822Z","end":"2026-04-20T09:42:31.105975Z","steps":["trace[1809962448] 'agreement among raft nodes before linearized reading' (duration: 100.35463ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:43:31.528329Z","caller":"traceutil/trace.go:171","msg":"trace[1387113342] linearizableReadLoop","detail":"{readStateIndex:5451; appliedIndex:5450; }","duration":"108.239053ms","start":"2026-04-20T09:43:31.420069Z","end":"2026-04-20T09:43:31.528308Z","steps":["trace[1387113342] 'read index received' (duration: 95.628664ms)","trace[1387113342] 'applied index is now lower than readState.Index' (duration: 12.609709ms)"],"step_count":2} {"level":"info","ts":"2026-04-20T09:43:31.528667Z","caller":"traceutil/trace.go:171","msg":"trace[1057660954] transaction","detail":"{read_only:false; response_revision:5258; number_of_response:1; }","duration":"110.004952ms","start":"2026-04-20T09:43:31.418648Z","end":"2026-04-20T09:43:31.528653Z","steps":["trace[1057660954] 'process raft request' (duration: 96.919402ms)","trace[1057660954] 'compare' (duration: 12.64296ms)"],"step_count":2} {"level":"warn","ts":"2026-04-20T09:43:31.528905Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.823499ms","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-04-20T09:43:31.528948Z","caller":"traceutil/trace.go:171","msg":"trace[365205464] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:5258; }","duration":"108.901062ms","start":"2026-04-20T09:43:31.420034Z","end":"2026-04-20T09:43:31.528935Z","steps":["trace[365205464] 'agreement among raft nodes before linearized reading' (duration: 108.767937ms)"],"step_count":1} {"level":"warn","ts":"2026-04-20T09:43:31.53737Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.433529ms","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-04-20T09:43:31.537441Z","caller":"traceutil/trace.go:171","msg":"trace[1085089744] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:5259; }","duration":"103.551294ms","start":"2026-04-20T09:43:31.433871Z","end":"2026-04-20T09:43:31.537423Z","steps":["trace[1085089744] 'agreement among raft nodes before linearized reading' (duration: 103.312203ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:44:23.912598Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2912} {"level":"info","ts":"2026-04-20T09:44:24.001604Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2912,"took":"87.626894ms","hash":2840547408,"current-db-size-bytes":53215232,"current-db-size":"53 MB","current-db-size-in-use-bytes":29339648,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-04-20T09:44:24.001669Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2840547408,"revision":2912,"compact-revision":-1} {"level":"info","ts":"2026-04-20T09:46:12.202714Z","caller":"traceutil/trace.go:171","msg":"trace[488332241] transaction","detail":"{read_only:false; response_revision:6377; number_of_response:1; }","duration":"133.794469ms","start":"2026-04-20T09:46:12.068899Z","end":"2026-04-20T09:46:12.202694Z","steps":["trace[488332241] 'process raft request' (duration: 133.760157ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:46:12.202884Z","caller":"traceutil/trace.go:171","msg":"trace[936302304] transaction","detail":"{read_only:false; response_revision:6376; number_of_response:1; }","duration":"172.557211ms","start":"2026-04-20T09:46:12.030319Z","end":"2026-04-20T09:46:12.202876Z","steps":["trace[936302304] 'process raft request' (duration: 172.192883ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:46:30.84848Z","caller":"traceutil/trace.go:171","msg":"trace[1909234167] transaction","detail":"{read_only:false; response_revision:6525; number_of_response:1; }","duration":"113.647069ms","start":"2026-04-20T09:46:30.734787Z","end":"2026-04-20T09:46:30.848434Z","steps":["trace[1909234167] 'process raft request' (duration: 113.394156ms)"],"step_count":1} {"level":"info","ts":"2026-04-20T09:49:23.917958Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5636} {"level":"info","ts":"2026-04-20T09:49:23.989285Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5636,"took":"70.112998ms","hash":591947563,"current-db-size-bytes":53215232,"current-db-size":"53 MB","current-db-size-in-use-bytes":18292736,"current-db-size-in-use":"18 MB"} {"level":"info","ts":"2026-04-20T09:49:23.989337Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":591947563,"revision":5636,"compact-revision":2912}