{"level":"warn","ts":"2026-07-25T04:17:35.356778Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-07-25T04:17:35.356865Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.223: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.223:2380","--initial-cluster=instance=https://199.204.45.223:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.223:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.223: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-07-25T04:17:35.356936Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-07-25T04:17:35.356945Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.223:2380"]}
{"level":"info","ts":"2026-07-25T04:17:35.356962Z","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-07-25T04:17:35.357644Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.223:2379"]}
{"level":"info","ts":"2026-07-25T04:17:35.357714Z","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.223:2380"],"listen-peer-urls":["https://199.204.45.223:2380"],"advertise-client-urls":["https://199.204.45.223:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.223:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.223: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-07-25T04:17:35.361972Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.85903ms"}
{"level":"info","ts":"2026-07-25T04:17:35.367494Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"11f26225a5bb9fe3","cluster-id":"75c25101f01fd4c6"}
{"level":"info","ts":"2026-07-25T04:17:35.36758Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 switched to configuration voters=()"}
{"level":"info","ts":"2026-07-25T04:17:35.367603Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 became follower at term 0"}
{"level":"info","ts":"2026-07-25T04:17:35.36762Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 11f26225a5bb9fe3 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-07-25T04:17:35.36763Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 became follower at term 1"}
{"level":"info","ts":"2026-07-25T04:17:35.367673Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 switched to configuration voters=(1293203956842602467)"}
{"level":"warn","ts":"2026-07-25T04:17:35.373367Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-07-25T04:17:35.375113Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-07-25T04:17:35.376423Z","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-07-25T04:17:35.37934Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"11f26225a5bb9fe3","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-07-25T04:17:35.379641Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"11f26225a5bb9fe3","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-07-25T04:17:35.379738Z","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-07-25T04:17:35.379897Z","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-07-25T04:17:35.379908Z","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-07-25T04:17:35.381598Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 switched to configuration voters=(1293203956842602467)"}
{"level":"info","ts":"2026-07-25T04:17:35.381816Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"75c25101f01fd4c6","local-member-id":"11f26225a5bb9fe3","added-peer-id":"11f26225a5bb9fe3","added-peer-peer-urls":["https://199.204.45.223:2380"]}
{"level":"info","ts":"2026-07-25T04:17:35.384141Z","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-07-25T04:17:35.384284Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.223:2380"}
{"level":"info","ts":"2026-07-25T04:17:35.384352Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.223:2380"}
{"level":"info","ts":"2026-07-25T04:17:35.384531Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"11f26225a5bb9fe3","initial-advertise-peer-urls":["https://199.204.45.223:2380"],"listen-peer-urls":["https://199.204.45.223:2380"],"advertise-client-urls":["https://199.204.45.223:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.223:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-07-25T04:17:35.384591Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-07-25T04:17:35.968532Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 is starting a new election at term 1"}
{"level":"info","ts":"2026-07-25T04:17:35.968621Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 became pre-candidate at term 1"}
{"level":"info","ts":"2026-07-25T04:17:35.968659Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 received MsgPreVoteResp from 11f26225a5bb9fe3 at term 1"}
{"level":"info","ts":"2026-07-25T04:17:35.968677Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 became candidate at term 2"}
{"level":"info","ts":"2026-07-25T04:17:35.968684Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 received MsgVoteResp from 11f26225a5bb9fe3 at term 2"}
{"level":"info","ts":"2026-07-25T04:17:35.968695Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"11f26225a5bb9fe3 became leader at term 2"}
{"level":"info","ts":"2026-07-25T04:17:35.968704Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 11f26225a5bb9fe3 elected leader 11f26225a5bb9fe3 at term 2"}
{"level":"info","ts":"2026-07-25T04:17:35.970334Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"11f26225a5bb9fe3","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.223:2379]}","request-path":"/0/members/11f26225a5bb9fe3/attributes","cluster-id":"75c25101f01fd4c6","publish-timeout":"7s"}
{"level":"info","ts":"2026-07-25T04:17:35.970534Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-07-25T04:17:35.970586Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-07-25T04:17:35.970801Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-07-25T04:17:35.971205Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-07-25T04:17:35.971243Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-07-25T04:17:35.972564Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"75c25101f01fd4c6","local-member-id":"11f26225a5bb9fe3","cluster-version":"3.5"}
{"level":"info","ts":"2026-07-25T04:17:35.972755Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-07-25T04:17:35.972807Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-07-25T04:17:35.973681Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-07-25T04:17:35.974854Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.223:2379"}
{"level":"info","ts":"2026-07-25T04:17:52.275711Z","caller":"traceutil/trace.go:171","msg":"trace[944434966] transaction","detail":"{read_only:false; response_revision:411; number_of_response:1; }","duration":"123.642276ms","start":"2026-07-25T04:17:52.152029Z","end":"2026-07-25T04:17:52.275671Z","steps":["trace[944434966] 'process raft request'  (duration: 123.387054ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:18:24.123652Z","caller":"traceutil/trace.go:171","msg":"trace[2081186670] transaction","detail":"{read_only:false; response_revision:640; number_of_response:1; }","duration":"190.951424ms","start":"2026-07-25T04:18:23.932658Z","end":"2026-07-25T04:18:24.12361Z","steps":["trace[2081186670] 'process raft request'  (duration: 188.920613ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:18:24.306968Z","caller":"traceutil/trace.go:171","msg":"trace[1895686766] transaction","detail":"{read_only:false; response_revision:642; number_of_response:1; }","duration":"125.439799ms","start":"2026-07-25T04:18:24.181502Z","end":"2026-07-25T04:18:24.306942Z","steps":["trace[1895686766] 'process raft request'  (duration: 125.382526ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:18:24.307023Z","caller":"traceutil/trace.go:171","msg":"trace[630565204] transaction","detail":"{read_only:false; response_revision:641; number_of_response:1; }","duration":"177.971262ms","start":"2026-07-25T04:18:24.129015Z","end":"2026-07-25T04:18:24.306986Z","steps":["trace[630565204] 'process raft request'  (duration: 83.718271ms)","trace[630565204] 'compare'  (duration: 93.993867ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:18:24.824154Z","caller":"traceutil/trace.go:171","msg":"trace[1203577368] linearizableReadLoop","detail":"{readStateIndex:668; appliedIndex:667; }","duration":"364.428902ms","start":"2026-07-25T04:18:24.459688Z","end":"2026-07-25T04:18:24.824117Z","steps":["trace[1203577368] 'read index received'  (duration: 358.094213ms)","trace[1203577368] 'applied index is now lower than readState.Index'  (duration: 6.333429ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:18:24.82418Z","caller":"traceutil/trace.go:171","msg":"trace[1718628880] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"429.796021ms","start":"2026-07-25T04:18:24.394343Z","end":"2026-07-25T04:18:24.824139Z","steps":["trace[1718628880] 'process raft request'  (duration: 423.340886ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:18:24.824901Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:18:24.394328Z","time spent":"429.96259ms","remote":"127.0.0.1:41848","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/cilium-hln79\" mod_revision:529 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-hln79\" value_size:17085 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-hln79\" > >"}
{"level":"warn","ts":"2026-07-25T04:18:24.825246Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"365.502301ms","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-07-25T04:18:24.8254Z","caller":"traceutil/trace.go:171","msg":"trace[1384686959] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:643; }","duration":"365.730103ms","start":"2026-07-25T04:18:24.459622Z","end":"2026-07-25T04:18:24.825352Z","steps":["trace[1384686959] 'agreement among raft nodes before linearized reading'  (duration: 364.670765ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:18:24.825449Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:18:24.459595Z","time spent":"365.84524ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"info","ts":"2026-07-25T04:18:24.84379Z","caller":"traceutil/trace.go:171","msg":"trace[1662182602] transaction","detail":"{read_only:false; response_revision:644; number_of_response:1; }","duration":"110.355448ms","start":"2026-07-25T04:18:24.733408Z","end":"2026-07-25T04:18:24.843763Z","steps":["trace[1662182602] 'process raft request'  (duration: 109.551764ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:18:40.243505Z","caller":"traceutil/trace.go:171","msg":"trace[632762175] transaction","detail":"{read_only:false; response_revision:807; number_of_response:1; }","duration":"146.099226ms","start":"2026-07-25T04:18:40.097378Z","end":"2026-07-25T04:18:40.243477Z","steps":["trace[632762175] 'process raft request'  (duration: 145.898514ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:00.759704Z","caller":"traceutil/trace.go:171","msg":"trace[208396590] linearizableReadLoop","detail":"{readStateIndex:1118; appliedIndex:1117; }","duration":"149.503867ms","start":"2026-07-25T04:19:00.610172Z","end":"2026-07-25T04:19:00.759676Z","steps":["trace[208396590] 'read index received'  (duration: 149.313926ms)","trace[208396590] 'applied index is now lower than readState.Index'  (duration: 188.701µs)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:19:00.759821Z","caller":"traceutil/trace.go:171","msg":"trace[1491419854] transaction","detail":"{read_only:false; response_revision:1081; number_of_response:1; }","duration":"250.275556ms","start":"2026-07-25T04:19:00.509501Z","end":"2026-07-25T04:19:00.759777Z","steps":["trace[1491419854] 'process raft request'  (duration: 249.983148ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:00.760073Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.866579ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/ingress-nginx/ingress-nginx-admission-create-qbd5q\" ","response":"range_response_count:1 size:4197"}
{"level":"info","ts":"2026-07-25T04:19:00.760215Z","caller":"traceutil/trace.go:171","msg":"trace[1516974315] range","detail":"{range_begin:/registry/pods/ingress-nginx/ingress-nginx-admission-create-qbd5q; range_end:; response_count:1; response_revision:1081; }","duration":"150.083572ms","start":"2026-07-25T04:19:00.610104Z","end":"2026-07-25T04:19:00.760187Z","steps":["trace[1516974315] 'agreement among raft nodes before linearized reading'  (duration: 149.698879ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:00.898678Z","caller":"traceutil/trace.go:171","msg":"trace[773039204] transaction","detail":"{read_only:false; response_revision:1082; number_of_response:1; }","duration":"128.686845ms","start":"2026-07-25T04:19:00.768706Z","end":"2026-07-25T04:19:00.897392Z","steps":["trace[773039204] 'process raft request'  (duration: 128.391538ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:13.796305Z","caller":"traceutil/trace.go:171","msg":"trace[929288697] transaction","detail":"{read_only:false; response_revision:1429; number_of_response:1; }","duration":"163.609026ms","start":"2026-07-25T04:19:13.632658Z","end":"2026-07-25T04:19:13.796267Z","steps":["trace[929288697] 'process raft request'  (duration: 89.550993ms)","trace[929288697] 'compare'  (duration: 73.750844ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:19:13.83491Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.036861ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/ingress-nginx/ingress-nginx-defaultbackend-6987ff55cf-r4ltv\" ","response":"range_response_count:1 size:4218"}
{"level":"info","ts":"2026-07-25T04:19:13.834982Z","caller":"traceutil/trace.go:171","msg":"trace[944690271] range","detail":"{range_begin:/registry/pods/ingress-nginx/ingress-nginx-defaultbackend-6987ff55cf-r4ltv; range_end:; response_count:1; response_revision:1430; }","duration":"111.17469ms","start":"2026-07-25T04:19:13.723791Z","end":"2026-07-25T04:19:13.834966Z","steps":["trace[944690271] 'agreement among raft nodes before linearized reading'  (duration: 110.928235ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:14.021054Z","caller":"traceutil/trace.go:171","msg":"trace[2019803682] transaction","detail":"{read_only:false; response_revision:1432; number_of_response:1; }","duration":"200.728314ms","start":"2026-07-25T04:19:13.820303Z","end":"2026-07-25T04:19:14.021031Z","steps":["trace[2019803682] 'process raft request'  (duration: 200.66571ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:14.021118Z","caller":"traceutil/trace.go:171","msg":"trace[795286153] transaction","detail":"{read_only:false; response_revision:1431; number_of_response:1; }","duration":"220.310205ms","start":"2026-07-25T04:19:13.80076Z","end":"2026-07-25T04:19:14.02107Z","steps":["trace[795286153] 'process raft request'  (duration: 165.124528ms)","trace[795286153] 'compare'  (duration: 54.904419ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:19:14.073599Z","caller":"traceutil/trace.go:171","msg":"trace[1599630774] transaction","detail":"{read_only:false; response_revision:1433; number_of_response:1; }","duration":"231.343897ms","start":"2026-07-25T04:19:13.842228Z","end":"2026-07-25T04:19:14.073571Z","steps":["trace[1599630774] 'process raft request'  (duration: 231.104482ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:14.073822Z","caller":"traceutil/trace.go:171","msg":"trace[1772890115] linearizableReadLoop","detail":"{readStateIndex:1474; appliedIndex:1470; }","duration":"174.117006ms","start":"2026-07-25T04:19:13.899669Z","end":"2026-07-25T04:19:14.073786Z","steps":["trace[1772890115] 'read index received'  (duration: 66.312337ms)","trace[1772890115] 'applied index is now lower than readState.Index'  (duration: 107.802589ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:19:14.073843Z","caller":"traceutil/trace.go:171","msg":"trace[1795708273] transaction","detail":"{read_only:false; response_revision:1434; number_of_response:1; }","duration":"208.677927ms","start":"2026-07-25T04:19:13.865137Z","end":"2026-07-25T04:19:14.073815Z","steps":["trace[1795708273] 'process raft request'  (duration: 208.357487ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:14.074038Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.35245ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:19:14.074112Z","caller":"traceutil/trace.go:171","msg":"trace[504814640] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1434; }","duration":"174.466147ms","start":"2026-07-25T04:19:13.899608Z","end":"2026-07-25T04:19:14.074074Z","steps":["trace[504814640] 'agreement among raft nodes before linearized reading'  (duration: 174.295337ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:44.934644Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"241.252146ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-fcd34547-bf81-4fc5-b77d-208f1b27e2ae\" ","response":"range_response_count:1 size:3627"}
{"level":"info","ts":"2026-07-25T04:19:44.934753Z","caller":"traceutil/trace.go:171","msg":"trace[791712990] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-fcd34547-bf81-4fc5-b77d-208f1b27e2ae; range_end:; response_count:1; response_revision:1960; }","duration":"241.424398ms","start":"2026-07-25T04:19:44.693305Z","end":"2026-07-25T04:19:44.93473Z","steps":["trace[791712990] 'range keys from in-memory index tree'  (duration: 241.037682ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:47.195245Z","caller":"traceutil/trace.go:171","msg":"trace[819509373] linearizableReadLoop","detail":"{readStateIndex:2064; appliedIndex:2063; }","duration":"141.834223ms","start":"2026-07-25T04:19:47.053379Z","end":"2026-07-25T04:19:47.195213Z","steps":["trace[819509373] 'read index received'  (duration: 141.533623ms)","trace[819509373] 'applied index is now lower than readState.Index'  (duration: 299.62µs)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:19:47.195382Z","caller":"traceutil/trace.go:171","msg":"trace[1347606837] transaction","detail":"{read_only:false; response_revision:1990; number_of_response:1; }","duration":"224.206159ms","start":"2026-07-25T04:19:46.971128Z","end":"2026-07-25T04:19:47.195334Z","steps":["trace[1347606837] 'process raft request'  (duration: 223.875767ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:47.195493Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.282863ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:19:47.195539Z","caller":"traceutil/trace.go:171","msg":"trace[609081266] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:1990; }","duration":"133.424982ms","start":"2026-07-25T04:19:47.0621Z","end":"2026-07-25T04:19:47.195525Z","steps":["trace[609081266] 'agreement among raft nodes before linearized reading'  (duration: 133.305804ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:47.195666Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.25145ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"}
{"level":"info","ts":"2026-07-25T04:19:47.195781Z","caller":"traceutil/trace.go:171","msg":"trace[1169543485] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1990; }","duration":"142.432183ms","start":"2026-07-25T04:19:47.053326Z","end":"2026-07-25T04:19:47.195758Z","steps":["trace[1169543485] 'agreement among raft nodes before linearized reading'  (duration: 142.076379ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:47.195811Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.152637ms","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-07-25T04:19:47.195846Z","caller":"traceutil/trace.go:171","msg":"trace[1046775015] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1990; }","duration":"123.21009ms","start":"2026-07-25T04:19:47.072625Z","end":"2026-07-25T04:19:47.195835Z","steps":["trace[1046775015] 'agreement among raft nodes before linearized reading'  (duration: 123.011397ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:47.316135Z","caller":"traceutil/trace.go:171","msg":"trace[1768185048] transaction","detail":"{read_only:false; response_revision:1991; number_of_response:1; }","duration":"114.258723ms","start":"2026-07-25T04:19:47.201842Z","end":"2026-07-25T04:19:47.316101Z","steps":["trace[1768185048] 'process raft request'  (duration: 98.436788ms)","trace[1768185048] 'compare'  (duration: 15.673065ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:19:47.62475Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.191522ms","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-07-25T04:19:47.625395Z","caller":"traceutil/trace.go:171","msg":"trace[2108097339] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1993; }","duration":"104.899619ms","start":"2026-07-25T04:19:47.520474Z","end":"2026-07-25T04:19:47.625373Z","steps":["trace[2108097339] 'range keys from in-memory index tree'  (duration: 103.962567ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:48.084918Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.843709ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"warn","ts":"2026-07-25T04:19:48.084973Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.925938ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:19:48.085084Z","caller":"traceutil/trace.go:171","msg":"trace[1514578759] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1994; }","duration":"185.177955ms","start":"2026-07-25T04:19:47.899882Z","end":"2026-07-25T04:19:48.08506Z","steps":["trace[1514578759] 'range keys from in-memory index tree'  (duration: 184.80755ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:48.085078Z","caller":"traceutil/trace.go:171","msg":"trace[1145430900] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1994; }","duration":"107.111686ms","start":"2026-07-25T04:19:47.977933Z","end":"2026-07-25T04:19:48.085045Z","steps":["trace[1145430900] 'range keys from in-memory index tree'  (duration: 106.544749ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:48.084968Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.821909ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-fcd34547-bf81-4fc5-b77d-208f1b27e2ae\" ","response":"range_response_count:1 size:3747"}
{"level":"info","ts":"2026-07-25T04:19:48.085455Z","caller":"traceutil/trace.go:171","msg":"trace[1675468576] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-fcd34547-bf81-4fc5-b77d-208f1b27e2ae; range_end:; response_count:1; response_revision:1994; }","duration":"131.367895ms","start":"2026-07-25T04:19:47.954076Z","end":"2026-07-25T04:19:48.085443Z","steps":["trace[1675468576] 'range keys from in-memory index tree'  (duration: 130.659837ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:48.084777Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.183882ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:10327"}
{"level":"info","ts":"2026-07-25T04:19:48.085591Z","caller":"traceutil/trace.go:171","msg":"trace[1104159153] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:1994; }","duration":"120.067751ms","start":"2026-07-25T04:19:47.965487Z","end":"2026-07-25T04:19:48.085555Z","steps":["trace[1104159153] 'range keys from in-memory index tree'  (duration: 118.917804ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:48.277997Z","caller":"traceutil/trace.go:171","msg":"trace[778817877] transaction","detail":"{read_only:false; response_revision:1997; number_of_response:1; }","duration":"116.584489ms","start":"2026-07-25T04:19:48.161372Z","end":"2026-07-25T04:19:48.277956Z","steps":["trace[778817877] 'process raft request'  (duration: 116.271858ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:19:48.854812Z","caller":"traceutil/trace.go:171","msg":"trace[1136936750] linearizableReadLoop","detail":"{readStateIndex:2072; appliedIndex:2071; }","duration":"170.932905ms","start":"2026-07-25T04:19:48.683843Z","end":"2026-07-25T04:19:48.854776Z","steps":["trace[1136936750] 'read index received'  (duration: 170.652156ms)","trace[1136936750] 'applied index is now lower than readState.Index'  (duration: 279.539µs)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:19:48.854931Z","caller":"traceutil/trace.go:171","msg":"trace[2126332574] transaction","detail":"{read_only:false; response_revision:1998; number_of_response:1; }","duration":"236.95573ms","start":"2026-07-25T04:19:48.617932Z","end":"2026-07-25T04:19:48.854887Z","steps":["trace[2126332574] 'process raft request'  (duration: 236.641869ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:48.85516Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.284688ms","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-07-25T04:19:48.85548Z","caller":"traceutil/trace.go:171","msg":"trace[204851753] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1998; }","duration":"171.705037ms","start":"2026-07-25T04:19:48.683748Z","end":"2026-07-25T04:19:48.855453Z","steps":["trace[204851753] 'agreement among raft nodes before linearized reading'  (duration: 171.167331ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:19:49.111363Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.543783ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749328005 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:1989 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:19:49.111577Z","caller":"traceutil/trace.go:171","msg":"trace[1975886559] transaction","detail":"{read_only:false; response_revision:1999; number_of_response:1; }","duration":"242.846653ms","start":"2026-07-25T04:19:48.868706Z","end":"2026-07-25T04:19:49.111553Z","steps":["trace[1975886559] 'process raft request'  (duration: 106.759853ms)","trace[1975886559] 'compare'  (duration: 135.393604ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:01.783577Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.697917ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749328411 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:2182 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:20:01.78377Z","caller":"traceutil/trace.go:171","msg":"trace[836565887] transaction","detail":"{read_only:false; response_revision:2216; number_of_response:1; }","duration":"352.003605ms","start":"2026-07-25T04:20:01.431751Z","end":"2026-07-25T04:20:01.783755Z","steps":["trace[836565887] 'process raft request'  (duration: 229.051622ms)","trace[836565887] 'compare'  (duration: 122.364924ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:01.783823Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:20:01.431719Z","time spent":"352.08303ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:2182 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"info","ts":"2026-07-25T04:20:01.784258Z","caller":"traceutil/trace.go:171","msg":"trace[1390219634] transaction","detail":"{read_only:false; response_revision:2217; number_of_response:1; }","duration":"352.343818ms","start":"2026-07-25T04:20:01.431887Z","end":"2026-07-25T04:20:01.784231Z","steps":["trace[1390219634] 'process raft request'  (duration: 351.78051ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:01.784442Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:20:01.431881Z","time spent":"352.485787ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:2183 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:370 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-07-25T04:20:07.133155Z","caller":"traceutil/trace.go:171","msg":"trace[471903636] transaction","detail":"{read_only:false; response_revision:2390; number_of_response:1; }","duration":"201.748761ms","start":"2026-07-25T04:20:06.931371Z","end":"2026-07-25T04:20:07.13312Z","steps":["trace[471903636] 'process raft request'  (duration: 201.533406ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:16.025261Z","caller":"traceutil/trace.go:171","msg":"trace[2079618121] linearizableReadLoop","detail":"{readStateIndex:2623; appliedIndex:2621; }","duration":"127.004103ms","start":"2026-07-25T04:20:15.898231Z","end":"2026-07-25T04:20:16.025235Z","steps":["trace[2079618121] 'read index received'  (duration: 11.423662ms)","trace[2079618121] 'applied index is now lower than readState.Index'  (duration: 115.579631ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:20:16.025372Z","caller":"traceutil/trace.go:171","msg":"trace[370927173] transaction","detail":"{read_only:false; response_revision:2532; number_of_response:1; }","duration":"146.74529ms","start":"2026-07-25T04:20:15.878578Z","end":"2026-07-25T04:20:16.025324Z","steps":["trace[370927173] 'process raft request'  (duration: 98.627489ms)","trace[370927173] 'compare'  (duration: 47.936388ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:16.025466Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.218007ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.025527Z","caller":"traceutil/trace.go:171","msg":"trace[460092731] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2532; }","duration":"127.321054ms","start":"2026-07-25T04:20:15.898194Z","end":"2026-07-25T04:20:16.025516Z","steps":["trace[460092731] 'agreement among raft nodes before linearized reading'  (duration: 127.181435ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.025659Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.233634ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/openstack/libvirt-libvirt-default-fmzsr.18c56d7a8172f5b6\" ","response":"range_response_count:1 size:782"}
{"level":"info","ts":"2026-07-25T04:20:16.025767Z","caller":"traceutil/trace.go:171","msg":"trace[760989055] range","detail":"{range_begin:/registry/events/openstack/libvirt-libvirt-default-fmzsr.18c56d7a8172f5b6; range_end:; response_count:1; response_revision:2532; }","duration":"101.409245ms","start":"2026-07-25T04:20:15.924333Z","end":"2026-07-25T04:20:16.025742Z","steps":["trace[760989055] 'agreement among raft nodes before linearized reading'  (duration: 101.108045ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.263465Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.980138ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/objectbucket.io/objectbucketclaims/\" range_end:\"/registry/objectbucket.io/objectbucketclaims0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.263548Z","caller":"traceutil/trace.go:171","msg":"trace[2012071119] range","detail":"{range_begin:/registry/objectbucket.io/objectbucketclaims/; range_end:/registry/objectbucket.io/objectbucketclaims0; response_count:0; response_revision:2534; }","duration":"116.127638ms","start":"2026-07-25T04:20:16.147403Z","end":"2026-07-25T04:20:16.26353Z","steps":["trace[2012071119] 'range keys from in-memory index tree'  (duration: 115.868691ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.264222Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.688239ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/objectbucket.io/objectbucketclaims/\" range_end:\"/registry/objectbucket.io/objectbucketclaims0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.264332Z","caller":"traceutil/trace.go:171","msg":"trace[1276890110] range","detail":"{range_begin:/registry/objectbucket.io/objectbucketclaims/; range_end:/registry/objectbucket.io/objectbucketclaims0; response_count:0; response_revision:2534; }","duration":"115.85993ms","start":"2026-07-25T04:20:16.148442Z","end":"2026-07-25T04:20:16.264302Z","steps":["trace[1276890110] 'range keys from in-memory index tree'  (duration: 115.588262ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.264938Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.222854ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/objectbucket.io/objectbucketclaims/\" range_end:\"/registry/objectbucket.io/objectbucketclaims0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.264989Z","caller":"traceutil/trace.go:171","msg":"trace[554560232] range","detail":"{range_begin:/registry/objectbucket.io/objectbucketclaims/; range_end:/registry/objectbucket.io/objectbucketclaims0; response_count:0; response_revision:2534; }","duration":"117.575604ms","start":"2026-07-25T04:20:16.147403Z","end":"2026-07-25T04:20:16.264978Z","steps":["trace[554560232] 'count revisions from in-memory index tree'  (duration: 116.105087ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:16.592349Z","caller":"traceutil/trace.go:171","msg":"trace[1747472826] linearizableReadLoop","detail":"{readStateIndex:2627; appliedIndex:2626; }","duration":"144.183381ms","start":"2026-07-25T04:20:16.448139Z","end":"2026-07-25T04:20:16.592323Z","steps":["trace[1747472826] 'read index received'  (duration: 110.270368ms)","trace[1747472826] 'applied index is now lower than readState.Index'  (duration: 33.911622ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:16.592514Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.630503ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephcosidrivers/\" range_end:\"/registry/ceph.rook.io/cephcosidrivers0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-07-25T04:20:16.592539Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.371493ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephclusters/\" range_end:\"/registry/ceph.rook.io/cephclusters0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-07-25T04:20:16.592633Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.655275ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"info","ts":"2026-07-25T04:20:16.592684Z","caller":"traceutil/trace.go:171","msg":"trace[1752187790] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2536; }","duration":"204.756862ms","start":"2026-07-25T04:20:16.387914Z","end":"2026-07-25T04:20:16.592671Z","steps":["trace[1752187790] 'agreement among raft nodes before linearized reading'  (duration: 204.594691ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:16.592699Z","caller":"traceutil/trace.go:171","msg":"trace[587915742] range","detail":"{range_begin:/registry/ceph.rook.io/cephcosidrivers/; range_end:/registry/ceph.rook.io/cephcosidrivers0; response_count:0; response_revision:2536; }","duration":"192.808974ms","start":"2026-07-25T04:20:16.399828Z","end":"2026-07-25T04:20:16.592637Z","steps":["trace[587915742] 'agreement among raft nodes before linearized reading'  (duration: 192.600161ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:16.592719Z","caller":"traceutil/trace.go:171","msg":"trace[1294058743] range","detail":"{range_begin:/registry/ceph.rook.io/cephclusters/; range_end:/registry/ceph.rook.io/cephclusters0; response_count:0; response_revision:2536; }","duration":"156.582628ms","start":"2026-07-25T04:20:16.436061Z","end":"2026-07-25T04:20:16.592643Z","steps":["trace[1294058743] 'agreement among raft nodes before linearized reading'  (duration: 156.31449ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.59298Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"231.139742ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephfilesystemmirrors/\" range_end:\"/registry/ceph.rook.io/cephfilesystemmirrors0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.592934Z","caller":"traceutil/trace.go:171","msg":"trace[1245802042] transaction","detail":"{read_only:false; response_revision:2536; number_of_response:1; }","duration":"181.263744ms","start":"2026-07-25T04:20:16.411606Z","end":"2026-07-25T04:20:16.59287Z","steps":["trace[1245802042] 'process raft request'  (duration: 146.88736ms)","trace[1245802042] 'compare'  (duration: 33.658806ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:20:16.59303Z","caller":"traceutil/trace.go:171","msg":"trace[368995897] range","detail":"{range_begin:/registry/ceph.rook.io/cephfilesystemmirrors/; range_end:/registry/ceph.rook.io/cephfilesystemmirrors0; response_count:0; response_revision:2536; }","duration":"231.228908ms","start":"2026-07-25T04:20:16.361789Z","end":"2026-07-25T04:20:16.593018Z","steps":["trace[368995897] 'agreement among raft nodes before linearized reading'  (duration: 231.144462ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.59315Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.747238ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephclusters/\" range_end:\"/registry/ceph.rook.io/cephclusters0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-07-25T04:20:16.593204Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"233.191919ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephfilesystemmirrors/\" range_end:\"/registry/ceph.rook.io/cephfilesystemmirrors0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.593275Z","caller":"traceutil/trace.go:171","msg":"trace[1377504830] range","detail":"{range_begin:/registry/ceph.rook.io/cephclusters/; range_end:/registry/ceph.rook.io/cephclusters0; response_count:0; response_revision:2536; }","duration":"156.874367ms","start":"2026-07-25T04:20:16.436355Z","end":"2026-07-25T04:20:16.593229Z","steps":["trace[1377504830] 'agreement among raft nodes before linearized reading'  (duration: 156.685144ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.593133Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.194371ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephcosidrivers/\" range_end:\"/registry/ceph.rook.io/cephcosidrivers0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.59332Z","caller":"traceutil/trace.go:171","msg":"trace[365552351] range","detail":"{range_begin:/registry/ceph.rook.io/cephfilesystemmirrors/; range_end:/registry/ceph.rook.io/cephfilesystemmirrors0; response_count:0; response_revision:2536; }","duration":"233.392442ms","start":"2026-07-25T04:20:16.359897Z","end":"2026-07-25T04:20:16.593289Z","steps":["trace[365552351] 'agreement among raft nodes before linearized reading'  (duration: 233.158956ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.593315Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.934531ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephclusters/\" range_end:\"/registry/ceph.rook.io/cephclusters0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.593428Z","caller":"traceutil/trace.go:171","msg":"trace[1309522510] range","detail":"{range_begin:/registry/ceph.rook.io/cephclusters/; range_end:/registry/ceph.rook.io/cephclusters0; response_count:0; response_revision:2536; }","duration":"157.099692ms","start":"2026-07-25T04:20:16.436297Z","end":"2026-07-25T04:20:16.593397Z","steps":["trace[1309522510] 'agreement among raft nodes before linearized reading'  (duration: 156.870267ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.593349Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.146727ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephcosidrivers/\" range_end:\"/registry/ceph.rook.io/cephcosidrivers0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.593453Z","caller":"traceutil/trace.go:171","msg":"trace[506350759] range","detail":"{range_begin:/registry/ceph.rook.io/cephcosidrivers/; range_end:/registry/ceph.rook.io/cephcosidrivers0; response_count:0; response_revision:2536; }","duration":"193.519642ms","start":"2026-07-25T04:20:16.399866Z","end":"2026-07-25T04:20:16.593385Z","steps":["trace[506350759] 'agreement among raft nodes before linearized reading'  (duration: 193.135287ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:16.593599Z","caller":"traceutil/trace.go:171","msg":"trace[1037787383] range","detail":"{range_begin:/registry/ceph.rook.io/cephcosidrivers/; range_end:/registry/ceph.rook.io/cephcosidrivers0; response_count:0; response_revision:2536; }","duration":"193.507251ms","start":"2026-07-25T04:20:16.400034Z","end":"2026-07-25T04:20:16.593541Z","steps":["trace[1037787383] 'agreement among raft nodes before linearized reading'  (duration: 192.962884ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.593651Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.483792ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephbuckettopics/\" range_end:\"/registry/ceph.rook.io/cephbuckettopics0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-07-25T04:20:16.593705Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.177655ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephnfses/\" range_end:\"/registry/ceph.rook.io/cephnfses0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.593728Z","caller":"traceutil/trace.go:171","msg":"trace[1686862004] range","detail":"{range_begin:/registry/ceph.rook.io/cephbuckettopics/; range_end:/registry/ceph.rook.io/cephbuckettopics0; response_count:0; response_revision:2536; }","duration":"107.595449ms","start":"2026-07-25T04:20:16.486117Z","end":"2026-07-25T04:20:16.593713Z","steps":["trace[1686862004] 'agreement among raft nodes before linearized reading'  (duration: 107.46521ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.593856Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.321174ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephnfses/\" range_end:\"/registry/ceph.rook.io/cephnfses0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.593896Z","caller":"traceutil/trace.go:171","msg":"trace[502187913] range","detail":"{range_begin:/registry/ceph.rook.io/cephnfses/; range_end:/registry/ceph.rook.io/cephnfses0; response_count:0; response_revision:2536; }","duration":"121.376738ms","start":"2026-07-25T04:20:16.472511Z","end":"2026-07-25T04:20:16.593888Z","steps":["trace[502187913] 'agreement among raft nodes before linearized reading'  (duration: 121.313104ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.593915Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.802523ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephbuckettopics/\" range_end:\"/registry/ceph.rook.io/cephbuckettopics0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.594004Z","caller":"traceutil/trace.go:171","msg":"trace[43076069] range","detail":"{range_begin:/registry/ceph.rook.io/cephbuckettopics/; range_end:/registry/ceph.rook.io/cephbuckettopics0; response_count:0; response_revision:2536; }","duration":"107.888279ms","start":"2026-07-25T04:20:16.486101Z","end":"2026-07-25T04:20:16.59399Z","steps":["trace[43076069] 'agreement among raft nodes before linearized reading'  (duration: 107.780001ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.593848Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.214088ms","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:5"}
{"level":"info","ts":"2026-07-25T04:20:16.594329Z","caller":"traceutil/trace.go:171","msg":"trace[1519258850] range","detail":"{range_begin:/registry/ceph.rook.io/cephnfses/; range_end:/registry/ceph.rook.io/cephnfses0; response_count:0; response_revision:2536; }","duration":"121.778015ms","start":"2026-07-25T04:20:16.472539Z","end":"2026-07-25T04:20:16.594317Z","steps":["trace[1519258850] 'agreement among raft nodes before linearized reading'  (duration: 121.197757ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:16.594454Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.3091ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephbuckettopics/\" range_end:\"/registry/ceph.rook.io/cephbuckettopics0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:16.594523Z","caller":"traceutil/trace.go:171","msg":"trace[2128178080] range","detail":"{range_begin:/registry/ceph.rook.io/cephbuckettopics/; range_end:/registry/ceph.rook.io/cephbuckettopics0; response_count:0; response_revision:2536; }","duration":"107.389915ms","start":"2026-07-25T04:20:16.48712Z","end":"2026-07-25T04:20:16.59451Z","steps":["trace[2128178080] 'agreement among raft nodes before linearized reading'  (duration: 107.291729ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:16.5938Z","caller":"traceutil/trace.go:171","msg":"trace[669145889] range","detail":"{range_begin:/registry/ceph.rook.io/cephnfses/; range_end:/registry/ceph.rook.io/cephnfses0; response_count:0; response_revision:2536; }","duration":"121.338356ms","start":"2026-07-25T04:20:16.472418Z","end":"2026-07-25T04:20:16.593757Z","steps":["trace[669145889] 'agreement among raft nodes before linearized reading'  (duration: 121.174385ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:17.100269Z","caller":"traceutil/trace.go:171","msg":"trace[1908545776] linearizableReadLoop","detail":"{readStateIndex:2633; appliedIndex:2631; }","duration":"114.04959ms","start":"2026-07-25T04:20:16.986187Z","end":"2026-07-25T04:20:17.100237Z","steps":["trace[1908545776] 'read index received'  (duration: 33.089618ms)","trace[1908545776] 'applied index is now lower than readState.Index'  (duration: 80.958772ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:17.100491Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.282075ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/local-path-storage/\" range_end:\"/registry/limitranges/local-path-storage0\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:17.100587Z","caller":"traceutil/trace.go:171","msg":"trace[439307507] range","detail":"{range_begin:/registry/limitranges/local-path-storage/; range_end:/registry/limitranges/local-path-storage0; response_count:0; response_revision:2542; }","duration":"114.394453ms","start":"2026-07-25T04:20:16.986173Z","end":"2026-07-25T04:20:17.100567Z","steps":["trace[439307507] 'agreement among raft nodes before linearized reading'  (duration: 114.182209ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:17.100942Z","caller":"traceutil/trace.go:171","msg":"trace[137263455] transaction","detail":"{read_only:false; response_revision:2542; number_of_response:1; }","duration":"116.013511ms","start":"2026-07-25T04:20:16.984235Z","end":"2026-07-25T04:20:17.100248Z","steps":["trace[137263455] 'process raft request'  (duration: 81.040577ms)","trace[137263455] 'compare'  (duration: 34.786811ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:20:17.429933Z","caller":"traceutil/trace.go:171","msg":"trace[377326489] transaction","detail":"{read_only:false; response_revision:2546; number_of_response:1; }","duration":"105.446246ms","start":"2026-07-25T04:20:17.324444Z","end":"2026-07-25T04:20:17.42989Z","steps":["trace[377326489] 'process raft request'  (duration: 92.090595ms)","trace[377326489] 'compare'  (duration: 13.162048ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:18.517512Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"419.518451ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749329046 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:2531 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:370 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:20:18.517876Z","caller":"traceutil/trace.go:171","msg":"trace[613471716] linearizableReadLoop","detail":"{readStateIndex:2644; appliedIndex:2642; }","duration":"276.400832ms","start":"2026-07-25T04:20:18.241448Z","end":"2026-07-25T04:20:18.517849Z","steps":["trace[613471716] 'read index received'  (duration: 25.93556ms)","trace[613471716] 'applied index is now lower than readState.Index'  (duration: 250.463562ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:20:18.517855Z","caller":"traceutil/trace.go:171","msg":"trace[1699255519] transaction","detail":"{read_only:false; response_revision:2552; number_of_response:1; }","duration":"587.437225ms","start":"2026-07-25T04:20:17.93038Z","end":"2026-07-25T04:20:18.517817Z","steps":["trace[1699255519] 'process raft request'  (duration: 167.437822ms)","trace[1699255519] 'compare'  (duration: 418.938162ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:18.518074Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:20:17.930355Z","time spent":"587.590965ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:2531 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:370 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-07-25T04:20:18.517951Z","caller":"traceutil/trace.go:171","msg":"trace[1738466851] transaction","detail":"{read_only:false; response_revision:2553; number_of_response:1; }","duration":"486.331678ms","start":"2026-07-25T04:20:18.031527Z","end":"2026-07-25T04:20:18.517859Z","steps":["trace[1738466851] 'process raft request'  (duration: 486.179118ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:18.518215Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.762266ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-951e0572-83e2-402b-b584-b9f7746ee996\" ","response":"range_response_count:1 size:3601"}
{"level":"info","ts":"2026-07-25T04:20:18.518274Z","caller":"traceutil/trace.go:171","msg":"trace[580341410] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-951e0572-83e2-402b-b584-b9f7746ee996; range_end:; response_count:1; response_revision:2553; }","duration":"276.882464ms","start":"2026-07-25T04:20:18.241376Z","end":"2026-07-25T04:20:18.518258Z","steps":["trace[580341410] 'agreement among raft nodes before linearized reading'  (duration: 276.661629ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:18.518333Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:20:18.031491Z","time spent":"486.735246ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:2532 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:464 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-07-25T04:20:18.540082Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"252.564611ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:11985"}
{"level":"info","ts":"2026-07-25T04:20:18.540182Z","caller":"traceutil/trace.go:171","msg":"trace[907266134] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:2554; }","duration":"252.6989ms","start":"2026-07-25T04:20:18.287461Z","end":"2026-07-25T04:20:18.54016Z","steps":["trace[907266134] 'agreement among raft nodes before linearized reading'  (duration: 252.406831ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:24.872143Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"220.759339ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749329248 > lease_revoke:<id:1fe39f977e28996f>","response":"size:27"}
{"level":"info","ts":"2026-07-25T04:20:24.872378Z","caller":"traceutil/trace.go:171","msg":"trace[843518106] transaction","detail":"{read_only:false; response_revision:2665; number_of_response:1; }","duration":"167.772314ms","start":"2026-07-25T04:20:24.70459Z","end":"2026-07-25T04:20:24.872363Z","steps":["trace[843518106] 'process raft request'  (duration: 167.652736ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:24.872418Z","caller":"traceutil/trace.go:171","msg":"trace[980408638] linearizableReadLoop","detail":"{readStateIndex:2759; appliedIndex:2758; }","duration":"218.252412ms","start":"2026-07-25T04:20:24.65413Z","end":"2026-07-25T04:20:24.872382Z","steps":["trace[980408638] 'read index received'  (duration: 51.043µs)","trace[980408638] 'applied index is now lower than readState.Index'  (duration: 218.197289ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:24.872619Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"218.469857ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csistoragecapacities/\" range_end:\"/registry/csistoragecapacities0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:24.872648Z","caller":"traceutil/trace.go:171","msg":"trace[1921987165] range","detail":"{range_begin:/registry/csistoragecapacities/; range_end:/registry/csistoragecapacities0; response_count:0; response_revision:2665; }","duration":"218.555452ms","start":"2026-07-25T04:20:24.654084Z","end":"2026-07-25T04:20:24.87264Z","steps":["trace[1921987165] 'agreement among raft nodes before linearized reading'  (duration: 218.434384ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:24.884229Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.286305ms","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-07-25T04:20:24.884292Z","caller":"traceutil/trace.go:171","msg":"trace[1733462079] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2666; }","duration":"160.400872ms","start":"2026-07-25T04:20:24.723873Z","end":"2026-07-25T04:20:24.884274Z","steps":["trace[1733462079] 'agreement among raft nodes before linearized reading'  (duration: 160.195169ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:24.884451Z","caller":"traceutil/trace.go:171","msg":"trace[169876544] transaction","detail":"{read_only:false; response_revision:2666; number_of_response:1; }","duration":"150.224813ms","start":"2026-07-25T04:20:24.734159Z","end":"2026-07-25T04:20:24.884384Z","steps":["trace[169876544] 'process raft request'  (duration: 149.793394ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:24.884572Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.779999ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"info","ts":"2026-07-25T04:20:24.884606Z","caller":"traceutil/trace.go:171","msg":"trace[256738278] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2666; }","duration":"132.847424ms","start":"2026-07-25T04:20:24.751747Z","end":"2026-07-25T04:20:24.884595Z","steps":["trace[256738278] 'agreement among raft nodes before linearized reading'  (duration: 132.756548ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:36.58558Z","caller":"traceutil/trace.go:171","msg":"trace[1522986061] linearizableReadLoop","detail":"{readStateIndex:2867; appliedIndex:2866; }","duration":"191.374999ms","start":"2026-07-25T04:20:36.394162Z","end":"2026-07-25T04:20:36.585537Z","steps":["trace[1522986061] 'read index received'  (duration: 176.180495ms)","trace[1522986061] 'applied index is now lower than readState.Index'  (duration: 15.192694ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:20:36.585782Z","caller":"traceutil/trace.go:171","msg":"trace[1680711627] transaction","detail":"{read_only:false; response_revision:2769; number_of_response:1; }","duration":"219.785034ms","start":"2026-07-25T04:20:36.365939Z","end":"2026-07-25T04:20:36.585724Z","steps":["trace[1680711627] 'process raft request'  (duration: 204.495334ms)","trace[1680711627] 'compare'  (duration: 14.808348ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:36.585884Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"191.687199ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/rook-ceph/rook-ceph-operator-76bbbb77ff-wmd72\" ","response":"range_response_count:1 size:4559"}
{"level":"info","ts":"2026-07-25T04:20:36.585943Z","caller":"traceutil/trace.go:171","msg":"trace[1693905010] range","detail":"{range_begin:/registry/pods/rook-ceph/rook-ceph-operator-76bbbb77ff-wmd72; range_end:; response_count:1; response_revision:2769; }","duration":"191.829709ms","start":"2026-07-25T04:20:36.39409Z","end":"2026-07-25T04:20:36.585919Z","steps":["trace[1693905010] 'agreement among raft nodes before linearized reading'  (duration: 191.679849ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:40.741039Z","caller":"traceutil/trace.go:171","msg":"trace[1927683241] transaction","detail":"{read_only:false; response_revision:2808; number_of_response:1; }","duration":"111.431587ms","start":"2026-07-25T04:20:40.629571Z","end":"2026-07-25T04:20:40.741003Z","steps":["trace[1927683241] 'process raft request'  (duration: 96.177022ms)","trace[1927683241] 'compare'  (duration: 14.779792ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:20:50.310165Z","caller":"traceutil/trace.go:171","msg":"trace[243316915] transaction","detail":"{read_only:false; response_revision:2889; number_of_response:1; }","duration":"106.458388ms","start":"2026-07-25T04:20:50.203676Z","end":"2026-07-25T04:20:50.310135Z","steps":["trace[243316915] 'process raft request'  (duration: 106.271453ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:53.086169Z","caller":"traceutil/trace.go:171","msg":"trace[689514327] transaction","detail":"{read_only:false; response_revision:2906; number_of_response:1; }","duration":"105.002938ms","start":"2026-07-25T04:20:52.981106Z","end":"2026-07-25T04:20:53.086109Z","steps":["trace[689514327] 'process raft request'  (duration: 86.972005ms)","trace[689514327] 'compare'  (duration: 17.700534ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:53.411572Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.133759ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749329823 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:2895 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:429 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:20:53.411721Z","caller":"traceutil/trace.go:171","msg":"trace[1241758055] transaction","detail":"{read_only:false; response_revision:2907; number_of_response:1; }","duration":"321.017862ms","start":"2026-07-25T04:20:53.090677Z","end":"2026-07-25T04:20:53.411695Z","steps":["trace[1241758055] 'process raft request'  (duration: 171.642217ms)","trace[1241758055] 'compare'  (duration: 148.991125ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:53.411797Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:20:53.090646Z","time spent":"321.113665ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":489,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:2895 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:429 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-07-25T04:20:53.421462Z","caller":"traceutil/trace.go:171","msg":"trace[46398539] transaction","detail":"{read_only:false; response_revision:2908; number_of_response:1; }","duration":"330.596379ms","start":"2026-07-25T04:20:53.090831Z","end":"2026-07-25T04:20:53.421427Z","steps":["trace[46398539] 'process raft request'  (duration: 330.386463ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:20:53.421684Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:20:53.090812Z","time spent":"330.749163ms","remote":"127.0.0.1:41702","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":819,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/events/openstack/percona-xtradb-pxc-0.18c56d83df2f5216\" mod_revision:2835 > success:<request_put:<key:\"/registry/events/openstack/percona-xtradb-pxc-0.18c56d83df2f5216\" value_size:737 lease:2297855707894553795 >> failure:<request_range:<key:\"/registry/events/openstack/percona-xtradb-pxc-0.18c56d83df2f5216\" > >"}
{"level":"info","ts":"2026-07-25T04:20:57.111781Z","caller":"traceutil/trace.go:171","msg":"trace[587850280] transaction","detail":"{read_only:false; response_revision:2932; number_of_response:1; }","duration":"275.512913ms","start":"2026-07-25T04:20:56.836235Z","end":"2026-07-25T04:20:57.111748Z","steps":["trace[587850280] 'process raft request'  (duration: 275.261106ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:57.111777Z","caller":"traceutil/trace.go:171","msg":"trace[1137724724] linearizableReadLoop","detail":"{readStateIndex:3035; appliedIndex:3034; }","duration":"213.921986ms","start":"2026-07-25T04:20:56.89779Z","end":"2026-07-25T04:20:57.111712Z","steps":["trace[1137724724] 'read index received'  (duration: 213.796892ms)","trace[1137724724] 'applied index is now lower than readState.Index'  (duration: 123.794µs)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:20:57.111946Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"214.127701ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:20:57.11202Z","caller":"traceutil/trace.go:171","msg":"trace[1084554724] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2932; }","duration":"214.266485ms","start":"2026-07-25T04:20:56.897734Z","end":"2026-07-25T04:20:57.112001Z","steps":["trace[1084554724] 'agreement among raft nodes before linearized reading'  (duration: 214.118491ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:20:57.203192Z","caller":"traceutil/trace.go:171","msg":"trace[1479143568] transaction","detail":"{read_only:false; response_revision:2933; number_of_response:1; }","duration":"102.105807ms","start":"2026-07-25T04:20:57.101032Z","end":"2026-07-25T04:20:57.203138Z","steps":["trace[1479143568] 'process raft request'  (duration: 101.950183ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:11.367874Z","caller":"traceutil/trace.go:171","msg":"trace[1748190960] transaction","detail":"{read_only:false; response_revision:3009; number_of_response:1; }","duration":"108.476735ms","start":"2026-07-25T04:21:11.259336Z","end":"2026-07-25T04:21:11.367813Z","steps":["trace[1748190960] 'process raft request'  (duration: 64.729625ms)","trace[1748190960] 'compare'  (duration: 43.369629ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:21:11.368296Z","caller":"traceutil/trace.go:171","msg":"trace[289162825] transaction","detail":"{read_only:false; response_revision:3010; number_of_response:1; }","duration":"108.850145ms","start":"2026-07-25T04:21:11.259414Z","end":"2026-07-25T04:21:11.368264Z","steps":["trace[289162825] 'process raft request'  (duration: 108.29744ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:11.368402Z","caller":"traceutil/trace.go:171","msg":"trace[938503043] transaction","detail":"{read_only:false; response_revision:3012; number_of_response:1; }","duration":"108.889876ms","start":"2026-07-25T04:21:11.259471Z","end":"2026-07-25T04:21:11.368361Z","steps":["trace[938503043] 'process raft request'  (duration: 108.772943ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:11.368477Z","caller":"traceutil/trace.go:171","msg":"trace[513139968] linearizableReadLoop","detail":"{readStateIndex:3119; appliedIndex:3113; }","duration":"108.616298ms","start":"2026-07-25T04:21:11.259824Z","end":"2026-07-25T04:21:11.36844Z","steps":["trace[513139968] 'read index received'  (duration: 37.479995ms)","trace[513139968] 'applied index is now lower than readState.Index'  (duration: 71.134743ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:21:11.368536Z","caller":"traceutil/trace.go:171","msg":"trace[1829631225] transaction","detail":"{read_only:false; response_revision:3011; number_of_response:1; }","duration":"109.084692ms","start":"2026-07-25T04:21:11.259411Z","end":"2026-07-25T04:21:11.368496Z","steps":["trace[1829631225] 'process raft request'  (duration: 108.706631ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:11.368651Z","caller":"traceutil/trace.go:171","msg":"trace[78543294] transaction","detail":"{read_only:false; response_revision:3013; number_of_response:1; }","duration":"109.162054ms","start":"2026-07-25T04:21:11.259466Z","end":"2026-07-25T04:21:11.368628Z","steps":["trace[78543294] 'process raft request'  (duration: 108.843285ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:21:11.368973Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.114303ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/neutron-coredns-7dd4958666-xz4gn\" ","response":"range_response_count:1 size:5132"}
{"level":"info","ts":"2026-07-25T04:21:11.369035Z","caller":"traceutil/trace.go:171","msg":"trace[350361766] range","detail":"{range_begin:/registry/pods/openstack/neutron-coredns-7dd4958666-xz4gn; range_end:; response_count:1; response_revision:3013; }","duration":"109.203125ms","start":"2026-07-25T04:21:11.259814Z","end":"2026-07-25T04:21:11.369017Z","steps":["trace[350361766] 'agreement among raft nodes before linearized reading'  (duration: 108.959959ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:22.379586Z","caller":"traceutil/trace.go:171","msg":"trace[2008169940] transaction","detail":"{read_only:false; response_revision:3073; number_of_response:1; }","duration":"135.9084ms","start":"2026-07-25T04:21:22.243623Z","end":"2026-07-25T04:21:22.379531Z","steps":["trace[2008169940] 'process raft request'  (duration: 121.455877ms)","trace[2008169940] 'compare'  (duration: 14.024801ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:21:37.123708Z","caller":"traceutil/trace.go:171","msg":"trace[711502603] transaction","detail":"{read_only:false; response_revision:3177; number_of_response:1; }","duration":"102.972041ms","start":"2026-07-25T04:21:37.020688Z","end":"2026-07-25T04:21:37.12366Z","steps":["trace[711502603] 'process raft request'  (duration: 102.805367ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:21:45.261949Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.504691ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/runtimeclasses/\" range_end:\"/registry/runtimeclasses0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:21:45.26206Z","caller":"traceutil/trace.go:171","msg":"trace[1178880084] range","detail":"{range_begin:/registry/runtimeclasses/; range_end:/registry/runtimeclasses0; response_count:0; response_revision:3222; }","duration":"153.675666ms","start":"2026-07-25T04:21:45.108363Z","end":"2026-07-25T04:21:45.262039Z","steps":["trace[1178880084] 'count revisions from in-memory index tree'  (duration: 153.400849ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:45.262618Z","caller":"traceutil/trace.go:171","msg":"trace[576503394] transaction","detail":"{read_only:false; response_revision:3223; number_of_response:1; }","duration":"111.525227ms","start":"2026-07-25T04:21:45.151069Z","end":"2026-07-25T04:21:45.262594Z","steps":["trace[576503394] 'process raft request'  (duration: 93.155302ms)","trace[576503394] 'compare'  (duration: 17.172992ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:21:49.10097Z","caller":"traceutil/trace.go:171","msg":"trace[92421245] transaction","detail":"{read_only:false; response_revision:3330; number_of_response:1; }","duration":"121.765748ms","start":"2026-07-25T04:21:48.97918Z","end":"2026-07-25T04:21:49.100946Z","steps":["trace[92421245] 'process raft request'  (duration: 121.614693ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:21:49.949122Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.950432ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/federations/\" range_end:\"/registry/rabbitmq.com/federations0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-07-25T04:21:49.949166Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.060612ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-f73ca3fc-dfc0-45e3-b11d-dab3aec4445a\" ","response":"range_response_count:1 size:3617"}
{"level":"info","ts":"2026-07-25T04:21:49.949182Z","caller":"traceutil/trace.go:171","msg":"trace[1773593716] linearizableReadLoop","detail":"{readStateIndex:3459; appliedIndex:3458; }","duration":"116.057002ms","start":"2026-07-25T04:21:49.833095Z","end":"2026-07-25T04:21:49.949152Z","steps":["trace[1773593716] 'read index received'  (duration: 106.16759ms)","trace[1773593716] 'applied index is now lower than readState.Index'  (duration: 9.888152ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:21:49.949269Z","caller":"traceutil/trace.go:171","msg":"trace[890586907] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-f73ca3fc-dfc0-45e3-b11d-dab3aec4445a; range_end:; response_count:1; response_revision:3338; }","duration":"120.196635ms","start":"2026-07-25T04:21:49.829052Z","end":"2026-07-25T04:21:49.949249Z","steps":["trace[890586907] 'range keys from in-memory index tree'  (duration: 119.912708ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:49.949322Z","caller":"traceutil/trace.go:171","msg":"trace[514981282] transaction","detail":"{read_only:false; response_revision:3339; number_of_response:1; }","duration":"117.831171ms","start":"2026-07-25T04:21:49.831437Z","end":"2026-07-25T04:21:49.949268Z","steps":["trace[514981282] 'process raft request'  (duration: 107.915108ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:49.949215Z","caller":"traceutil/trace.go:171","msg":"trace[755760815] range","detail":"{range_begin:/registry/rabbitmq.com/federations/; range_end:/registry/rabbitmq.com/federations0; response_count:0; response_revision:3338; }","duration":"123.115356ms","start":"2026-07-25T04:21:49.82608Z","end":"2026-07-25T04:21:49.949196Z","steps":["trace[755760815] 'count revisions from in-memory index tree'  (duration: 122.846799ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:21:49.949508Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.399811ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"}
{"level":"info","ts":"2026-07-25T04:21:49.949564Z","caller":"traceutil/trace.go:171","msg":"trace[902327872] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:3339; }","duration":"116.468564ms","start":"2026-07-25T04:21:49.83308Z","end":"2026-07-25T04:21:49.949548Z","steps":["trace[902327872] 'agreement among raft nodes before linearized reading'  (duration: 116.221987ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:51.161073Z","caller":"traceutil/trace.go:171","msg":"trace[725721041] transaction","detail":"{read_only:false; response_revision:3347; number_of_response:1; }","duration":"300.972068ms","start":"2026-07-25T04:21:50.860055Z","end":"2026-07-25T04:21:51.161028Z","steps":["trace[725721041] 'process raft request'  (duration: 225.41771ms)","trace[725721041] 'compare'  (duration: 75.26505ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:21:51.161286Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:21:50.86004Z","time spent":"301.130032ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":515,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/cert-manager/cert-manager-controller\" mod_revision:3170 > success:<request_put:<key:\"/registry/leases/cert-manager/cert-manager-controller\" value_size:454 >> failure:<request_range:<key:\"/registry/leases/cert-manager/cert-manager-controller\" > >"}
{"level":"info","ts":"2026-07-25T04:21:51.161371Z","caller":"traceutil/trace.go:171","msg":"trace[1351200310] transaction","detail":"{read_only:false; response_revision:3349; number_of_response:1; }","duration":"297.546653ms","start":"2026-07-25T04:21:50.863795Z","end":"2026-07-25T04:21:51.161342Z","steps":["trace[1351200310] 'process raft request'  (duration: 297.41437ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:51.161394Z","caller":"traceutil/trace.go:171","msg":"trace[1912683214] transaction","detail":"{read_only:false; response_revision:3348; number_of_response:1; }","duration":"301.013469ms","start":"2026-07-25T04:21:50.860343Z","end":"2026-07-25T04:21:51.161356Z","steps":["trace[1912683214] 'process raft request'  (duration: 300.573266ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:21:51.161703Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:21:50.860305Z","time spent":"301.273056ms","remote":"127.0.0.1:41702","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":778,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/events/openstack/valkey-server-1.18c56d9442464571\" mod_revision:0 > success:<request_put:<key:\"/registry/events/openstack/valkey-server-1.18c56d9442464571\" value_size:701 lease:2297855707894554825 >> failure:<>"}
{"level":"info","ts":"2026-07-25T04:21:51.171574Z","caller":"traceutil/trace.go:171","msg":"trace[1462296958] transaction","detail":"{read_only:false; response_revision:3350; number_of_response:1; }","duration":"296.470254ms","start":"2026-07-25T04:21:50.875089Z","end":"2026-07-25T04:21:51.17156Z","steps":["trace[1462296958] 'process raft request'  (duration: 296.347651ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:51.367332Z","caller":"traceutil/trace.go:171","msg":"trace[1794866560] transaction","detail":"{read_only:false; response_revision:3353; number_of_response:1; }","duration":"106.1866ms","start":"2026-07-25T04:21:51.261093Z","end":"2026-07-25T04:21:51.36728Z","steps":["trace[1794866560] 'process raft request'  (duration: 97.561053ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:51.395565Z","caller":"traceutil/trace.go:171","msg":"trace[263880425] linearizableReadLoop","detail":"{readStateIndex:3474; appliedIndex:3472; }","duration":"121.594314ms","start":"2026-07-25T04:21:51.273946Z","end":"2026-07-25T04:21:51.39554Z","steps":["trace[263880425] 'read index received'  (duration: 84.792732ms)","trace[263880425] 'applied index is now lower than readState.Index'  (duration: 36.799942ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:21:51.395606Z","caller":"traceutil/trace.go:171","msg":"trace[1773029638] transaction","detail":"{read_only:false; number_of_response:1; response_revision:3353; }","duration":"129.682717ms","start":"2026-07-25T04:21:51.26588Z","end":"2026-07-25T04:21:51.395563Z","steps":["trace[1773029638] 'process raft request'  (duration: 129.468161ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:51.395659Z","caller":"traceutil/trace.go:171","msg":"trace[1839097777] transaction","detail":"{read_only:false; response_revision:3354; number_of_response:1; }","duration":"109.997455ms","start":"2026-07-25T04:21:51.285618Z","end":"2026-07-25T04:21:51.395616Z","steps":["trace[1839097777] 'process raft request'  (duration: 109.82466ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:21:51.395879Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.902142ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-f73ca3fc-dfc0-45e3-b11d-dab3aec4445a\" ","response":"range_response_count:1 size:3734"}
{"level":"info","ts":"2026-07-25T04:21:51.395966Z","caller":"traceutil/trace.go:171","msg":"trace[350331088] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-f73ca3fc-dfc0-45e3-b11d-dab3aec4445a; range_end:; response_count:1; response_revision:3354; }","duration":"122.055776ms","start":"2026-07-25T04:21:51.27389Z","end":"2026-07-25T04:21:51.395946Z","steps":["trace[350331088] 'agreement among raft nodes before linearized reading'  (duration: 121.747198ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:21:53.652703Z","caller":"traceutil/trace.go:171","msg":"trace[1190918012] transaction","detail":"{read_only:false; response_revision:3371; number_of_response:1; }","duration":"155.511747ms","start":"2026-07-25T04:21:53.497151Z","end":"2026-07-25T04:21:53.652663Z","steps":["trace[1190918012] 'process raft request'  (duration: 112.022281ms)","trace[1190918012] 'compare'  (duration: 43.294651ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:21:53.716957Z","caller":"traceutil/trace.go:171","msg":"trace[1637765986] transaction","detail":"{read_only:false; response_revision:3372; number_of_response:1; }","duration":"100.37028ms","start":"2026-07-25T04:21:53.61656Z","end":"2026-07-25T04:21:53.71693Z","steps":["trace[1637765986] 'process raft request'  (duration: 100.230196ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:22:16.477155Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.297629ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-g7fmx\" ","response":"range_response_count:1 size:6451"}
{"level":"info","ts":"2026-07-25T04:22:16.477276Z","caller":"traceutil/trace.go:171","msg":"trace[755542908] range","detail":"{range_begin:/registry/pods/openstack/keepalived-g7fmx; range_end:; response_count:1; response_revision:3597; }","duration":"124.465103ms","start":"2026-07-25T04:22:16.352784Z","end":"2026-07-25T04:22:16.47725Z","steps":["trace[755542908] 'range keys from in-memory index tree'  (duration: 124.071432ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:22:16.477258Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.3598ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5651"}
{"level":"warn","ts":"2026-07-25T04:22:16.477155Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"131.050905ms","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-07-25T04:22:16.477354Z","caller":"traceutil/trace.go:171","msg":"trace[1945440918] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:3597; }","duration":"148.495924ms","start":"2026-07-25T04:22:16.328837Z","end":"2026-07-25T04:22:16.477333Z","steps":["trace[1945440918] 'range keys from in-memory index tree'  (duration: 148.154995ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:22:16.477411Z","caller":"traceutil/trace.go:171","msg":"trace[1665555450] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:3597; }","duration":"131.308981ms","start":"2026-07-25T04:22:16.346046Z","end":"2026-07-25T04:22:16.477355Z","steps":["trace[1665555450] 'range keys from in-memory index tree'  (duration: 130.881369ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:22:16.726375Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.869084ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/valkey-data-valkey-node-0\" ","response":"range_response_count:1 size:1633"}
{"level":"info","ts":"2026-07-25T04:22:16.726472Z","caller":"traceutil/trace.go:171","msg":"trace[521327784] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/valkey-data-valkey-node-0; range_end:; response_count:1; response_revision:3598; }","duration":"149.043689ms","start":"2026-07-25T04:22:16.577405Z","end":"2026-07-25T04:22:16.726448Z","steps":["trace[521327784] 'range keys from in-memory index tree'  (duration: 148.620667ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:22:16.726565Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.021564ms","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-07-25T04:22:16.726671Z","caller":"traceutil/trace.go:171","msg":"trace[1354839115] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:3598; }","duration":"111.217789ms","start":"2026-07-25T04:22:16.61543Z","end":"2026-07-25T04:22:16.726647Z","steps":["trace[1354839115] 'range keys from in-memory index tree'  (duration: 110.763956ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:22:24.694742Z","caller":"traceutil/trace.go:171","msg":"trace[1454117982] transaction","detail":"{read_only:false; response_revision:3656; number_of_response:1; }","duration":"161.569183ms","start":"2026-07-25T04:22:24.533099Z","end":"2026-07-25T04:22:24.694668Z","steps":["trace[1454117982] 'process raft request'  (duration: 161.295026ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:22:40.28396Z","caller":"traceutil/trace.go:171","msg":"trace[65249899] transaction","detail":"{read_only:false; response_revision:3754; number_of_response:1; }","duration":"144.038432ms","start":"2026-07-25T04:22:40.139896Z","end":"2026-07-25T04:22:40.283935Z","steps":["trace[65249899] 'process raft request'  (duration: 143.868537ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:22:57.193164Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.634305ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749332104 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:3831 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:22:57.193405Z","caller":"traceutil/trace.go:171","msg":"trace[62227058] transaction","detail":"{read_only:false; response_revision:3842; number_of_response:1; }","duration":"128.22553ms","start":"2026-07-25T04:22:57.065127Z","end":"2026-07-25T04:22:57.193353Z","steps":["trace[62227058] 'process raft request'  (duration: 26.244065ms)","trace[62227058] 'compare'  (duration: 101.338647ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:22:57.567522Z","caller":"traceutil/trace.go:171","msg":"trace[815126519] transaction","detail":"{read_only:false; response_revision:3843; number_of_response:1; }","duration":"141.772839ms","start":"2026-07-25T04:22:57.425719Z","end":"2026-07-25T04:22:57.567492Z","steps":["trace[815126519] 'process raft request'  (duration: 141.550463ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:23:11.394778Z","caller":"traceutil/trace.go:171","msg":"trace[1649349473] transaction","detail":"{read_only:false; response_revision:3917; number_of_response:1; }","duration":"127.642852ms","start":"2026-07-25T04:23:11.267108Z","end":"2026-07-25T04:23:11.394751Z","steps":["trace[1649349473] 'process raft request'  (duration: 127.464397ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:23:14.531151Z","caller":"traceutil/trace.go:171","msg":"trace[1830114915] transaction","detail":"{read_only:false; response_revision:3932; number_of_response:1; }","duration":"125.699428ms","start":"2026-07-25T04:23:14.405412Z","end":"2026-07-25T04:23:14.531111Z","steps":["trace[1830114915] 'process raft request'  (duration: 125.347899ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:23:15.381344Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.4405ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/replicasets/\" range_end:\"/registry/replicasets0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-07-25T04:23:15.381419Z","caller":"traceutil/trace.go:171","msg":"trace[778817480] range","detail":"{range_begin:/registry/replicasets/; range_end:/registry/replicasets0; response_count:0; response_revision:3936; }","duration":"116.573203ms","start":"2026-07-25T04:23:15.264829Z","end":"2026-07-25T04:23:15.381402Z","steps":["trace[778817480] 'count revisions from in-memory index tree'  (duration: 116.320696ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:23:15.542197Z","caller":"traceutil/trace.go:171","msg":"trace[1774731044] transaction","detail":"{read_only:false; response_revision:3937; number_of_response:1; }","duration":"123.468707ms","start":"2026-07-25T04:23:15.418692Z","end":"2026-07-25T04:23:15.54216Z","steps":["trace[1774731044] 'process raft request'  (duration: 123.266781ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:23:52.218205Z","caller":"traceutil/trace.go:171","msg":"trace[2081932266] transaction","detail":"{read_only:false; response_revision:4127; number_of_response:1; }","duration":"114.628836ms","start":"2026-07-25T04:23:52.103534Z","end":"2026-07-25T04:23:52.218163Z","steps":["trace[2081932266] 'process raft request'  (duration: 60.439361ms)","trace[2081932266] 'compare'  (duration: 54.017031ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:23:58.164715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.209448ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749332979 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:4145 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:465 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:23:58.164928Z","caller":"traceutil/trace.go:171","msg":"trace[1530681020] linearizableReadLoop","detail":"{readStateIndex:4302; appliedIndex:4300; }","duration":"211.198665ms","start":"2026-07-25T04:23:57.953708Z","end":"2026-07-25T04:23:58.164906Z","steps":["trace[1530681020] 'read index received'  (duration: 49.846863ms)","trace[1530681020] 'applied index is now lower than readState.Index'  (duration: 161.350452ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:23:58.165051Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.33493ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-07-25T04:23:58.165091Z","caller":"traceutil/trace.go:171","msg":"trace[1849922235] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:4154; }","duration":"211.393291ms","start":"2026-07-25T04:23:57.953687Z","end":"2026-07-25T04:23:58.16508Z","steps":["trace[1849922235] 'agreement among raft nodes before linearized reading'  (duration: 211.288128ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:23:58.165085Z","caller":"traceutil/trace.go:171","msg":"trace[1855096835] transaction","detail":"{read_only:false; response_revision:4153; number_of_response:1; }","duration":"235.752977ms","start":"2026-07-25T04:23:57.929287Z","end":"2026-07-25T04:23:58.16504Z","steps":["trace[1855096835] 'process raft request'  (duration: 74.097656ms)","trace[1855096835] 'compare'  (duration: 161.065664ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:23:58.165054Z","caller":"traceutil/trace.go:171","msg":"trace[492350563] transaction","detail":"{read_only:false; response_revision:4154; number_of_response:1; }","duration":"233.697489ms","start":"2026-07-25T04:23:57.931313Z","end":"2026-07-25T04:23:58.16501Z","steps":["trace[492350563] 'process raft request'  (duration: 233.537725ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:20.547731Z","caller":"traceutil/trace.go:171","msg":"trace[1378250771] transaction","detail":"{read_only:false; response_revision:4269; number_of_response:1; }","duration":"248.352902ms","start":"2026-07-25T04:24:20.299329Z","end":"2026-07-25T04:24:20.547682Z","steps":["trace[1378250771] 'process raft request'  (duration: 225.248561ms)","trace[1378250771] 'compare'  (duration: 22.492234ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:20.556608Z","caller":"traceutil/trace.go:171","msg":"trace[2113319109] linearizableReadLoop","detail":"{readStateIndex:4424; appliedIndex:4422; }","duration":"125.134112ms","start":"2026-07-25T04:24:20.431437Z","end":"2026-07-25T04:24:20.556571Z","steps":["trace[2113319109] 'read index received'  (duration: 93.225634ms)","trace[2113319109] 'applied index is now lower than readState.Index'  (duration: 31.907288ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:20.556647Z","caller":"traceutil/trace.go:171","msg":"trace[1018884073] transaction","detail":"{read_only:false; response_revision:4270; number_of_response:1; }","duration":"159.240053ms","start":"2026-07-25T04:24:20.397365Z","end":"2026-07-25T04:24:20.556606Z","steps":["trace[1018884073] 'process raft request'  (duration: 159.042348ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:20.556771Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.319478ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/keystone-openid-metadata\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:24:20.556821Z","caller":"traceutil/trace.go:171","msg":"trace[1213576736] range","detail":"{range_begin:/registry/configmaps/openstack/keystone-openid-metadata; range_end:; response_count:0; response_revision:4271; }","duration":"125.428601ms","start":"2026-07-25T04:24:20.431379Z","end":"2026-07-25T04:24:20.556808Z","steps":["trace[1213576736] 'agreement among raft nodes before linearized reading'  (duration: 125.328378ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:20.557062Z","caller":"traceutil/trace.go:171","msg":"trace[2116430148] transaction","detail":"{read_only:false; response_revision:4271; number_of_response:1; }","duration":"115.78011ms","start":"2026-07-25T04:24:20.441227Z","end":"2026-07-25T04:24:20.557007Z","steps":["trace[2116430148] 'process raft request'  (duration: 115.297466ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:21.071937Z","caller":"traceutil/trace.go:171","msg":"trace[913373730] transaction","detail":"{read_only:false; response_revision:4275; number_of_response:1; }","duration":"100.14813ms","start":"2026-07-25T04:24:20.971723Z","end":"2026-07-25T04:24:21.071872Z","steps":["trace[913373730] 'process raft request'  (duration: 99.917543ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:28.695836Z","caller":"traceutil/trace.go:171","msg":"trace[374727776] transaction","detail":"{read_only:false; response_revision:4309; number_of_response:1; }","duration":"102.759023ms","start":"2026-07-25T04:24:28.59304Z","end":"2026-07-25T04:24:28.695799Z","steps":["trace[374727776] 'process raft request'  (duration: 102.515426ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:28.696671Z","caller":"traceutil/trace.go:171","msg":"trace[1097254375] transaction","detail":"{read_only:false; response_revision:4310; number_of_response:1; }","duration":"102.216248ms","start":"2026-07-25T04:24:28.594409Z","end":"2026-07-25T04:24:28.696626Z","steps":["trace[1097254375] 'process raft request'  (duration: 101.859438ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:48.482759Z","caller":"traceutil/trace.go:171","msg":"trace[1518274237] transaction","detail":"{read_only:false; response_revision:4408; number_of_response:1; }","duration":"266.640017ms","start":"2026-07-25T04:24:48.216086Z","end":"2026-07-25T04:24:48.482726Z","steps":["trace[1518274237] 'process raft request'  (duration: 266.452881ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:48.839183Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.590099ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cronjobs/\" range_end:\"/registry/cronjobs0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:24:48.839324Z","caller":"traceutil/trace.go:171","msg":"trace[2031818582] range","detail":"{range_begin:/registry/cronjobs/; range_end:/registry/cronjobs0; response_count:0; response_revision:4409; }","duration":"107.774894ms","start":"2026-07-25T04:24:48.731492Z","end":"2026-07-25T04:24:48.839267Z","steps":["trace[2031818582] 'count revisions from in-memory index tree'  (duration: 107.452765ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:48.924357Z","caller":"traceutil/trace.go:171","msg":"trace[757926990] transaction","detail":"{read_only:false; response_revision:4410; number_of_response:1; }","duration":"133.599621ms","start":"2026-07-25T04:24:48.790736Z","end":"2026-07-25T04:24:48.924335Z","steps":["trace[757926990] 'process raft request'  (duration: 133.437607ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:49.073088Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.135596ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749333691 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:4402 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:459 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:24:49.073302Z","caller":"traceutil/trace.go:171","msg":"trace[2018713812] transaction","detail":"{read_only:false; response_revision:4411; number_of_response:1; }","duration":"272.263835ms","start":"2026-07-25T04:24:48.800989Z","end":"2026-07-25T04:24:49.073253Z","steps":["trace[2018713812] 'process raft request'  (duration: 159.83483ms)","trace[2018713812] 'compare'  (duration: 111.56858ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:49.073954Z","caller":"traceutil/trace.go:171","msg":"trace[1461517109] linearizableReadLoop","detail":"{readStateIndex:4571; appliedIndex:4568; }","duration":"245.731318ms","start":"2026-07-25T04:24:48.828198Z","end":"2026-07-25T04:24:49.073929Z","steps":["trace[1461517109] 'read index received'  (duration: 96.072135ms)","trace[1461517109] 'applied index is now lower than readState.Index'  (duration: 149.657633ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:24:49.07422Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.782607ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:24:49.074114Z","caller":"traceutil/trace.go:171","msg":"trace[1563028412] transaction","detail":"{read_only:false; response_revision:4412; number_of_response:1; }","duration":"268.493268ms","start":"2026-07-25T04:24:48.805591Z","end":"2026-07-25T04:24:49.074084Z","steps":["trace[1563028412] 'process raft request'  (duration: 267.629654ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:49.074295Z","caller":"traceutil/trace.go:171","msg":"trace[1855083363] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4412; }","duration":"176.9069ms","start":"2026-07-25T04:24:48.897361Z","end":"2026-07-25T04:24:49.074268Z","steps":["trace[1855083363] 'agreement among raft nodes before linearized reading'  (duration: 176.795007ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:49.07423Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"246.021886ms","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-07-25T04:24:49.07449Z","caller":"traceutil/trace.go:171","msg":"trace[313258060] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4412; }","duration":"246.307684ms","start":"2026-07-25T04:24:48.828167Z","end":"2026-07-25T04:24:49.074475Z","steps":["trace[313258060] 'agreement among raft nodes before linearized reading'  (duration: 245.916763ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:49.617413Z","caller":"traceutil/trace.go:171","msg":"trace[1089305018] linearizableReadLoop","detail":"{readStateIndex:4572; appliedIndex:4571; }","duration":"465.34184ms","start":"2026-07-25T04:24:49.152044Z","end":"2026-07-25T04:24:49.617386Z","steps":["trace[1089305018] 'read index received'  (duration: 465.092093ms)","trace[1089305018] 'applied index is now lower than readState.Index'  (duration: 248.197µs)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:49.617574Z","caller":"traceutil/trace.go:171","msg":"trace[21097930] transaction","detail":"{read_only:false; response_revision:4413; number_of_response:1; }","duration":"538.434158ms","start":"2026-07-25T04:24:49.079124Z","end":"2026-07-25T04:24:49.617558Z","steps":["trace[21097930] 'process raft request'  (duration: 538.083958ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:49.617687Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:24:49.079104Z","time spent":"538.498529ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:4404 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >"}
{"level":"warn","ts":"2026-07-25T04:24:49.618252Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"265.71111ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"warn","ts":"2026-07-25T04:24:49.618266Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"256.971104ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.223\" ","response":"range_response_count:1 size:135"}
{"level":"info","ts":"2026-07-25T04:24:49.618305Z","caller":"traceutil/trace.go:171","msg":"trace[1863387757] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4413; }","duration":"265.800912ms","start":"2026-07-25T04:24:49.352492Z","end":"2026-07-25T04:24:49.618293Z","steps":["trace[1863387757] 'agreement among raft nodes before linearized reading'  (duration: 265.632088ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:49.618247Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"329.905317ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"warn","ts":"2026-07-25T04:24:49.618288Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"317.503479ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"warn","ts":"2026-07-25T04:24:49.618309Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"466.202685ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-07-25T04:24:49.618355Z","caller":"traceutil/trace.go:171","msg":"trace[2125236802] range","detail":"{range_begin:/registry/masterleases/199.204.45.223; range_end:; response_count:1; response_revision:4413; }","duration":"257.095398ms","start":"2026-07-25T04:24:49.361241Z","end":"2026-07-25T04:24:49.618336Z","steps":["trace[2125236802] 'agreement among raft nodes before linearized reading'  (duration: 256.82603ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:49.618388Z","caller":"traceutil/trace.go:171","msg":"trace[600322228] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:4413; }","duration":"330.099182ms","start":"2026-07-25T04:24:49.288261Z","end":"2026-07-25T04:24:49.618361Z","steps":["trace[600322228] 'agreement among raft nodes before linearized reading'  (duration: 329.775563ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:49.618409Z","caller":"traceutil/trace.go:171","msg":"trace[1617273827] range","detail":"{range_begin:/registry/clusterroles/; range_end:/registry/clusterroles0; response_count:0; response_revision:4413; }","duration":"466.38503ms","start":"2026-07-25T04:24:49.152001Z","end":"2026-07-25T04:24:49.618386Z","steps":["trace[1617273827] 'agreement among raft nodes before linearized reading'  (duration: 466.081542ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:49.618447Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:24:49.288239Z","time spent":"330.197085ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"warn","ts":"2026-07-25T04:24:49.618461Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"218.140441ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-g7fmx\" ","response":"range_response_count:1 size:6451"}
{"level":"warn","ts":"2026-07-25T04:24:49.618469Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:24:49.151988Z","time spent":"466.468602ms","remote":"127.0.0.1:42024","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":107,"response size":29,"request content":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true "}
{"level":"info","ts":"2026-07-25T04:24:49.618517Z","caller":"traceutil/trace.go:171","msg":"trace[1934951163] range","detail":"{range_begin:/registry/pods/openstack/keepalived-g7fmx; range_end:; response_count:1; response_revision:4413; }","duration":"218.197742ms","start":"2026-07-25T04:24:49.400305Z","end":"2026-07-25T04:24:49.618502Z","steps":["trace[1934951163] 'agreement among raft nodes before linearized reading'  (duration: 218.054228ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:49.618395Z","caller":"traceutil/trace.go:171","msg":"trace[185063591] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:4413; }","duration":"317.687984ms","start":"2026-07-25T04:24:49.300683Z","end":"2026-07-25T04:24:49.618371Z","steps":["trace[185063591] 'agreement among raft nodes before linearized reading'  (duration: 317.455277ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:49.619202Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:24:49.300619Z","time spent":"318.564439ms","remote":"127.0.0.1:41790","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":4,"response size":29,"request content":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true "}
{"level":"info","ts":"2026-07-25T04:24:49.983267Z","caller":"traceutil/trace.go:171","msg":"trace[1472677301] transaction","detail":"{read_only:false; response_revision:4418; number_of_response:1; }","duration":"100.578721ms","start":"2026-07-25T04:24:49.882629Z","end":"2026-07-25T04:24:49.983207Z","steps":["trace[1472677301] 'process raft request'  (duration: 100.141379ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:50.599932Z","caller":"traceutil/trace.go:171","msg":"trace[1283418116] transaction","detail":"{read_only:false; response_revision:4420; number_of_response:1; }","duration":"106.5743ms","start":"2026-07-25T04:24:50.493322Z","end":"2026-07-25T04:24:50.599896Z","steps":["trace[1283418116] 'process raft request'  (duration: 106.397885ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:50.600789Z","caller":"traceutil/trace.go:171","msg":"trace[93001141] transaction","detail":"{read_only:false; response_revision:4421; number_of_response:1; }","duration":"102.628399ms","start":"2026-07-25T04:24:50.498141Z","end":"2026-07-25T04:24:50.600769Z","steps":["trace[93001141] 'process raft request'  (duration: 102.547256ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:51.818347Z","caller":"traceutil/trace.go:171","msg":"trace[1911350594] transaction","detail":"{read_only:false; response_revision:4428; number_of_response:1; }","duration":"107.99951ms","start":"2026-07-25T04:24:51.710318Z","end":"2026-07-25T04:24:51.818317Z","steps":["trace[1911350594] 'process raft request'  (duration: 95.90992ms)","trace[1911350594] 'compare'  (duration: 11.952627ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:51.821597Z","caller":"traceutil/trace.go:171","msg":"trace[681563287] transaction","detail":"{read_only:false; response_revision:4429; number_of_response:1; }","duration":"110.1106ms","start":"2026-07-25T04:24:51.711454Z","end":"2026-07-25T04:24:51.821564Z","steps":["trace[681563287] 'process raft request'  (duration: 109.856523ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:51.82176Z","caller":"traceutil/trace.go:171","msg":"trace[1500370008] linearizableReadLoop","detail":"{readStateIndex:4590; appliedIndex:4587; }","duration":"108.899805ms","start":"2026-07-25T04:24:51.712788Z","end":"2026-07-25T04:24:51.821687Z","steps":["trace[1500370008] 'read index received'  (duration: 93.494222ms)","trace[1500370008] 'applied index is now lower than readState.Index'  (duration: 15.402883ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:51.821813Z","caller":"traceutil/trace.go:171","msg":"trace[1509390503] transaction","detail":"{read_only:false; response_revision:4430; number_of_response:1; }","duration":"109.124862ms","start":"2026-07-25T04:24:51.712649Z","end":"2026-07-25T04:24:51.821774Z","steps":["trace[1509390503] 'process raft request'  (duration: 108.865234ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:51.822057Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.257066ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:12 size:119967"}
{"level":"info","ts":"2026-07-25T04:24:51.822133Z","caller":"traceutil/trace.go:171","msg":"trace[1703869941] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:12; response_revision:4430; }","duration":"109.359488ms","start":"2026-07-25T04:24:51.712756Z","end":"2026-07-25T04:24:51.822116Z","steps":["trace[1703869941] 'agreement among raft nodes before linearized reading'  (duration: 109.087941ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:53.875962Z","caller":"traceutil/trace.go:171","msg":"trace[1132687636] transaction","detail":"{read_only:false; response_revision:4437; number_of_response:1; }","duration":"159.407067ms","start":"2026-07-25T04:24:53.716517Z","end":"2026-07-25T04:24:53.875924Z","steps":["trace[1132687636] 'process raft request'  (duration: 159.16059ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:56.004416Z","caller":"traceutil/trace.go:171","msg":"trace[1996131117] linearizableReadLoop","detail":"{readStateIndex:4607; appliedIndex:4606; }","duration":"108.669634ms","start":"2026-07-25T04:24:55.895715Z","end":"2026-07-25T04:24:56.004385Z","steps":["trace[1996131117] 'read index received'  (duration: 108.435888ms)","trace[1996131117] 'applied index is now lower than readState.Index'  (duration: 233.076µs)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:56.004505Z","caller":"traceutil/trace.go:171","msg":"trace[324644738] transaction","detail":"{read_only:false; response_revision:4446; number_of_response:1; }","duration":"116.416553ms","start":"2026-07-25T04:24:55.888033Z","end":"2026-07-25T04:24:56.004449Z","steps":["trace[324644738] 'process raft request'  (duration: 116.190087ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:56.004614Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.86522ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:24:56.004645Z","caller":"traceutil/trace.go:171","msg":"trace[1038727527] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4446; }","duration":"108.957332ms","start":"2026-07-25T04:24:55.895679Z","end":"2026-07-25T04:24:56.004636Z","steps":["trace[1038727527] 'agreement among raft nodes before linearized reading'  (duration: 108.86414ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:56.214702Z","caller":"traceutil/trace.go:171","msg":"trace[632977520] transaction","detail":"{read_only:false; response_revision:4447; number_of_response:1; }","duration":"205.135743ms","start":"2026-07-25T04:24:56.009532Z","end":"2026-07-25T04:24:56.214668Z","steps":["trace[632977520] 'process raft request'  (duration: 128.757672ms)","trace[632977520] 'compare'  (duration: 76.154005ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:56.214974Z","caller":"traceutil/trace.go:171","msg":"trace[245989469] transaction","detail":"{read_only:false; response_revision:4448; number_of_response:1; }","duration":"205.353329ms","start":"2026-07-25T04:24:56.009593Z","end":"2026-07-25T04:24:56.214947Z","steps":["trace[245989469] 'process raft request'  (duration: 205.022159ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:24:56.215055Z","caller":"traceutil/trace.go:171","msg":"trace[462761299] linearizableReadLoop","detail":"{readStateIndex:4609; appliedIndex:4607; }","duration":"205.418581ms","start":"2026-07-25T04:24:56.009625Z","end":"2026-07-25T04:24:56.215044Z","steps":["trace[462761299] 'read index received'  (duration: 128.803943ms)","trace[462761299] 'applied index is now lower than readState.Index'  (duration: 76.613447ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:24:56.215122Z","caller":"traceutil/trace.go:171","msg":"trace[587033183] transaction","detail":"{read_only:false; response_revision:4449; number_of_response:1; }","duration":"204.553676ms","start":"2026-07-25T04:24:56.010518Z","end":"2026-07-25T04:24:56.215072Z","steps":["trace[587033183] 'process raft request'  (duration: 204.31607ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:56.215212Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"187.383971ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:24:56.215264Z","caller":"traceutil/trace.go:171","msg":"trace[101330271] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4449; }","duration":"187.502294ms","start":"2026-07-25T04:24:56.027752Z","end":"2026-07-25T04:24:56.215254Z","steps":["trace[101330271] 'agreement among raft nodes before linearized reading'  (duration: 187.385111ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:24:56.215417Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.76763ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:12 size:119967"}
{"level":"info","ts":"2026-07-25T04:24:56.215459Z","caller":"traceutil/trace.go:171","msg":"trace[2037476546] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:12; response_revision:4449; }","duration":"206.044599ms","start":"2026-07-25T04:24:56.009404Z","end":"2026-07-25T04:24:56.215449Z","steps":["trace[2037476546] 'agreement among raft nodes before linearized reading'  (duration: 205.705539ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:02.590552Z","caller":"traceutil/trace.go:171","msg":"trace[1488754480] transaction","detail":"{read_only:false; response_revision:4479; number_of_response:1; }","duration":"343.335611ms","start":"2026-07-25T04:25:02.247165Z","end":"2026-07-25T04:25:02.590501Z","steps":["trace[1488754480] 'process raft request'  (duration: 329.85688ms)","trace[1488754480] 'compare'  (duration: 13.271665ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:02.590698Z","caller":"traceutil/trace.go:171","msg":"trace[2140992788] linearizableReadLoop","detail":"{readStateIndex:4642; appliedIndex:4639; }","duration":"341.615333ms","start":"2026-07-25T04:25:02.249049Z","end":"2026-07-25T04:25:02.590664Z","steps":["trace[2140992788] 'read index received'  (duration: 21.721904ms)","trace[2140992788] 'applied index is now lower than readState.Index'  (duration: 319.892179ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:25:02.59077Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:02.247144Z","time spent":"343.512567ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":489,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:4470 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:429 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-07-25T04:25:02.590788Z","caller":"traceutil/trace.go:171","msg":"trace[1712696496] transaction","detail":"{read_only:false; response_revision:4480; number_of_response:1; }","duration":"342.883179ms","start":"2026-07-25T04:25:02.247856Z","end":"2026-07-25T04:25:02.590739Z","steps":["trace[1712696496] 'process raft request'  (duration: 342.591971ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:02.591088Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"342.011154ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:12 size:119967"}
{"level":"warn","ts":"2026-07-25T04:25:02.591106Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:02.247827Z","time spent":"343.088135ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:4469 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:410 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-07-25T04:25:02.591128Z","caller":"traceutil/trace.go:171","msg":"trace[447910183] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:12; response_revision:4480; }","duration":"342.089117ms","start":"2026-07-25T04:25:02.249028Z","end":"2026-07-25T04:25:02.591117Z","steps":["trace[447910183] 'agreement among raft nodes before linearized reading'  (duration: 341.737587ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:02.591197Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:02.249018Z","time spent":"342.169299ms","remote":"127.0.0.1:41848","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":12,"response size":119989,"request content":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" "}
{"level":"warn","ts":"2026-07-25T04:25:02.975456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.3128ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749333883 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:4471 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:465 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:25:02.975562Z","caller":"traceutil/trace.go:171","msg":"trace[1340080186] linearizableReadLoop","detail":"{readStateIndex:4643; appliedIndex:4642; }","duration":"275.39136ms","start":"2026-07-25T04:25:02.700152Z","end":"2026-07-25T04:25:02.975544Z","steps":["trace[1340080186] 'read index received'  (duration: 111.865455ms)","trace[1340080186] 'applied index is now lower than readState.Index'  (duration: 163.524485ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:25:02.97567Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"275.530815ms","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-07-25T04:25:02.975689Z","caller":"traceutil/trace.go:171","msg":"trace[983371611] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4481; }","duration":"275.607126ms","start":"2026-07-25T04:25:02.700075Z","end":"2026-07-25T04:25:02.975682Z","steps":["trace[983371611] 'agreement among raft nodes before linearized reading'  (duration: 275.508313ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:02.975645Z","caller":"traceutil/trace.go:171","msg":"trace[2146776438] transaction","detail":"{read_only:false; response_revision:4481; number_of_response:1; }","duration":"285.167787ms","start":"2026-07-25T04:25:02.690437Z","end":"2026-07-25T04:25:02.975605Z","steps":["trace[2146776438] 'process raft request'  (duration: 121.616061ms)","trace[2146776438] 'compare'  (duration: 163.178565ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:25:03.274851Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.148705ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749333886 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:4473 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:25:03.27499Z","caller":"traceutil/trace.go:171","msg":"trace[429940414] transaction","detail":"{read_only:false; response_revision:4483; number_of_response:1; }","duration":"290.413186ms","start":"2026-07-25T04:25:02.984553Z","end":"2026-07-25T04:25:03.274966Z","steps":["trace[429940414] 'process raft request'  (duration: 150.037855ms)","trace[429940414] 'compare'  (duration: 139.759513ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:03.286277Z","caller":"traceutil/trace.go:171","msg":"trace[464380937] transaction","detail":"{read_only:false; response_revision:4484; number_of_response:1; }","duration":"163.534686ms","start":"2026-07-25T04:25:03.122712Z","end":"2026-07-25T04:25:03.286247Z","steps":["trace[464380937] 'process raft request'  (duration: 163.298649ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:03.286504Z","caller":"traceutil/trace.go:171","msg":"trace[2097300700] transaction","detail":"{read_only:false; response_revision:4485; number_of_response:1; }","duration":"162.686432ms","start":"2026-07-25T04:25:03.123781Z","end":"2026-07-25T04:25:03.286468Z","steps":["trace[2097300700] 'process raft request'  (duration: 162.395264ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:09.541653Z","caller":"traceutil/trace.go:171","msg":"trace[1637073261] linearizableReadLoop","detail":"{readStateIndex:4675; appliedIndex:4674; }","duration":"480.577194ms","start":"2026-07-25T04:25:09.061046Z","end":"2026-07-25T04:25:09.541623Z","steps":["trace[1637073261] 'read index received'  (duration: 480.44059ms)","trace[1637073261] 'applied index is now lower than readState.Index'  (duration: 135.184µs)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:09.541801Z","caller":"traceutil/trace.go:171","msg":"trace[270087599] transaction","detail":"{read_only:false; response_revision:4512; number_of_response:1; }","duration":"488.622082ms","start":"2026-07-25T04:25:09.053134Z","end":"2026-07-25T04:25:09.541756Z","steps":["trace[270087599] 'process raft request'  (duration: 488.304133ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:09.541922Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"480.858762ms","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-07-25T04:25:09.541968Z","caller":"traceutil/trace.go:171","msg":"trace[271160403] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4512; }","duration":"480.968355ms","start":"2026-07-25T04:25:09.060989Z","end":"2026-07-25T04:25:09.541957Z","steps":["trace[271160403] 'agreement among raft nodes before linearized reading'  (duration: 480.7707ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:09.542011Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:09.060977Z","time spent":"481.024787ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-07-25T04:25:09.542066Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:09.053111Z","time spent":"488.811957ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:4502 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:464 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >"}
{"level":"info","ts":"2026-07-25T04:25:09.671405Z","caller":"traceutil/trace.go:171","msg":"trace[1632058155] transaction","detail":"{read_only:false; response_revision:4514; number_of_response:1; }","duration":"370.448278ms","start":"2026-07-25T04:25:09.300923Z","end":"2026-07-25T04:25:09.671371Z","steps":["trace[1632058155] 'process raft request'  (duration: 370.311264ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:09.671455Z","caller":"traceutil/trace.go:171","msg":"trace[548326198] transaction","detail":"{read_only:false; response_revision:4513; number_of_response:1; }","duration":"375.509601ms","start":"2026-07-25T04:25:09.295899Z","end":"2026-07-25T04:25:09.671409Z","steps":["trace[548326198] 'process raft request'  (duration: 297.717041ms)","trace[548326198] 'compare'  (duration: 77.454661ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:25:09.671615Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:09.300893Z","time spent":"370.605363ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:4506 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"warn","ts":"2026-07-25T04:25:09.671656Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:09.295862Z","time spent":"375.680706ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:4505 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"info","ts":"2026-07-25T04:25:09.671848Z","caller":"traceutil/trace.go:171","msg":"trace[5045807] transaction","detail":"{read_only:false; response_revision:4515; number_of_response:1; }","duration":"365.273052ms","start":"2026-07-25T04:25:09.306464Z","end":"2026-07-25T04:25:09.671737Z","steps":["trace[5045807] 'process raft request'  (duration: 364.811759ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:09.671899Z","caller":"traceutil/trace.go:171","msg":"trace[17752717] transaction","detail":"{read_only:false; response_revision:4516; number_of_response:1; }","duration":"124.329407ms","start":"2026-07-25T04:25:09.547532Z","end":"2026-07-25T04:25:09.671862Z","steps":["trace[17752717] 'process raft request'  (duration: 124.109261ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:09.67214Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:09.306452Z","time spent":"365.54174ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:4507 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:459 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >"}
{"level":"warn","ts":"2026-07-25T04:25:09.672173Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"309.410812ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.223\" ","response":"range_response_count:1 size:135"}
{"level":"info","ts":"2026-07-25T04:25:09.67222Z","caller":"traceutil/trace.go:171","msg":"trace[1144066574] range","detail":"{range_begin:/registry/masterleases/199.204.45.223; range_end:; response_count:1; response_revision:4516; }","duration":"309.525645ms","start":"2026-07-25T04:25:09.362686Z","end":"2026-07-25T04:25:09.672212Z","steps":["trace[1144066574] 'agreement among raft nodes before linearized reading'  (duration: 309.35132ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:09.672248Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:09.36266Z","time spent":"309.582657ms","remote":"127.0.0.1:41672","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/199.204.45.223\" "}
{"level":"info","ts":"2026-07-25T04:25:09.671869Z","caller":"traceutil/trace.go:171","msg":"trace[632194083] linearizableReadLoop","detail":"{readStateIndex:4678; appliedIndex:4675; }","duration":"130.11485ms","start":"2026-07-25T04:25:09.541725Z","end":"2026-07-25T04:25:09.67184Z","steps":["trace[632194083] 'read index received'  (duration: 51.930189ms)","trace[632194083] 'applied index is now lower than readState.Index'  (duration: 78.182251ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:14.925278Z","caller":"traceutil/trace.go:171","msg":"trace[193367464] transaction","detail":"{read_only:false; response_revision:4541; number_of_response:1; }","duration":"181.71096ms","start":"2026-07-25T04:25:14.743527Z","end":"2026-07-25T04:25:14.925238Z","steps":["trace[193367464] 'process raft request'  (duration: 181.466133ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:17.868035Z","caller":"traceutil/trace.go:171","msg":"trace[834658640] transaction","detail":"{read_only:false; response_revision:4556; number_of_response:1; }","duration":"171.981585ms","start":"2026-07-25T04:25:17.696024Z","end":"2026-07-25T04:25:17.868006Z","steps":["trace[834658640] 'process raft request'  (duration: 171.822761ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:18.133619Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.251484ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749334093 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:4544 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:25:18.133936Z","caller":"traceutil/trace.go:171","msg":"trace[707455638] transaction","detail":"{read_only:false; response_revision:4557; number_of_response:1; }","duration":"437.210448ms","start":"2026-07-25T04:25:17.696657Z","end":"2026-07-25T04:25:18.133867Z","steps":["trace[707455638] 'process raft request'  (duration: 288.608464ms)","trace[707455638] 'compare'  (duration: 147.997227ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:18.133997Z","caller":"traceutil/trace.go:171","msg":"trace[5651667] linearizableReadLoop","detail":"{readStateIndex:4723; appliedIndex:4720; }","duration":"427.007429ms","start":"2026-07-25T04:25:17.706961Z","end":"2026-07-25T04:25:18.133969Z","steps":["trace[5651667] 'read index received'  (duration: 160.884001ms)","trace[5651667] 'applied index is now lower than readState.Index'  (duration: 266.122078ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:18.134085Z","caller":"traceutil/trace.go:171","msg":"trace[1611850222] transaction","detail":"{read_only:false; response_revision:4558; number_of_response:1; }","duration":"435.069848ms","start":"2026-07-25T04:25:17.698961Z","end":"2026-07-25T04:25:18.134031Z","steps":["trace[1611850222] 'process raft request'  (duration: 434.779649ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:18.134229Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:17.696603Z","time spent":"437.458055ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:4544 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-07-25T04:25:18.134331Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"427.334449ms","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-07-25T04:25:18.134383Z","caller":"traceutil/trace.go:171","msg":"trace[711609331] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4558; }","duration":"427.452132ms","start":"2026-07-25T04:25:17.706918Z","end":"2026-07-25T04:25:18.13437Z","steps":["trace[711609331] 'agreement among raft nodes before linearized reading'  (duration: 427.114233ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:18.134395Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"236.371516ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-07-25T04:25:18.134431Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"281.235956ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/valkey-node-0\" ","response":"range_response_count:1 size:17051"}
{"level":"info","ts":"2026-07-25T04:25:18.134466Z","caller":"traceutil/trace.go:171","msg":"trace[777939301] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4558; }","duration":"236.495781ms","start":"2026-07-25T04:25:17.897952Z","end":"2026-07-25T04:25:18.134447Z","steps":["trace[777939301] 'agreement among raft nodes before linearized reading'  (duration: 236.356747ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:18.134478Z","caller":"traceutil/trace.go:171","msg":"trace[115251605] range","detail":"{range_begin:/registry/pods/openstack/valkey-node-0; range_end:; response_count:1; response_revision:4558; }","duration":"281.339679ms","start":"2026-07-25T04:25:17.853126Z","end":"2026-07-25T04:25:18.134466Z","steps":["trace[115251605] 'agreement among raft nodes before linearized reading'  (duration: 281.153954ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:18.134456Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:17.7069Z","time spent":"427.543494ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-07-25T04:25:18.134436Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:17.698942Z","time spent":"435.290603ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:4545 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:459 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >"}
{"level":"warn","ts":"2026-07-25T04:25:25.008426Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"257.496344ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749334206 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:4595 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:25:25.008585Z","caller":"traceutil/trace.go:171","msg":"trace[2013487383] linearizableReadLoop","detail":"{readStateIndex:4770; appliedIndex:4769; }","duration":"189.507081ms","start":"2026-07-25T04:25:24.819053Z","end":"2026-07-25T04:25:25.00856Z","steps":["trace[2013487383] 'read index received'  (duration: 58.402µs)","trace[2013487383] 'applied index is now lower than readState.Index'  (duration: 189.446809ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:25:25.008676Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.627784ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas/\" range_end:\"/registry/flowschemas0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-07-25T04:25:25.008715Z","caller":"traceutil/trace.go:171","msg":"trace[210371371] range","detail":"{range_begin:/registry/flowschemas/; range_end:/registry/flowschemas0; response_count:0; response_revision:4604; }","duration":"189.701536ms","start":"2026-07-25T04:25:24.819003Z","end":"2026-07-25T04:25:25.008705Z","steps":["trace[210371371] 'agreement among raft nodes before linearized reading'  (duration: 189.618494ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:25.008934Z","caller":"traceutil/trace.go:171","msg":"trace[1808024356] transaction","detail":"{read_only:false; response_revision:4604; number_of_response:1; }","duration":"283.032787ms","start":"2026-07-25T04:25:24.725838Z","end":"2026-07-25T04:25:25.008871Z","steps":["trace[1808024356] 'process raft request'  (duration: 24.961697ms)","trace[1808024356] 'compare'  (duration: 257.334169ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:25:25.191441Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.285239ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749334207 > lease_revoke:<id:1fe39f977e28add2>","response":"size:27"}
{"level":"info","ts":"2026-07-25T04:25:25.191549Z","caller":"traceutil/trace.go:171","msg":"trace[740352624] linearizableReadLoop","detail":"{readStateIndex:4771; appliedIndex:4770; }","duration":"177.619584ms","start":"2026-07-25T04:25:25.013913Z","end":"2026-07-25T04:25:25.191533Z","steps":["trace[740352624] 'read index received'  (duration: 20.140219ms)","trace[740352624] 'applied index is now lower than readState.Index'  (duration: 157.478205ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:25:25.191624Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.706247ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:25:25.191654Z","caller":"traceutil/trace.go:171","msg":"trace[1775740307] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:4604; }","duration":"177.783819ms","start":"2026-07-25T04:25:25.013859Z","end":"2026-07-25T04:25:25.191643Z","steps":["trace[1775740307] 'agreement among raft nodes before linearized reading'  (duration: 177.716458ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:25.747688Z","caller":"traceutil/trace.go:171","msg":"trace[2062839757] transaction","detail":"{read_only:false; response_revision:4605; number_of_response:1; }","duration":"148.566743ms","start":"2026-07-25T04:25:25.59908Z","end":"2026-07-25T04:25:25.747647Z","steps":["trace[2062839757] 'process raft request'  (duration: 148.198733ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:25.987202Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.492132ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/federations/\" range_end:\"/registry/rabbitmq.com/federations0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:25:25.987278Z","caller":"traceutil/trace.go:171","msg":"trace[284969626] range","detail":"{range_begin:/registry/rabbitmq.com/federations/; range_end:/registry/rabbitmq.com/federations0; response_count:0; response_revision:4605; }","duration":"124.636455ms","start":"2026-07-25T04:25:25.862623Z","end":"2026-07-25T04:25:25.98726Z","steps":["trace[284969626] 'count revisions from in-memory index tree'  (duration: 124.373958ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:25.987246Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.853722ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:25:25.987391Z","caller":"traceutil/trace.go:171","msg":"trace[1427834037] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:4605; }","duration":"119.090799ms","start":"2026-07-25T04:25:25.868272Z","end":"2026-07-25T04:25:25.987363Z","steps":["trace[1427834037] 'range keys from in-memory index tree'  (duration: 118.704128ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:32.294711Z","caller":"traceutil/trace.go:171","msg":"trace[1269719423] transaction","detail":"{read_only:false; response_revision:4638; number_of_response:1; }","duration":"107.311025ms","start":"2026-07-25T04:25:32.187358Z","end":"2026-07-25T04:25:32.294669Z","steps":["trace[1269719423] 'process raft request'  (duration: 107.072289ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:42.97996Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.340202ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-g7fmx\" ","response":"range_response_count:1 size:6451"}
{"level":"info","ts":"2026-07-25T04:25:42.98006Z","caller":"traceutil/trace.go:171","msg":"trace[724197624] range","detail":"{range_begin:/registry/pods/openstack/keepalived-g7fmx; range_end:; response_count:1; response_revision:4693; }","duration":"121.508568ms","start":"2026-07-25T04:25:42.858529Z","end":"2026-07-25T04:25:42.980037Z","steps":["trace[724197624] 'range keys from in-memory index tree'  (duration: 121.104036ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:42.980411Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.0274ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"info","ts":"2026-07-25T04:25:42.980492Z","caller":"traceutil/trace.go:171","msg":"trace[1880971501] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4693; }","duration":"129.170484ms","start":"2026-07-25T04:25:42.851302Z","end":"2026-07-25T04:25:42.980473Z","steps":["trace[1880971501] 'range keys from in-memory index tree'  (duration: 128.737432ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:43.229202Z","caller":"traceutil/trace.go:171","msg":"trace[420527719] linearizableReadLoop","detail":"{readStateIndex:4864; appliedIndex:4863; }","duration":"243.841628ms","start":"2026-07-25T04:25:42.985338Z","end":"2026-07-25T04:25:43.229179Z","steps":["trace[420527719] 'read index received'  (duration: 243.691634ms)","trace[420527719] 'applied index is now lower than readState.Index'  (duration: 148.704µs)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:43.229336Z","caller":"traceutil/trace.go:171","msg":"trace[2058693651] transaction","detail":"{read_only:false; response_revision:4694; number_of_response:1; }","duration":"244.679341ms","start":"2026-07-25T04:25:42.984606Z","end":"2026-07-25T04:25:43.229285Z","steps":["trace[2058693651] 'process raft request'  (duration: 244.432284ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:43.229472Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.575168ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/\" range_end:\"/registry/apiextensions.k8s.io/customresourcedefinitions0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-07-25T04:25:43.229519Z","caller":"traceutil/trace.go:171","msg":"trace[1753753961] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:4694; }","duration":"227.68447ms","start":"2026-07-25T04:25:43.001812Z","end":"2026-07-25T04:25:43.229496Z","steps":["trace[1753753961] 'agreement among raft nodes before linearized reading'  (duration: 227.504805ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:43.229853Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.466446ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:12 size:119773"}
{"level":"info","ts":"2026-07-25T04:25:43.229967Z","caller":"traceutil/trace.go:171","msg":"trace[1675769899] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:12; response_revision:4694; }","duration":"244.673852ms","start":"2026-07-25T04:25:42.985269Z","end":"2026-07-25T04:25:43.229942Z","steps":["trace[1675769899] 'agreement among raft nodes before linearized reading'  (duration: 244.035044ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:43.229981Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.559699ms","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-07-25T04:25:43.230095Z","caller":"traceutil/trace.go:171","msg":"trace[2030427202] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:4694; }","duration":"132.713255ms","start":"2026-07-25T04:25:43.097359Z","end":"2026-07-25T04:25:43.230072Z","steps":["trace[2030427202] 'agreement among raft nodes before linearized reading'  (duration: 132.353834ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:50.324151Z","caller":"traceutil/trace.go:171","msg":"trace[1485085616] transaction","detail":"{read_only:false; response_revision:4727; number_of_response:1; }","duration":"174.771754ms","start":"2026-07-25T04:25:50.149356Z","end":"2026-07-25T04:25:50.324127Z","steps":["trace[1485085616] 'process raft request'  (duration: 174.582289ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:50.727076Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"280.295999ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749334556 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:4717 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:454 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:25:50.727375Z","caller":"traceutil/trace.go:171","msg":"trace[149258911] linearizableReadLoop","detail":"{readStateIndex:4902; appliedIndex:4899; }","duration":"344.074444ms","start":"2026-07-25T04:25:50.383277Z","end":"2026-07-25T04:25:50.727352Z","steps":["trace[149258911] 'read index received'  (duration: 63.409514ms)","trace[149258911] 'applied index is now lower than readState.Index'  (duration: 280.6637ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:50.72742Z","caller":"traceutil/trace.go:171","msg":"trace[481421438] transaction","detail":"{read_only:false; response_revision:4730; number_of_response:1; }","duration":"376.313305ms","start":"2026-07-25T04:25:50.35108Z","end":"2026-07-25T04:25:50.727394Z","steps":["trace[481421438] 'process raft request'  (duration: 376.199592ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:50.72747Z","caller":"traceutil/trace.go:171","msg":"trace[1555292654] transaction","detail":"{read_only:false; response_revision:4729; number_of_response:1; }","duration":"382.307085ms","start":"2026-07-25T04:25:50.34509Z","end":"2026-07-25T04:25:50.727397Z","steps":["trace[1555292654] 'process raft request'  (duration: 382.094569ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:50.72742Z","caller":"traceutil/trace.go:171","msg":"trace[1656772298] transaction","detail":"{read_only:false; response_revision:4728; number_of_response:1; }","duration":"542.433865ms","start":"2026-07-25T04:25:50.184944Z","end":"2026-07-25T04:25:50.727378Z","steps":["trace[1656772298] 'process raft request'  (duration: 261.711983ms)","trace[1656772298] 'compare'  (duration: 280.170756ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:25:50.727628Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:50.351067Z","time spent":"376.441589ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:4719 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:459 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >"}
{"level":"warn","ts":"2026-07-25T04:25:50.727645Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"316.707589ms","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-07-25T04:25:50.727685Z","caller":"traceutil/trace.go:171","msg":"trace[901869544] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4730; }","duration":"316.795732ms","start":"2026-07-25T04:25:50.410877Z","end":"2026-07-25T04:25:50.727673Z","steps":["trace[901869544] 'agreement among raft nodes before linearized reading'  (duration: 316.625267ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:50.727663Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.894993ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"warn","ts":"2026-07-25T04:25:50.72772Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:50.410857Z","time spent":"316.855013ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-07-25T04:25:50.727728Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:50.184909Z","time spent":"542.744813ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:4717 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:454 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"warn","ts":"2026-07-25T04:25:50.727729Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:50.345068Z","time spent":"382.51099ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:4718 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"info","ts":"2026-07-25T04:25:50.727747Z","caller":"traceutil/trace.go:171","msg":"trace[1217257063] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:4730; }","duration":"207.042917ms","start":"2026-07-25T04:25:50.520685Z","end":"2026-07-25T04:25:50.727728Z","steps":["trace[1217257063] 'agreement among raft nodes before linearized reading'  (duration: 206.790359ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:50.727769Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"344.470155ms","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-07-25T04:25:50.727895Z","caller":"traceutil/trace.go:171","msg":"trace[1698683793] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4730; }","duration":"344.66425ms","start":"2026-07-25T04:25:50.383196Z","end":"2026-07-25T04:25:50.72786Z","steps":["trace[1698683793] 'agreement among raft nodes before linearized reading'  (duration: 344.250429ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:50.727961Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T04:25:50.383168Z","time spent":"344.780114ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"info","ts":"2026-07-25T04:25:50.964238Z","caller":"traceutil/trace.go:171","msg":"trace[2116171856] transaction","detail":"{read_only:false; response_revision:4732; number_of_response:1; }","duration":"231.998043ms","start":"2026-07-25T04:25:50.732197Z","end":"2026-07-25T04:25:50.964195Z","steps":["trace[2116171856] 'process raft request'  (duration: 231.691474ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:50.964246Z","caller":"traceutil/trace.go:171","msg":"trace[1984068683] transaction","detail":"{read_only:false; response_revision:4733; number_of_response:1; }","duration":"231.390305ms","start":"2026-07-25T04:25:50.732825Z","end":"2026-07-25T04:25:50.964216Z","steps":["trace[1984068683] 'process raft request'  (duration: 231.292713ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:51.179637Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.938033ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumendpoints/\" range_end:\"/registry/cilium.io/ciliumendpoints0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-07-25T04:25:51.179799Z","caller":"traceutil/trace.go:171","msg":"trace[1240020559] range","detail":"{range_begin:/registry/cilium.io/ciliumendpoints/; range_end:/registry/cilium.io/ciliumendpoints0; response_count:0; response_revision:4733; }","duration":"167.142228ms","start":"2026-07-25T04:25:51.012591Z","end":"2026-07-25T04:25:51.179733Z","steps":["trace[1240020559] 'count revisions from in-memory index tree'  (duration: 166.782318ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:54.949775Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"301.937382ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749334611 > lease_revoke:<id:1fe39f977e28af89>","response":"size:27"}
{"level":"info","ts":"2026-07-25T04:25:54.950052Z","caller":"traceutil/trace.go:171","msg":"trace[1844262125] transaction","detail":"{read_only:false; response_revision:4749; number_of_response:1; }","duration":"211.096222ms","start":"2026-07-25T04:25:54.738934Z","end":"2026-07-25T04:25:54.95003Z","steps":["trace[1844262125] 'process raft request'  (duration: 210.955218ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:54.952789Z","caller":"traceutil/trace.go:171","msg":"trace[1722135770] transaction","detail":"{read_only:false; response_revision:4750; number_of_response:1; }","duration":"211.592025ms","start":"2026-07-25T04:25:54.741171Z","end":"2026-07-25T04:25:54.952763Z","steps":["trace[1722135770] 'process raft request'  (duration: 211.454711ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:25:54.95307Z","caller":"traceutil/trace.go:171","msg":"trace[1548910640] linearizableReadLoop","detail":"{readStateIndex:4924; appliedIndex:4920; }","duration":"113.062008ms","start":"2026-07-25T04:25:54.839974Z","end":"2026-07-25T04:25:54.953036Z","steps":["trace[1548910640] 'read index received'  (duration: 63.341591ms)","trace[1548910640] 'applied index is now lower than readState.Index'  (duration: 49.718537ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:54.953249Z","caller":"traceutil/trace.go:171","msg":"trace[1205805652] transaction","detail":"{read_only:false; response_revision:4751; number_of_response:1; }","duration":"211.73146ms","start":"2026-07-25T04:25:54.741504Z","end":"2026-07-25T04:25:54.953235Z","steps":["trace[1205805652] 'process raft request'  (duration: 211.222815ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:54.953525Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.531102ms","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-07-25T04:25:54.953639Z","caller":"traceutil/trace.go:171","msg":"trace[1777995066] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4751; }","duration":"113.730597ms","start":"2026-07-25T04:25:54.839883Z","end":"2026-07-25T04:25:54.953613Z","steps":["trace[1777995066] 'agreement among raft nodes before linearized reading'  (duration: 113.407478ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:25:57.584943Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.288987ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749334661 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:4756 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-25T04:25:57.585084Z","caller":"traceutil/trace.go:171","msg":"trace[912881620] transaction","detail":"{read_only:false; response_revision:4765; number_of_response:1; }","duration":"241.718948ms","start":"2026-07-25T04:25:57.343344Z","end":"2026-07-25T04:25:57.585063Z","steps":["trace[912881620] 'process raft request'  (duration: 112.200944ms)","trace[912881620] 'compare'  (duration: 129.141423ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:25:57.832681Z","caller":"traceutil/trace.go:171","msg":"trace[40511086] transaction","detail":"{read_only:false; response_revision:4766; number_of_response:1; }","duration":"167.090487ms","start":"2026-07-25T04:25:57.665562Z","end":"2026-07-25T04:25:57.832653Z","steps":["trace[40511086] 'process raft request'  (duration: 166.86684ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:26:04.822997Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.04161ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749334758 > lease_revoke:<id:1fe39f977e28b012>","response":"size:27"}
{"level":"info","ts":"2026-07-25T04:26:11.28643Z","caller":"traceutil/trace.go:171","msg":"trace[293084718] transaction","detail":"{read_only:false; response_revision:4833; number_of_response:1; }","duration":"156.909607ms","start":"2026-07-25T04:26:11.129473Z","end":"2026-07-25T04:26:11.286383Z","steps":["trace[293084718] 'process raft request'  (duration: 156.602849ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:26:23.678529Z","caller":"traceutil/trace.go:171","msg":"trace[33062751] linearizableReadLoop","detail":"{readStateIndex:5077; appliedIndex:5076; }","duration":"191.631103ms","start":"2026-07-25T04:26:23.486865Z","end":"2026-07-25T04:26:23.678496Z","steps":["trace[33062751] 'read index received'  (duration: 116.219364ms)","trace[33062751] 'applied index is now lower than readState.Index'  (duration: 75.409959ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:26:23.678543Z","caller":"traceutil/trace.go:171","msg":"trace[108979788] transaction","detail":"{read_only:false; response_revision:4898; number_of_response:1; }","duration":"272.33148ms","start":"2026-07-25T04:26:23.406165Z","end":"2026-07-25T04:26:23.678496Z","steps":["trace[108979788] 'process raft request'  (duration: 196.900671ms)","trace[108979788] 'compare'  (duration: 75.287075ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:26:23.678877Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.676193ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-g7fmx\" ","response":"range_response_count:1 size:6451"}
{"level":"warn","ts":"2026-07-25T04:26:23.678877Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"188.756533ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"info","ts":"2026-07-25T04:26:23.678933Z","caller":"traceutil/trace.go:171","msg":"trace[569453796] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4898; }","duration":"188.887386ms","start":"2026-07-25T04:26:23.490031Z","end":"2026-07-25T04:26:23.678918Z","steps":["trace[569453796] 'agreement among raft nodes before linearized reading'  (duration: 188.66399ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:26:23.678926Z","caller":"traceutil/trace.go:171","msg":"trace[1803857887] range","detail":"{range_begin:/registry/pods/openstack/keepalived-g7fmx; range_end:; response_count:1; response_revision:4898; }","duration":"176.794957ms","start":"2026-07-25T04:26:23.502115Z","end":"2026-07-25T04:26:23.67891Z","steps":["trace[1803857887] 'agreement among raft nodes before linearized reading'  (duration: 176.586461ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:26:23.678899Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.010104ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"info","ts":"2026-07-25T04:26:23.679016Z","caller":"traceutil/trace.go:171","msg":"trace[594319621] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:4898; }","duration":"192.19868ms","start":"2026-07-25T04:26:23.48679Z","end":"2026-07-25T04:26:23.678988Z","steps":["trace[594319621] 'agreement among raft nodes before linearized reading'  (duration: 191.868851ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:26:23.852725Z","caller":"traceutil/trace.go:171","msg":"trace[832827192] transaction","detail":"{read_only:false; response_revision:4899; number_of_response:1; }","duration":"168.263037ms","start":"2026-07-25T04:26:23.68443Z","end":"2026-07-25T04:26:23.852693Z","steps":["trace[832827192] 'process raft request'  (duration: 166.077226ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:26:23.853017Z","caller":"traceutil/trace.go:171","msg":"trace[986396848] transaction","detail":"{read_only:false; response_revision:4900; number_of_response:1; }","duration":"168.449642ms","start":"2026-07-25T04:26:23.68453Z","end":"2026-07-25T04:26:23.852979Z","steps":["trace[986396848] 'process raft request'  (duration: 168.108593ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:26:23.853585Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.878876ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:12 size:119773"}
{"level":"info","ts":"2026-07-25T04:26:23.853668Z","caller":"traceutil/trace.go:171","msg":"trace[765644060] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:12; response_revision:4900; }","duration":"168.0263ms","start":"2026-07-25T04:26:23.685623Z","end":"2026-07-25T04:26:23.853649Z","steps":["trace[765644060] 'agreement among raft nodes before linearized reading'  (duration: 167.622979ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:26:23.853011Z","caller":"traceutil/trace.go:171","msg":"trace[597876062] linearizableReadLoop","detail":"{readStateIndex:5079; appliedIndex:5077; }","duration":"167.253728ms","start":"2026-07-25T04:26:23.685684Z","end":"2026-07-25T04:26:23.852937Z","steps":["trace[597876062] 'read index received'  (duration: 164.83884ms)","trace[597876062] 'applied index is now lower than readState.Index'  (duration: 2.413398ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:26:23.85398Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.558494ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/keystone-openid-metadata\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-25T04:26:23.854063Z","caller":"traceutil/trace.go:171","msg":"trace[130965919] range","detail":"{range_begin:/registry/configmaps/openstack/keystone-openid-metadata; range_end:; response_count:0; response_revision:4900; }","duration":"163.666928ms","start":"2026-07-25T04:26:23.690372Z","end":"2026-07-25T04:26:23.854039Z","steps":["trace[130965919] 'agreement among raft nodes before linearized reading'  (duration: 163.511734ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:27:16.416108Z","caller":"traceutil/trace.go:171","msg":"trace[1997041795] transaction","detail":"{read_only:false; response_revision:5167; number_of_response:1; }","duration":"123.858051ms","start":"2026-07-25T04:27:16.292219Z","end":"2026-07-25T04:27:16.416077Z","steps":["trace[1997041795] 'process raft request'  (duration: 117.257967ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:27:19.527549Z","caller":"traceutil/trace.go:171","msg":"trace[1722134754] transaction","detail":"{read_only:false; response_revision:5178; number_of_response:1; }","duration":"126.906367ms","start":"2026-07-25T04:27:19.400607Z","end":"2026-07-25T04:27:19.527513Z","steps":["trace[1722134754] 'process raft request'  (duration: 126.63795ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:27:19.535634Z","caller":"traceutil/trace.go:171","msg":"trace[701865278] transaction","detail":"{read_only:false; response_revision:5179; number_of_response:1; }","duration":"106.815376ms","start":"2026-07-25T04:27:19.42877Z","end":"2026-07-25T04:27:19.535585Z","steps":["trace[701865278] 'process raft request'  (duration: 106.639911ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:27:36.218808Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":3731}
{"level":"info","ts":"2026-07-25T04:27:36.321539Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":3731,"took":"100.995442ms","hash":2958239203,"current-db-size-bytes":43515904,"current-db-size":"44 MB","current-db-size-in-use-bytes":13897728,"current-db-size-in-use":"14 MB"}
{"level":"info","ts":"2026-07-25T04:27:36.321648Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2958239203,"revision":3731,"compact-revision":-1}
{"level":"info","ts":"2026-07-25T04:27:47.816712Z","caller":"traceutil/trace.go:171","msg":"trace[1123532085] transaction","detail":"{read_only:false; response_revision:5368; number_of_response:1; }","duration":"130.974821ms","start":"2026-07-25T04:27:47.685707Z","end":"2026-07-25T04:27:47.816682Z","steps":["trace[1123532085] 'process raft request'  (duration: 130.745234ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:27:47.820578Z","caller":"traceutil/trace.go:171","msg":"trace[1186349826] transaction","detail":"{read_only:false; response_revision:5370; number_of_response:1; }","duration":"133.018618ms","start":"2026-07-25T04:27:47.687524Z","end":"2026-07-25T04:27:47.820542Z","steps":["trace[1186349826] 'process raft request'  (duration: 132.963376ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:27:47.820648Z","caller":"traceutil/trace.go:171","msg":"trace[265881093] transaction","detail":"{read_only:false; response_revision:5369; number_of_response:1; }","duration":"134.15521ms","start":"2026-07-25T04:27:47.686451Z","end":"2026-07-25T04:27:47.820607Z","steps":["trace[265881093] 'process raft request'  (duration: 133.82116ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:32:36.225517Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5265}
{"level":"info","ts":"2026-07-25T04:32:36.276267Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5265,"took":"49.083915ms","hash":3068896193,"current-db-size-bytes":43515904,"current-db-size":"44 MB","current-db-size-in-use-bytes":16166912,"current-db-size-in-use":"16 MB"}
{"level":"info","ts":"2026-07-25T04:32:36.27632Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3068896193,"revision":5265,"compact-revision":3731}
{"level":"info","ts":"2026-07-25T04:35:12.661042Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-00000000000024e4.wal"}
{"level":"info","ts":"2026-07-25T04:35:39.804955Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"11f26225a5bb9fe3","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-07-25T04:35:39.809898Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001}
{"level":"info","ts":"2026-07-25T04:35:39.810741Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001}
{"level":"info","ts":"2026-07-25T04:37:36.233199Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":7170}
{"level":"info","ts":"2026-07-25T04:37:36.315348Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":7170,"took":"78.967279ms","hash":1010333645,"current-db-size-bytes":50262016,"current-db-size":"50 MB","current-db-size-in-use-bytes":45756416,"current-db-size-in-use":"46 MB"}
{"level":"info","ts":"2026-07-25T04:37:36.315417Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1010333645,"revision":7170,"compact-revision":5265}
{"level":"info","ts":"2026-07-25T04:42:36.248196Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":11681}
{"level":"info","ts":"2026-07-25T04:42:36.459428Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":11681,"took":"206.032747ms","hash":313747859,"current-db-size-bytes":76042240,"current-db-size":"76 MB","current-db-size-in-use-bytes":48480256,"current-db-size-in-use":"48 MB"}
{"level":"info","ts":"2026-07-25T04:42:36.459489Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":313747859,"revision":11681,"compact-revision":7170}
{"level":"info","ts":"2026-07-25T04:43:23.284985Z","caller":"traceutil/trace.go:171","msg":"trace[1114997761] linearizableReadLoop","detail":"{readStateIndex:16697; appliedIndex:16696; }","duration":"115.968548ms","start":"2026-07-25T04:43:23.168991Z","end":"2026-07-25T04:43:23.28496Z","steps":["trace[1114997761] 'read index received'  (duration: 109.833957ms)","trace[1114997761] 'applied index is now lower than readState.Index'  (duration: 6.133771ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:43:23.285243Z","caller":"traceutil/trace.go:171","msg":"trace[663446841] transaction","detail":"{read_only:false; response_revision:16209; number_of_response:1; }","duration":"117.972393ms","start":"2026-07-25T04:43:23.167263Z","end":"2026-07-25T04:43:23.285235Z","steps":["trace[663446841] 'process raft request'  (duration: 111.544175ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:43:23.285516Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.502752ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/capo-system/capo-controller-manager-8c5df4f-zpnvd\" ","response":"range_response_count:1 size:4633"}
{"level":"info","ts":"2026-07-25T04:43:23.2856Z","caller":"traceutil/trace.go:171","msg":"trace[709556063] range","detail":"{range_begin:/registry/pods/capo-system/capo-controller-manager-8c5df4f-zpnvd; range_end:; response_count:1; response_revision:16209; }","duration":"116.630396ms","start":"2026-07-25T04:43:23.168957Z","end":"2026-07-25T04:43:23.285588Z","steps":["trace[709556063] 'agreement among raft nodes before linearized reading'  (duration: 116.447141ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:43:23.28598Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.926258ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/capo-system/controller-leader-election-capo\" ","response":"range_response_count:1 size:534"}
{"level":"info","ts":"2026-07-25T04:43:23.286208Z","caller":"traceutil/trace.go:171","msg":"trace[206642414] transaction","detail":"{read_only:false; response_revision:16210; number_of_response:1; }","duration":"115.950797ms","start":"2026-07-25T04:43:23.170225Z","end":"2026-07-25T04:43:23.286176Z","steps":["trace[206642414] 'process raft request'  (duration: 115.403562ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:43:23.289343Z","caller":"traceutil/trace.go:171","msg":"trace[628927333] range","detail":"{range_begin:/registry/leases/capo-system/controller-leader-election-capo; range_end:; response_count:1; response_revision:16211; }","duration":"105.337353ms","start":"2026-07-25T04:43:23.183982Z","end":"2026-07-25T04:43:23.289319Z","steps":["trace[628927333] 'agreement among raft nodes before linearized reading'  (duration: 101.849516ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:43:39.760752Z","caller":"traceutil/trace.go:171","msg":"trace[960724865] transaction","detail":"{read_only:false; response_revision:16508; number_of_response:1; }","duration":"104.53006ms","start":"2026-07-25T04:43:39.656178Z","end":"2026-07-25T04:43:39.760708Z","steps":["trace[960724865] 'process raft request'  (duration: 104.271403ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:43:39.973611Z","caller":"traceutil/trace.go:171","msg":"trace[1991297836] transaction","detail":"{read_only:false; response_revision:16510; number_of_response:1; }","duration":"189.012074ms","start":"2026-07-25T04:43:39.784565Z","end":"2026-07-25T04:43:39.973577Z","steps":["trace[1991297836] 'process raft request'  (duration: 188.775518ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:43:40.054064Z","caller":"traceutil/trace.go:171","msg":"trace[694947787] transaction","detail":"{read_only:false; response_revision:16511; number_of_response:1; }","duration":"245.194893ms","start":"2026-07-25T04:43:39.808846Z","end":"2026-07-25T04:43:40.054041Z","steps":["trace[694947787] 'process raft request'  (duration: 245.030018ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:43:40.0545Z","caller":"traceutil/trace.go:171","msg":"trace[457832265] linearizableReadLoop","detail":"{readStateIndex:17010; appliedIndex:17006; }","duration":"220.278962ms","start":"2026-07-25T04:43:39.834185Z","end":"2026-07-25T04:43:40.054464Z","steps":["trace[457832265] 'read index received'  (duration: 139.179031ms)","trace[457832265] 'applied index is now lower than readState.Index'  (duration: 81.098821ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:43:40.054615Z","caller":"traceutil/trace.go:171","msg":"trace[428924230] transaction","detail":"{read_only:false; response_revision:16512; number_of_response:1; }","duration":"241.965173ms","start":"2026-07-25T04:43:39.812634Z","end":"2026-07-25T04:43:40.054599Z","steps":["trace[428924230] 'process raft request'  (duration: 241.375227ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:43:40.054715Z","caller":"traceutil/trace.go:171","msg":"trace[478989543] transaction","detail":"{read_only:false; response_revision:16513; number_of_response:1; }","duration":"237.88161ms","start":"2026-07-25T04:43:39.816821Z","end":"2026-07-25T04:43:40.054702Z","steps":["trace[478989543] 'process raft request'  (duration: 237.51414ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:43:40.054962Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.727409ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-07-25T04:43:40.055024Z","caller":"traceutil/trace.go:171","msg":"trace[899873741] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:16513; }","duration":"156.830561ms","start":"2026-07-25T04:43:39.898176Z","end":"2026-07-25T04:43:40.055007Z","steps":["trace[899873741] 'agreement among raft nodes before linearized reading'  (duration: 156.729668ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:43:40.055224Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.046964ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-07-25T04:43:40.055268Z","caller":"traceutil/trace.go:171","msg":"trace[1334003574] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:16513; }","duration":"221.137426ms","start":"2026-07-25T04:43:39.834121Z","end":"2026-07-25T04:43:40.055258Z","steps":["trace[1334003574] 'agreement among raft nodes before linearized reading'  (duration: 221.071094ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:43:40.185761Z","caller":"traceutil/trace.go:171","msg":"trace[1627993058] transaction","detail":"{read_only:false; response_revision:16515; number_of_response:1; }","duration":"119.63667ms","start":"2026-07-25T04:43:40.066095Z","end":"2026-07-25T04:43:40.185732Z","steps":["trace[1627993058] 'process raft request'  (duration: 119.376363ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:43:40.185901Z","caller":"traceutil/trace.go:171","msg":"trace[1010401986] linearizableReadLoop","detail":"{readStateIndex:17012; appliedIndex:17010; }","duration":"115.857715ms","start":"2026-07-25T04:43:40.069769Z","end":"2026-07-25T04:43:40.185627Z","steps":["trace[1010401986] 'read index received'  (duration: 34.840517ms)","trace[1010401986] 'applied index is now lower than readState.Index'  (duration: 81.015718ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:43:40.186143Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.323568ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-compute-default-2gc9j\" ","response":"range_response_count:1 size:22022"}
{"level":"info","ts":"2026-07-25T04:43:40.186248Z","caller":"traceutil/trace.go:171","msg":"trace[286456743] range","detail":"{range_begin:/registry/pods/openstack/nova-compute-default-2gc9j; range_end:; response_count:1; response_revision:16515; }","duration":"116.470061ms","start":"2026-07-25T04:43:40.069754Z","end":"2026-07-25T04:43:40.186224Z","steps":["trace[286456743] 'agreement among raft nodes before linearized reading'  (duration: 116.104761ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:43:40.195661Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.993334ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/openstack/neutron-server\" ","response":"range_response_count:1 size:700"}
{"level":"info","ts":"2026-07-25T04:43:40.195737Z","caller":"traceutil/trace.go:171","msg":"trace[1962959484] range","detail":"{range_begin:/registry/services/endpoints/openstack/neutron-server; range_end:; response_count:1; response_revision:16515; }","duration":"105.099476ms","start":"2026-07-25T04:43:40.090621Z","end":"2026-07-25T04:43:40.19572Z","steps":["trace[1962959484] 'agreement among raft nodes before linearized reading'  (duration: 95.417487ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:45:37.662543Z","caller":"traceutil/trace.go:171","msg":"trace[417148851] transaction","detail":"{read_only:false; response_revision:18262; number_of_response:1; }","duration":"191.289708ms","start":"2026-07-25T04:45:37.471225Z","end":"2026-07-25T04:45:37.662514Z","steps":["trace[417148851] 'process raft request'  (duration: 191.048182ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:46:05.580614Z","caller":"traceutil/trace.go:171","msg":"trace[27015206] transaction","detail":"{read_only:false; response_revision:18502; number_of_response:1; }","duration":"233.539698ms","start":"2026-07-25T04:46:05.347033Z","end":"2026-07-25T04:46:05.580572Z","steps":["trace[27015206] 'process raft request'  (duration: 147.765862ms)","trace[27015206] 'compare'  (duration: 81.742744ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:46:05.580704Z","caller":"traceutil/trace.go:171","msg":"trace[977810919] transaction","detail":"{read_only:false; response_revision:18503; number_of_response:1; }","duration":"225.001511ms","start":"2026-07-25T04:46:05.35568Z","end":"2026-07-25T04:46:05.580681Z","steps":["trace[977810919] 'process raft request'  (duration: 224.586919ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:46:05.580894Z","caller":"traceutil/trace.go:171","msg":"trace[1920924485] transaction","detail":"{read_only:false; number_of_response:1; response_revision:18503; }","duration":"224.321463ms","start":"2026-07-25T04:46:05.356562Z","end":"2026-07-25T04:46:05.580884Z","steps":["trace[1920924485] 'process raft request'  (duration: 223.771777ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:46:19.234671Z","caller":"traceutil/trace.go:171","msg":"trace[1671632483] linearizableReadLoop","detail":"{readStateIndex:19409; appliedIndex:19408; }","duration":"139.279998ms","start":"2026-07-25T04:46:19.095365Z","end":"2026-07-25T04:46:19.234645Z","steps":["trace[1671632483] 'read index received'  (duration: 139.083242ms)","trace[1671632483] 'applied index is now lower than readState.Index'  (duration: 195.426µs)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:46:19.23469Z","caller":"traceutil/trace.go:171","msg":"trace[542438809] transaction","detail":"{read_only:false; response_revision:18857; number_of_response:1; }","duration":"145.737206ms","start":"2026-07-25T04:46:19.088919Z","end":"2026-07-25T04:46:19.234656Z","steps":["trace[542438809] 'process raft request'  (duration: 145.548171ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:46:19.23514Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"139.742901ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:494"}
{"level":"info","ts":"2026-07-25T04:46:19.235308Z","caller":"traceutil/trace.go:171","msg":"trace[1942779551] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:18857; }","duration":"139.919525ms","start":"2026-07-25T04:46:19.095324Z","end":"2026-07-25T04:46:19.235243Z","steps":["trace[1942779551] 'agreement among raft nodes before linearized reading'  (duration: 139.542965ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:46:19.496973Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.498903ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749375894 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:18822 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:410 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:18"}
{"level":"info","ts":"2026-07-25T04:46:19.497081Z","caller":"traceutil/trace.go:171","msg":"trace[1874729597] linearizableReadLoop","detail":"{readStateIndex:19410; appliedIndex:19409; }","duration":"246.485056ms","start":"2026-07-25T04:46:19.250577Z","end":"2026-07-25T04:46:19.497062Z","steps":["trace[1874729597] 'read index received'  (duration: 97.772348ms)","trace[1874729597] 'applied index is now lower than readState.Index'  (duration: 148.711338ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:46:19.497236Z","caller":"traceutil/trace.go:171","msg":"trace[1067535408] transaction","detail":"{read_only:false; response_revision:18858; number_of_response:1; }","duration":"256.863954ms","start":"2026-07-25T04:46:19.240349Z","end":"2026-07-25T04:46:19.497213Z","steps":["trace[1067535408] 'process raft request'  (duration: 108.036852ms)","trace[1067535408] 'compare'  (duration: 148.06025ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:46:19.497291Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"246.675192ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" count_only:true ","response":"range_response_count:0 size:8"}
{"level":"info","ts":"2026-07-25T04:46:19.497374Z","caller":"traceutil/trace.go:171","msg":"trace[300497419] range","detail":"{range_begin:/registry/statefulsets/; range_end:/registry/statefulsets0; response_count:0; response_revision:18858; }","duration":"246.812686ms","start":"2026-07-25T04:46:19.250547Z","end":"2026-07-25T04:46:19.49736Z","steps":["trace[300497419] 'agreement among raft nodes before linearized reading'  (duration: 246.624211ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:46:19.497591Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.026626ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-07-25T04:46:19.497672Z","caller":"traceutil/trace.go:171","msg":"trace[1868133727] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:18858; }","duration":"232.140529ms","start":"2026-07-25T04:46:19.265519Z","end":"2026-07-25T04:46:19.49766Z","steps":["trace[1868133727] 'agreement among raft nodes before linearized reading'  (duration: 232.028516ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:46:19.497733Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"233.473916ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-07-25T04:46:19.497763Z","caller":"traceutil/trace.go:171","msg":"trace[1500195936] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:18858; }","duration":"233.518838ms","start":"2026-07-25T04:46:19.264239Z","end":"2026-07-25T04:46:19.497758Z","steps":["trace[1500195936] 'agreement among raft nodes before linearized reading'  (duration: 233.460826ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:46:19.49788Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"233.440456ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-07-25T04:46:19.497974Z","caller":"traceutil/trace.go:171","msg":"trace[192776162] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:18858; }","duration":"233.60788ms","start":"2026-07-25T04:46:19.264349Z","end":"2026-07-25T04:46:19.497957Z","steps":["trace[192776162] 'agreement among raft nodes before linearized reading'  (duration: 233.287361ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:46:19.498095Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"234.867515ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-07-25T04:46:19.498149Z","caller":"traceutil/trace.go:171","msg":"trace[1268128202] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:0; response_revision:18858; }","duration":"234.960697ms","start":"2026-07-25T04:46:19.263179Z","end":"2026-07-25T04:46:19.49814Z","steps":["trace[1268128202] 'agreement among raft nodes before linearized reading'  (duration: 234.120874ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:46:19.685243Z","caller":"traceutil/trace.go:171","msg":"trace[818338855] transaction","detail":"{read_only:false; response_revision:18859; number_of_response:1; }","duration":"133.275291ms","start":"2026-07-25T04:46:19.551926Z","end":"2026-07-25T04:46:19.685201Z","steps":["trace[818338855] 'process raft request'  (duration: 128.316034ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:46:20.413627Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.936128ms","expected-duration":"100ms","prefix":"","request":"header:<ID:11521227744749375910 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-cp-lock\" mod_revision:18848 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-cp-lock\" value_size:368 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-cp-lock\" > >>","response":"size:18"}
{"level":"info","ts":"2026-07-25T04:46:20.413844Z","caller":"traceutil/trace.go:171","msg":"trace[888305401] transaction","detail":"{read_only:false; response_revision:18863; number_of_response:1; }","duration":"287.132662ms","start":"2026-07-25T04:46:20.126671Z","end":"2026-07-25T04:46:20.413804Z","steps":["trace[888305401] 'process raft request'  (duration: 154.827858ms)","trace[888305401] 'compare'  (duration: 129.586469ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:46:20.413954Z","caller":"traceutil/trace.go:171","msg":"trace[1370655446] linearizableReadLoop","detail":"{readStateIndex:19416; appliedIndex:19415; }","duration":"158.096309ms","start":"2026-07-25T04:46:20.255839Z","end":"2026-07-25T04:46:20.413936Z","steps":["trace[1370655446] 'read index received'  (duration: 25.582409ms)","trace[1370655446] 'applied index is now lower than readState.Index'  (duration: 132.51241ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T04:46:20.414182Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.334485ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-07-25T04:46:20.414222Z","caller":"traceutil/trace.go:171","msg":"trace[1896864538] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:18863; }","duration":"158.445258ms","start":"2026-07-25T04:46:20.255767Z","end":"2026-07-25T04:46:20.414212Z","steps":["trace[1896864538] 'agreement among raft nodes before linearized reading'  (duration: 158.267534ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T04:46:20.414191Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.78744ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:482"}
{"level":"warn","ts":"2026-07-25T04:46:20.414329Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.537001ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-heat-server-0\" ","response":"range_response_count:1 size:1850"}
{"level":"info","ts":"2026-07-25T04:46:20.414288Z","caller":"traceutil/trace.go:171","msg":"trace[1124399102] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:18863; }","duration":"118.911354ms","start":"2026-07-25T04:46:20.295347Z","end":"2026-07-25T04:46:20.414258Z","steps":["trace[1124399102] 'agreement among raft nodes before linearized reading'  (duration: 118.727979ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:46:20.414365Z","caller":"traceutil/trace.go:171","msg":"trace[1531960000] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-heat-server-0; range_end:; response_count:1; response_revision:18863; }","duration":"115.568541ms","start":"2026-07-25T04:46:20.298782Z","end":"2026-07-25T04:46:20.414351Z","steps":["trace[1531960000] 'agreement among raft nodes before linearized reading'  (duration: 115.424657ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:46:20.641073Z","caller":"traceutil/trace.go:171","msg":"trace[1880397644] transaction","detail":"{read_only:false; response_revision:18865; number_of_response:1; }","duration":"221.32058ms","start":"2026-07-25T04:46:20.419724Z","end":"2026-07-25T04:46:20.641044Z","steps":["trace[1880397644] 'process raft request'  (duration: 131.451151ms)","trace[1880397644] 'compare'  (duration: 89.259162ms)"],"step_count":2}
{"level":"info","ts":"2026-07-25T04:46:20.641695Z","caller":"traceutil/trace.go:171","msg":"trace[299277192] transaction","detail":"{read_only:false; response_revision:18866; number_of_response:1; }","duration":"178.452382ms","start":"2026-07-25T04:46:20.463223Z","end":"2026-07-25T04:46:20.641675Z","steps":["trace[299277192] 'process raft request'  (duration: 177.609669ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T04:47:07.22086Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"11f26225a5bb9fe3","local-member-applied-index":20002,"local-member-snapshot-index":10001,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-07-25T04:47:07.226239Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":20002}
{"level":"info","ts":"2026-07-25T04:47:07.226371Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":15002}
{"level":"info","ts":"2026-07-25T04:47:36.256792Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":15623}
{"level":"info","ts":"2026-07-25T04:47:36.411924Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":15623,"took":"150.130273ms","hash":2257135572,"current-db-size-bytes":76042240,"current-db-size":"76 MB","current-db-size-in-use-bytes":43548672,"current-db-size-in-use":"44 MB"}
{"level":"info","ts":"2026-07-25T04:47:36.412015Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2257135572,"revision":15623,"compact-revision":11681}
{"level":"info","ts":"2026-07-25T04:52:36.263386Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":19737}
{"level":"info","ts":"2026-07-25T04:52:36.431396Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":19737,"took":"162.873487ms","hash":3330002230,"current-db-size-bytes":76042240,"current-db-size":"76 MB","current-db-size-in-use-bytes":36003840,"current-db-size-in-use":"36 MB"}
{"level":"info","ts":"2026-07-25T04:52:36.431468Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3330002230,"revision":19737,"compact-revision":15623}
{"level":"info","ts":"2026-07-25T04:57:36.269915Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":22367}
{"level":"info","ts":"2026-07-25T04:57:36.401956Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":22367,"took":"127.578899ms","hash":1423591357,"current-db-size-bytes":76042240,"current-db-size":"76 MB","current-db-size-in-use-bytes":30334976,"current-db-size-in-use":"30 MB"}
{"level":"info","ts":"2026-07-25T04:57:36.402057Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1423591357,"revision":22367,"compact-revision":19737}
{"level":"info","ts":"2026-07-25T05:02:07.390924Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000002-0000000000006b81.wal"}
{"level":"info","ts":"2026-07-25T05:02:36.275507Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":24598}
{"level":"info","ts":"2026-07-25T05:02:36.408837Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":24598,"took":"128.525934ms","hash":1055987603,"current-db-size-bytes":76042240,"current-db-size":"76 MB","current-db-size-in-use-bytes":32219136,"current-db-size-in-use":"32 MB"}
{"level":"info","ts":"2026-07-25T05:02:36.408903Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1055987603,"revision":24598,"compact-revision":22367}
{"level":"info","ts":"2026-07-25T05:07:04.695424Z","caller":"traceutil/trace.go:171","msg":"trace[73104848] transaction","detail":"{read_only:false; response_revision:28995; number_of_response:1; }","duration":"461.081412ms","start":"2026-07-25T05:07:04.234322Z","end":"2026-07-25T05:07:04.695404Z","steps":["trace[73104848] 'process raft request'  (duration: 460.559707ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T05:07:04.695121Z","caller":"traceutil/trace.go:171","msg":"trace[1691129948] linearizableReadLoop","detail":"{readStateIndex:29825; appliedIndex:29824; }","duration":"460.072614ms","start":"2026-07-25T05:07:04.235008Z","end":"2026-07-25T05:07:04.69508Z","steps":["trace[1691129948] 'read index received'  (duration: 459.897469ms)","trace[1691129948] 'applied index is now lower than readState.Index'  (duration: 173.785µs)"],"step_count":2}
{"level":"warn","ts":"2026-07-25T05:07:04.69557Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.234312Z","time spent":"461.158724ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:28987 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:458 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >"}
{"level":"warn","ts":"2026-07-25T05:07:04.695792Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"460.775083ms","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-07-25T05:07:04.695827Z","caller":"traceutil/trace.go:171","msg":"trace[1936277612] range","detail":"{range_begin:/registry/serviceaccounts/; range_end:/registry/serviceaccounts0; response_count:0; response_revision:28995; }","duration":"460.818784ms","start":"2026-07-25T05:07:04.234999Z","end":"2026-07-25T05:07:04.695818Z","steps":["trace[1936277612] 'agreement among raft nodes before linearized reading'  (duration: 460.543246ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.695865Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.234982Z","time spent":"460.874126ms","remote":"127.0.0.1:41872","response type":"/etcdserverpb.KV/Range","request count":0,"request size":58,"response count":257,"response size":31,"request content":"key:\"/registry/serviceaccounts/\" range_end:\"/registry/serviceaccounts0\" count_only:true "}
{"level":"info","ts":"2026-07-25T05:07:04.698617Z","caller":"traceutil/trace.go:171","msg":"trace[1194063938] transaction","detail":"{read_only:false; response_revision:29001; number_of_response:1; }","duration":"438.096056ms","start":"2026-07-25T05:07:04.260499Z","end":"2026-07-25T05:07:04.698595Z","steps":["trace[1194063938] 'process raft request'  (duration: 438.032134ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.698765Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.26048Z","time spent":"438.208129ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:28988 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:454 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"info","ts":"2026-07-25T05:07:04.698891Z","caller":"traceutil/trace.go:171","msg":"trace[1744677336] transaction","detail":"{read_only:false; response_revision:28998; number_of_response:1; }","duration":"460.809904ms","start":"2026-07-25T05:07:04.238063Z","end":"2026-07-25T05:07:04.698873Z","steps":["trace[1744677336] 'process raft request'  (duration: 460.378002ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.698991Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.238048Z","time spent":"460.890416ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:28989 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"info","ts":"2026-07-25T05:07:04.698998Z","caller":"traceutil/trace.go:171","msg":"trace[1183995019] transaction","detail":"{read_only:false; response_revision:29002; number_of_response:1; }","duration":"275.288304ms","start":"2026-07-25T05:07:04.423698Z","end":"2026-07-25T05:07:04.698987Z","steps":["trace[1183995019] 'process raft request'  (duration: 274.858692ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T05:07:04.699044Z","caller":"traceutil/trace.go:171","msg":"trace[1735803212] transaction","detail":"{read_only:false; response_revision:28999; number_of_response:1; }","duration":"454.561821ms","start":"2026-07-25T05:07:04.244474Z","end":"2026-07-25T05:07:04.699036Z","steps":["trace[1735803212] 'process raft request'  (duration: 453.997866ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T05:07:04.699087Z","caller":"traceutil/trace.go:171","msg":"trace[944026636] transaction","detail":"{read_only:false; response_revision:28996; number_of_response:1; }","duration":"464.007302ms","start":"2026-07-25T05:07:04.235071Z","end":"2026-07-25T05:07:04.699078Z","steps":["trace[944026636] 'process raft request'  (duration: 463.152819ms)"],"step_count":1}
{"level":"info","ts":"2026-07-25T05:07:04.699118Z","caller":"traceutil/trace.go:171","msg":"trace[953525192] transaction","detail":"{read_only:false; response_revision:29000; number_of_response:1; }","duration":"448.893034ms","start":"2026-07-25T05:07:04.250219Z","end":"2026-07-25T05:07:04.699112Z","steps":["trace[953525192] 'process raft request'  (duration: 448.287947ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.699145Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.23506Z","time spent":"464.050324ms","remote":"127.0.0.1:41702","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":791,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/events/openstack/memcached-memcached-cf56b6468-9prpc.18c5700c0413d269\" mod_revision:0 > success:<request_put:<key:\"/registry/events/openstack/memcached-memcached-cf56b6468-9prpc.18c5700c0413d269\" value_size:694 lease:2297855707894624139 >> failure:<>"}
{"level":"warn","ts":"2026-07-25T05:07:04.699156Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.250207Z","time spent":"448.932106ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/capi-system/controller-leader-election-capi\" mod_revision:28981 > success:<request_put:<key:\"/registry/leases/capi-system/controller-leader-election-capi\" value_size:453 >> failure:<request_range:<key:\"/registry/leases/capi-system/controller-leader-election-capi\" > >"}
{"level":"warn","ts":"2026-07-25T05:07:04.699093Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.244431Z","time spent":"454.638193ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":627,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/capi-kubeadm-control-plane-system/kubeadm-control-plane-manager-leader-election-capi\" mod_revision:28958 > success:<request_put:<key:\"/registry/leases/capi-kubeadm-control-plane-system/kubeadm-control-plane-manager-leader-election-capi\" value_size:518 >> failure:<request_range:<key:\"/registry/leases/capi-kubeadm-control-plane-system/kubeadm-control-plane-manager-leader-election-capi\" > >"}
{"level":"warn","ts":"2026-07-25T05:07:04.699482Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"464.329651ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true ","response":"range_response_count:0 size:8"}
{"level":"info","ts":"2026-07-25T05:07:04.699515Z","caller":"traceutil/trace.go:171","msg":"trace[550078565] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:29003; }","duration":"464.364342ms","start":"2026-07-25T05:07:04.235143Z","end":"2026-07-25T05:07:04.699507Z","steps":["trace[550078565] 'agreement among raft nodes before linearized reading'  (duration: 464.27959ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.699537Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.235095Z","time spent":"464.435595ms","remote":"127.0.0.1:41790","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":15,"response size":30,"request content":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true "}
{"level":"warn","ts":"2026-07-25T05:07:04.699619Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"436.521872ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:481"}
{"level":"warn","ts":"2026-07-25T05:07:04.699701Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"450.955781ms","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-07-25T05:07:04.699727Z","caller":"traceutil/trace.go:171","msg":"trace[465468990] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:29003; }","duration":"450.988552ms","start":"2026-07-25T05:07:04.248732Z","end":"2026-07-25T05:07:04.699721Z","steps":["trace[465468990] 'agreement among raft nodes before linearized reading'  (duration: 450.91205ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.699747Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.248729Z","time spent":"451.012183ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":462,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"warn","ts":"2026-07-25T05:07:04.699842Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"451.120126ms","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-07-25T05:07:04.699863Z","caller":"traceutil/trace.go:171","msg":"trace[63115353] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:29003; }","duration":"451.176318ms","start":"2026-07-25T05:07:04.248682Z","end":"2026-07-25T05:07:04.699858Z","steps":["trace[63115353] 'agreement among raft nodes before linearized reading'  (duration: 451.117086ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.69988Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.248667Z","time spent":"451.208808ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-07-25T05:07:04.700093Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"456.70845ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:508"}
{"level":"info","ts":"2026-07-25T05:07:04.70012Z","caller":"traceutil/trace.go:171","msg":"trace[1250130336] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:29003; }","duration":"456.768402ms","start":"2026-07-25T05:07:04.243344Z","end":"2026-07-25T05:07:04.700112Z","steps":["trace[1250130336] 'agreement among raft nodes before linearized reading'  (duration: 456.69925ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.700109Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"460.620619ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"}
{"level":"warn","ts":"2026-07-25T05:07:04.700159Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.243327Z","time spent":"456.824994ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"info","ts":"2026-07-25T05:07:04.700173Z","caller":"traceutil/trace.go:171","msg":"trace[1910379564] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:29003; }","duration":"460.716571ms","start":"2026-07-25T05:07:04.239448Z","end":"2026-07-25T05:07:04.700164Z","steps":["trace[1910379564] 'agreement among raft nodes before linearized reading'  (duration: 460.626389ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.700201Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.239433Z","time spent":"460.758513ms","remote":"127.0.0.1:41636","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-07-25T05:07:04.700878Z","caller":"traceutil/trace.go:171","msg":"trace[1643116875] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:29003; }","duration":"436.595345ms","start":"2026-07-25T05:07:04.263044Z","end":"2026-07-25T05:07:04.699639Z","steps":["trace[1643116875] 'agreement among raft nodes before linearized reading'  (duration: 436.458531ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.700928Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.263035Z","time spent":"437.87283ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"info","ts":"2026-07-25T05:07:04.701012Z","caller":"traceutil/trace.go:171","msg":"trace[1486040274] transaction","detail":"{read_only:false; response_revision:28997; number_of_response:1; }","duration":"462.789549ms","start":"2026-07-25T05:07:04.236335Z","end":"2026-07-25T05:07:04.699124Z","steps":["trace[1486040274] 'process raft request'  (duration: 462.032308ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-25T05:07:04.701069Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-25T05:07:04.236319Z","time spent":"464.716112ms","remote":"127.0.0.1:41934","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:28990 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:464 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >"}
{"level":"info","ts":"2026-07-25T05:07:26.816246Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"11f26225a5bb9fe3","local-member-applied-index":30003,"local-member-snapshot-index":20002,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-07-25T05:07:26.821231Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":30003}
{"level":"info","ts":"2026-07-25T05:07:26.821351Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":25003}
{"level":"info","ts":"2026-07-25T05:07:36.286547Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":26965}
{"level":"info","ts":"2026-07-25T05:07:36.430008Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":26965,"took":"137.361212ms","hash":930476027,"current-db-size-bytes":76042240,"current-db-size":"76 MB","current-db-size-in-use-bytes":32796672,"current-db-size-in-use":"33 MB"}
{"level":"info","ts":"2026-07-25T05:07:36.430092Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":930476027,"revision":26965,"compact-revision":24598}
{"level":"info","ts":"2026-07-25T05:12:36.29316Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":29229}
{"level":"info","ts":"2026-07-25T05:12:36.420896Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":29229,"took":"119.339361ms","hash":1967415057,"current-db-size-bytes":76042240,"current-db-size":"76 MB","current-db-size-in-use-bytes":33923072,"current-db-size-in-use":"34 MB"}
{"level":"info","ts":"2026-07-25T05:12:36.420986Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1967415057,"revision":29229,"compact-revision":26965}