{"level":"warn","ts":"2026-04-27T21:02:16.992992Z","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-27T21:02:16.993104Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.210:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.210:2380","--initial-cluster=instance=https://199.204.45.210:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.210:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.210: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-27T21:02:16.993177Z","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-27T21:02:16.993188Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.210:2380"]} {"level":"info","ts":"2026-04-27T21:02:16.993212Z","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-27T21:02:16.994282Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.210:2379"]} {"level":"info","ts":"2026-04-27T21:02:16.994393Z","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":16,"max-cpu-available":16,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.210:2380"],"listen-peer-urls":["https://199.204.45.210:2380"],"advertise-client-urls":["https://199.204.45.210:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.210:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.210: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-27T21:02:16.997914Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.297171ms"} {"level":"info","ts":"2026-04-27T21:02:17.006597Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"1cac722af8b2b8a6","cluster-id":"ba0a336ca61ee41d"} {"level":"info","ts":"2026-04-27T21:02:17.006709Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 switched to configuration voters=()"} {"level":"info","ts":"2026-04-27T21:02:17.00673Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 became follower at term 0"} {"level":"info","ts":"2026-04-27T21:02:17.006774Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 1cac722af8b2b8a6 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-27T21:02:17.006784Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 became follower at term 1"} {"level":"info","ts":"2026-04-27T21:02:17.006817Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 switched to configuration voters=(2066151857942870182)"} {"level":"warn","ts":"2026-04-27T21:02:17.01369Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-27T21:02:17.016714Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-27T21:02:17.018661Z","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-27T21:02:17.022855Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"1cac722af8b2b8a6","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-27T21:02:17.023115Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"1cac722af8b2b8a6","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-27T21:02:17.023085Z","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-27T21:02:17.02321Z","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-27T21:02:17.023232Z","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-27T21:02:17.023915Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 switched to configuration voters=(2066151857942870182)"} {"level":"info","ts":"2026-04-27T21:02:17.024061Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"ba0a336ca61ee41d","local-member-id":"1cac722af8b2b8a6","added-peer-id":"1cac722af8b2b8a6","added-peer-peer-urls":["https://199.204.45.210:2380"]} {"level":"info","ts":"2026-04-27T21:02:17.027594Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.210:2380"} {"level":"info","ts":"2026-04-27T21:02:17.027524Z","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-27T21:02:17.027623Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.210:2380"} {"level":"info","ts":"2026-04-27T21:02:17.028004Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"1cac722af8b2b8a6","initial-advertise-peer-urls":["https://199.204.45.210:2380"],"listen-peer-urls":["https://199.204.45.210:2380"],"advertise-client-urls":["https://199.204.45.210:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.210:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-27T21:02:17.028063Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-27T21:02:17.907368Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 is starting a new election at term 1"} {"level":"info","ts":"2026-04-27T21:02:17.907424Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 became pre-candidate at term 1"} {"level":"info","ts":"2026-04-27T21:02:17.907459Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 received MsgPreVoteResp from 1cac722af8b2b8a6 at term 1"} {"level":"info","ts":"2026-04-27T21:02:17.907478Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 became candidate at term 2"} {"level":"info","ts":"2026-04-27T21:02:17.907497Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 received MsgVoteResp from 1cac722af8b2b8a6 at term 2"} {"level":"info","ts":"2026-04-27T21:02:17.907513Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1cac722af8b2b8a6 became leader at term 2"} {"level":"info","ts":"2026-04-27T21:02:17.907528Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 1cac722af8b2b8a6 elected leader 1cac722af8b2b8a6 at term 2"} {"level":"info","ts":"2026-04-27T21:02:17.908464Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-27T21:02:17.909375Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"1cac722af8b2b8a6","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.210:2379]}","request-path":"/0/members/1cac722af8b2b8a6/attributes","cluster-id":"ba0a336ca61ee41d","publish-timeout":"7s"} {"level":"info","ts":"2026-04-27T21:02:17.909561Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-27T21:02:17.909668Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-27T21:02:17.909852Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"ba0a336ca61ee41d","local-member-id":"1cac722af8b2b8a6","cluster-version":"3.5"} {"level":"info","ts":"2026-04-27T21:02:17.909973Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-27T21:02:17.910006Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-27T21:02:17.909941Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-27T21:02:17.910057Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-27T21:02:17.913217Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-27T21:02:17.913436Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.210:2379"} {"level":"info","ts":"2026-04-27T21:02:43.39253Z","caller":"traceutil/trace.go:171","msg":"trace[419065662] transaction","detail":"{read_only:false; response_revision:464; number_of_response:1; }","duration":"109.772842ms","start":"2026-04-27T21:02:43.282728Z","end":"2026-04-27T21:02:43.392501Z","steps":["trace[419065662] 'process raft request' (duration: 109.607719ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:02:53.877244Z","caller":"traceutil/trace.go:171","msg":"trace[146154751] transaction","detail":"{read_only:false; response_revision:616; number_of_response:1; }","duration":"251.544595ms","start":"2026-04-27T21:02:53.625666Z","end":"2026-04-27T21:02:53.87721Z","steps":["trace[146154751] 'process raft request' (duration: 249.866433ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:02:53.884987Z","caller":"traceutil/trace.go:171","msg":"trace[1981753186] transaction","detail":"{read_only:false; response_revision:617; number_of_response:1; }","duration":"181.446908ms","start":"2026-04-27T21:02:53.703515Z","end":"2026-04-27T21:02:53.884962Z","steps":["trace[1981753186] 'process raft request' (duration: 181.320715ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:02:54.23865Z","caller":"traceutil/trace.go:171","msg":"trace[1752758094] linearizableReadLoop","detail":"{readStateIndex:637; appliedIndex:636; }","duration":"287.075923ms","start":"2026-04-27T21:02:53.951549Z","end":"2026-04-27T21:02:54.238625Z","steps":["trace[1752758094] 'read index received' (duration: 286.93237ms)","trace[1752758094] 'applied index is now lower than readState.Index' (duration: 142.533µs)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:02:54.238762Z","caller":"traceutil/trace.go:171","msg":"trace[379706573] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"302.249628ms","start":"2026-04-27T21:02:53.936481Z","end":"2026-04-27T21:02:54.238731Z","steps":["trace[379706573] 'process raft request' (duration: 302.012223ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:02:54.238991Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.4247ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-f9xnm\" ","response":"range_response_count:1 size:16965"} {"level":"warn","ts":"2026-04-27T21:02:54.239281Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:02:53.936435Z","time spent":"302.401351ms","remote":"127.0.0.1:52310","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1627,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-27T21:02:54.239519Z","caller":"traceutil/trace.go:171","msg":"trace[487221037] range","detail":"{range_begin:/registry/pods/kube-system/cilium-f9xnm; range_end:; response_count:1; response_revision:618; }","duration":"287.581652ms","start":"2026-04-27T21:02:53.951491Z","end":"2026-04-27T21:02:54.239073Z","steps":["trace[487221037] 'agreement among raft nodes before linearized reading' (duration: 287.237806ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:02:54.406768Z","caller":"traceutil/trace.go:171","msg":"trace[594947421] linearizableReadLoop","detail":"{readStateIndex:638; appliedIndex:637; }","duration":"129.238158ms","start":"2026-04-27T21:02:54.277505Z","end":"2026-04-27T21:02:54.406743Z","steps":["trace[594947421] 'read index received' (duration: 127.126978ms)","trace[594947421] 'applied index is now lower than readState.Index' (duration: 2.11029ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:02:54.406924Z","caller":"traceutil/trace.go:171","msg":"trace[1296077467] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"154.631825ms","start":"2026-04-27T21:02:54.25225Z","end":"2026-04-27T21:02:54.406882Z","steps":["trace[1296077467] 'process raft request' (duration: 152.449073ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:02:54.407071Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.522973ms","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-04-27T21:02:54.407145Z","caller":"traceutil/trace.go:171","msg":"trace[1034163807] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:619; }","duration":"129.669936ms","start":"2026-04-27T21:02:54.277462Z","end":"2026-04-27T21:02:54.407132Z","steps":["trace[1034163807] 'agreement among raft nodes before linearized reading' (duration: 129.370631ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:03:10.759927Z","caller":"traceutil/trace.go:171","msg":"trace[611153557] transaction","detail":"{read_only:false; response_revision:784; number_of_response:1; }","duration":"268.874881ms","start":"2026-04-27T21:03:10.49103Z","end":"2026-04-27T21:03:10.759905Z","steps":["trace[611153557] 'process raft request' (duration: 268.727788ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:03:36.419045Z","caller":"traceutil/trace.go:171","msg":"trace[674357050] transaction","detail":"{read_only:false; response_revision:1172; number_of_response:1; }","duration":"149.634426ms","start":"2026-04-27T21:03:36.269386Z","end":"2026-04-27T21:03:36.41902Z","steps":["trace[674357050] 'process raft request' (duration: 149.448953ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:04:21.64862Z","caller":"traceutil/trace.go:171","msg":"trace[955512431] transaction","detail":"{read_only:false; response_revision:1834; number_of_response:1; }","duration":"226.410896ms","start":"2026-04-27T21:04:21.42218Z","end":"2026-04-27T21:04:21.648591Z","steps":["trace[955512431] 'process raft request' (duration: 226.110461ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:04:22.049408Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.647694ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/\" range_end:\"/registry/services/specs0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-27T21:04:22.049505Z","caller":"traceutil/trace.go:171","msg":"trace[35883375] range","detail":"{range_begin:/registry/services/specs/; range_end:/registry/services/specs0; response_count:0; response_revision:1841; }","duration":"199.814467ms","start":"2026-04-27T21:04:21.849672Z","end":"2026-04-27T21:04:22.049486Z","steps":["trace[35883375] 'count revisions from in-memory index tree' (duration: 199.519961ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:04:34.268963Z","caller":"traceutil/trace.go:171","msg":"trace[1222036726] transaction","detail":"{read_only:false; response_revision:1946; number_of_response:1; }","duration":"107.140279ms","start":"2026-04-27T21:04:34.1618Z","end":"2026-04-27T21:04:34.26894Z","steps":["trace[1222036726] 'process raft request' (duration: 107.084198ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:04:34.269007Z","caller":"traceutil/trace.go:171","msg":"trace[861217090] transaction","detail":"{read_only:false; response_revision:1945; number_of_response:1; }","duration":"107.169319ms","start":"2026-04-27T21:04:34.161801Z","end":"2026-04-27T21:04:34.268971Z","steps":["trace[861217090] 'process raft request' (duration: 82.533758ms)","trace[861217090] 'compare' (duration: 24.360136ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:05:11.07654Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.201105ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-27T21:05:11.076879Z","caller":"traceutil/trace.go:171","msg":"trace[769031514] linearizableReadLoop","detail":"{readStateIndex:2237; appliedIndex:2235; }","duration":"176.030758ms","start":"2026-04-27T21:05:10.90083Z","end":"2026-04-27T21:05:11.076861Z","steps":["trace[769031514] 'read index received' (duration: 19.001806ms)","trace[769031514] 'applied index is now lower than readState.Index' (duration: 157.027792ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:05:11.077018Z","caller":"traceutil/trace.go:171","msg":"trace[1816052027] transaction","detail":"{read_only:false; response_revision:2158; number_of_response:1; }","duration":"187.760798ms","start":"2026-04-27T21:05:10.889245Z","end":"2026-04-27T21:05:11.077005Z","steps":["trace[1816052027] 'process raft request' (duration: 187.489063ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:05:11.077039Z","caller":"traceutil/trace.go:171","msg":"trace[1494547337] transaction","detail":"{read_only:false; response_revision:2157; number_of_response:1; }","duration":"315.311607ms","start":"2026-04-27T21:05:10.761683Z","end":"2026-04-27T21:05:11.076995Z","steps":["trace[1494547337] 'process raft request' (duration: 158.140683ms)","trace[1494547337] 'compare' (duration: 155.955991ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:05:11.077222Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:05:10.761641Z","time spent":"315.479601ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:05:11.078168Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.338852ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.210\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-04-27T21:05:11.078208Z","caller":"traceutil/trace.go:171","msg":"trace[1955143787] range","detail":"{range_begin:/registry/masterleases/199.204.45.210; range_end:; response_count:1; response_revision:2158; }","duration":"177.407423ms","start":"2026-04-27T21:05:10.900791Z","end":"2026-04-27T21:05:11.078199Z","steps":["trace[1955143787] 'agreement among raft nodes before linearized reading' (duration: 176.260072ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:05:16.83126Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.898448ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-27T21:05:16.8314Z","caller":"traceutil/trace.go:171","msg":"trace[192702258] linearizableReadLoop","detail":"{readStateIndex:2269; appliedIndex:2268; }","duration":"298.42659ms","start":"2026-04-27T21:05:16.532961Z","end":"2026-04-27T21:05:16.831387Z","steps":["trace[192702258] 'read index received' (duration: 93.277517ms)","trace[192702258] 'applied index is now lower than readState.Index' (duration: 205.147813ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:05:16.831459Z","caller":"traceutil/trace.go:171","msg":"trace[388461797] transaction","detail":"{read_only:false; response_revision:2188; number_of_response:1; }","duration":"324.102412ms","start":"2026-04-27T21:05:16.507349Z","end":"2026-04-27T21:05:16.831451Z","steps":["trace[388461797] 'process raft request' (duration: 118.931578ms)","trace[388461797] 'compare' (duration: 204.824267ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:05:16.831501Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:05:16.507313Z","time spent":"324.167813ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:05:16.831701Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.738406ms","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-27T21:05:16.831725Z","caller":"traceutil/trace.go:171","msg":"trace[1395915080] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2188; }","duration":"298.786017ms","start":"2026-04-27T21:05:16.532933Z","end":"2026-04-27T21:05:16.831719Z","steps":["trace[1395915080] 'agreement among raft nodes before linearized reading' (duration: 298.688846ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:05:17.113555Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.481273ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-27T21:05:17.113657Z","caller":"traceutil/trace.go:171","msg":"trace[2137567189] transaction","detail":"{read_only:false; response_revision:2189; number_of_response:1; }","duration":"290.990691ms","start":"2026-04-27T21:05:16.822638Z","end":"2026-04-27T21:05:17.113628Z","steps":["trace[2137567189] 'process raft request' (duration: 143.353235ms)","trace[2137567189] 'compare' (duration: 147.381351ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:05:17.113723Z","caller":"traceutil/trace.go:171","msg":"trace[836250290] linearizableReadLoop","detail":"{readStateIndex:2270; appliedIndex:2269; }","duration":"282.277388ms","start":"2026-04-27T21:05:16.831422Z","end":"2026-04-27T21:05:17.113699Z","steps":["trace[836250290] 'read index received' (duration: 134.586172ms)","trace[836250290] 'applied index is now lower than readState.Index' (duration: 147.688706ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:05:17.11379Z","caller":"traceutil/trace.go:171","msg":"trace[705218298] transaction","detail":"{read_only:false; response_revision:2190; number_of_response:1; }","duration":"278.679071ms","start":"2026-04-27T21:05:16.835102Z","end":"2026-04-27T21:05:17.113781Z","steps":["trace[705218298] 'process raft request' (duration: 278.533198ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:05:17.113879Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"466.812435ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:05:17.113925Z","caller":"traceutil/trace.go:171","msg":"trace[704091392] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:2192; }","duration":"466.903397ms","start":"2026-04-27T21:05:16.647011Z","end":"2026-04-27T21:05:17.113914Z","steps":["trace[704091392] 'agreement among raft nodes before linearized reading' (duration: 466.773695ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:05:17.113962Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:05:16.647Z","time spent":"466.952278ms","remote":"127.0.0.1:53130","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:05:17.114005Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"410.48813ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/rabbitmqclusters/\" range_end:\"/registry/rabbitmq.com/rabbitmqclusters0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:05:17.114124Z","caller":"traceutil/trace.go:171","msg":"trace[1039760755] range","detail":"{range_begin:/registry/rabbitmq.com/rabbitmqclusters/; range_end:/registry/rabbitmq.com/rabbitmqclusters0; response_count:0; response_revision:2192; }","duration":"410.641763ms","start":"2026-04-27T21:05:16.703445Z","end":"2026-04-27T21:05:17.114086Z","steps":["trace[1039760755] 'agreement among raft nodes before linearized reading' (duration: 410.45289ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:05:17.114188Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:05:16.703419Z","time spent":"410.755175ms","remote":"127.0.0.1:59092","response type":"/etcdserverpb.KV/Range","request count":0,"request size":86,"response count":0,"response size":28,"request content":"key:\"/registry/rabbitmq.com/rabbitmqclusters/\" range_end:\"/registry/rabbitmq.com/rabbitmqclusters0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:05:17.114187Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"338.075174ms","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-04-27T21:05:17.114335Z","caller":"traceutil/trace.go:171","msg":"trace[1978868679] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2192; }","duration":"338.360169ms","start":"2026-04-27T21:05:16.775952Z","end":"2026-04-27T21:05:17.114312Z","steps":["trace[1978868679] 'agreement among raft nodes before linearized reading' (duration: 337.88691ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:05:17.114423Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:05:16.775932Z","time spent":"338.473551ms","remote":"127.0.0.1:54440","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":5435,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" "} {"level":"info","ts":"2026-04-27T21:06:25.45222Z","caller":"traceutil/trace.go:171","msg":"trace[150982966] transaction","detail":"{read_only:false; response_revision:2757; number_of_response:1; }","duration":"102.344646ms","start":"2026-04-27T21:06:25.349856Z","end":"2026-04-27T21:06:25.452201Z","steps":["trace[150982966] 'process raft request' (duration: 102.142803ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:06:25.49337Z","caller":"traceutil/trace.go:171","msg":"trace[750196034] transaction","detail":"{read_only:false; response_revision:2758; number_of_response:1; }","duration":"136.800345ms","start":"2026-04-27T21:06:25.356545Z","end":"2026-04-27T21:06:25.493346Z","steps":["trace[750196034] 'process raft request' (duration: 129.207524ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:06:25.493553Z","caller":"traceutil/trace.go:171","msg":"trace[275533477] transaction","detail":"{read_only:false; response_revision:2759; number_of_response:1; }","duration":"134.725877ms","start":"2026-04-27T21:06:25.358813Z","end":"2026-04-27T21:06:25.493539Z","steps":["trace[275533477] 'process raft request' (duration: 134.457342ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:06:25.903198Z","caller":"traceutil/trace.go:171","msg":"trace[1306441996] transaction","detail":"{read_only:false; response_revision:2761; number_of_response:1; }","duration":"136.03941ms","start":"2026-04-27T21:06:25.76714Z","end":"2026-04-27T21:06:25.903179Z","steps":["trace[1306441996] 'process raft request' (duration: 135.912438ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:14.490318Z","caller":"traceutil/trace.go:171","msg":"trace[1497863212] transaction","detail":"{read_only:false; response_revision:4780; number_of_response:1; }","duration":"121.977315ms","start":"2026-04-27T21:10:14.368314Z","end":"2026-04-27T21:10:14.490292Z","steps":["trace[1497863212] 'process raft request' (duration: 100.575276ms)","trace[1497863212] 'compare' (duration: 21.274667ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:10:14.734357Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.358941ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"} {"level":"info","ts":"2026-04-27T21:10:14.734437Z","caller":"traceutil/trace.go:171","msg":"trace[1158349914] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:4781; }","duration":"129.448653ms","start":"2026-04-27T21:10:14.60497Z","end":"2026-04-27T21:10:14.734418Z","steps":["trace[1158349914] 'range keys from in-memory index tree' (duration: 129.234089ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:19.083772Z","caller":"traceutil/trace.go:171","msg":"trace[554495491] transaction","detail":"{read_only:false; response_revision:4934; number_of_response:1; }","duration":"106.581226ms","start":"2026-04-27T21:10:18.977163Z","end":"2026-04-27T21:10:19.083744Z","steps":["trace[554495491] 'process raft request' (duration: 106.388093ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:28.430702Z","caller":"traceutil/trace.go:171","msg":"trace[1350892607] transaction","detail":"{read_only:false; response_revision:5130; number_of_response:1; }","duration":"141.392583ms","start":"2026-04-27T21:10:28.28925Z","end":"2026-04-27T21:10:28.430642Z","steps":["trace[1350892607] 'process raft request' (duration: 94.723911ms)","trace[1350892607] 'compare' (duration: 46.398717ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:10:28.430851Z","caller":"traceutil/trace.go:171","msg":"trace[846742409] transaction","detail":"{read_only:false; response_revision:5131; number_of_response:1; }","duration":"141.315591ms","start":"2026-04-27T21:10:28.28951Z","end":"2026-04-27T21:10:28.430826Z","steps":["trace[846742409] 'process raft request' (duration: 141.062827ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:28.431232Z","caller":"traceutil/trace.go:171","msg":"trace[1549434585] transaction","detail":"{read_only:false; response_revision:5132; number_of_response:1; }","duration":"141.430314ms","start":"2026-04-27T21:10:28.289759Z","end":"2026-04-27T21:10:28.43119Z","steps":["trace[1549434585] 'process raft request' (duration: 141.007986ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:28.431262Z","caller":"traceutil/trace.go:171","msg":"trace[1190909639] transaction","detail":"{read_only:false; response_revision:5134; number_of_response:1; }","duration":"141.292411ms","start":"2026-04-27T21:10:28.28995Z","end":"2026-04-27T21:10:28.431242Z","steps":["trace[1190909639] 'process raft request' (duration: 141.206319ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:28.431235Z","caller":"traceutil/trace.go:171","msg":"trace[865401437] transaction","detail":"{read_only:false; response_revision:5133; number_of_response:1; }","duration":"141.304541ms","start":"2026-04-27T21:10:28.289894Z","end":"2026-04-27T21:10:28.431199Z","steps":["trace[865401437] 'process raft request' (duration: 141.189189ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:28.431401Z","caller":"traceutil/trace.go:171","msg":"trace[1198035191] transaction","detail":"{read_only:false; response_revision:5135; number_of_response:1; }","duration":"118.388544ms","start":"2026-04-27T21:10:28.312987Z","end":"2026-04-27T21:10:28.431375Z","steps":["trace[1198035191] 'process raft request' (duration: 118.20531ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:10:35.655247Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.345287ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-27T21:10:35.65543Z","caller":"traceutil/trace.go:171","msg":"trace[71544056] transaction","detail":"{read_only:false; number_of_response:1; response_revision:5294; }","duration":"175.250507ms","start":"2026-04-27T21:10:35.480162Z","end":"2026-04-27T21:10:35.655413Z","steps":["trace[71544056] 'process raft request' (duration: 175.198916ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:35.655659Z","caller":"traceutil/trace.go:171","msg":"trace[441700237] linearizableReadLoop","detail":"{readStateIndex:5486; appliedIndex:5485; }","duration":"177.616011ms","start":"2026-04-27T21:10:35.478017Z","end":"2026-04-27T21:10:35.655633Z","steps":["trace[441700237] 'read index received' (duration: 76.832206ms)","trace[441700237] 'applied index is now lower than readState.Index' (duration: 100.780635ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:10:35.655821Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.782634ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-1\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:10:35.655864Z","caller":"traceutil/trace.go:171","msg":"trace[1559274280] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-1; range_end:; response_count:0; response_revision:5294; }","duration":"177.857036ms","start":"2026-04-27T21:10:35.477994Z","end":"2026-04-27T21:10:35.655851Z","steps":["trace[1559274280] 'agreement among raft nodes before linearized reading' (duration: 177.769324ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:35.655624Z","caller":"traceutil/trace.go:171","msg":"trace[1997467293] transaction","detail":"{read_only:false; response_revision:5294; number_of_response:1; }","duration":"178.492427ms","start":"2026-04-27T21:10:35.477061Z","end":"2026-04-27T21:10:35.655554Z","steps":["trace[1997467293] 'process raft request' (duration: 77.750303ms)","trace[1997467293] 'compare' (duration: 99.711775ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:10:35.935986Z","caller":"traceutil/trace.go:171","msg":"trace[765652949] linearizableReadLoop","detail":"{readStateIndex:5490; appliedIndex:5489; }","duration":"219.28999ms","start":"2026-04-27T21:10:35.716669Z","end":"2026-04-27T21:10:35.935959Z","steps":["trace[765652949] 'read index received' (duration: 138.581842ms)","trace[765652949] 'applied index is now lower than readState.Index' (duration: 80.707258ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:10:35.936051Z","caller":"traceutil/trace.go:171","msg":"trace[406412045] transaction","detail":"{read_only:false; response_revision:5297; number_of_response:1; }","duration":"245.573061ms","start":"2026-04-27T21:10:35.690448Z","end":"2026-04-27T21:10:35.936021Z","steps":["trace[406412045] 'process raft request' (duration: 164.914324ms)","trace[406412045] 'compare' (duration: 80.470754ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:10:35.936244Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.165515ms","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-04-27T21:10:35.936303Z","caller":"traceutil/trace.go:171","msg":"trace[1157858113] range","detail":"{range_begin:/registry/secrets/monitoring/kube-prometheus-stack-admission; range_end:; response_count:1; response_revision:5297; }","duration":"221.244237ms","start":"2026-04-27T21:10:35.715043Z","end":"2026-04-27T21:10:35.936287Z","steps":["trace[1157858113] 'agreement among raft nodes before linearized reading' (duration: 221.057733ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:10:35.936456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"216.602441ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-web-config\" ","response":"range_response_count:1 size:708"} {"level":"info","ts":"2026-04-27T21:10:35.936489Z","caller":"traceutil/trace.go:171","msg":"trace[463805833] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-web-config; range_end:; response_count:1; response_revision:5297; }","duration":"216.675693ms","start":"2026-04-27T21:10:35.719805Z","end":"2026-04-27T21:10:35.936481Z","steps":["trace[463805833] 'agreement among raft nodes before linearized reading' (duration: 216.51893ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:36.167622Z","caller":"traceutil/trace.go:171","msg":"trace[1473481356] transaction","detail":"{read_only:false; response_revision:5299; number_of_response:1; }","duration":"225.637578ms","start":"2026-04-27T21:10:35.941954Z","end":"2026-04-27T21:10:36.167591Z","steps":["trace[1473481356] 'process raft request' (duration: 221.601433ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:36.167958Z","caller":"traceutil/trace.go:171","msg":"trace[1267062504] transaction","detail":"{read_only:false; response_revision:5300; number_of_response:1; }","duration":"224.919905ms","start":"2026-04-27T21:10:35.943011Z","end":"2026-04-27T21:10:36.167931Z","steps":["trace[1267062504] 'process raft request' (duration: 224.498228ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:36.168109Z","caller":"traceutil/trace.go:171","msg":"trace[749246265] transaction","detail":"{read_only:false; response_revision:5301; number_of_response:1; }","duration":"220.966081ms","start":"2026-04-27T21:10:35.947129Z","end":"2026-04-27T21:10:36.168095Z","steps":["trace[749246265] 'process raft request' (duration: 220.661886ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:10:36.16814Z","caller":"traceutil/trace.go:171","msg":"trace[1623974191] linearizableReadLoop","detail":"{readStateIndex:5493; appliedIndex:5491; }","duration":"222.974969ms","start":"2026-04-27T21:10:35.945147Z","end":"2026-04-27T21:10:36.168122Z","steps":["trace[1623974191] 'read index received' (duration: 55.1173ms)","trace[1623974191] 'applied index is now lower than readState.Index' (duration: 167.856609ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:10:36.173635Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"214.965398ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus\" ","response":"range_response_count:1 size:3565"} {"level":"info","ts":"2026-04-27T21:10:36.173714Z","caller":"traceutil/trace.go:171","msg":"trace[1164810507] range","detail":"{range_begin:/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus; range_end:; response_count:1; response_revision:5301; }","duration":"215.102662ms","start":"2026-04-27T21:10:35.958592Z","end":"2026-04-27T21:10:36.173695Z","steps":["trace[1164810507] 'agreement among raft nodes before linearized reading' (duration: 214.787306ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:10:36.173776Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.540023ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/monitoring/alertmanager-operated\" ","response":"range_response_count:1 size:1285"} {"level":"info","ts":"2026-04-27T21:10:36.173863Z","caller":"traceutil/trace.go:171","msg":"trace[371669531] range","detail":"{range_begin:/registry/services/specs/monitoring/alertmanager-operated; range_end:; response_count:1; response_revision:5301; }","duration":"228.752967ms","start":"2026-04-27T21:10:35.945096Z","end":"2026-04-27T21:10:36.173849Z","steps":["trace[371669531] 'agreement among raft nodes before linearized reading' (duration: 223.126882ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:12:17.932334Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":3046} {"level":"info","ts":"2026-04-27T21:12:18.014002Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":3046,"took":"79.788232ms","hash":866124512,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":32239616,"current-db-size-in-use":"32 MB"} {"level":"info","ts":"2026-04-27T21:12:18.014073Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":866124512,"revision":3046,"compact-revision":-1} {"level":"info","ts":"2026-04-27T21:16:34.394947Z","caller":"traceutil/trace.go:171","msg":"trace[251054182] transaction","detail":"{read_only:false; response_revision:8100; number_of_response:1; }","duration":"163.106307ms","start":"2026-04-27T21:16:34.231819Z","end":"2026-04-27T21:16:34.394925Z","steps":["trace[251054182] 'process raft request' (duration: 162.946824ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:16:46.129358Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.442139ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-04-27T21:16:47.127255Z","caller":"traceutil/trace.go:171","msg":"trace[1186540605] transaction","detail":"{read_only:false; response_revision:8163; number_of_response:1; }","duration":"135.603111ms","start":"2026-04-27T21:16:46.991612Z","end":"2026-04-27T21:16:47.127215Z","steps":["trace[1186540605] 'process raft request' (duration: 135.295486ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:16:47.246736Z","caller":"traceutil/trace.go:171","msg":"trace[913238210] transaction","detail":"{read_only:false; response_revision:8164; number_of_response:1; }","duration":"186.555027ms","start":"2026-04-27T21:16:47.060145Z","end":"2026-04-27T21:16:47.2467Z","steps":["trace[913238210] 'process raft request' (duration: 149.983902ms)","trace[913238210] 'compare' (duration: 36.164368ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:16:47.70907Z","caller":"traceutil/trace.go:171","msg":"trace[240274396] transaction","detail":"{read_only:false; response_revision:8168; number_of_response:1; }","duration":"115.607787ms","start":"2026-04-27T21:16:47.593441Z","end":"2026-04-27T21:16:47.709049Z","steps":["trace[240274396] 'process raft request' (duration: 51.374763ms)","trace[240274396] 'compare' (duration: 64.111452ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:16:47.91889Z","caller":"traceutil/trace.go:171","msg":"trace[1014183394] linearizableReadLoop","detail":"{readStateIndex:8453; appliedIndex:8452; }","duration":"102.357559ms","start":"2026-04-27T21:16:47.816504Z","end":"2026-04-27T21:16:47.918861Z","steps":["trace[1014183394] 'read index received' (duration: 65.896686ms)","trace[1014183394] 'applied index is now lower than readState.Index' (duration: 36.459853ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:16:47.919109Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.591243ms","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-04-27T21:16:47.919153Z","caller":"traceutil/trace.go:171","msg":"trace[2017027197] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:8169; }","duration":"102.705466ms","start":"2026-04-27T21:16:47.816436Z","end":"2026-04-27T21:16:47.919141Z","steps":["trace[2017027197] 'agreement among raft nodes before linearized reading' (duration: 102.541683ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:16:47.919173Z","caller":"traceutil/trace.go:171","msg":"trace[99234078] transaction","detail":"{read_only:false; response_revision:8169; number_of_response:1; }","duration":"122.960245ms","start":"2026-04-27T21:16:47.796173Z","end":"2026-04-27T21:16:47.919134Z","steps":["trace[99234078] 'process raft request' (duration: 86.274528ms)","trace[99234078] 'compare' (duration: 36.27723ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:16:48.724173Z","caller":"traceutil/trace.go:171","msg":"trace[157496874] transaction","detail":"{read_only:false; response_revision:8174; number_of_response:1; }","duration":"110.055423ms","start":"2026-04-27T21:16:48.614093Z","end":"2026-04-27T21:16:48.724148Z","steps":["trace[157496874] 'process raft request' (duration: 109.91728ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:17:16.218986Z","caller":"traceutil/trace.go:171","msg":"trace[2029389802] transaction","detail":"{read_only:false; response_revision:8376; number_of_response:1; }","duration":"199.344066ms","start":"2026-04-27T21:17:16.019623Z","end":"2026-04-27T21:17:16.218967Z","steps":["trace[2029389802] 'process raft request' (duration: 199.239624ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:17:16.392596Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.709968ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-04-27T21:17:16.392677Z","caller":"traceutil/trace.go:171","msg":"trace[911641641] linearizableReadLoop","detail":"{readStateIndex:8668; appliedIndex:8667; }","duration":"263.500469ms","start":"2026-04-27T21:17:16.129163Z","end":"2026-04-27T21:17:16.392663Z","steps":["trace[911641641] 'read index received' (duration: 89.912315ms)","trace[911641641] 'applied index is now lower than readState.Index' (duration: 173.587144ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:17:16.392788Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"263.618642ms","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-27T21:17:16.392813Z","caller":"traceutil/trace.go:171","msg":"trace[664230854] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:8376; }","duration":"263.681373ms","start":"2026-04-27T21:17:16.129124Z","end":"2026-04-27T21:17:16.392806Z","steps":["trace[664230854] 'agreement among raft nodes before linearized reading' (duration: 263.574411ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:17:17.941333Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":6203} {"level":"info","ts":"2026-04-27T21:17:18.050257Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":6203,"took":"106.510216ms","hash":1382752390,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":23252992,"current-db-size-in-use":"23 MB"} {"level":"info","ts":"2026-04-27T21:17:18.050338Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1382752390,"revision":6203,"compact-revision":3046} {"level":"info","ts":"2026-04-27T21:17:19.432093Z","caller":"traceutil/trace.go:171","msg":"trace[1868142051] transaction","detail":"{read_only:false; response_revision:8391; number_of_response:1; }","duration":"149.742867ms","start":"2026-04-27T21:17:19.282333Z","end":"2026-04-27T21:17:19.432076Z","steps":["trace[1868142051] 'process raft request' (duration: 149.626645ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:17:19.451726Z","caller":"traceutil/trace.go:171","msg":"trace[2127857594] transaction","detail":"{read_only:false; response_revision:8392; number_of_response:1; }","duration":"102.022142ms","start":"2026-04-27T21:17:19.34968Z","end":"2026-04-27T21:17:19.451703Z","steps":["trace[2127857594] 'process raft request' (duration: 101.90402ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:17:28.780874Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.983762ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/rook-ceph-detect-version-k7xjz\" ","response":"range_response_count:1 size:4648"} {"level":"info","ts":"2026-04-27T21:17:28.780952Z","caller":"traceutil/trace.go:171","msg":"trace[1388501983] range","detail":"{range_begin:/registry/pods/openstack/rook-ceph-detect-version-k7xjz; range_end:; response_count:1; response_revision:8481; }","duration":"149.123055ms","start":"2026-04-27T21:17:28.631813Z","end":"2026-04-27T21:17:28.780936Z","steps":["trace[1388501983] 'range keys from in-memory index tree' (duration: 148.767518ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:17:28.906337Z","caller":"traceutil/trace.go:171","msg":"trace[1287899863] linearizableReadLoop","detail":"{readStateIndex:8780; appliedIndex:8779; }","duration":"152.534199ms","start":"2026-04-27T21:17:28.75378Z","end":"2026-04-27T21:17:28.906314Z","steps":["trace[1287899863] 'read index received' (duration: 152.446137ms)","trace[1287899863] 'applied index is now lower than readState.Index' (duration: 87.192µs)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:17:28.906485Z","caller":"traceutil/trace.go:171","msg":"trace[104643521] transaction","detail":"{read_only:false; response_revision:8482; number_of_response:1; }","duration":"274.506326ms","start":"2026-04-27T21:17:28.631914Z","end":"2026-04-27T21:17:28.906421Z","steps":["trace[104643521] 'process raft request' (duration: 274.279761ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:17:28.906997Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.17337ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-04-27T21:17:28.907451Z","caller":"traceutil/trace.go:171","msg":"trace[879913551] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:8482; }","duration":"153.347034ms","start":"2026-04-27T21:17:28.75373Z","end":"2026-04-27T21:17:28.907077Z","steps":["trace[879913551] 'agreement among raft nodes before linearized reading' (duration: 152.697982ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:17:28.947403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.104706ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secretgen.k14s.io/certificates/\" range_end:\"/registry/secretgen.k14s.io/certificates0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:17:28.947518Z","caller":"traceutil/trace.go:171","msg":"trace[738717534] range","detail":"{range_begin:/registry/secretgen.k14s.io/certificates/; range_end:/registry/secretgen.k14s.io/certificates0; response_count:0; response_revision:8483; }","duration":"132.244389ms","start":"2026-04-27T21:17:28.815248Z","end":"2026-04-27T21:17:28.947492Z","steps":["trace[738717534] 'agreement among raft nodes before linearized reading' (duration: 132.053705ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:17:28.947466Z","caller":"traceutil/trace.go:171","msg":"trace[1935741938] transaction","detail":"{read_only:false; response_revision:8483; number_of_response:1; }","duration":"159.897727ms","start":"2026-04-27T21:17:28.787539Z","end":"2026-04-27T21:17:28.947437Z","steps":["trace[1935741938] 'process raft request' (duration: 159.557411ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:18:20.643189Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-0000000000002462.wal"} {"level":"info","ts":"2026-04-27T21:19:46.151729Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"1cac722af8b2b8a6","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-04-27T21:19:46.157004Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001} {"level":"info","ts":"2026-04-27T21:19:46.157127Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001} {"level":"info","ts":"2026-04-27T21:22:17.947548Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":8386} {"level":"info","ts":"2026-04-27T21:22:18.026996Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":8386,"took":"77.227487ms","hash":1484607560,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":26701824,"current-db-size-in-use":"27 MB"} {"level":"info","ts":"2026-04-27T21:22:18.027065Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1484607560,"revision":8386,"compact-revision":6203} {"level":"info","ts":"2026-04-27T21:27:17.955084Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":11019} {"level":"info","ts":"2026-04-27T21:27:18.034397Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":11019,"took":"76.703003ms","hash":634625082,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":28262400,"current-db-size-in-use":"28 MB"} {"level":"info","ts":"2026-04-27T21:27:18.034464Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":634625082,"revision":11019,"compact-revision":8386} {"level":"info","ts":"2026-04-27T21:28:54.27771Z","caller":"traceutil/trace.go:171","msg":"trace[1429116435] transaction","detail":"{read_only:false; response_revision:13674; number_of_response:1; }","duration":"109.768619ms","start":"2026-04-27T21:28:54.167903Z","end":"2026-04-27T21:28:54.277671Z","steps":["trace[1429116435] 'process raft request' (duration: 96.889627ms)","trace[1429116435] 'compare' (duration: 12.73352ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:28:55.010716Z","caller":"traceutil/trace.go:171","msg":"trace[1506095636] transaction","detail":"{read_only:false; response_revision:13679; number_of_response:1; }","duration":"112.476619ms","start":"2026-04-27T21:28:54.898219Z","end":"2026-04-27T21:28:55.010696Z","steps":["trace[1506095636] 'process raft request' (duration: 112.264565ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:28:55.163534Z","caller":"traceutil/trace.go:171","msg":"trace[1333599076] linearizableReadLoop","detail":"{readStateIndex:14144; appliedIndex:14143; }","duration":"147.203341ms","start":"2026-04-27T21:28:55.016306Z","end":"2026-04-27T21:28:55.163509Z","steps":["trace[1333599076] 'read index received' (duration: 23.29µs)","trace[1333599076] 'applied index is now lower than readState.Index' (duration: 147.179071ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:28:55.163782Z","caller":"traceutil/trace.go:171","msg":"trace[1165983157] transaction","detail":"{read_only:false; response_revision:13680; number_of_response:1; }","duration":"147.471516ms","start":"2026-04-27T21:28:55.016265Z","end":"2026-04-27T21:28:55.163737Z","steps":["trace[1165983157] 'process raft request' (duration: 132.986974ms)","trace[1165983157] 'compare' (duration: 14.149446ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:28:55.163877Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.541088ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:28:55.163968Z","caller":"traceutil/trace.go:171","msg":"trace[392393037] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:13680; }","duration":"147.68832ms","start":"2026-04-27T21:28:55.01626Z","end":"2026-04-27T21:28:55.163948Z","steps":["trace[392393037] 'agreement among raft nodes before linearized reading' (duration: 147.517627ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:28:55.170419Z","caller":"traceutil/trace.go:171","msg":"trace[1433100981] transaction","detail":"{read_only:false; response_revision:13681; number_of_response:1; }","duration":"154.04895ms","start":"2026-04-27T21:28:55.016347Z","end":"2026-04-27T21:28:55.170395Z","steps":["trace[1433100981] 'process raft request' (duration: 153.742904ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:29:04.201374Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.527833ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-27T21:29:04.201483Z","caller":"traceutil/trace.go:171","msg":"trace[1904485392] range","detail":"{range_begin:/registry/apiregistration.k8s.io/apiservices/; range_end:/registry/apiregistration.k8s.io/apiservices0; response_count:0; response_revision:13848; }","duration":"102.694367ms","start":"2026-04-27T21:29:04.098766Z","end":"2026-04-27T21:29:04.20146Z","steps":["trace[1904485392] 'count revisions from in-memory index tree' (duration: 102.383359ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:29:04.533422Z","caller":"traceutil/trace.go:171","msg":"trace[1328382687] transaction","detail":"{read_only:false; response_revision:13849; number_of_response:1; }","duration":"171.63214ms","start":"2026-04-27T21:29:04.361761Z","end":"2026-04-27T21:29:04.533393Z","steps":["trace[1328382687] 'process raft request' (duration: 171.449546ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:29:04.533467Z","caller":"traceutil/trace.go:171","msg":"trace[1723497260] linearizableReadLoop","detail":"{readStateIndex:14317; appliedIndex:14317; }","duration":"108.914773ms","start":"2026-04-27T21:29:04.424518Z","end":"2026-04-27T21:29:04.533433Z","steps":["trace[1723497260] 'read index received' (duration: 108.902722ms)","trace[1723497260] 'applied index is now lower than readState.Index' (duration: 9.6µs)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:29:04.533736Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.206609ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-04-27T21:29:04.533821Z","caller":"traceutil/trace.go:171","msg":"trace[1371457258] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:13849; }","duration":"109.34125ms","start":"2026-04-27T21:29:04.424457Z","end":"2026-04-27T21:29:04.533799Z","steps":["trace[1371457258] 'agreement among raft nodes before linearized reading' (duration: 109.100956ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:30:43.079777Z","caller":"traceutil/trace.go:171","msg":"trace[580871831] transaction","detail":"{read_only:false; response_revision:14928; number_of_response:1; }","duration":"196.23455ms","start":"2026-04-27T21:30:42.883515Z","end":"2026-04-27T21:30:43.07975Z","steps":["trace[580871831] 'process raft request' (duration: 196.075598ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:30:43.098566Z","caller":"traceutil/trace.go:171","msg":"trace[768636792] linearizableReadLoop","detail":"{readStateIndex:15431; appliedIndex:15429; }","duration":"176.102253ms","start":"2026-04-27T21:30:42.922443Z","end":"2026-04-27T21:30:43.098545Z","steps":["trace[768636792] 'read index received' (duration: 157.127988ms)","trace[768636792] 'applied index is now lower than readState.Index' (duration: 18.973045ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:30:43.09863Z","caller":"traceutil/trace.go:171","msg":"trace[67483956] transaction","detail":"{read_only:false; response_revision:14929; number_of_response:1; }","duration":"206.915791ms","start":"2026-04-27T21:30:42.891675Z","end":"2026-04-27T21:30:43.09859Z","steps":["trace[67483956] 'process raft request' (duration: 206.754658ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:43.098747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.291987ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:30:43.098795Z","caller":"traceutil/trace.go:171","msg":"trace[387629158] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:14929; }","duration":"176.384508ms","start":"2026-04-27T21:30:42.922398Z","end":"2026-04-27T21:30:43.098782Z","steps":["trace[387629158] 'agreement among raft nodes before linearized reading' (duration: 176.299526ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:43.098952Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.358743ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-db-sync\" ","response":"range_response_count:1 size:5523"} {"level":"info","ts":"2026-04-27T21:30:43.099072Z","caller":"traceutil/trace.go:171","msg":"trace[1520967502] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:14929; }","duration":"163.499417ms","start":"2026-04-27T21:30:42.935525Z","end":"2026-04-27T21:30:43.099025Z","steps":["trace[1520967502] 'agreement among raft nodes before linearized reading' (duration: 163.232731ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:43.417611Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.894686ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-27T21:30:43.417718Z","caller":"traceutil/trace.go:171","msg":"trace[786397651] transaction","detail":"{read_only:false; response_revision:14930; number_of_response:1; }","duration":"314.924516ms","start":"2026-04-27T21:30:43.102776Z","end":"2026-04-27T21:30:43.417701Z","steps":["trace[786397651] 'process raft request' (duration: 168.855607ms)","trace[786397651] 'compare' (duration: 145.721772ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:30:43.417773Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:30:43.102762Z","time spent":"314.983527ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:30:43.455066Z","caller":"traceutil/trace.go:171","msg":"trace[1187212952] linearizableReadLoop","detail":"{readStateIndex:15433; appliedIndex:15431; }","duration":"349.295981ms","start":"2026-04-27T21:30:43.105751Z","end":"2026-04-27T21:30:43.455047Z","steps":["trace[1187212952] 'read index received' (duration: 165.87095ms)","trace[1187212952] 'applied index is now lower than readState.Index' (duration: 183.423861ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:30:43.455773Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"350.012775ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:79 size:770113"} {"level":"info","ts":"2026-04-27T21:30:43.455808Z","caller":"traceutil/trace.go:171","msg":"trace[696892441] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:79; response_revision:14931; }","duration":"350.098336ms","start":"2026-04-27T21:30:43.105702Z","end":"2026-04-27T21:30:43.4558Z","steps":["trace[696892441] 'agreement among raft nodes before linearized reading' (duration: 349.427174ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:43.455835Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:30:43.105685Z","time spent":"350.142757ms","remote":"127.0.0.1:51968","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":79,"response size":770136,"request content":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" "} {"level":"info","ts":"2026-04-27T21:30:43.456465Z","caller":"traceutil/trace.go:171","msg":"trace[292539907] transaction","detail":"{read_only:false; response_revision:14931; number_of_response:1; }","duration":"351.830228ms","start":"2026-04-27T21:30:43.104624Z","end":"2026-04-27T21:30:43.456454Z","steps":["trace[292539907] 'process raft request' (duration: 350.32726ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:43.456544Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:30:43.104598Z","time spent":"351.89562ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:30:43.831513Z","caller":"traceutil/trace.go:171","msg":"trace[2034615736] transaction","detail":"{read_only:false; response_revision:14933; number_of_response:1; }","duration":"108.794471ms","start":"2026-04-27T21:30:43.722695Z","end":"2026-04-27T21:30:43.831489Z","steps":["trace[2034615736] 'process raft request' (duration: 108.589297ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:30:43.882948Z","caller":"traceutil/trace.go:171","msg":"trace[1688655274] linearizableReadLoop","detail":"{readStateIndex:15436; appliedIndex:15434; }","duration":"156.29053ms","start":"2026-04-27T21:30:43.726621Z","end":"2026-04-27T21:30:43.882912Z","steps":["trace[1688655274] 'read index received' (duration: 104.721263ms)","trace[1688655274] 'applied index is now lower than readState.Index' (duration: 51.564877ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:30:43.883085Z","caller":"traceutil/trace.go:171","msg":"trace[49555057] transaction","detail":"{read_only:false; response_revision:14934; number_of_response:1; }","duration":"158.507702ms","start":"2026-04-27T21:30:43.724565Z","end":"2026-04-27T21:30:43.883072Z","steps":["trace[49555057] 'process raft request' (duration: 123.759091ms)","trace[49555057] 'compare' (duration: 34.433035ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:30:43.883261Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.620857ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-ks-endpoints\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:30:43.883301Z","caller":"traceutil/trace.go:171","msg":"trace[2106537147] range","detail":"{range_begin:/registry/jobs/openstack/nova-ks-endpoints; range_end:; response_count:0; response_revision:14934; }","duration":"156.697478ms","start":"2026-04-27T21:30:43.726594Z","end":"2026-04-27T21:30:43.883291Z","steps":["trace[2106537147] 'agreement among raft nodes before linearized reading' (duration: 156.617316ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:43.883491Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.638759ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-rabbit-init\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-27T21:30:43.8836Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.765341ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-ks-user\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-27T21:30:43.883601Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.60041ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-db-sync\" ","response":"range_response_count:1 size:5523"} {"level":"info","ts":"2026-04-27T21:30:43.883668Z","caller":"traceutil/trace.go:171","msg":"trace[1725149444] range","detail":"{range_begin:/registry/jobs/openstack/nova-ks-user; range_end:; response_count:0; response_revision:14934; }","duration":"155.827212ms","start":"2026-04-27T21:30:43.72781Z","end":"2026-04-27T21:30:43.883637Z","steps":["trace[1725149444] 'agreement among raft nodes before linearized reading' (duration: 155.755151ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:30:43.883669Z","caller":"traceutil/trace.go:171","msg":"trace[1943930584] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:14934; }","duration":"153.687553ms","start":"2026-04-27T21:30:43.729963Z","end":"2026-04-27T21:30:43.883651Z","steps":["trace[1943930584] 'agreement among raft nodes before linearized reading' (duration: 153.483019ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:30:43.883731Z","caller":"traceutil/trace.go:171","msg":"trace[1864499576] range","detail":"{range_begin:/registry/jobs/openstack/nova-rabbit-init; range_end:; response_count:0; response_revision:14934; }","duration":"155.818063ms","start":"2026-04-27T21:30:43.727797Z","end":"2026-04-27T21:30:43.883615Z","steps":["trace[1864499576] 'agreement among raft nodes before linearized reading' (duration: 155.604259ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:43.883725Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.384408ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-fkbc5\" ","response":"range_response_count:1 size:6524"} {"level":"info","ts":"2026-04-27T21:30:43.883952Z","caller":"traceutil/trace.go:171","msg":"trace[842404348] range","detail":"{range_begin:/registry/pods/openstack/keepalived-fkbc5; range_end:; response_count:1; response_revision:14934; }","duration":"136.629263ms","start":"2026-04-27T21:30:43.747298Z","end":"2026-04-27T21:30:43.883927Z","steps":["trace[842404348] 'agreement among raft nodes before linearized reading' (duration: 136.261226ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:44.137271Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.127035ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-ks-user\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:30:44.137423Z","caller":"traceutil/trace.go:171","msg":"trace[1592297286] range","detail":"{range_begin:/registry/jobs/openstack/nova-ks-user; range_end:; response_count:0; response_revision:14934; }","duration":"118.329679ms","start":"2026-04-27T21:30:44.019066Z","end":"2026-04-27T21:30:44.137396Z","steps":["trace[1592297286] 'range keys from in-memory index tree' (duration: 117.959533ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:44.137588Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.335469ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-rabbit-init\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-27T21:30:44.137668Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.993333ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-ks-endpoints\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-27T21:30:44.137714Z","caller":"traceutil/trace.go:171","msg":"trace[1578152425] range","detail":"{range_begin:/registry/jobs/openstack/nova-ks-endpoints; range_end:; response_count:0; response_revision:14934; }","duration":"118.047714ms","start":"2026-04-27T21:30:44.019652Z","end":"2026-04-27T21:30:44.1377Z","steps":["trace[1578152425] 'range keys from in-memory index tree' (duration: 117.952012ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:30:44.137621Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.574655ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-db-sync\" ","response":"range_response_count:1 size:5523"} {"level":"info","ts":"2026-04-27T21:30:44.137804Z","caller":"traceutil/trace.go:171","msg":"trace[257840675] range","detail":"{range_begin:/registry/jobs/openstack/nova-rabbit-init; range_end:; response_count:0; response_revision:14934; }","duration":"118.502122ms","start":"2026-04-27T21:30:44.019187Z","end":"2026-04-27T21:30:44.137689Z","steps":["trace[257840675] 'range keys from in-memory index tree' (duration: 118.150146ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:30:44.137871Z","caller":"traceutil/trace.go:171","msg":"trace[338788065] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:14934; }","duration":"117.84275ms","start":"2026-04-27T21:30:44.020008Z","end":"2026-04-27T21:30:44.13785Z","steps":["trace[338788065] 'range keys from in-memory index tree' (duration: 117.467953ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:32:17.966198Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":13058} {"level":"info","ts":"2026-04-27T21:32:18.040015Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":13058,"took":"70.957431ms","hash":206780123,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":31469568,"current-db-size-in-use":"32 MB"} {"level":"info","ts":"2026-04-27T21:32:18.040069Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":206780123,"revision":13058,"compact-revision":11019} {"level":"info","ts":"2026-04-27T21:36:24.985499Z","caller":"traceutil/trace.go:171","msg":"trace[955697380] transaction","detail":"{read_only:false; response_revision:17554; number_of_response:1; }","duration":"139.153106ms","start":"2026-04-27T21:36:24.846319Z","end":"2026-04-27T21:36:24.985472Z","steps":["trace[955697380] 'process raft request' (duration: 136.314193ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:36:25.670248Z","caller":"traceutil/trace.go:171","msg":"trace[1662227754] linearizableReadLoop","detail":"{readStateIndex:18143; appliedIndex:18142; }","duration":"179.483233ms","start":"2026-04-27T21:36:25.490739Z","end":"2026-04-27T21:36:25.670222Z","steps":["trace[1662227754] 'read index received' (duration: 179.427772ms)","trace[1662227754] 'applied index is now lower than readState.Index' (duration: 54.471µs)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:36:25.670543Z","caller":"traceutil/trace.go:171","msg":"trace[1550040487] transaction","detail":"{read_only:false; response_revision:17557; number_of_response:1; }","duration":"226.427282ms","start":"2026-04-27T21:36:25.44404Z","end":"2026-04-27T21:36:25.670467Z","steps":["trace[1550040487] 'process raft request' (duration: 226.038085ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:36:25.670821Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"180.057633ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-compute-default-k72lt\" ","response":"range_response_count:1 size:22126"} {"level":"info","ts":"2026-04-27T21:36:25.670969Z","caller":"traceutil/trace.go:171","msg":"trace[870629660] range","detail":"{range_begin:/registry/pods/openstack/nova-compute-default-k72lt; range_end:; response_count:1; response_revision:17557; }","duration":"180.232317ms","start":"2026-04-27T21:36:25.490688Z","end":"2026-04-27T21:36:25.67092Z","steps":["trace[870629660] 'agreement among raft nodes before linearized reading' (duration: 179.809979ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:36:25.709311Z","caller":"traceutil/trace.go:171","msg":"trace[299015858] transaction","detail":"{read_only:false; response_revision:17558; number_of_response:1; }","duration":"200.004188ms","start":"2026-04-27T21:36:25.509259Z","end":"2026-04-27T21:36:25.709263Z","steps":["trace[299015858] 'process raft request' (duration: 190.307186ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:36:25.709507Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.065463ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-04-27T21:36:25.709639Z","caller":"traceutil/trace.go:171","msg":"trace[1734849375] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:17558; }","duration":"173.251286ms","start":"2026-04-27T21:36:25.536369Z","end":"2026-04-27T21:36:25.709621Z","steps":["trace[1734849375] 'agreement among raft nodes before linearized reading' (duration: 172.874339ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:37:17.972522Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":15549} {"level":"info","ts":"2026-04-27T21:37:18.067979Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":15549,"took":"93.121545ms","hash":3668822080,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":34050048,"current-db-size-in-use":"34 MB"} {"level":"info","ts":"2026-04-27T21:37:18.068098Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3668822080,"revision":15549,"compact-revision":13058} {"level":"info","ts":"2026-04-27T21:40:06.432577Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"1cac722af8b2b8a6","local-member-applied-index":20004,"local-member-snapshot-index":10001,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-04-27T21:40:06.437432Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":20004} {"level":"info","ts":"2026-04-27T21:40:06.437645Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":15004} {"level":"info","ts":"2026-04-27T21:41:50.86343Z","caller":"traceutil/trace.go:171","msg":"trace[550211090] linearizableReadLoop","detail":"{readStateIndex:20710; appliedIndex:20709; }","duration":"106.195425ms","start":"2026-04-27T21:41:50.757196Z","end":"2026-04-27T21:41:50.863392Z","steps":["trace[550211090] 'read index received' (duration: 105.880639ms)","trace[550211090] 'applied index is now lower than readState.Index' (duration: 313.406µs)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:41:50.864575Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.348725ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-27T21:41:50.864678Z","caller":"traceutil/trace.go:171","msg":"trace[1244354485] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:20040; }","duration":"107.509089ms","start":"2026-04-27T21:41:50.757144Z","end":"2026-04-27T21:41:50.864653Z","steps":["trace[1244354485] 'agreement among raft nodes before linearized reading' (duration: 106.408058ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:41:50.865128Z","caller":"traceutil/trace.go:171","msg":"trace[1703436261] transaction","detail":"{read_only:false; response_revision:20040; number_of_response:1; }","duration":"109.775631ms","start":"2026-04-27T21:41:50.755338Z","end":"2026-04-27T21:41:50.865114Z","steps":["trace[1703436261] 'process raft request' (duration: 107.843606ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:41:50.987277Z","caller":"traceutil/trace.go:171","msg":"trace[1102515059] transaction","detail":"{read_only:false; response_revision:20041; number_of_response:1; }","duration":"116.315272ms","start":"2026-04-27T21:41:50.870934Z","end":"2026-04-27T21:41:50.987249Z","steps":["trace[1102515059] 'process raft request' (duration: 116.046768ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:41:50.988463Z","caller":"traceutil/trace.go:171","msg":"trace[2061312346] transaction","detail":"{read_only:false; response_revision:20042; number_of_response:1; }","duration":"110.325551ms","start":"2026-04-27T21:41:50.878115Z","end":"2026-04-27T21:41:50.98844Z","steps":["trace[2061312346] 'process raft request' (duration: 110.160398ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:41:56.524035Z","caller":"traceutil/trace.go:171","msg":"trace[578684427] transaction","detail":"{read_only:false; response_revision:20069; number_of_response:1; }","duration":"255.25774ms","start":"2026-04-27T21:41:56.268744Z","end":"2026-04-27T21:41:56.524002Z","steps":["trace[578684427] 'process raft request' (duration: 255.123566ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:41:56.886701Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"215.056899ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-04-27T21:41:56.886802Z","caller":"traceutil/trace.go:171","msg":"trace[121328591] linearizableReadLoop","detail":"{readStateIndex:20741; appliedIndex:20740; }","duration":"391.038177ms","start":"2026-04-27T21:41:56.495746Z","end":"2026-04-27T21:41:56.886784Z","steps":["trace[121328591] 'read index received' (duration: 28.816789ms)","trace[121328591] 'applied index is now lower than readState.Index' (duration: 362.219928ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:41:56.887069Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"381.666951ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/rook-ceph-pdbstatemap\" ","response":"range_response_count:1 size:357"} {"level":"warn","ts":"2026-04-27T21:41:56.887097Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"391.343222ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/storageclasses/\" range_end:\"/registry/storageclasses0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-04-27T21:41:56.887125Z","caller":"traceutil/trace.go:171","msg":"trace[810920507] range","detail":"{range_begin:/registry/configmaps/openstack/rook-ceph-pdbstatemap; range_end:; response_count:1; response_revision:20069; }","duration":"381.780153ms","start":"2026-04-27T21:41:56.50533Z","end":"2026-04-27T21:41:56.88711Z","steps":["trace[810920507] 'agreement among raft nodes before linearized reading' (duration: 381.584669ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:41:56.887132Z","caller":"traceutil/trace.go:171","msg":"trace[486145919] range","detail":"{range_begin:/registry/storageclasses/; range_end:/registry/storageclasses0; response_count:0; response_revision:20069; }","duration":"391.421054ms","start":"2026-04-27T21:41:56.495701Z","end":"2026-04-27T21:41:56.887123Z","steps":["trace[486145919] 'agreement among raft nodes before linearized reading' (duration: 391.349413ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:41:56.88716Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:41:56.495677Z","time spent":"391.473354ms","remote":"127.0.0.1:52168","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":1,"response size":31,"request content":"key:\"/registry/storageclasses/\" range_end:\"/registry/storageclasses0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:41:56.887159Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:41:56.505261Z","time spent":"381.889255ms","remote":"127.0.0.1:51892","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":380,"request content":"key:\"/registry/configmaps/openstack/rook-ceph-pdbstatemap\" "} {"level":"warn","ts":"2026-04-27T21:41:57.300808Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.534083ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:41:57.300957Z","caller":"traceutil/trace.go:171","msg":"trace[1684727706] transaction","detail":"{read_only:false; response_revision:20072; number_of_response:1; }","duration":"246.040697ms","start":"2026-04-27T21:41:57.054899Z","end":"2026-04-27T21:41:57.30094Z","steps":["trace[1684727706] 'process raft request' (duration: 140.278751ms)","trace[1684727706] 'compare' (duration: 105.400089ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:41:57.47535Z","caller":"traceutil/trace.go:171","msg":"trace[1327798716] linearizableReadLoop","detail":"{readStateIndex:20745; appliedIndex:20744; }","duration":"147.636709ms","start":"2026-04-27T21:41:57.327679Z","end":"2026-04-27T21:41:57.475316Z","steps":["trace[1327798716] 'read index received' (duration: 104.096466ms)","trace[1327798716] 'applied index is now lower than readState.Index' (duration: 43.538733ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:41:57.475478Z","caller":"traceutil/trace.go:171","msg":"trace[1650956969] transaction","detail":"{read_only:false; response_revision:20073; number_of_response:1; }","duration":"170.468576ms","start":"2026-04-27T21:41:57.304966Z","end":"2026-04-27T21:41:57.475434Z","steps":["trace[1650956969] 'process raft request' (duration: 126.7969ms)","trace[1650956969] 'compare' (duration: 43.395211ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:41:57.475611Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.917734ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-04-27T21:41:57.475683Z","caller":"traceutil/trace.go:171","msg":"trace[851786546] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:20073; }","duration":"148.015916ms","start":"2026-04-27T21:41:57.327628Z","end":"2026-04-27T21:41:57.475643Z","steps":["trace[851786546] 'agreement among raft nodes before linearized reading' (duration: 147.831712ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:41:57.592379Z","caller":"traceutil/trace.go:171","msg":"trace[1195850647] linearizableReadLoop","detail":"{readStateIndex:20746; appliedIndex:20745; }","duration":"116.914614ms","start":"2026-04-27T21:41:57.47543Z","end":"2026-04-27T21:41:57.592345Z","steps":["trace[1195850647] 'read index received' (duration: 111.602255ms)","trace[1195850647] 'applied index is now lower than readState.Index' (duration: 5.310979ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:41:57.592556Z","caller":"traceutil/trace.go:171","msg":"trace[887961662] transaction","detail":"{read_only:false; response_revision:20074; number_of_response:1; }","duration":"171.349441ms","start":"2026-04-27T21:41:57.421194Z","end":"2026-04-27T21:41:57.592544Z","steps":["trace[887961662] 'process raft request' (duration: 165.823878ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:41:57.592797Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"169.215551ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-04-27T21:41:57.592874Z","caller":"traceutil/trace.go:171","msg":"trace[102354253] range","detail":"{range_begin:/registry/clusterrolebindings/; range_end:/registry/clusterrolebindings0; response_count:0; response_revision:20074; }","duration":"169.331053ms","start":"2026-04-27T21:41:57.42353Z","end":"2026-04-27T21:41:57.592861Z","steps":["trace[102354253] 'agreement among raft nodes before linearized reading' (duration: 169.17314ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:41:57.594927Z","caller":"traceutil/trace.go:171","msg":"trace[1452813559] transaction","detail":"{read_only:false; response_revision:20075; number_of_response:1; }","duration":"114.869026ms","start":"2026-04-27T21:41:57.480028Z","end":"2026-04-27T21:41:57.594897Z","steps":["trace[1452813559] 'process raft request' (duration: 114.661433ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:42:17.979948Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":18178} {"level":"info","ts":"2026-04-27T21:42:18.098435Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":18178,"took":"113.700585ms","hash":2777195846,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":29769728,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-04-27T21:42:18.098573Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2777195846,"revision":18178,"compact-revision":15549} {"level":"info","ts":"2026-04-27T21:45:44.66873Z","caller":"traceutil/trace.go:171","msg":"trace[406124004] transaction","detail":"{read_only:false; response_revision:22465; number_of_response:1; }","duration":"117.624088ms","start":"2026-04-27T21:45:44.55106Z","end":"2026-04-27T21:45:44.668684Z","steps":["trace[406124004] 'process raft request' (duration: 106.008551ms)","trace[406124004] 'compare' (duration: 11.413943ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:45:45.017744Z","caller":"traceutil/trace.go:171","msg":"trace[840833573] linearizableReadLoop","detail":"{readStateIndex:23211; appliedIndex:23210; }","duration":"182.376687ms","start":"2026-04-27T21:45:44.835343Z","end":"2026-04-27T21:45:45.01772Z","steps":["trace[840833573] 'read index received' (duration: 156.979833ms)","trace[840833573] 'applied index is now lower than readState.Index' (duration: 25.395904ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:45:45.017765Z","caller":"traceutil/trace.go:171","msg":"trace[1048873339] transaction","detail":"{read_only:false; response_revision:22468; number_of_response:1; }","duration":"302.38834ms","start":"2026-04-27T21:45:44.715346Z","end":"2026-04-27T21:45:45.017734Z","steps":["trace[1048873339] 'process raft request' (duration: 277.082727ms)","trace[1048873339] 'compare' (duration: 25.17707ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:45:45.017903Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:45:44.715327Z","time spent":"302.505111ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:45:45.018032Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.684793ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:482"} {"level":"info","ts":"2026-04-27T21:45:45.018105Z","caller":"traceutil/trace.go:171","msg":"trace[765337599] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:22468; }","duration":"182.799515ms","start":"2026-04-27T21:45:44.835289Z","end":"2026-04-27T21:45:45.018089Z","steps":["trace[765337599] 'agreement among raft nodes before linearized reading' (duration: 182.611622ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:45:45.018086Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.900151ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12217"} {"level":"info","ts":"2026-04-27T21:45:45.018196Z","caller":"traceutil/trace.go:171","msg":"trace[1201536439] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:22468; }","duration":"141.045185ms","start":"2026-04-27T21:45:44.877126Z","end":"2026-04-27T21:45:45.018171Z","steps":["trace[1201536439] 'agreement among raft nodes before linearized reading' (duration: 140.80098ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:47:17.986032Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":20187} {"level":"info","ts":"2026-04-27T21:47:18.093875Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":20187,"took":"103.345871ms","hash":1768183312,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":41545728,"current-db-size-in-use":"42 MB"} {"level":"info","ts":"2026-04-27T21:47:18.093949Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1768183312,"revision":20187,"compact-revision":18178} {"level":"info","ts":"2026-04-27T21:48:50.094185Z","caller":"traceutil/trace.go:171","msg":"trace[908500141] transaction","detail":"{read_only:false; response_revision:24393; number_of_response:1; }","duration":"127.966941ms","start":"2026-04-27T21:48:49.966164Z","end":"2026-04-27T21:48:50.094131Z","steps":["trace[908500141] 'process raft request' (duration: 62.874885ms)","trace[908500141] 'compare' (duration: 64.731759ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:50.097115Z","caller":"traceutil/trace.go:171","msg":"trace[1052829882] transaction","detail":"{read_only:false; response_revision:24394; number_of_response:1; }","duration":"116.013407ms","start":"2026-04-27T21:48:49.981079Z","end":"2026-04-27T21:48:50.097092Z","steps":["trace[1052829882] 'process raft request' (duration: 115.750412ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:50.748785Z","caller":"traceutil/trace.go:171","msg":"trace[1397375317] linearizableReadLoop","detail":"{readStateIndex:25187; appliedIndex:25186; }","duration":"104.590544ms","start":"2026-04-27T21:48:50.644169Z","end":"2026-04-27T21:48:50.74876Z","steps":["trace[1397375317] 'read index received' (duration: 104.3345ms)","trace[1397375317] 'applied index is now lower than readState.Index' (duration: 255.124µs)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:50.748931Z","caller":"traceutil/trace.go:171","msg":"trace[963908083] transaction","detail":"{read_only:false; response_revision:24396; number_of_response:1; }","duration":"155.587296ms","start":"2026-04-27T21:48:50.593277Z","end":"2026-04-27T21:48:50.748864Z","steps":["trace[963908083] 'process raft request' (duration: 155.301731ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:50.749017Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.827709ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/glance-api\" ","response":"range_response_count:1 size:11793"} {"level":"info","ts":"2026-04-27T21:48:50.749053Z","caller":"traceutil/trace.go:171","msg":"trace[1574497099] range","detail":"{range_begin:/registry/deployments/openstack/glance-api; range_end:; response_count:1; response_revision:24396; }","duration":"104.91605ms","start":"2026-04-27T21:48:50.644126Z","end":"2026-04-27T21:48:50.749042Z","steps":["trace[1574497099] 'agreement among raft nodes before linearized reading' (duration: 104.732526ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:51.365942Z","caller":"traceutil/trace.go:171","msg":"trace[1421565124] transaction","detail":"{read_only:false; response_revision:24400; number_of_response:1; }","duration":"275.277123ms","start":"2026-04-27T21:48:51.090617Z","end":"2026-04-27T21:48:51.365895Z","steps":["trace[1421565124] 'process raft request' (duration: 274.809644ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:51.36614Z","caller":"traceutil/trace.go:171","msg":"trace[502475357] transaction","detail":"{read_only:false; response_revision:24401; number_of_response:1; }","duration":"269.619538ms","start":"2026-04-27T21:48:51.09644Z","end":"2026-04-27T21:48:51.36606Z","steps":["trace[502475357] 'process raft request' (duration: 269.21179ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:51.366299Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"312.248353ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.210\" ","response":"range_response_count:1 size:140"} {"level":"info","ts":"2026-04-27T21:48:51.36636Z","caller":"traceutil/trace.go:171","msg":"trace[154250970] range","detail":"{range_begin:/registry/masterleases/199.204.45.210; range_end:; response_count:1; response_revision:24401; }","duration":"312.353896ms","start":"2026-04-27T21:48:51.053991Z","end":"2026-04-27T21:48:51.366345Z","steps":["trace[154250970] 'agreement among raft nodes before linearized reading' (duration: 312.130872ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:51.366411Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:48:51.053981Z","time spent":"312.420028ms","remote":"127.0.0.1:51810","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":163,"request content":"key:\"/registry/masterleases/199.204.45.210\" "} {"level":"info","ts":"2026-04-27T21:48:51.366052Z","caller":"traceutil/trace.go:171","msg":"trace[424056650] linearizableReadLoop","detail":"{readStateIndex:25191; appliedIndex:25189; }","duration":"274.839985ms","start":"2026-04-27T21:48:51.091154Z","end":"2026-04-27T21:48:51.365994Z","steps":["trace[424056650] 'read index received' (duration: 10.476456ms)","trace[424056650] 'applied index is now lower than readState.Index' (duration: 264.362159ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:48:51.527168Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.441447ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:48:51.527397Z","caller":"traceutil/trace.go:171","msg":"trace[339776075] transaction","detail":"{read_only:false; response_revision:24402; number_of_response:1; }","duration":"225.095575ms","start":"2026-04-27T21:48:51.302272Z","end":"2026-04-27T21:48:51.527367Z","steps":["trace[339776075] 'process raft request' (duration: 94.360472ms)","trace[339776075] 'compare' (duration: 130.086961ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:51.527448Z","caller":"traceutil/trace.go:171","msg":"trace[585797980] linearizableReadLoop","detail":"{readStateIndex:25194; appliedIndex:25192; }","duration":"160.489568ms","start":"2026-04-27T21:48:51.366936Z","end":"2026-04-27T21:48:51.527426Z","steps":["trace[585797980] 'read index received' (duration: 29.634033ms)","trace[585797980] 'applied index is now lower than readState.Index' (duration: 130.854495ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:51.527672Z","caller":"traceutil/trace.go:171","msg":"trace[434272464] transaction","detail":"{read_only:false; response_revision:24403; number_of_response:1; }","duration":"162.69484ms","start":"2026-04-27T21:48:51.364961Z","end":"2026-04-27T21:48:51.527656Z","steps":["trace[434272464] 'process raft request' (duration: 162.340603ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:51.527938Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.639287ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cert-manager.io/certificates/\" range_end:\"/registry/cert-manager.io/certificates0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-04-27T21:48:51.527992Z","caller":"traceutil/trace.go:171","msg":"trace[1966335069] range","detail":"{range_begin:/registry/cert-manager.io/certificates/; range_end:/registry/cert-manager.io/certificates0; response_count:0; response_revision:24403; }","duration":"269.76903ms","start":"2026-04-27T21:48:51.258206Z","end":"2026-04-27T21:48:51.527975Z","steps":["trace[1966335069] 'agreement among raft nodes before linearized reading' (duration: 269.621027ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:51.555932Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.993025ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/openstack.k-orc.cloud/volumetypes/\" range_end:\"/registry/openstack.k-orc.cloud/volumetypes0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-04-27T21:48:51.555992Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.197325ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cluster.x-k8s.io/clusters/\" range_end:\"/registry/cluster.x-k8s.io/clusters0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:48:51.556122Z","caller":"traceutil/trace.go:171","msg":"trace[108586529] range","detail":"{range_begin:/registry/cluster.x-k8s.io/clusters/; range_end:/registry/cluster.x-k8s.io/clusters0; response_count:0; response_revision:24403; }","duration":"182.368247ms","start":"2026-04-27T21:48:51.373733Z","end":"2026-04-27T21:48:51.556102Z","steps":["trace[108586529] 'agreement among raft nodes before linearized reading' (duration: 182.178044ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:51.556038Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.037178ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-27T21:48:51.556263Z","caller":"traceutil/trace.go:171","msg":"trace[717531592] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24403; }","duration":"177.293622ms","start":"2026-04-27T21:48:51.378955Z","end":"2026-04-27T21:48:51.556249Z","steps":["trace[717531592] 'agreement among raft nodes before linearized reading' (duration: 176.928045ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:51.556041Z","caller":"traceutil/trace.go:171","msg":"trace[1769806375] range","detail":"{range_begin:/registry/openstack.k-orc.cloud/volumetypes/; range_end:/registry/openstack.k-orc.cloud/volumetypes0; response_count:0; response_revision:24403; }","duration":"155.111538ms","start":"2026-04-27T21:48:51.4009Z","end":"2026-04-27T21:48:51.556012Z","steps":["trace[1769806375] 'agreement among raft nodes before linearized reading' (duration: 154.923974ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:51.730909Z","caller":"traceutil/trace.go:171","msg":"trace[1328409251] transaction","detail":"{read_only:false; response_revision:24406; number_of_response:1; }","duration":"161.949846ms","start":"2026-04-27T21:48:51.568924Z","end":"2026-04-27T21:48:51.730874Z","steps":["trace[1328409251] 'process raft request' (duration: 161.895975ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:51.731111Z","caller":"traceutil/trace.go:171","msg":"trace[1037178562] transaction","detail":"{read_only:false; response_revision:24405; number_of_response:1; }","duration":"163.19041ms","start":"2026-04-27T21:48:51.567889Z","end":"2026-04-27T21:48:51.73108Z","steps":["trace[1037178562] 'process raft request' (duration: 138.656582ms)","trace[1037178562] 'compare' (duration: 24.0623ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:51.731136Z","caller":"traceutil/trace.go:171","msg":"trace[1966261578] linearizableReadLoop","detail":"{readStateIndex:25197; appliedIndex:25196; }","duration":"162.335703ms","start":"2026-04-27T21:48:51.568788Z","end":"2026-04-27T21:48:51.731124Z","steps":["trace[1966261578] 'read index received' (duration: 137.690932ms)","trace[1966261578] 'applied index is now lower than readState.Index' (duration: 24.643211ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:48:51.73127Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.461215ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/\" range_end:\"/registry/masterleases0\" ","response":"range_response_count:1 size:140"} {"level":"info","ts":"2026-04-27T21:48:51.731318Z","caller":"traceutil/trace.go:171","msg":"trace[1127324778] range","detail":"{range_begin:/registry/masterleases/; range_end:/registry/masterleases0; response_count:1; response_revision:24406; }","duration":"162.543487ms","start":"2026-04-27T21:48:51.568764Z","end":"2026-04-27T21:48:51.731307Z","steps":["trace[1127324778] 'agreement among raft nodes before linearized reading' (duration: 162.392815ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:52.184244Z","caller":"traceutil/trace.go:171","msg":"trace[1575694344] linearizableReadLoop","detail":"{readStateIndex:25199; appliedIndex:25198; }","duration":"170.818522ms","start":"2026-04-27T21:48:52.013394Z","end":"2026-04-27T21:48:52.184213Z","steps":["trace[1575694344] 'read index received' (duration: 170.541617ms)","trace[1575694344] 'applied index is now lower than readState.Index' (duration: 275.425µs)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:52.184287Z","caller":"traceutil/trace.go:171","msg":"trace[63285010] transaction","detail":"{read_only:false; response_revision:24407; number_of_response:1; }","duration":"257.321258ms","start":"2026-04-27T21:48:51.926931Z","end":"2026-04-27T21:48:52.184252Z","steps":["trace[63285010] 'process raft request' (duration: 257.048083ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:52.184457Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.041897ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:48:52.186012Z","caller":"traceutil/trace.go:171","msg":"trace[1357254768] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24407; }","duration":"172.649426ms","start":"2026-04-27T21:48:52.013337Z","end":"2026-04-27T21:48:52.185986Z","steps":["trace[1357254768] 'agreement among raft nodes before linearized reading' (duration: 171.002055ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:52.19769Z","caller":"traceutil/trace.go:171","msg":"trace[505763459] transaction","detail":"{read_only:false; response_revision:24408; number_of_response:1; }","duration":"164.903332ms","start":"2026-04-27T21:48:52.03277Z","end":"2026-04-27T21:48:52.197674Z","steps":["trace[505763459] 'process raft request' (duration: 164.737989ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:52.483803Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.699252ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:48:52.483916Z","caller":"traceutil/trace.go:171","msg":"trace[1044023255] transaction","detail":"{read_only:false; response_revision:24410; number_of_response:1; }","duration":"273.397847ms","start":"2026-04-27T21:48:52.210499Z","end":"2026-04-27T21:48:52.483897Z","steps":["trace[1044023255] 'process raft request' (duration: 135.503091ms)","trace[1044023255] 'compare' (duration: 137.55822ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:53.080151Z","caller":"traceutil/trace.go:171","msg":"trace[1918693094] transaction","detail":"{read_only:false; response_revision:24412; number_of_response:1; }","duration":"187.123686ms","start":"2026-04-27T21:48:52.892984Z","end":"2026-04-27T21:48:53.080107Z","steps":["trace[1918693094] 'process raft request' (duration: 186.919122ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:53.371294Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.600892ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:48:53.371469Z","caller":"traceutil/trace.go:171","msg":"trace[1508693542] linearizableReadLoop","detail":"{readStateIndex:25206; appliedIndex:25204; }","duration":"150.46224ms","start":"2026-04-27T21:48:53.220986Z","end":"2026-04-27T21:48:53.371448Z","steps":["trace[1508693542] 'read index received' (duration: 91.061241ms)","trace[1508693542] 'applied index is now lower than readState.Index' (duration: 59.399959ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:48:53.371732Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.715075ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cluster.x-k8s.io/machinedeployments/\" range_end:\"/registry/cluster.x-k8s.io/machinedeployments0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:48:53.371876Z","caller":"traceutil/trace.go:171","msg":"trace[722321014] range","detail":"{range_begin:/registry/cluster.x-k8s.io/machinedeployments/; range_end:/registry/cluster.x-k8s.io/machinedeployments0; response_count:0; response_revision:24414; }","duration":"150.885458ms","start":"2026-04-27T21:48:53.220933Z","end":"2026-04-27T21:48:53.371818Z","steps":["trace[722321014] 'agreement among raft nodes before linearized reading' (duration: 150.666254ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:53.371866Z","caller":"traceutil/trace.go:171","msg":"trace[607768146] transaction","detail":"{read_only:false; response_revision:24413; number_of_response:1; }","duration":"275.335924ms","start":"2026-04-27T21:48:53.096487Z","end":"2026-04-27T21:48:53.371822Z","steps":["trace[607768146] 'process raft request' (duration: 100.128121ms)","trace[607768146] 'compare' (duration: 174.49559ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:53.372248Z","caller":"traceutil/trace.go:171","msg":"trace[1836713724] transaction","detail":"{read_only:false; response_revision:24414; number_of_response:1; }","duration":"264.999382ms","start":"2026-04-27T21:48:53.107222Z","end":"2026-04-27T21:48:53.372221Z","steps":["trace[1836713724] 'process raft request' (duration: 264.174205ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:53.562753Z","caller":"traceutil/trace.go:171","msg":"trace[404098201] transaction","detail":"{read_only:false; response_revision:24416; number_of_response:1; }","duration":"184.235253ms","start":"2026-04-27T21:48:53.378475Z","end":"2026-04-27T21:48:53.56271Z","steps":["trace[404098201] 'process raft request' (duration: 149.918021ms)","trace[404098201] 'compare' (duration: 34.116767ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:53.713969Z","caller":"traceutil/trace.go:171","msg":"trace[1569384380] transaction","detail":"{read_only:false; response_revision:24417; number_of_response:1; }","duration":"182.049331ms","start":"2026-04-27T21:48:53.531886Z","end":"2026-04-27T21:48:53.713935Z","steps":["trace[1569384380] 'process raft request' (duration: 167.201103ms)","trace[1569384380] 'compare' (duration: 14.709745ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:53.876457Z","caller":"traceutil/trace.go:171","msg":"trace[465460216] linearizableReadLoop","detail":"{readStateIndex:25210; appliedIndex:25208; }","duration":"311.565512ms","start":"2026-04-27T21:48:53.564865Z","end":"2026-04-27T21:48:53.87643Z","steps":["trace[465460216] 'read index received' (duration: 134.191988ms)","trace[465460216] 'applied index is now lower than readState.Index' (duration: 177.372134ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:53.876523Z","caller":"traceutil/trace.go:171","msg":"trace[729605277] transaction","detail":"{read_only:false; response_revision:24418; number_of_response:1; }","duration":"337.329313ms","start":"2026-04-27T21:48:53.539154Z","end":"2026-04-27T21:48:53.876483Z","steps":["trace[729605277] 'process raft request' (duration: 296.238065ms)","trace[729605277] 'compare' (duration: 40.922044ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:48:53.876611Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"311.734195ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/policies/\" range_end:\"/registry/rabbitmq.com/policies0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:48:53.876688Z","caller":"traceutil/trace.go:171","msg":"trace[1924798244] range","detail":"{range_begin:/registry/rabbitmq.com/policies/; range_end:/registry/rabbitmq.com/policies0; response_count:0; response_revision:24418; }","duration":"311.844757ms","start":"2026-04-27T21:48:53.56482Z","end":"2026-04-27T21:48:53.876665Z","steps":["trace[1924798244] 'agreement among raft nodes before linearized reading' (duration: 311.712365ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:53.876708Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:48:53.539133Z","time spent":"337.473136ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":498,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:48:53.876723Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:48:53.564806Z","time spent":"311.907128ms","remote":"127.0.0.1:54268","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":0,"response size":29,"request content":"key:\"/registry/rabbitmq.com/policies/\" range_end:\"/registry/rabbitmq.com/policies0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:48:53.87676Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.752693ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12217"} {"level":"info","ts":"2026-04-27T21:48:53.876802Z","caller":"traceutil/trace.go:171","msg":"trace[1637162224] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:24418; }","duration":"176.841874ms","start":"2026-04-27T21:48:53.699947Z","end":"2026-04-27T21:48:53.876789Z","steps":["trace[1637162224] 'agreement among raft nodes before linearized reading' (duration: 176.63924ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:53.876841Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.634237ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:509"} {"level":"warn","ts":"2026-04-27T21:48:53.876841Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.857181ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-27T21:48:53.876914Z","caller":"traceutil/trace.go:171","msg":"trace[107893438] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24418; }","duration":"141.985064ms","start":"2026-04-27T21:48:53.734914Z","end":"2026-04-27T21:48:53.876899Z","steps":["trace[107893438] 'agreement among raft nodes before linearized reading' (duration: 141.78903ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:53.87691Z","caller":"traceutil/trace.go:171","msg":"trace[1702976458] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:24418; }","duration":"141.734459ms","start":"2026-04-27T21:48:53.735158Z","end":"2026-04-27T21:48:53.876893Z","steps":["trace[1702976458] 'agreement among raft nodes before linearized reading' (duration: 141.543645ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:48:54.030064Z","caller":"traceutil/trace.go:171","msg":"trace[533947373] linearizableReadLoop","detail":"{readStateIndex:25212; appliedIndex:25211; }","duration":"147.837881ms","start":"2026-04-27T21:48:53.882208Z","end":"2026-04-27T21:48:54.030046Z","steps":["trace[533947373] 'read index received' (duration: 27.649576ms)","trace[533947373] 'applied index is now lower than readState.Index' (duration: 120.187545ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:48:54.030263Z","caller":"traceutil/trace.go:171","msg":"trace[1878720256] transaction","detail":"{read_only:false; response_revision:24420; number_of_response:1; }","duration":"148.293151ms","start":"2026-04-27T21:48:53.881946Z","end":"2026-04-27T21:48:54.030239Z","steps":["trace[1878720256] 'process raft request' (duration: 147.319463ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:54.030458Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.238699ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:18624"} {"level":"info","ts":"2026-04-27T21:48:54.030486Z","caller":"traceutil/trace.go:171","msg":"trace[227669204] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:24420; }","duration":"148.278229ms","start":"2026-04-27T21:48:53.882201Z","end":"2026-04-27T21:48:54.030479Z","steps":["trace[227669204] 'agreement among raft nodes before linearized reading' (duration: 148.177297ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:48:54.030569Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.9488ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-magnum-server-0\" ","response":"range_response_count:1 size:1860"} {"level":"info","ts":"2026-04-27T21:48:54.030669Z","caller":"traceutil/trace.go:171","msg":"trace[261173595] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-magnum-server-0; range_end:; response_count:1; response_revision:24420; }","duration":"129.057652ms","start":"2026-04-27T21:48:53.901577Z","end":"2026-04-27T21:48:54.030635Z","steps":["trace[261173595] 'agreement among raft nodes before linearized reading' (duration: 128.883958ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.390069Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":13305495669012739495,"retry-timeout":"500ms"} {"level":"info","ts":"2026-04-27T21:49:09.443677Z","caller":"traceutil/trace.go:171","msg":"trace[1102159443] transaction","detail":"{read_only:false; response_revision:24586; number_of_response:1; }","duration":"554.926379ms","start":"2026-04-27T21:49:08.888726Z","end":"2026-04-27T21:49:09.443652Z","steps":["trace[1102159443] 'process raft request' (duration: 554.654983ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.443964Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:08.888691Z","time spent":"555.092702ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:09.690327Z","caller":"traceutil/trace.go:171","msg":"trace[686247703] transaction","detail":"{read_only:false; response_revision:24587; number_of_response:1; }","duration":"649.77294ms","start":"2026-04-27T21:49:09.040513Z","end":"2026-04-27T21:49:09.690286Z","steps":["trace[686247703] 'process raft request' (duration: 602.530458ms)","trace[686247703] 'compare' (duration: 47.050279ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:09.690646Z","caller":"traceutil/trace.go:171","msg":"trace[524904233] transaction","detail":"{read_only:false; response_revision:24589; number_of_response:1; }","duration":"268.889555ms","start":"2026-04-27T21:49:09.42173Z","end":"2026-04-27T21:49:09.69062Z","steps":["trace[524904233] 'process raft request' (duration: 268.548128ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:09.690363Z","caller":"traceutil/trace.go:171","msg":"trace[489685941] transaction","detail":"{read_only:false; response_revision:24588; number_of_response:1; }","duration":"547.421409ms","start":"2026-04-27T21:49:09.142902Z","end":"2026-04-27T21:49:09.690324Z","steps":["trace[489685941] 'process raft request' (duration: 547.314397ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.691085Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:09.040482Z","time spent":"650.360042ms","remote":"127.0.0.1:38684","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":7732,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:09.691106Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:09.142877Z","time spent":"548.078651ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":605,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:09.691313Z","caller":"traceutil/trace.go:171","msg":"trace[1657137992] linearizableReadLoop","detail":"{readStateIndex:25384; appliedIndex:25381; }","duration":"801.266221ms","start":"2026-04-27T21:49:08.89001Z","end":"2026-04-27T21:49:09.691276Z","steps":["trace[1657137992] 'read index received' (duration: 553.399279ms)","trace[1657137992] 'applied index is now lower than readState.Index' (duration: 247.862852ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:09.691218Z","caller":"traceutil/trace.go:171","msg":"trace[798546443] transaction","detail":"{read_only:false; response_revision:24590; number_of_response:1; }","duration":"269.254601ms","start":"2026-04-27T21:49:09.42192Z","end":"2026-04-27T21:49:09.691175Z","steps":["trace[798546443] 'process raft request' (duration: 268.611779ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.691491Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"801.469394ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-octavia-server-0\" ","response":"range_response_count:1 size:1864"} {"level":"info","ts":"2026-04-27T21:49:09.691557Z","caller":"traceutil/trace.go:171","msg":"trace[1663575510] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-octavia-server-0; range_end:; response_count:1; response_revision:24590; }","duration":"801.593756ms","start":"2026-04-27T21:49:08.889945Z","end":"2026-04-27T21:49:09.691538Z","steps":["trace[1663575510] 'agreement among raft nodes before linearized reading' (duration: 801.407433ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.691594Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:08.889921Z","time spent":"801.664668ms","remote":"127.0.0.1:51946","response type":"/etcdserverpb.KV/Range","request count":0,"request size":82,"response count":1,"response size":1887,"request content":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-octavia-server-0\" "} {"level":"info","ts":"2026-04-27T21:49:09.716773Z","caller":"traceutil/trace.go:171","msg":"trace[1740255078] transaction","detail":"{read_only:false; response_revision:24591; number_of_response:1; }","duration":"263.253558ms","start":"2026-04-27T21:49:09.453499Z","end":"2026-04-27T21:49:09.716752Z","steps":["trace[1740255078] 'process raft request' (duration: 263.100406ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:09.71704Z","caller":"traceutil/trace.go:171","msg":"trace[224488847] transaction","detail":"{read_only:false; response_revision:24592; number_of_response:1; }","duration":"251.770433ms","start":"2026-04-27T21:49:09.465205Z","end":"2026-04-27T21:49:09.716976Z","steps":["trace[224488847] 'process raft request' (duration: 251.498768ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.717314Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"703.728418ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-04-27T21:49:09.717363Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.512282ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secretgen.carvel.dev/secretimports/\" range_end:\"/registry/secretgen.carvel.dev/secretimports0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-04-27T21:49:09.7174Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"395.960378ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12217"} {"level":"info","ts":"2026-04-27T21:49:09.717376Z","caller":"traceutil/trace.go:171","msg":"trace[1303554021] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24592; }","duration":"703.85164ms","start":"2026-04-27T21:49:09.013507Z","end":"2026-04-27T21:49:09.717359Z","steps":["trace[1303554021] 'agreement among raft nodes before linearized reading' (duration: 703.674737ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:09.717463Z","caller":"traceutil/trace.go:171","msg":"trace[460043642] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:24592; }","duration":"396.066649ms","start":"2026-04-27T21:49:09.321381Z","end":"2026-04-27T21:49:09.717448Z","steps":["trace[460043642] 'agreement among raft nodes before linearized reading' (duration: 395.884426ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.717497Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:09.321359Z","time spent":"396.130661ms","remote":"127.0.0.1:51968","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":12240,"request content":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" "} {"level":"warn","ts":"2026-04-27T21:49:09.717571Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:09.013492Z","time spent":"703.971422ms","remote":"127.0.0.1:51772","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-04-27T21:49:09.717466Z","caller":"traceutil/trace.go:171","msg":"trace[1244764215] range","detail":"{range_begin:/registry/secretgen.carvel.dev/secretimports/; range_end:/registry/secretgen.carvel.dev/secretimports0; response_count:0; response_revision:24592; }","duration":"112.674655ms","start":"2026-04-27T21:49:09.60477Z","end":"2026-04-27T21:49:09.717445Z","steps":["trace[1244764215] 'agreement among raft nodes before linearized reading' (duration: 112.438031ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.717927Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"734.199868ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephnfses/\" range_end:\"/registry/ceph.rook.io/cephnfses0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:09.718006Z","caller":"traceutil/trace.go:171","msg":"trace[1656357781] range","detail":"{range_begin:/registry/ceph.rook.io/cephnfses/; range_end:/registry/ceph.rook.io/cephnfses0; response_count:0; response_revision:24592; }","duration":"734.3192ms","start":"2026-04-27T21:49:08.983673Z","end":"2026-04-27T21:49:09.717992Z","steps":["trace[1656357781] 'agreement among raft nodes before linearized reading' (duration: 734.152777ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.718108Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:08.983655Z","time spent":"734.411021ms","remote":"127.0.0.1:38770","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":0,"response size":29,"request content":"key:\"/registry/ceph.rook.io/cephnfses/\" range_end:\"/registry/ceph.rook.io/cephnfses0\" count_only:true "} {"level":"info","ts":"2026-04-27T21:49:09.824244Z","caller":"traceutil/trace.go:171","msg":"trace[1871920591] transaction","detail":"{read_only:false; response_revision:24593; number_of_response:1; }","duration":"102.22421ms","start":"2026-04-27T21:49:09.721984Z","end":"2026-04-27T21:49:09.824209Z","steps":["trace[1871920591] 'process raft request' (duration: 79.863012ms)","trace[1871920591] 'compare' (duration: 22.186174ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:09.824311Z","caller":"traceutil/trace.go:171","msg":"trace[1297143193] linearizableReadLoop","detail":"{readStateIndex:25389; appliedIndex:25388; }","duration":"102.200309ms","start":"2026-04-27T21:49:09.72208Z","end":"2026-04-27T21:49:09.824281Z","steps":["trace[1297143193] 'read index received' (duration: 79.78223ms)","trace[1297143193] 'applied index is now lower than readState.Index' (duration: 22.416829ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:09.824553Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.105578ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/data-ovn-ovsdb-sb-0\" ","response":"range_response_count:1 size:1566"} {"level":"info","ts":"2026-04-27T21:49:09.824616Z","caller":"traceutil/trace.go:171","msg":"trace[545531178] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/data-ovn-ovsdb-sb-0; range_end:; response_count:1; response_revision:24594; }","duration":"102.20483ms","start":"2026-04-27T21:49:09.722394Z","end":"2026-04-27T21:49:09.824599Z","steps":["trace[545531178] 'agreement among raft nodes before linearized reading' (duration: 102.027996ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:09.824583Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.482825ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:18624"} {"level":"info","ts":"2026-04-27T21:49:09.824682Z","caller":"traceutil/trace.go:171","msg":"trace[1784280419] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:24594; }","duration":"102.607147ms","start":"2026-04-27T21:49:09.722056Z","end":"2026-04-27T21:49:09.824663Z","steps":["trace[1784280419] 'agreement among raft nodes before linearized reading' (duration: 102.307761ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:10.301389Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.695081ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:49:10.301495Z","caller":"traceutil/trace.go:171","msg":"trace[1087598406] linearizableReadLoop","detail":"{readStateIndex:25394; appliedIndex:25393; }","duration":"326.825347ms","start":"2026-04-27T21:49:09.974653Z","end":"2026-04-27T21:49:10.301479Z","steps":["trace[1087598406] 'read index received' (duration: 88.897551ms)","trace[1087598406] 'applied index is now lower than readState.Index' (duration: 237.926776ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:10.301597Z","caller":"traceutil/trace.go:171","msg":"trace[1691816434] transaction","detail":"{read_only:false; response_revision:24598; number_of_response:1; }","duration":"328.192701ms","start":"2026-04-27T21:49:09.973367Z","end":"2026-04-27T21:49:10.30156Z","steps":["trace[1691816434] 'process raft request' (duration: 90.247556ms)","trace[1691816434] 'compare' (duration: 237.354624ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:10.301677Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"327.00689ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:509"} {"level":"info","ts":"2026-04-27T21:49:10.301754Z","caller":"traceutil/trace.go:171","msg":"trace[1725517507] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:24598; }","duration":"327.126832ms","start":"2026-04-27T21:49:09.974609Z","end":"2026-04-27T21:49:10.301736Z","steps":["trace[1725517507] 'agreement among raft nodes before linearized reading' (duration: 326.943649ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:10.301813Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:09.973357Z","time spent":"328.330064ms","remote":"127.0.0.1:51856","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":729,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:10.30183Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:09.974588Z","time spent":"327.220244ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":532,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-04-27T21:49:10.301881Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.401112ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-04-27T21:49:10.30194Z","caller":"traceutil/trace.go:171","msg":"trace[1409827294] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24598; }","duration":"179.501004ms","start":"2026-04-27T21:49:10.122424Z","end":"2026-04-27T21:49:10.301925Z","steps":["trace[1409827294] 'agreement among raft nodes before linearized reading' (duration: 179.146127ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:10.302104Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.506611ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/\" range_end:\"/registry/serviceaccounts0\" count_only:true ","response":"range_response_count:0 size:9"} {"level":"info","ts":"2026-04-27T21:49:10.302205Z","caller":"traceutil/trace.go:171","msg":"trace[1846263959] range","detail":"{range_begin:/registry/serviceaccounts/; range_end:/registry/serviceaccounts0; response_count:0; response_revision:24598; }","duration":"166.640073ms","start":"2026-04-27T21:49:10.135545Z","end":"2026-04-27T21:49:10.302185Z","steps":["trace[1846263959] 'agreement among raft nodes before linearized reading' (duration: 166.084842ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:10.674608Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.021308ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:49:10.674893Z","caller":"traceutil/trace.go:171","msg":"trace[1951018516] transaction","detail":"{read_only:false; response_revision:24599; number_of_response:1; }","duration":"369.26177ms","start":"2026-04-27T21:49:10.305602Z","end":"2026-04-27T21:49:10.674863Z","steps":["trace[1951018516] 'process raft request' (duration: 169.877355ms)","trace[1951018516] 'compare' (duration: 198.729503ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:10.675041Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.305558Z","time spent":"369.407423ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:10.675333Z","caller":"traceutil/trace.go:171","msg":"trace[350050789] transaction","detail":"{read_only:false; response_revision:24600; number_of_response:1; }","duration":"369.208668ms","start":"2026-04-27T21:49:10.306105Z","end":"2026-04-27T21:49:10.675314Z","steps":["trace[350050789] 'process raft request' (duration: 368.903832ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:10.675496Z","caller":"traceutil/trace.go:171","msg":"trace[1467020967] linearizableReadLoop","detail":"{readStateIndex:25397; appliedIndex:25394; }","duration":"335.478288ms","start":"2026-04-27T21:49:10.339967Z","end":"2026-04-27T21:49:10.675445Z","steps":["trace[1467020967] 'read index received' (duration: 135.523633ms)","trace[1467020967] 'applied index is now lower than readState.Index' (duration: 199.951755ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:10.675552Z","caller":"traceutil/trace.go:171","msg":"trace[942386208] transaction","detail":"{read_only:false; response_revision:24601; number_of_response:1; }","duration":"369.3095ms","start":"2026-04-27T21:49:10.306214Z","end":"2026-04-27T21:49:10.675524Z","steps":["trace[942386208] 'process raft request' (duration: 369.048275ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:10.675693Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.306191Z","time spent":"369.425063ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":522,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:10.675491Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.30608Z","time spent":"369.30314ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:10.675797Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"335.780834ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:440"} {"level":"warn","ts":"2026-04-27T21:49:10.675782Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.213009ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-a405194e-cbd6-498f-8df1-320a779edd90\" ","response":"range_response_count:1 size:3644"} {"level":"info","ts":"2026-04-27T21:49:10.675913Z","caller":"traceutil/trace.go:171","msg":"trace[1617019546] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:24601; }","duration":"335.976838ms","start":"2026-04-27T21:49:10.339917Z","end":"2026-04-27T21:49:10.675894Z","steps":["trace[1617019546] 'agreement among raft nodes before linearized reading' (duration: 335.647272ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:10.676098Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.339903Z","time spent":"336.175151ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":463,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-04-27T21:49:10.675945Z","caller":"traceutil/trace.go:171","msg":"trace[791323117] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-a405194e-cbd6-498f-8df1-320a779edd90; range_end:; response_count:1; response_revision:24601; }","duration":"201.428262ms","start":"2026-04-27T21:49:10.474493Z","end":"2026-04-27T21:49:10.675921Z","steps":["trace[791323117] 'agreement among raft nodes before linearized reading' (duration: 201.162097ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:11.014997Z","caller":"traceutil/trace.go:171","msg":"trace[360125643] transaction","detail":"{read_only:false; response_revision:24602; number_of_response:1; }","duration":"334.811155ms","start":"2026-04-27T21:49:10.680154Z","end":"2026-04-27T21:49:11.014965Z","steps":["trace[360125643] 'process raft request' (duration: 314.288922ms)","trace[360125643] 'compare' (duration: 20.3817ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:11.015186Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.680135Z","time spent":"334.948928ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:11.193529Z","caller":"traceutil/trace.go:171","msg":"trace[44304686] transaction","detail":"{read_only:false; response_revision:24603; number_of_response:1; }","duration":"513.317091ms","start":"2026-04-27T21:49:10.68019Z","end":"2026-04-27T21:49:11.193507Z","steps":["trace[44304686] 'process raft request' (duration: 506.775239ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:11.193653Z","caller":"traceutil/trace.go:171","msg":"trace[1433078609] transaction","detail":"{read_only:false; response_revision:24604; number_of_response:1; }","duration":"511.16679ms","start":"2026-04-27T21:49:10.682466Z","end":"2026-04-27T21:49:11.193633Z","steps":["trace[1433078609] 'process raft request' (duration: 510.952067ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:11.193872Z","caller":"traceutil/trace.go:171","msg":"trace[966865374] transaction","detail":"{read_only:false; response_revision:24605; number_of_response:1; }","duration":"474.134929ms","start":"2026-04-27T21:49:10.719722Z","end":"2026-04-27T21:49:11.193857Z","steps":["trace[966865374] 'process raft request' (duration: 473.851593ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:11.193886Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"319.244225ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-a405194e-cbd6-498f-8df1-320a779edd90\" ","response":"range_response_count:1 size:3764"} {"level":"warn","ts":"2026-04-27T21:49:11.19393Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.719705Z","time spent":"474.199659ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:11.193943Z","caller":"traceutil/trace.go:171","msg":"trace[1131013065] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-a405194e-cbd6-498f-8df1-320a779edd90; range_end:; response_count:1; response_revision:24605; }","duration":"319.306016ms","start":"2026-04-27T21:49:10.874616Z","end":"2026-04-27T21:49:11.193922Z","steps":["trace[1131013065] 'agreement among raft nodes before linearized reading' (duration: 319.193574ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:11.194022Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.874544Z","time spent":"319.461709ms","remote":"127.0.0.1:51968","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":1,"response size":3787,"request content":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-a405194e-cbd6-498f-8df1-320a779edd90\" "} {"level":"warn","ts":"2026-04-27T21:49:11.19407Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.68244Z","time spent":"511.416394ms","remote":"127.0.0.1:51968","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3746,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:11.193672Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.680166Z","time spent":"513.434353ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:11.193758Z","caller":"traceutil/trace.go:171","msg":"trace[732720657] linearizableReadLoop","detail":"{readStateIndex:25401; appliedIndex:25397; }","duration":"319.099432ms","start":"2026-04-27T21:49:10.874633Z","end":"2026-04-27T21:49:11.193732Z","steps":["trace[732720657] 'read index received' (duration: 119.85561ms)","trace[732720657] 'applied index is now lower than readState.Index' (duration: 199.242832ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:11.194319Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"305.502858ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/monitoring.coreos.com/scrapeconfigs/\" range_end:\"/registry/monitoring.coreos.com/scrapeconfigs0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:11.194354Z","caller":"traceutil/trace.go:171","msg":"trace[1818009957] range","detail":"{range_begin:/registry/monitoring.coreos.com/scrapeconfigs/; range_end:/registry/monitoring.coreos.com/scrapeconfigs0; response_count:0; response_revision:24605; }","duration":"305.582049ms","start":"2026-04-27T21:49:10.888763Z","end":"2026-04-27T21:49:11.194345Z","steps":["trace[1818009957] 'agreement among raft nodes before linearized reading' (duration: 305.509288ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:11.194376Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:10.888716Z","time spent":"305.653691ms","remote":"127.0.0.1:45708","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":29,"request content":"key:\"/registry/monitoring.coreos.com/scrapeconfigs/\" range_end:\"/registry/monitoring.coreos.com/scrapeconfigs0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:49:11.194404Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.210534ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:11.194449Z","caller":"traceutil/trace.go:171","msg":"trace[1100725925] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24605; }","duration":"182.304877ms","start":"2026-04-27T21:49:11.012134Z","end":"2026-04-27T21:49:11.194439Z","steps":["trace[1100725925] 'agreement among raft nodes before linearized reading' (duration: 182.233525ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:11.194507Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"139.375594ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.210\" ","response":"range_response_count:1 size:140"} {"level":"info","ts":"2026-04-27T21:49:11.194586Z","caller":"traceutil/trace.go:171","msg":"trace[1915746982] range","detail":"{range_begin:/registry/masterleases/199.204.45.210; range_end:; response_count:1; response_revision:24605; }","duration":"139.501926ms","start":"2026-04-27T21:49:11.055066Z","end":"2026-04-27T21:49:11.194568Z","steps":["trace[1915746982] 'agreement among raft nodes before linearized reading' (duration: 139.258611ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:11.487151Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.626844ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:49:11.487286Z","caller":"traceutil/trace.go:171","msg":"trace[678533438] linearizableReadLoop","detail":"{readStateIndex:25403; appliedIndex:25402; }","duration":"228.806746ms","start":"2026-04-27T21:49:11.258456Z","end":"2026-04-27T21:49:11.487263Z","steps":["trace[678533438] 'read index received' (duration: 92.984358ms)","trace[678533438] 'applied index is now lower than readState.Index' (duration: 135.816958ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:11.487311Z","caller":"traceutil/trace.go:171","msg":"trace[2115027245] transaction","detail":"{read_only:false; response_revision:24606; number_of_response:1; }","duration":"272.95542ms","start":"2026-04-27T21:49:11.214323Z","end":"2026-04-27T21:49:11.487278Z","steps":["trace[2115027245] 'process raft request' (duration: 137.107692ms)","trace[2115027245] 'compare' (duration: 135.299798ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:11.487469Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.966529ms","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:6"} {"level":"info","ts":"2026-04-27T21:49:11.487522Z","caller":"traceutil/trace.go:171","msg":"trace[364679092] range","detail":"{range_begin:/registry/rabbitmq.com/vhosts/; range_end:/registry/rabbitmq.com/vhosts0; response_count:0; response_revision:24606; }","duration":"229.0845ms","start":"2026-04-27T21:49:11.258424Z","end":"2026-04-27T21:49:11.487508Z","steps":["trace[364679092] 'agreement among raft nodes before linearized reading' (duration: 228.912017ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:11.573272Z","caller":"traceutil/trace.go:171","msg":"trace[1872459107] transaction","detail":"{read_only:false; response_revision:24607; number_of_response:1; }","duration":"123.373215ms","start":"2026-04-27T21:49:11.449871Z","end":"2026-04-27T21:49:11.573245Z","steps":["trace[1872459107] 'process raft request' (duration: 123.119581ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:12.126867Z","caller":"traceutil/trace.go:171","msg":"trace[1381567821] transaction","detail":"{read_only:false; response_revision:24609; number_of_response:1; }","duration":"429.82403ms","start":"2026-04-27T21:49:11.697021Z","end":"2026-04-27T21:49:12.126846Z","steps":["trace[1381567821] 'process raft request' (duration: 429.611196ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.127018Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:11.696989Z","time spent":"429.946773ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:12.127148Z","caller":"traceutil/trace.go:171","msg":"trace[920505772] linearizableReadLoop","detail":"{readStateIndex:25406; appliedIndex:25404; }","duration":"430.039874ms","start":"2026-04-27T21:49:11.697089Z","end":"2026-04-27T21:49:12.127129Z","steps":["trace[920505772] 'read index received' (duration: 81.040554ms)","trace[920505772] 'applied index is now lower than readState.Index' (duration: 348.99856ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:12.127153Z","caller":"traceutil/trace.go:171","msg":"trace[601354954] transaction","detail":"{read_only:false; response_revision:24610; number_of_response:1; }","duration":"429.796279ms","start":"2026-04-27T21:49:11.697331Z","end":"2026-04-27T21:49:12.127128Z","steps":["trace[601354954] 'process raft request' (duration: 429.472433ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:12.127206Z","caller":"traceutil/trace.go:171","msg":"trace[1645061124] transaction","detail":"{read_only:false; response_revision:24611; number_of_response:1; }","duration":"405.363983ms","start":"2026-04-27T21:49:11.721805Z","end":"2026-04-27T21:49:12.127169Z","steps":["trace[1645061124] 'process raft request' (duration: 405.222881ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.127284Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"430.176617ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"warn","ts":"2026-04-27T21:49:12.127304Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:11.697315Z","time spent":"429.918092ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":607,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:12.127309Z","caller":"traceutil/trace.go:171","msg":"trace[191809259] range","detail":"{range_begin:/registry/ingress/; range_end:/registry/ingress0; response_count:0; response_revision:24611; }","duration":"430.26096ms","start":"2026-04-27T21:49:11.697043Z","end":"2026-04-27T21:49:12.127304Z","steps":["trace[191809259] 'agreement among raft nodes before linearized reading' (duration: 430.166467ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.127402Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:11.697023Z","time spent":"430.353421ms","remote":"127.0.0.1:52086","response type":"/etcdserverpb.KV/Range","request count":0,"request size":42,"response count":18,"response size":31,"request content":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:49:12.127388Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:11.721779Z","time spent":"405.514366ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":523,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:12.446443Z","caller":"traceutil/trace.go:171","msg":"trace[1944910197] transaction","detail":"{read_only:false; response_revision:24612; number_of_response:1; }","duration":"616.012968ms","start":"2026-04-27T21:49:11.830405Z","end":"2026-04-27T21:49:12.446418Z","steps":["trace[1944910197] 'process raft request' (duration: 615.772194ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.446615Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:11.830379Z","time spent":"616.137411ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":541,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:12.446863Z","caller":"traceutil/trace.go:171","msg":"trace[1524863135] transaction","detail":"{read_only:false; response_revision:24613; number_of_response:1; }","duration":"509.329996ms","start":"2026-04-27T21:49:11.937521Z","end":"2026-04-27T21:49:12.446851Z","steps":["trace[1524863135] 'process raft request' (duration: 508.845776ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:12.446885Z","caller":"traceutil/trace.go:171","msg":"trace[1157431515] linearizableReadLoop","detail":"{readStateIndex:25411; appliedIndex:25408; }","duration":"319.655633ms","start":"2026-04-27T21:49:12.127202Z","end":"2026-04-27T21:49:12.446858Z","steps":["trace[1157431515] 'read index received' (duration: 319.078132ms)","trace[1157431515] 'applied index is now lower than readState.Index' (duration: 576.201µs)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:12.44696Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:11.937502Z","time spent":"509.394978ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":475,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:12.447044Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"433.053361ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:12.447084Z","caller":"traceutil/trace.go:171","msg":"trace[1169433519] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24614; }","duration":"433.153233ms","start":"2026-04-27T21:49:12.01392Z","end":"2026-04-27T21:49:12.447074Z","steps":["trace[1169433519] 'agreement among raft nodes before linearized reading' (duration: 433.069382ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:12.44708Z","caller":"traceutil/trace.go:171","msg":"trace[264905192] transaction","detail":"{read_only:false; response_revision:24614; number_of_response:1; }","duration":"475.360292ms","start":"2026-04-27T21:49:11.971706Z","end":"2026-04-27T21:49:12.447066Z","steps":["trace[264905192] 'process raft request' (duration: 475.017666ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.447076Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.449591ms","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:8"} {"level":"warn","ts":"2026-04-27T21:49:12.447134Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:12.013893Z","time spent":"433.218245ms","remote":"127.0.0.1:51772","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-04-27T21:49:12.447155Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:11.971687Z","time spent":"475.427493ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":498,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:12.447184Z","caller":"traceutil/trace.go:171","msg":"trace[2054957456] range","detail":"{range_begin:/registry/cert-manager.io/certificaterequests/; range_end:/registry/cert-manager.io/certificaterequests0; response_count:0; response_revision:24614; }","duration":"340.628715ms","start":"2026-04-27T21:49:12.106527Z","end":"2026-04-27T21:49:12.447155Z","steps":["trace[2054957456] 'agreement among raft nodes before linearized reading' (duration: 340.37932ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.447249Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:12.106506Z","time spent":"340.726796ms","remote":"127.0.0.1:44868","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":37,"response size":31,"request content":"key:\"/registry/cert-manager.io/certificaterequests/\" range_end:\"/registry/cert-manager.io/certificaterequests0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:49:12.447361Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"618.086839ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:495"} {"level":"info","ts":"2026-04-27T21:49:12.44748Z","caller":"traceutil/trace.go:171","msg":"trace[322978558] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:24614; }","duration":"618.261862ms","start":"2026-04-27T21:49:11.82919Z","end":"2026-04-27T21:49:12.447452Z","steps":["trace[322978558] 'agreement among raft nodes before linearized reading' (duration: 617.909716ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.447544Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:11.829167Z","time spent":"618.365204ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":518,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-04-27T21:49:12.485139Z","caller":"traceutil/trace.go:171","msg":"trace[2027376042] transaction","detail":"{read_only:false; response_revision:24615; number_of_response:1; }","duration":"258.170623ms","start":"2026-04-27T21:49:12.226942Z","end":"2026-04-27T21:49:12.485113Z","steps":["trace[2027376042] 'process raft request' (duration: 258.023331ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.485475Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.53754ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/openstack/persistence-rabbitmq-manila-server-0.18aa55141d84101d\" ","response":"range_response_count:1 size:1010"} {"level":"info","ts":"2026-04-27T21:49:12.48554Z","caller":"traceutil/trace.go:171","msg":"trace[171603847] range","detail":"{range_begin:/registry/events/openstack/persistence-rabbitmq-manila-server-0.18aa55141d84101d; range_end:; response_count:1; response_revision:24615; }","duration":"175.606571ms","start":"2026-04-27T21:49:12.309916Z","end":"2026-04-27T21:49:12.485523Z","steps":["trace[171603847] 'agreement among raft nodes before linearized reading' (duration: 175.342606ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.485709Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.357878ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-a405194e-cbd6-498f-8df1-320a779edd90\" ","response":"range_response_count:1 size:3764"} {"level":"info","ts":"2026-04-27T21:49:12.485831Z","caller":"traceutil/trace.go:171","msg":"trace[1117416470] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-a405194e-cbd6-498f-8df1-320a779edd90; range_end:; response_count:1; response_revision:24615; }","duration":"287.546552ms","start":"2026-04-27T21:49:12.198256Z","end":"2026-04-27T21:49:12.485802Z","steps":["trace[1117416470] 'agreement among raft nodes before linearized reading' (duration: 287.151755ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.853703Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.082213ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:12.853833Z","caller":"traceutil/trace.go:171","msg":"trace[1601978826] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:24616; }","duration":"144.226985ms","start":"2026-04-27T21:49:12.709586Z","end":"2026-04-27T21:49:12.853813Z","steps":["trace[1601978826] 'range keys from in-memory index tree' (duration: 144.063742ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.853876Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"218.883389ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:49:12.853957Z","caller":"traceutil/trace.go:171","msg":"trace[1491644421] linearizableReadLoop","detail":"{readStateIndex:25414; appliedIndex:25413; }","duration":"189.762066ms","start":"2026-04-27T21:49:12.664183Z","end":"2026-04-27T21:49:12.853945Z","steps":["trace[1491644421] 'read index received' (duration: 58.791µs)","trace[1491644421] 'applied index is now lower than readState.Index' (duration: 189.702405ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:12.853965Z","caller":"traceutil/trace.go:171","msg":"trace[1892173151] transaction","detail":"{read_only:false; response_revision:24617; number_of_response:1; }","duration":"365.986338ms","start":"2026-04-27T21:49:12.487965Z","end":"2026-04-27T21:49:12.853952Z","steps":["trace[1892173151] 'process raft request' (duration: 146.957836ms)","trace[1892173151] 'compare' (duration: 218.494082ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:12.854044Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:12.487936Z","time spent":"366.08346ms","remote":"127.0.0.1:51856","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":992,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:12.854122Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.931219ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/rabbitmqclusters/openstack/rabbitmq-manila\" ","response":"range_response_count:1 size:3309"} {"level":"info","ts":"2026-04-27T21:49:12.854211Z","caller":"traceutil/trace.go:171","msg":"trace[393199611] range","detail":"{range_begin:/registry/rabbitmq.com/rabbitmqclusters/openstack/rabbitmq-manila; range_end:; response_count:1; response_revision:24617; }","duration":"190.075801ms","start":"2026-04-27T21:49:12.664118Z","end":"2026-04-27T21:49:12.854193Z","steps":["trace[393199611] 'agreement among raft nodes before linearized reading' (duration: 189.877668ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:12.854458Z","caller":"traceutil/trace.go:171","msg":"trace[1260124863] transaction","detail":"{read_only:false; response_revision:24618; number_of_response:1; }","duration":"173.258087ms","start":"2026-04-27T21:49:12.681186Z","end":"2026-04-27T21:49:12.854444Z","steps":["trace[1260124863] 'process raft request' (duration: 172.933231ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.854515Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.476469ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-04-27T21:49:12.854629Z","caller":"traceutil/trace.go:171","msg":"trace[2015408433] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24618; }","duration":"174.636053ms","start":"2026-04-27T21:49:12.679966Z","end":"2026-04-27T21:49:12.854602Z","steps":["trace[2015408433] 'agreement among raft nodes before linearized reading' (duration: 174.335417ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:12.855144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.429739ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:509"} {"level":"info","ts":"2026-04-27T21:49:12.856072Z","caller":"traceutil/trace.go:171","msg":"trace[67402713] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:24618; }","duration":"175.174433ms","start":"2026-04-27T21:49:12.680596Z","end":"2026-04-27T21:49:12.855771Z","steps":["trace[67402713] 'agreement among raft nodes before linearized reading' (duration: 174.302556ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:13.164564Z","caller":"traceutil/trace.go:171","msg":"trace[793395269] transaction","detail":"{read_only:false; response_revision:24619; number_of_response:1; }","duration":"305.250573ms","start":"2026-04-27T21:49:12.85928Z","end":"2026-04-27T21:49:13.16453Z","steps":["trace[793395269] 'process raft request' (duration: 301.263068ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:13.16474Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:12.859257Z","time spent":"305.385186ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:13.173263Z","caller":"traceutil/trace.go:171","msg":"trace[555955439] linearizableReadLoop","detail":"{readStateIndex:25417; appliedIndex:25415; }","duration":"158.95948ms","start":"2026-04-27T21:49:13.014287Z","end":"2026-04-27T21:49:13.173247Z","steps":["trace[555955439] 'read index received' (duration: 146.194731ms)","trace[555955439] 'applied index is now lower than readState.Index' (duration: 12.763659ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:13.17339Z","caller":"traceutil/trace.go:171","msg":"trace[494200155] transaction","detail":"{read_only:false; response_revision:24620; number_of_response:1; }","duration":"313.884635ms","start":"2026-04-27T21:49:12.859482Z","end":"2026-04-27T21:49:13.173366Z","steps":["trace[494200155] 'process raft request' (duration: 313.652161ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:13.173435Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"159.141644ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:13.173487Z","caller":"traceutil/trace.go:171","msg":"trace[345133042] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24620; }","duration":"159.248136ms","start":"2026-04-27T21:49:13.014228Z","end":"2026-04-27T21:49:13.173477Z","steps":["trace[345133042] 'agreement among raft nodes before linearized reading' (duration: 159.161615ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:13.173489Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:12.859451Z","time spent":"313.991127ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:13.173508Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.332203ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumcidrgroups/\" range_end:\"/registry/cilium.io/ciliumcidrgroups0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-04-27T21:49:13.173531Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.752491ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:482"} {"level":"info","ts":"2026-04-27T21:49:13.17359Z","caller":"traceutil/trace.go:171","msg":"trace[1331378272] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:24620; }","duration":"154.868663ms","start":"2026-04-27T21:49:13.018708Z","end":"2026-04-27T21:49:13.173577Z","steps":["trace[1331378272] 'agreement among raft nodes before linearized reading' (duration: 154.68431ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:13.173591Z","caller":"traceutil/trace.go:171","msg":"trace[160773766] range","detail":"{range_begin:/registry/cilium.io/ciliumcidrgroups/; range_end:/registry/cilium.io/ciliumcidrgroups0; response_count:0; response_revision:24620; }","duration":"154.443696ms","start":"2026-04-27T21:49:13.019126Z","end":"2026-04-27T21:49:13.173569Z","steps":["trace[160773766] 'agreement among raft nodes before linearized reading' (duration: 154.307983ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:19.350883Z","caller":"traceutil/trace.go:171","msg":"trace[790142856] linearizableReadLoop","detail":"{readStateIndex:25484; appliedIndex:25483; }","duration":"153.779253ms","start":"2026-04-27T21:49:19.197087Z","end":"2026-04-27T21:49:19.350867Z","steps":["trace[790142856] 'read index received' (duration: 153.652321ms)","trace[790142856] 'applied index is now lower than readState.Index' (duration: 126.212µs)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:19.351044Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.951566ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-04-27T21:49:19.351066Z","caller":"traceutil/trace.go:171","msg":"trace[359976215] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24685; }","duration":"153.988617ms","start":"2026-04-27T21:49:19.197072Z","end":"2026-04-27T21:49:19.35106Z","steps":["trace[359976215] 'agreement among raft nodes before linearized reading' (duration: 153.889145ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:19.351193Z","caller":"traceutil/trace.go:171","msg":"trace[1378022251] transaction","detail":"{read_only:false; response_revision:24685; number_of_response:1; }","duration":"161.952536ms","start":"2026-04-27T21:49:19.189025Z","end":"2026-04-27T21:49:19.350978Z","steps":["trace[1378022251] 'process raft request' (duration: 161.731562ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:19.728557Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.316852ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:49:19.728754Z","caller":"traceutil/trace.go:171","msg":"trace[2075401708] transaction","detail":"{read_only:false; response_revision:24689; number_of_response:1; }","duration":"132.990964ms","start":"2026-04-27T21:49:19.595751Z","end":"2026-04-27T21:49:19.728742Z","steps":["trace[2075401708] 'process raft request' (duration: 132.963454ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:19.728917Z","caller":"traceutil/trace.go:171","msg":"trace[1879334089] linearizableReadLoop","detail":"{readStateIndex:25487; appliedIndex:25485; }","duration":"203.9252ms","start":"2026-04-27T21:49:19.524957Z","end":"2026-04-27T21:49:19.728883Z","steps":["trace[1879334089] 'read index received' (duration: 63.12594ms)","trace[1879334089] 'applied index is now lower than readState.Index' (duration: 140.79549ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:19.728955Z","caller":"traceutil/trace.go:171","msg":"trace[558521170] transaction","detail":"{read_only:false; response_revision:24688; number_of_response:1; }","duration":"370.88882ms","start":"2026-04-27T21:49:19.358035Z","end":"2026-04-27T21:49:19.728924Z","steps":["trace[558521170] 'process raft request' (duration: 370.595804ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:19.729073Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.094913ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:19.729117Z","caller":"traceutil/trace.go:171","msg":"trace[2099759873] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24689; }","duration":"204.201695ms","start":"2026-04-27T21:49:19.524905Z","end":"2026-04-27T21:49:19.729106Z","steps":["trace[2099759873] 'agreement among raft nodes before linearized reading' (duration: 204.089593ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:19.729113Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:19.358029Z","time spent":"371.000382ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:19.729184Z","caller":"traceutil/trace.go:171","msg":"trace[775858227] transaction","detail":"{read_only:false; response_revision:24687; number_of_response:1; }","duration":"371.874488ms","start":"2026-04-27T21:49:19.357141Z","end":"2026-04-27T21:49:19.729016Z","steps":["trace[775858227] 'process raft request' (duration: 231.025607ms)","trace[775858227] 'compare' (duration: 140.154599ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:19.729412Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:19.357128Z","time spent":"372.193834ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:19.923513Z","caller":"traceutil/trace.go:171","msg":"trace[1345601368] transaction","detail":"{read_only:false; response_revision:24690; number_of_response:1; }","duration":"120.143025ms","start":"2026-04-27T21:49:19.80334Z","end":"2026-04-27T21:49:19.923483Z","steps":["trace[1345601368] 'process raft request' (duration: 57.983922ms)","trace[1345601368] 'compare' (duration: 62.024659ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:44.284651Z","caller":"traceutil/trace.go:171","msg":"trace[940048530] transaction","detail":"{read_only:false; response_revision:24883; number_of_response:1; }","duration":"389.509138ms","start":"2026-04-27T21:49:43.895108Z","end":"2026-04-27T21:49:44.284617Z","steps":["trace[940048530] 'process raft request' (duration: 389.317745ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:44.284882Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:43.895084Z","time spent":"389.678751ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:44.30497Z","caller":"traceutil/trace.go:171","msg":"trace[731210024] transaction","detail":"{read_only:false; response_revision:24884; number_of_response:1; }","duration":"408.91185ms","start":"2026-04-27T21:49:43.896034Z","end":"2026-04-27T21:49:44.304946Z","steps":["trace[731210024] 'process raft request' (duration: 408.637905ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:44.305096Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:43.896017Z","time spent":"409.022482ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-27T21:49:44.305071Z","caller":"traceutil/trace.go:171","msg":"trace[658922632] linearizableReadLoop","detail":"{readStateIndex:25688; appliedIndex:25687; }","duration":"405.7308ms","start":"2026-04-27T21:49:43.899313Z","end":"2026-04-27T21:49:44.305044Z","steps":["trace[658922632] 'read index received' (duration: 386.171315ms)","trace[658922632] 'applied index is now lower than readState.Index' (duration: 19.557975ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:44.305132Z","caller":"traceutil/trace.go:171","msg":"trace[676251075] transaction","detail":"{read_only:false; response_revision:24885; number_of_response:1; }","duration":"274.877295ms","start":"2026-04-27T21:49:44.030187Z","end":"2026-04-27T21:49:44.305064Z","steps":["trace[676251075] 'process raft request' (duration: 274.674012ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:44.305473Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"406.150139ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/\" range_end:\"/registry/persistentvolumeclaims0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-04-27T21:49:44.305535Z","caller":"traceutil/trace.go:171","msg":"trace[1279179539] range","detail":"{range_begin:/registry/persistentvolumeclaims/; range_end:/registry/persistentvolumeclaims0; response_count:0; response_revision:24888; }","duration":"406.26152ms","start":"2026-04-27T21:49:43.899258Z","end":"2026-04-27T21:49:44.30552Z","steps":["trace[1279179539] 'agreement among raft nodes before linearized reading' (duration: 406.108647ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:44.305571Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:43.899237Z","time spent":"406.325412ms","remote":"127.0.0.1:51946","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":17,"response size":31,"request content":"key:\"/registry/persistentvolumeclaims/\" range_end:\"/registry/persistentvolumeclaims0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:49:44.305573Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"371.424899ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:44.305626Z","caller":"traceutil/trace.go:171","msg":"trace[1899157807] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:24888; }","duration":"371.50907ms","start":"2026-04-27T21:49:43.9341Z","end":"2026-04-27T21:49:44.305609Z","steps":["trace[1899157807] 'agreement among raft nodes before linearized reading' (duration: 371.394718ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:44.305663Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:43.934057Z","time spent":"371.595392ms","remote":"127.0.0.1:53160","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" count_only:true "} {"level":"warn","ts":"2026-04-27T21:49:44.305956Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"284.055927ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:44.306Z","caller":"traceutil/trace.go:171","msg":"trace[1409028691] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24888; }","duration":"284.145948ms","start":"2026-04-27T21:49:44.021843Z","end":"2026-04-27T21:49:44.305989Z","steps":["trace[1409028691] 'agreement among raft nodes before linearized reading' (duration: 284.072067ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:44.679268Z","caller":"traceutil/trace.go:171","msg":"trace[211635726] transaction","detail":"{read_only:false; response_revision:24890; number_of_response:1; }","duration":"127.540353ms","start":"2026-04-27T21:49:44.551693Z","end":"2026-04-27T21:49:44.679233Z","steps":["trace[211635726] 'process raft request' (duration: 127.268477ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:44.822185Z","caller":"traceutil/trace.go:171","msg":"trace[371488892] transaction","detail":"{read_only:false; response_revision:24891; number_of_response:1; }","duration":"139.248232ms","start":"2026-04-27T21:49:44.682907Z","end":"2026-04-27T21:49:44.822155Z","steps":["trace[371488892] 'process raft request' (duration: 115.497518ms)","trace[371488892] 'compare' (duration: 23.281485ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:45.713487Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.135141ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12217"} {"level":"info","ts":"2026-04-27T21:49:45.713575Z","caller":"traceutil/trace.go:171","msg":"trace[802858496] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:24893; }","duration":"138.241744ms","start":"2026-04-27T21:49:45.575314Z","end":"2026-04-27T21:49:45.713556Z","steps":["trace[802858496] 'range keys from in-memory index tree' (duration: 137.954588ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:45.713562Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.768957ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:482"} {"level":"info","ts":"2026-04-27T21:49:45.713641Z","caller":"traceutil/trace.go:171","msg":"trace[419184581] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:24893; }","duration":"120.888748ms","start":"2026-04-27T21:49:45.592732Z","end":"2026-04-27T21:49:45.71362Z","steps":["trace[419184581] 'range keys from in-memory index tree' (duration: 120.584112ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:45.996926Z","caller":"traceutil/trace.go:171","msg":"trace[1994479679] transaction","detail":"{read_only:false; response_revision:24895; number_of_response:1; }","duration":"105.97499ms","start":"2026-04-27T21:49:45.89093Z","end":"2026-04-27T21:49:45.996905Z","steps":["trace[1994479679] 'process raft request' (duration: 53.731304ms)","trace[1994479679] 'compare' (duration: 52.013572ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:45.996926Z","caller":"traceutil/trace.go:171","msg":"trace[2094390976] linearizableReadLoop","detail":"{readStateIndex:25699; appliedIndex:25698; }","duration":"103.925372ms","start":"2026-04-27T21:49:45.892966Z","end":"2026-04-27T21:49:45.996891Z","steps":["trace[2094390976] 'read index received' (duration: 51.563993ms)","trace[2094390976] 'applied index is now lower than readState.Index' (duration: 52.360019ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:45.997098Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.127095ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12217"} {"level":"info","ts":"2026-04-27T21:49:45.997136Z","caller":"traceutil/trace.go:171","msg":"trace[438534124] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:24895; }","duration":"104.230907ms","start":"2026-04-27T21:49:45.892897Z","end":"2026-04-27T21:49:45.997128Z","steps":["trace[438534124] 'agreement among raft nodes before linearized reading' (duration: 104.073274ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:46.469717Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.343881ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-04-27T21:49:46.469778Z","caller":"traceutil/trace.go:171","msg":"trace[688259670] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:24896; }","duration":"179.444742ms","start":"2026-04-27T21:49:46.290319Z","end":"2026-04-27T21:49:46.469764Z","steps":["trace[688259670] 'range keys from in-memory index tree' (duration: 179.203968ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:46.470103Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.288024ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-27T21:49:46.470135Z","caller":"traceutil/trace.go:171","msg":"trace[327043492] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24896; }","duration":"160.345966ms","start":"2026-04-27T21:49:46.309781Z","end":"2026-04-27T21:49:46.470127Z","steps":["trace[327043492] 'range keys from in-memory index tree' (duration: 160.202522ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:46.470529Z","caller":"traceutil/trace.go:171","msg":"trace[1336166743] transaction","detail":"{read_only:false; response_revision:24897; number_of_response:1; }","duration":"158.000071ms","start":"2026-04-27T21:49:46.312518Z","end":"2026-04-27T21:49:46.470518Z","steps":["trace[1336166743] 'process raft request' (duration: 144.404347ms)","trace[1336166743] 'compare' (duration: 12.458523ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:46.542988Z","caller":"traceutil/trace.go:171","msg":"trace[514652556] transaction","detail":"{read_only:false; response_revision:24899; number_of_response:1; }","duration":"230.13549ms","start":"2026-04-27T21:49:46.312829Z","end":"2026-04-27T21:49:46.542964Z","steps":["trace[514652556] 'process raft request' (duration: 230.061579ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:46.543096Z","caller":"traceutil/trace.go:171","msg":"trace[1788117812] transaction","detail":"{read_only:false; response_revision:24898; number_of_response:1; }","duration":"230.422305ms","start":"2026-04-27T21:49:46.312637Z","end":"2026-04-27T21:49:46.54306Z","steps":["trace[1788117812] 'process raft request' (duration: 230.106819ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:46.543169Z","caller":"traceutil/trace.go:171","msg":"trace[1084884390] transaction","detail":"{read_only:false; response_revision:24900; number_of_response:1; }","duration":"230.259792ms","start":"2026-04-27T21:49:46.312893Z","end":"2026-04-27T21:49:46.543152Z","steps":["trace[1084884390] 'process raft request' (duration: 230.032908ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:46.686244Z","caller":"traceutil/trace.go:171","msg":"trace[399100955] transaction","detail":"{read_only:false; response_revision:24902; number_of_response:1; }","duration":"211.626895ms","start":"2026-04-27T21:49:46.474575Z","end":"2026-04-27T21:49:46.686202Z","steps":["trace[399100955] 'process raft request' (duration: 211.327829ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:46.68597Z","caller":"traceutil/trace.go:171","msg":"trace[206868425] transaction","detail":"{read_only:false; response_revision:24901; number_of_response:1; }","duration":"211.798838ms","start":"2026-04-27T21:49:46.474141Z","end":"2026-04-27T21:49:46.68594Z","steps":["trace[206868425] 'process raft request' (duration: 118.158298ms)","trace[206868425] 'compare' (duration: 93.405196ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:46.84086Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.720691ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-04-27T21:49:46.841356Z","caller":"traceutil/trace.go:171","msg":"trace[144219475] transaction","detail":"{read_only:false; response_revision:24903; number_of_response:1; }","duration":"212.478869ms","start":"2026-04-27T21:49:46.62885Z","end":"2026-04-27T21:49:46.841329Z","steps":["trace[144219475] 'process raft request' (duration: 212.109242ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:47.000879Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"159.47057ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-04-27T21:49:47.000982Z","caller":"traceutil/trace.go:171","msg":"trace[569990130] linearizableReadLoop","detail":"{readStateIndex:25709; appliedIndex:25706; }","duration":"175.311456ms","start":"2026-04-27T21:49:46.825654Z","end":"2026-04-27T21:49:47.000965Z","steps":["trace[569990130] 'read index received' (duration: 8.475079ms)","trace[569990130] 'applied index is now lower than readState.Index' (duration: 166.835007ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:47.001069Z","caller":"traceutil/trace.go:171","msg":"trace[1916591208] transaction","detail":"{read_only:false; response_revision:24904; number_of_response:1; }","duration":"314.076968ms","start":"2026-04-27T21:49:46.686981Z","end":"2026-04-27T21:49:47.001058Z","steps":["trace[1916591208] 'process raft request' (duration: 154.335724ms)","trace[1916591208] 'compare' (duration: 159.326247ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:47.001135Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-27T21:49:46.686942Z","time spent":"314.16214ms","remote":"127.0.0.1:52060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":541,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-27T21:49:47.001481Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.829086ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:495"} {"level":"info","ts":"2026-04-27T21:49:47.001528Z","caller":"traceutil/trace.go:171","msg":"trace[1538744819] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:24904; }","duration":"175.923018ms","start":"2026-04-27T21:49:46.825587Z","end":"2026-04-27T21:49:47.00151Z","steps":["trace[1538744819] 'agreement among raft nodes before linearized reading' (duration: 175.772474ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:47.164483Z","caller":"traceutil/trace.go:171","msg":"trace[817726851] transaction","detail":"{read_only:false; response_revision:24905; number_of_response:1; }","duration":"157.955612ms","start":"2026-04-27T21:49:47.006497Z","end":"2026-04-27T21:49:47.164452Z","steps":["trace[817726851] 'process raft request' (duration: 142.755277ms)","trace[817726851] 'compare' (duration: 14.978351ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:47.164839Z","caller":"traceutil/trace.go:171","msg":"trace[2055524415] transaction","detail":"{read_only:false; response_revision:24906; number_of_response:1; }","duration":"157.615044ms","start":"2026-04-27T21:49:47.007205Z","end":"2026-04-27T21:49:47.16482Z","steps":["trace[2055524415] 'process raft request' (duration: 157.157846ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:47.164997Z","caller":"traceutil/trace.go:171","msg":"trace[1936842691] transaction","detail":"{read_only:false; response_revision:24907; number_of_response:1; }","duration":"114.875416ms","start":"2026-04-27T21:49:47.050105Z","end":"2026-04-27T21:49:47.164981Z","steps":["trace[1936842691] 'process raft request' (duration: 114.300336ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:47.640532Z","caller":"traceutil/trace.go:171","msg":"trace[1937499291] transaction","detail":"{read_only:false; response_revision:24908; number_of_response:1; }","duration":"111.500694ms","start":"2026-04-27T21:49:47.529012Z","end":"2026-04-27T21:49:47.640513Z","steps":["trace[1937499291] 'process raft request' (duration: 111.357481ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:47.641601Z","caller":"traceutil/trace.go:171","msg":"trace[1712768621] transaction","detail":"{read_only:false; response_revision:24909; number_of_response:1; }","duration":"111.115936ms","start":"2026-04-27T21:49:47.530457Z","end":"2026-04-27T21:49:47.641573Z","steps":["trace[1712768621] 'process raft request' (duration: 110.968674ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:47.966698Z","caller":"traceutil/trace.go:171","msg":"trace[142726902] transaction","detail":"{read_only:false; response_revision:24910; number_of_response:1; }","duration":"120.734206ms","start":"2026-04-27T21:49:47.845933Z","end":"2026-04-27T21:49:47.966667Z","steps":["trace[142726902] 'process raft request' (duration: 120.502852ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:48.295651Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.609208ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/endpointslices/magnum-system/\" range_end:\"/registry/endpointslices/magnum-system0\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:48.295762Z","caller":"traceutil/trace.go:171","msg":"trace[102797048] range","detail":"{range_begin:/registry/endpointslices/magnum-system/; range_end:/registry/endpointslices/magnum-system0; response_count:0; response_revision:24911; }","duration":"109.760192ms","start":"2026-04-27T21:49:48.185969Z","end":"2026-04-27T21:49:48.295729Z","steps":["trace[102797048] 'range keys from in-memory index tree' (duration: 109.547967ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:48.827213Z","caller":"traceutil/trace.go:171","msg":"trace[31360200] linearizableReadLoop","detail":"{readStateIndex:25720; appliedIndex:25718; }","duration":"136.454319ms","start":"2026-04-27T21:49:48.690725Z","end":"2026-04-27T21:49:48.827179Z","steps":["trace[31360200] 'read index received' (duration: 136.154923ms)","trace[31360200] 'applied index is now lower than readState.Index' (duration: 297.956µs)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:48.827418Z","caller":"traceutil/trace.go:171","msg":"trace[1393558899] transaction","detail":"{read_only:false; response_revision:24915; number_of_response:1; }","duration":"276.713399ms","start":"2026-04-27T21:49:48.550688Z","end":"2026-04-27T21:49:48.827401Z","steps":["trace[1393558899] 'process raft request' (duration: 276.426544ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:48.827762Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.015089ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-27T21:49:48.827228Z","caller":"traceutil/trace.go:171","msg":"trace[228595204] transaction","detail":"{read_only:false; response_revision:24914; number_of_response:1; }","duration":"277.154208ms","start":"2026-04-27T21:49:48.550037Z","end":"2026-04-27T21:49:48.827192Z","steps":["trace[228595204] 'process raft request' (duration: 276.830932ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:48.827809Z","caller":"traceutil/trace.go:171","msg":"trace[1906954342] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24915; }","duration":"137.117911ms","start":"2026-04-27T21:49:48.690678Z","end":"2026-04-27T21:49:48.827796Z","steps":["trace[1906954342] 'agreement among raft nodes before linearized reading' (duration: 136.904347ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:48.828047Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.308435ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-04-27T21:49:48.828097Z","caller":"traceutil/trace.go:171","msg":"trace[2083742525] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:24915; }","duration":"137.404077ms","start":"2026-04-27T21:49:48.69068Z","end":"2026-04-27T21:49:48.828084Z","steps":["trace[2083742525] 'agreement among raft nodes before linearized reading' (duration: 137.235974ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:49.017356Z","caller":"traceutil/trace.go:171","msg":"trace[1152520699] transaction","detail":"{read_only:false; response_revision:24919; number_of_response:1; }","duration":"128.050143ms","start":"2026-04-27T21:49:48.889278Z","end":"2026-04-27T21:49:49.017328Z","steps":["trace[1152520699] 'process raft request' (duration: 52.160215ms)","trace[1152520699] 'compare' (duration: 75.542671ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:49.280286Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.588347ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:495"} {"level":"info","ts":"2026-04-27T21:49:49.280411Z","caller":"traceutil/trace.go:171","msg":"trace[1492493068] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:24920; }","duration":"110.814691ms","start":"2026-04-27T21:49:49.169566Z","end":"2026-04-27T21:49:49.28038Z","steps":["trace[1492493068] 'range keys from in-memory index tree' (duration: 110.28841ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:49.357036Z","caller":"traceutil/trace.go:171","msg":"trace[956376141] transaction","detail":"{read_only:false; response_revision:24921; number_of_response:1; }","duration":"186.029845ms","start":"2026-04-27T21:49:49.170977Z","end":"2026-04-27T21:49:49.357007Z","steps":["trace[956376141] 'process raft request' (duration: 185.554706ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:50.18187Z","caller":"traceutil/trace.go:171","msg":"trace[430022037] linearizableReadLoop","detail":"{readStateIndex:25730; appliedIndex:25728; }","duration":"167.542831ms","start":"2026-04-27T21:49:50.014298Z","end":"2026-04-27T21:49:50.181841Z","steps":["trace[430022037] 'read index received' (duration: 48.088698ms)","trace[430022037] 'applied index is now lower than readState.Index' (duration: 119.452863ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:49:50.181963Z","caller":"traceutil/trace.go:171","msg":"trace[1474832433] transaction","detail":"{read_only:false; response_revision:24925; number_of_response:1; }","duration":"206.263884ms","start":"2026-04-27T21:49:49.975651Z","end":"2026-04-27T21:49:50.181915Z","steps":["trace[1474832433] 'process raft request' (duration: 149.545325ms)","trace[1474832433] 'compare' (duration: 56.338572ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:49:50.182055Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.737334ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:50.182248Z","caller":"traceutil/trace.go:171","msg":"trace[1719284180] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24925; }","duration":"167.972589ms","start":"2026-04-27T21:49:50.014253Z","end":"2026-04-27T21:49:50.182226Z","steps":["trace[1719284180] 'agreement among raft nodes before linearized reading' (duration: 167.734664ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:49:50.247874Z","caller":"traceutil/trace.go:171","msg":"trace[1349227151] transaction","detail":"{read_only:false; response_revision:24926; number_of_response:1; }","duration":"158.45478ms","start":"2026-04-27T21:49:50.089387Z","end":"2026-04-27T21:49:50.247842Z","steps":["trace[1349227151] 'process raft request' (duration: 158.287577ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:50.247977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"218.39259ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/\" range_end:\"/registry/jobs0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-04-27T21:49:50.248029Z","caller":"traceutil/trace.go:171","msg":"trace[731261379] range","detail":"{range_begin:/registry/jobs/; range_end:/registry/jobs0; response_count:0; response_revision:24926; }","duration":"218.489682ms","start":"2026-04-27T21:49:50.029528Z","end":"2026-04-27T21:49:50.248018Z","steps":["trace[731261379] 'agreement among raft nodes before linearized reading' (duration: 218.310649ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:49:50.248173Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"224.080267ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cluster.x-k8s.io/machines/\" range_end:\"/registry/cluster.x-k8s.io/machines0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:49:50.248244Z","caller":"traceutil/trace.go:171","msg":"trace[1489360659] range","detail":"{range_begin:/registry/cluster.x-k8s.io/machines/; range_end:/registry/cluster.x-k8s.io/machines0; response_count:0; response_revision:24926; }","duration":"224.19582ms","start":"2026-04-27T21:49:50.024033Z","end":"2026-04-27T21:49:50.248229Z","steps":["trace[1489360659] 'agreement among raft nodes before linearized reading' (duration: 224.047357ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:50:03.568154Z","caller":"traceutil/trace.go:171","msg":"trace[438758187] transaction","detail":"{read_only:false; response_revision:25040; number_of_response:1; }","duration":"112.287408ms","start":"2026-04-27T21:50:03.455835Z","end":"2026-04-27T21:50:03.568122Z","steps":["trace[438758187] 'process raft request' (duration: 111.949042ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:50:04.83785Z","caller":"traceutil/trace.go:171","msg":"trace[34988777] linearizableReadLoop","detail":"{readStateIndex:25853; appliedIndex:25852; }","duration":"161.822804ms","start":"2026-04-27T21:50:04.676008Z","end":"2026-04-27T21:50:04.837831Z","steps":["trace[34988777] 'read index received' (duration: 161.759003ms)","trace[34988777] 'applied index is now lower than readState.Index' (duration: 63.021µs)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:50:04.837989Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.963427ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/openstack.k-orc.cloud/networks/\" range_end:\"/registry/openstack.k-orc.cloud/networks0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:50:04.838043Z","caller":"traceutil/trace.go:171","msg":"trace[1542543146] range","detail":"{range_begin:/registry/openstack.k-orc.cloud/networks/; range_end:/registry/openstack.k-orc.cloud/networks0; response_count:0; response_revision:25045; }","duration":"162.036118ms","start":"2026-04-27T21:50:04.675996Z","end":"2026-04-27T21:50:04.838032Z","steps":["trace[1542543146] 'agreement among raft nodes before linearized reading' (duration: 161.940876ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:50:04.838475Z","caller":"traceutil/trace.go:171","msg":"trace[510449175] transaction","detail":"{read_only:false; response_revision:25045; number_of_response:1; }","duration":"196.659725ms","start":"2026-04-27T21:50:04.641234Z","end":"2026-04-27T21:50:04.837894Z","steps":["trace[510449175] 'process raft request' (duration: 196.464442ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:50:04.851729Z","caller":"traceutil/trace.go:171","msg":"trace[766095184] transaction","detail":"{read_only:false; response_revision:25046; number_of_response:1; }","duration":"128.716526ms","start":"2026-04-27T21:50:04.722993Z","end":"2026-04-27T21:50:04.851709Z","steps":["trace[766095184] 'process raft request' (duration: 128.555872ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:50:04.997138Z","caller":"traceutil/trace.go:171","msg":"trace[100422378] transaction","detail":"{read_only:false; response_revision:25047; number_of_response:1; }","duration":"114.55916ms","start":"2026-04-27T21:50:04.882555Z","end":"2026-04-27T21:50:04.997114Z","steps":["trace[100422378] 'process raft request' (duration: 43.212677ms)","trace[100422378] 'compare' (duration: 71.17697ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:50:04.997427Z","caller":"traceutil/trace.go:171","msg":"trace[2014479218] transaction","detail":"{read_only:false; response_revision:25048; number_of_response:1; }","duration":"112.88395ms","start":"2026-04-27T21:50:04.88452Z","end":"2026-04-27T21:50:04.997404Z","steps":["trace[2014479218] 'process raft request' (duration: 112.549623ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:50:05.209261Z","caller":"traceutil/trace.go:171","msg":"trace[551697213] linearizableReadLoop","detail":"{readStateIndex:25859; appliedIndex:25857; }","duration":"198.681002ms","start":"2026-04-27T21:50:05.01056Z","end":"2026-04-27T21:50:05.209241Z","steps":["trace[551697213] 'read index received' (duration: 55.887304ms)","trace[551697213] 'applied index is now lower than readState.Index' (duration: 142.792768ms)"],"step_count":2} {"level":"warn","ts":"2026-04-27T21:50:05.209478Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.899506ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-04-27T21:50:05.209515Z","caller":"traceutil/trace.go:171","msg":"trace[1964656388] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:25051; }","duration":"198.966817ms","start":"2026-04-27T21:50:05.010538Z","end":"2026-04-27T21:50:05.209505Z","steps":["trace[1964656388] 'agreement among raft nodes before linearized reading' (duration: 198.827054ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:50:05.209689Z","caller":"traceutil/trace.go:171","msg":"trace[1523587548] transaction","detail":"{read_only:false; response_revision:25051; number_of_response:1; }","duration":"206.404196ms","start":"2026-04-27T21:50:05.003221Z","end":"2026-04-27T21:50:05.209625Z","steps":["trace[1523587548] 'process raft request' (duration: 196.921869ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:50:05.222788Z","caller":"traceutil/trace.go:171","msg":"trace[1067040398] transaction","detail":"{read_only:false; response_revision:25052; number_of_response:1; }","duration":"124.428514ms","start":"2026-04-27T21:50:05.098343Z","end":"2026-04-27T21:50:05.222771Z","steps":["trace[1067040398] 'process raft request' (duration: 124.160039ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:51:46.477633Z","caller":"traceutil/trace.go:171","msg":"trace[929940013] linearizableReadLoop","detail":"{readStateIndex:26921; appliedIndex:26919; }","duration":"119.186808ms","start":"2026-04-27T21:51:46.358423Z","end":"2026-04-27T21:51:46.47761Z","steps":["trace[929940013] 'read index received' (duration: 28.027416ms)","trace[929940013] 'applied index is now lower than readState.Index' (duration: 91.158412ms)"],"step_count":2} {"level":"info","ts":"2026-04-27T21:51:46.477754Z","caller":"traceutil/trace.go:171","msg":"trace[302238923] transaction","detail":"{read_only:false; response_revision:26089; number_of_response:1; }","duration":"131.751883ms","start":"2026-04-27T21:51:46.345976Z","end":"2026-04-27T21:51:46.477728Z","steps":["trace[302238923] 'process raft request' (duration: 131.471948ms)"],"step_count":1} {"level":"warn","ts":"2026-04-27T21:51:46.477839Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.408181ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:509"} {"level":"info","ts":"2026-04-27T21:51:46.477872Z","caller":"traceutil/trace.go:171","msg":"trace[1563365890] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:26089; }","duration":"119.484952ms","start":"2026-04-27T21:51:46.358378Z","end":"2026-04-27T21:51:46.477863Z","steps":["trace[1563365890] 'agreement among raft nodes before linearized reading' (duration: 119.334109ms)"],"step_count":1} {"level":"info","ts":"2026-04-27T21:52:17.997324Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":23485} {"level":"info","ts":"2026-04-27T21:52:18.21506Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":23485,"took":"213.720801ms","hash":623056441,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":36536320,"current-db-size-in-use":"36 MB"} {"level":"info","ts":"2026-04-27T21:52:18.215125Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":623056441,"revision":23485,"compact-revision":20187} {"level":"info","ts":"2026-04-27T21:52:22.095034Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000002-0000000000006a57.wal"} {"level":"info","ts":"2026-04-27T21:57:18.004744Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":26352} {"level":"info","ts":"2026-04-27T21:57:18.145492Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":26352,"took":"136.332059ms","hash":102760363,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":33067008,"current-db-size-in-use":"33 MB"} {"level":"info","ts":"2026-04-27T21:57:18.145572Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":102760363,"revision":26352,"compact-revision":23485} {"level":"info","ts":"2026-04-27T21:57:41.482138Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"1cac722af8b2b8a6","local-member-applied-index":30005,"local-member-snapshot-index":20004,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-04-27T21:57:41.487189Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":30005} {"level":"info","ts":"2026-04-27T21:57:41.487288Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":25005} {"level":"info","ts":"2026-04-27T22:02:18.010776Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":28916} {"level":"info","ts":"2026-04-27T22:02:18.144828Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":28916,"took":"129.972292ms","hash":338833430,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":31293440,"current-db-size-in-use":"31 MB"} {"level":"info","ts":"2026-04-27T22:02:18.144899Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":338833430,"revision":28916,"compact-revision":26352} {"level":"info","ts":"2026-04-27T22:07:18.018284Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":31204} {"level":"info","ts":"2026-04-27T22:07:18.143815Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":31204,"took":"122.081523ms","hash":1118636150,"current-db-size-bytes":58884096,"current-db-size":"59 MB","current-db-size-in-use-bytes":30892032,"current-db-size-in-use":"31 MB"} {"level":"info","ts":"2026-04-27T22:07:18.143888Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1118636150,"revision":31204,"compact-revision":28916} {"level":"info","ts":"2026-04-27T22:12:18.02517Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":33561} {"level":"info","ts":"2026-04-27T22:12:18.164141Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":33561,"took":"134.603469ms","hash":967279773,"current-db-size-bytes":59727872,"current-db-size":"60 MB","current-db-size-in-use-bytes":32661504,"current-db-size-in-use":"33 MB"} {"level":"info","ts":"2026-04-27T22:12:18.164296Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":967279773,"revision":33561,"compact-revision":31204} {"level":"info","ts":"2026-04-27T22:17:18.031381Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":35796} {"level":"info","ts":"2026-04-27T22:17:18.176518Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":35796,"took":"140.480818ms","hash":4279047111,"current-db-size-bytes":62726144,"current-db-size":"63 MB","current-db-size-in-use-bytes":31014912,"current-db-size-in-use":"31 MB"} {"level":"info","ts":"2026-04-27T22:17:18.176576Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":4279047111,"revision":35796,"compact-revision":33561} {"level":"info","ts":"2026-04-27T22:18:58.133314Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"1cac722af8b2b8a6","local-member-applied-index":40006,"local-member-snapshot-index":30005,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-04-27T22:18:58.137273Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":40006} {"level":"info","ts":"2026-04-27T22:18:58.137361Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":35006}