{"level":"warn","ts":"2026-10-04T09:46:39.159444Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-10-04T09:46:39.159572Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.212: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://162.253.55.212:2380","--initial-cluster=instance=https://162.253.55.212:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.212:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.212: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-10-04T09:46:39.160348Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-10-04T09:46:39.160372Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.212:2380"]}
{"level":"info","ts":"2026-10-04T09:46:39.160397Z","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-10-04T09:46:39.162445Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.212:2379"]}
{"level":"info","ts":"2026-10-04T09:46:39.162699Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://162.253.55.212:2380"],"listen-peer-urls":["https://162.253.55.212:2380"],"advertise-client-urls":["https://162.253.55.212:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.212:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.212: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-10-04T09:46:39.169096Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"6.151846ms"}
{"level":"info","ts":"2026-10-04T09:46:39.176242Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"d078b1e39c21939c","cluster-id":"cdc9ba8de57e3589"}
{"level":"info","ts":"2026-10-04T09:46:39.176318Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c switched to configuration voters=()"}
{"level":"info","ts":"2026-10-04T09:46:39.176415Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c became follower at term 0"}
{"level":"info","ts":"2026-10-04T09:46:39.176428Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft d078b1e39c21939c [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-10-04T09:46:39.176435Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c became follower at term 1"}
{"level":"info","ts":"2026-10-04T09:46:39.176546Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c switched to configuration voters=(15021952148229428124)"}
{"level":"warn","ts":"2026-10-04T09:46:39.186712Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-10-04T09:46:39.190943Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-10-04T09:46:39.192031Z","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-10-04T09:46:39.194042Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"d078b1e39c21939c","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-10-04T09:46:39.19431Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"d078b1e39c21939c","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-10-04T09:46:39.194923Z","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-10-04T09:46:39.19516Z","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-10-04T09:46:39.195169Z","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-10-04T09:46:39.199889Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c switched to configuration voters=(15021952148229428124)"}
{"level":"info","ts":"2026-10-04T09:46:39.200231Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"cdc9ba8de57e3589","local-member-id":"d078b1e39c21939c","added-peer-id":"d078b1e39c21939c","added-peer-peer-urls":["https://162.253.55.212:2380"]}
{"level":"info","ts":"2026-10-04T09:46:39.201038Z","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-10-04T09:46:39.201246Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.212:2380"}
{"level":"info","ts":"2026-10-04T09:46:39.201313Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.212:2380"}
{"level":"info","ts":"2026-10-04T09:46:39.201433Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"d078b1e39c21939c","initial-advertise-peer-urls":["https://162.253.55.212:2380"],"listen-peer-urls":["https://162.253.55.212:2380"],"advertise-client-urls":["https://162.253.55.212:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.212:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-10-04T09:46:39.20151Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-10-04T09:46:39.477952Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c is starting a new election at term 1"}
{"level":"info","ts":"2026-10-04T09:46:39.4781Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c became pre-candidate at term 1"}
{"level":"info","ts":"2026-10-04T09:46:39.478134Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c received MsgPreVoteResp from d078b1e39c21939c at term 1"}
{"level":"info","ts":"2026-10-04T09:46:39.47817Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c became candidate at term 2"}
{"level":"info","ts":"2026-10-04T09:46:39.478194Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c received MsgVoteResp from d078b1e39c21939c at term 2"}
{"level":"info","ts":"2026-10-04T09:46:39.478265Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d078b1e39c21939c became leader at term 2"}
{"level":"info","ts":"2026-10-04T09:46:39.478286Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: d078b1e39c21939c elected leader d078b1e39c21939c at term 2"}
{"level":"info","ts":"2026-10-04T09:46:39.479916Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"d078b1e39c21939c","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.212:2379]}","request-path":"/0/members/d078b1e39c21939c/attributes","cluster-id":"cdc9ba8de57e3589","publish-timeout":"7s"}
{"level":"info","ts":"2026-10-04T09:46:39.480232Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-10-04T09:46:39.480677Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-10-04T09:46:39.480693Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-10-04T09:46:39.482366Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.212:2379"}
{"level":"info","ts":"2026-10-04T09:46:39.482958Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-04T09:46:39.483163Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-10-04T09:46:39.484824Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-10-04T09:46:39.485753Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"cdc9ba8de57e3589","local-member-id":"d078b1e39c21939c","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-04T09:46:39.485842Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-04T09:46:39.485887Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"warn","ts":"2026-10-04T09:46:58.727991Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"422.69011ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10636553468408548226 > lease_revoke:<id:139ca1064ef0c9e1>","response":"size:29"}
{"level":"info","ts":"2026-10-04T09:46:58.728614Z","caller":"traceutil/trace.go:171","msg":"trace[589903226] linearizableReadLoop","detail":"{readStateIndex:397; appliedIndex:395; }","duration":"278.973282ms","start":"2026-10-04T09:46:58.449616Z","end":"2026-10-04T09:46:58.728589Z","steps":["trace[589903226] 'read index received'  (duration: 29.02µs)","trace[589903226] 'applied index is now lower than readState.Index'  (duration: 278.942812ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:46:58.728891Z","caller":"traceutil/trace.go:171","msg":"trace[358550450] transaction","detail":"{read_only:false; response_revision:382; number_of_response:1; }","duration":"516.370346ms","start":"2026-10-04T09:46:58.212501Z","end":"2026-10-04T09:46:58.728871Z","steps":["trace[358550450] 'process raft request'  (duration: 515.668254ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:46:58.729209Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"279.149966ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:46:58.729262Z","caller":"traceutil/trace.go:171","msg":"trace[348720543] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:382; }","duration":"279.686754ms","start":"2026-10-04T09:46:58.449556Z","end":"2026-10-04T09:46:58.729242Z","steps":["trace[348720543] 'agreement among raft nodes before linearized reading'  (duration: 279.120065ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:46:58.729553Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:46:58.212469Z","time spent":"516.471137ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":421,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:378 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:369 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"info","ts":"2026-10-04T09:47:19.025577Z","caller":"traceutil/trace.go:171","msg":"trace[354521052] transaction","detail":"{read_only:false; response_revision:494; number_of_response:1; }","duration":"136.763963ms","start":"2026-10-04T09:47:18.888766Z","end":"2026-10-04T09:47:19.02553Z","steps":["trace[354521052] 'process raft request'  (duration: 136.343277ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.025683Z","caller":"traceutil/trace.go:171","msg":"trace[1174746353] transaction","detail":"{read_only:false; response_revision:495; number_of_response:1; }","duration":"133.789087ms","start":"2026-10-04T09:47:18.891817Z","end":"2026-10-04T09:47:19.025606Z","steps":["trace[1174746353] 'process raft request'  (duration: 133.637125ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.025861Z","caller":"traceutil/trace.go:171","msg":"trace[1718960673] transaction","detail":"{read_only:false; response_revision:496; number_of_response:1; }","duration":"123.800266ms","start":"2026-10-04T09:47:18.901969Z","end":"2026-10-04T09:47:19.025769Z","steps":["trace[1718960673] 'process raft request'  (duration: 123.576292ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.02591Z","caller":"traceutil/trace.go:171","msg":"trace[450219264] transaction","detail":"{read_only:false; response_revision:497; number_of_response:1; }","duration":"117.838336ms","start":"2026-10-04T09:47:18.908018Z","end":"2026-10-04T09:47:19.025856Z","steps":["trace[450219264] 'process raft request'  (duration: 117.620763ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.026038Z","caller":"traceutil/trace.go:171","msg":"trace[1340666108] transaction","detail":"{read_only:false; response_revision:498; number_of_response:1; }","duration":"111.918635ms","start":"2026-10-04T09:47:18.914105Z","end":"2026-10-04T09:47:19.026024Z","steps":["trace[1340666108] 'process raft request'  (duration: 111.665512ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.026163Z","caller":"traceutil/trace.go:171","msg":"trace[1362497664] transaction","detail":"{read_only:false; response_revision:499; number_of_response:1; }","duration":"111.965396ms","start":"2026-10-04T09:47:18.914183Z","end":"2026-10-04T09:47:19.026149Z","steps":["trace[1362497664] 'process raft request'  (duration: 111.637271ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.026213Z","caller":"traceutil/trace.go:171","msg":"trace[1388149123] linearizableReadLoop","detail":"{readStateIndex:518; appliedIndex:512; }","duration":"108.329271ms","start":"2026-10-04T09:47:18.917852Z","end":"2026-10-04T09:47:19.026181Z","steps":["trace[1388149123] 'read index received'  (duration: 50.303262ms)","trace[1388149123] 'applied index is now lower than readState.Index'  (duration: 58.024569ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:47:19.026526Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.663486ms","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-10-04T09:47:19.026563Z","caller":"traceutil/trace.go:171","msg":"trace[32379977] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:502; }","duration":"108.767667ms","start":"2026-10-04T09:47:18.917786Z","end":"2026-10-04T09:47:19.026554Z","steps":["trace[32379977] 'agreement among raft nodes before linearized reading'  (duration: 108.580195ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.098834Z","caller":"traceutil/trace.go:171","msg":"trace[267761941] transaction","detail":"{read_only:false; response_revision:503; number_of_response:1; }","duration":"124.370479ms","start":"2026-10-04T09:47:18.974441Z","end":"2026-10-04T09:47:19.098811Z","steps":["trace[267761941] 'process raft request'  (duration: 123.978524ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.099215Z","caller":"traceutil/trace.go:171","msg":"trace[1832333245] transaction","detail":"{read_only:false; number_of_response:1; response_revision:503; }","duration":"124.654594ms","start":"2026-10-04T09:47:18.974508Z","end":"2026-10-04T09:47:19.099163Z","steps":["trace[1832333245] 'process raft request'  (duration: 124.235997ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.099455Z","caller":"traceutil/trace.go:171","msg":"trace[159704104] transaction","detail":"{read_only:false; response_revision:505; number_of_response:1; }","duration":"119.338563ms","start":"2026-10-04T09:47:18.9801Z","end":"2026-10-04T09:47:19.099439Z","steps":["trace[159704104] 'process raft request'  (duration: 119.260192ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.099496Z","caller":"traceutil/trace.go:171","msg":"trace[1768102000] transaction","detail":"{read_only:false; response_revision:504; number_of_response:1; }","duration":"124.772695ms","start":"2026-10-04T09:47:18.974694Z","end":"2026-10-04T09:47:19.099466Z","steps":["trace[1768102000] 'process raft request'  (duration: 124.42197ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.233603Z","caller":"traceutil/trace.go:171","msg":"trace[1039514259] transaction","detail":"{read_only:false; response_revision:506; number_of_response:1; }","duration":"197.538152ms","start":"2026-10-04T09:47:19.036016Z","end":"2026-10-04T09:47:19.233554Z","steps":["trace[1039514259] 'process raft request'  (duration: 184.648898ms)","trace[1039514259] 'compare'  (duration: 12.637971ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:47:19.2337Z","caller":"traceutil/trace.go:171","msg":"trace[887423682] transaction","detail":"{read_only:false; response_revision:507; number_of_response:1; }","duration":"197.557883ms","start":"2026-10-04T09:47:19.036088Z","end":"2026-10-04T09:47:19.233646Z","steps":["trace[887423682] 'process raft request'  (duration: 197.3678ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.233878Z","caller":"traceutil/trace.go:171","msg":"trace[1987887816] transaction","detail":"{read_only:false; response_revision:510; number_of_response:1; }","duration":"187.510101ms","start":"2026-10-04T09:47:19.046343Z","end":"2026-10-04T09:47:19.233853Z","steps":["trace[1987887816] 'process raft request'  (duration: 187.218217ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.233959Z","caller":"traceutil/trace.go:171","msg":"trace[68290230] transaction","detail":"{read_only:false; response_revision:511; number_of_response:1; }","duration":"182.199851ms","start":"2026-10-04T09:47:19.051715Z","end":"2026-10-04T09:47:19.233915Z","steps":["trace[68290230] 'process raft request'  (duration: 181.895996ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.234015Z","caller":"traceutil/trace.go:171","msg":"trace[393032038] transaction","detail":"{read_only:false; response_revision:508; number_of_response:1; }","duration":"195.706514ms","start":"2026-10-04T09:47:19.038299Z","end":"2026-10-04T09:47:19.234005Z","steps":["trace[393032038] 'process raft request'  (duration: 195.201437ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.234089Z","caller":"traceutil/trace.go:171","msg":"trace[166775296] transaction","detail":"{read_only:false; response_revision:509; number_of_response:1; }","duration":"195.585872ms","start":"2026-10-04T09:47:19.038491Z","end":"2026-10-04T09:47:19.234077Z","steps":["trace[166775296] 'process raft request'  (duration: 195.041454ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.234102Z","caller":"traceutil/trace.go:171","msg":"trace[1477846179] transaction","detail":"{read_only:false; response_revision:512; number_of_response:1; }","duration":"181.344528ms","start":"2026-10-04T09:47:19.052747Z","end":"2026-10-04T09:47:19.234092Z","steps":["trace[1477846179] 'process raft request'  (duration: 180.963262ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.234518Z","caller":"traceutil/trace.go:171","msg":"trace[1566964327] transaction","detail":"{read_only:false; response_revision:513; number_of_response:1; }","duration":"179.710703ms","start":"2026-10-04T09:47:19.054767Z","end":"2026-10-04T09:47:19.234478Z","steps":["trace[1566964327] 'process raft request'  (duration: 178.993993ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.23501Z","caller":"traceutil/trace.go:171","msg":"trace[855455836] transaction","detail":"{read_only:false; response_revision:514; number_of_response:1; }","duration":"176.89093ms","start":"2026-10-04T09:47:19.058106Z","end":"2026-10-04T09:47:19.234997Z","steps":["trace[855455836] 'process raft request'  (duration: 176.820399ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.264408Z","caller":"traceutil/trace.go:171","msg":"trace[124725659] transaction","detail":"{read_only:false; response_revision:517; number_of_response:1; }","duration":"143.598028ms","start":"2026-10-04T09:47:19.120679Z","end":"2026-10-04T09:47:19.264277Z","steps":["trace[124725659] 'process raft request'  (duration: 140.062995ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.266011Z","caller":"traceutil/trace.go:171","msg":"trace[1426229449] transaction","detail":"{read_only:false; response_revision:515; number_of_response:1; }","duration":"154.063735ms","start":"2026-10-04T09:47:19.111931Z","end":"2026-10-04T09:47:19.265995Z","steps":["trace[1426229449] 'process raft request'  (duration: 148.085715ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.267531Z","caller":"traceutil/trace.go:171","msg":"trace[285345625] transaction","detail":"{read_only:false; response_revision:516; number_of_response:1; }","duration":"150.223958ms","start":"2026-10-04T09:47:19.117268Z","end":"2026-10-04T09:47:19.267492Z","steps":["trace[285345625] 'process raft request'  (duration: 142.936498ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:47:19.889664Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"367.265624ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10636553468408548498 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xlistenersets.gateway.networking.x-k8s.io\" mod_revision:498 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xlistenersets.gateway.networking.x-k8s.io\" value_size:29344 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xlistenersets.gateway.networking.x-k8s.io\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-04T09:47:19.889793Z","caller":"traceutil/trace.go:171","msg":"trace[211086130] transaction","detail":"{read_only:false; response_revision:529; number_of_response:1; }","duration":"433.660956ms","start":"2026-10-04T09:47:19.4561Z","end":"2026-10-04T09:47:19.889761Z","steps":["trace[211086130] 'process raft request'  (duration: 66.204429ms)","trace[211086130] 'compare'  (duration: 367.087542ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:47:19.889859Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:47:19.456073Z","time spent":"433.756667ms","remote":"127.0.0.1:60118","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29452,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xlistenersets.gateway.networking.x-k8s.io\" mod_revision:498 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xlistenersets.gateway.networking.x-k8s.io\" value_size:29344 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xlistenersets.gateway.networking.x-k8s.io\" > >"}
{"level":"info","ts":"2026-10-04T09:47:19.894935Z","caller":"traceutil/trace.go:171","msg":"trace[1886446794] transaction","detail":"{read_only:false; response_revision:530; number_of_response:1; }","duration":"414.564318ms","start":"2026-10-04T09:47:19.480322Z","end":"2026-10-04T09:47:19.894887Z","steps":["trace[1886446794] 'process raft request'  (duration: 414.193052ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:19.895148Z","caller":"traceutil/trace.go:171","msg":"trace[338876246] transaction","detail":"{read_only:false; response_revision:531; number_of_response:1; }","duration":"409.124805ms","start":"2026-10-04T09:47:19.48601Z","end":"2026-10-04T09:47:19.895135Z","steps":["trace[338876246] 'process raft request'  (duration: 408.74185ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:47:19.89515Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:47:19.480301Z","time spent":"414.74172ms","remote":"127.0.0.1:60118","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":97665,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/backendtrafficpolicies.gateway.envoyproxy.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/backendtrafficpolicies.gateway.envoyproxy.io\" value_size:97554 >> failure:<>"}
{"level":"warn","ts":"2026-10-04T09:47:19.895275Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:47:19.485974Z","time spent":"409.217317ms","remote":"127.0.0.1:60118","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":23066,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xbackendtrafficpolicies.gateway.networking.x-k8s.io\" mod_revision:527 > success:<request_put:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xbackendtrafficpolicies.gateway.networking.x-k8s.io\" value_size:22948 >> failure:<request_range:<key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/xbackendtrafficpolicies.gateway.networking.x-k8s.io\" > >"}
{"level":"info","ts":"2026-10-04T09:47:19.894927Z","caller":"traceutil/trace.go:171","msg":"trace[405843552] linearizableReadLoop","detail":"{readStateIndex:555; appliedIndex:553; }","duration":"259.033891ms","start":"2026-10-04T09:47:19.635875Z","end":"2026-10-04T09:47:19.894909Z","steps":["trace[405843552] 'read index received'  (duration: 258.30053ms)","trace[405843552] 'applied index is now lower than readState.Index'  (duration: 732.491µs)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:47:19.895584Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"259.695741ms","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-10-04T09:47:19.895732Z","caller":"traceutil/trace.go:171","msg":"trace[546985355] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:531; }","duration":"259.923624ms","start":"2026-10-04T09:47:19.635791Z","end":"2026-10-04T09:47:19.895715Z","steps":["trace[546985355] 'agreement among raft nodes before linearized reading'  (duration: 259.65181ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:47:19.895843Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.739784ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"}
{"level":"info","ts":"2026-10-04T09:47:19.895908Z","caller":"traceutil/trace.go:171","msg":"trace[808923613] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:531; }","duration":"136.827226ms","start":"2026-10-04T09:47:19.759068Z","end":"2026-10-04T09:47:19.895895Z","steps":["trace[808923613] 'agreement among raft nodes before linearized reading'  (duration: 136.536612ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:26.975886Z","caller":"traceutil/trace.go:171","msg":"trace[611599266] transaction","detail":"{read_only:false; response_revision:606; number_of_response:1; }","duration":"160.757843ms","start":"2026-10-04T09:47:26.815095Z","end":"2026-10-04T09:47:26.975853Z","steps":["trace[611599266] 'process raft request'  (duration: 160.128044ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:47:27.576636Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.679016ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10636553468408548646 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/pods/kube-system/cilium-j5j27\" mod_revision:487 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-j5j27\" value_size:17085 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-j5j27\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-04T09:47:27.577008Z","caller":"traceutil/trace.go:171","msg":"trace[244454906] linearizableReadLoop","detail":"{readStateIndex:633; appliedIndex:631; }","duration":"298.651153ms","start":"2026-10-04T09:47:27.27833Z","end":"2026-10-04T09:47:27.576981Z","steps":["trace[244454906] 'read index received'  (duration: 108.602553ms)","trace[244454906] 'applied index is now lower than readState.Index'  (duration: 190.04659ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:47:27.577204Z","caller":"traceutil/trace.go:171","msg":"trace[339849977] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"520.68599ms","start":"2026-10-04T09:47:27.056475Z","end":"2026-10-04T09:47:27.57716Z","steps":["trace[339849977] 'process raft request'  (duration: 520.428626ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:47:27.577296Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:47:27.056445Z","time spent":"520.809971ms","remote":"127.0.0.1:60282","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" mod_revision:0 > success:<request_put:<key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" value_size:2525 >> failure:<>"}
{"level":"warn","ts":"2026-10-04T09:47:27.57736Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.342996ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:47:27.577306Z","caller":"traceutil/trace.go:171","msg":"trace[278811564] transaction","detail":"{read_only:false; response_revision:607; number_of_response:1; }","duration":"551.256156ms","start":"2026-10-04T09:47:27.026007Z","end":"2026-10-04T09:47:27.577264Z","steps":["trace[278811564] 'process raft request'  (duration: 360.84218ms)","trace[278811564] 'compare'  (duration: 189.473082ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:47:27.577442Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"299.10682ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-10-04T09:47:27.577448Z","caller":"traceutil/trace.go:171","msg":"trace[887055164] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:608; }","duration":"127.518589ms","start":"2026-10-04T09:47:27.449909Z","end":"2026-10-04T09:47:27.577427Z","steps":["trace[887055164] 'agreement among raft nodes before linearized reading'  (duration: 127.292646ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:27.577512Z","caller":"traceutil/trace.go:171","msg":"trace[684709102] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:608; }","duration":"299.233672ms","start":"2026-10-04T09:47:27.278257Z","end":"2026-10-04T09:47:27.577491Z","steps":["trace[684709102] 'agreement among raft nodes before linearized reading'  (duration: 298.898007ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:47:27.577663Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:47:27.025978Z","time spent":"551.504599ms","remote":"127.0.0.1:60236","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/cilium-j5j27\" mod_revision:487 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-j5j27\" value_size:17085 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-j5j27\" > >"}
{"level":"info","ts":"2026-10-04T09:47:55.781836Z","caller":"traceutil/trace.go:171","msg":"trace[1968756995] transaction","detail":"{read_only:false; response_revision:912; number_of_response:1; }","duration":"114.602702ms","start":"2026-10-04T09:47:55.667204Z","end":"2026-10-04T09:47:55.781807Z","steps":["trace[1968756995] 'process raft request'  (duration: 49.588564ms)","trace[1968756995] 'compare'  (duration: 64.641923ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:47:55.783078Z","caller":"traceutil/trace.go:171","msg":"trace[1984112405] transaction","detail":"{read_only:false; response_revision:913; number_of_response:1; }","duration":"114.209726ms","start":"2026-10-04T09:47:55.668841Z","end":"2026-10-04T09:47:55.783051Z","steps":["trace[1984112405] 'process raft request'  (duration: 112.750567ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:47:55.783699Z","caller":"traceutil/trace.go:171","msg":"trace[1523999801] transaction","detail":"{read_only:false; response_revision:914; number_of_response:1; }","duration":"112.502595ms","start":"2026-10-04T09:47:55.671185Z","end":"2026-10-04T09:47:55.783688Z","steps":["trace[1523999801] 'process raft request'  (duration: 111.111296ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:48:46.75986Z","caller":"traceutil/trace.go:171","msg":"trace[552419972] transaction","detail":"{read_only:false; response_revision:1548; number_of_response:1; }","duration":"120.646565ms","start":"2026-10-04T09:48:46.639179Z","end":"2026-10-04T09:48:46.759825Z","steps":["trace[552419972] 'process raft request'  (duration: 120.1911ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:48:46.760138Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.378992ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"}
{"level":"info","ts":"2026-10-04T09:48:46.759851Z","caller":"traceutil/trace.go:171","msg":"trace[867891747] linearizableReadLoop","detail":"{readStateIndex:1599; appliedIndex:1598; }","duration":"109.065359ms","start":"2026-10-04T09:48:46.65072Z","end":"2026-10-04T09:48:46.759785Z","steps":["trace[867891747] 'read index received'  (duration: 108.531462ms)","trace[867891747] 'applied index is now lower than readState.Index'  (duration: 531.707µs)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:48:46.760194Z","caller":"traceutil/trace.go:171","msg":"trace[1200908238] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1548; }","duration":"109.482513ms","start":"2026-10-04T09:48:46.650699Z","end":"2026-10-04T09:48:46.760182Z","steps":["trace[1200908238] 'agreement among raft nodes before linearized reading'  (duration: 109.23527ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:48:46.992054Z","caller":"traceutil/trace.go:171","msg":"trace[953269574] transaction","detail":"{read_only:false; response_revision:1550; number_of_response:1; }","duration":"151.803564ms","start":"2026-10-04T09:48:46.840213Z","end":"2026-10-04T09:48:46.992017Z","steps":["trace[953269574] 'process raft request'  (duration: 145.203646ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:48:48.022131Z","caller":"traceutil/trace.go:171","msg":"trace[1841373292] transaction","detail":"{read_only:false; number_of_response:0; response_revision:1553; }","duration":"125.109126ms","start":"2026-10-04T09:48:47.896995Z","end":"2026-10-04T09:48:48.022105Z","steps":["trace[1841373292] 'process raft request'  (duration: 125.010975ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:48:48.170026Z","caller":"traceutil/trace.go:171","msg":"trace[1166207843] transaction","detail":"{read_only:false; number_of_response:0; response_revision:1553; }","duration":"129.537566ms","start":"2026-10-04T09:48:48.040458Z","end":"2026-10-04T09:48:48.169996Z","steps":["trace[1166207843] 'process raft request'  (duration: 129.417954ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:48:48.305924Z","caller":"traceutil/trace.go:171","msg":"trace[897833399] transaction","detail":"{read_only:false; number_of_response:0; response_revision:1554; }","duration":"102.842042ms","start":"2026-10-04T09:48:48.203043Z","end":"2026-10-04T09:48:48.305885Z","steps":["trace[897833399] 'process raft request'  (duration: 85.853072ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:49:07.851369Z","caller":"traceutil/trace.go:171","msg":"trace[1493023289] transaction","detail":"{read_only:false; response_revision:1860; number_of_response:1; }","duration":"254.958223ms","start":"2026-10-04T09:49:07.596356Z","end":"2026-10-04T09:49:07.851315Z","steps":["trace[1493023289] 'process raft request'  (duration: 228.59543ms)","trace[1493023289] 'compare'  (duration: 26.146141ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:49:08.331798Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"335.07963ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10636553468408551159 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:1840 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:478 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-04T09:49:08.332194Z","caller":"traceutil/trace.go:171","msg":"trace[1021194730] transaction","detail":"{read_only:false; response_revision:1862; number_of_response:1; }","duration":"473.758815ms","start":"2026-10-04T09:49:07.858413Z","end":"2026-10-04T09:49:08.332172Z","steps":["trace[1021194730] 'process raft request'  (duration: 473.683154ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:08.332312Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:07.858391Z","time spent":"473.879987ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":515,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/cert-manager/cert-manager-controller\" mod_revision:1658 > 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-10-04T09:49:08.332325Z","caller":"traceutil/trace.go:171","msg":"trace[1665414083] transaction","detail":"{read_only:false; response_revision:1861; number_of_response:1; }","duration":"525.282998ms","start":"2026-10-04T09:49:07.807003Z","end":"2026-10-04T09:49:08.332286Z","steps":["trace[1665414083] 'process raft request'  (duration: 189.599331ms)","trace[1665414083] 'compare'  (duration: 334.885998ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:49:08.33235Z","caller":"traceutil/trace.go:171","msg":"trace[1070110957] linearizableReadLoop","detail":"{readStateIndex:1940; appliedIndex:1939; }","duration":"474.884489ms","start":"2026-10-04T09:49:07.857431Z","end":"2026-10-04T09:49:08.332316Z","steps":["trace[1070110957] 'read index received'  (duration: 139.173971ms)","trace[1070110957] 'applied index is now lower than readState.Index'  (duration: 335.707457ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:49:08.332508Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:07.806968Z","time spent":"525.428479ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:1840 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:478 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-10-04T09:49:08.332616Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"475.188292ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-haproxy-0\" ","response":"range_response_count:1 size:10630"}
{"level":"info","ts":"2026-10-04T09:49:08.332684Z","caller":"traceutil/trace.go:171","msg":"trace[1456013430] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-haproxy-0; range_end:; response_count:1; response_revision:1862; }","duration":"475.259533ms","start":"2026-10-04T09:49:07.857407Z","end":"2026-10-04T09:49:08.332666Z","steps":["trace[1456013430] 'agreement among raft nodes before linearized reading'  (duration: 474.99816ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:08.332725Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:07.857335Z","time spent":"475.380404ms","remote":"127.0.0.1:60236","response type":"/etcdserverpb.KV/Range","request count":0,"request size":51,"response count":1,"response size":10654,"request content":"key:\"/registry/pods/openstack/percona-xtradb-haproxy-0\" "}
{"level":"warn","ts":"2026-10-04T09:49:08.357495Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"328.882659ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5444"}
{"level":"info","ts":"2026-10-04T09:49:08.357656Z","caller":"traceutil/trace.go:171","msg":"trace[179014967] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1863; }","duration":"329.084201ms","start":"2026-10-04T09:49:08.028543Z","end":"2026-10-04T09:49:08.357627Z","steps":["trace[179014967] 'agreement among raft nodes before linearized reading'  (duration: 328.806718ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:08.357742Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.028493Z","time spent":"329.235693ms","remote":"127.0.0.1:40654","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":5468,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" "}
{"level":"warn","ts":"2026-10-04T09:49:10.013351Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.167422971s","expected-duration":"100ms","prefix":"","request":"header:<ID:10636553468408551166 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:1845 > 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-10-04T09:49:10.013574Z","caller":"traceutil/trace.go:171","msg":"trace[1719348906] transaction","detail":"{read_only:false; response_revision:1865; number_of_response:1; }","duration":"1.650590212s","start":"2026-10-04T09:49:08.362956Z","end":"2026-10-04T09:49:10.013546Z","steps":["trace[1719348906] 'process raft request'  (duration: 482.872518ms)","trace[1719348906] 'compare'  (duration: 1.166658092s)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:49:10.013665Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.362926Z","time spent":"1.650693434s","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:1845 > 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":"warn","ts":"2026-10-04T09:49:10.449578Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.999951765s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"","error":"context canceled"}
{"level":"info","ts":"2026-10-04T09:49:10.449683Z","caller":"traceutil/trace.go:171","msg":"trace[1898056182] range","detail":"{range_begin:/registry/health; range_end:; }","duration":"2.000124958s","start":"2026-10-04T09:49:08.449537Z","end":"2026-10-04T09:49:10.449662Z","steps":["trace[1898056182] 'agreement among raft nodes before linearized reading'  (duration: 1.999993116s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.449737Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.449496Z","time spent":"2.000229888s","remote":"127.0.0.1:60068","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":0,"request content":"key:\"/registry/health\" "}
2026/10/04 09:49:10 WARNING: [core] [Server #8] grpc: Server.processUnaryRPC failed to write status: connection error: desc = "transport is closing"
{"level":"warn","ts":"2026-10-04T09:49:10.796123Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"782.648572ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10636553468408551167 > lease_revoke:<id:139ca1064ef0d56b>","response":"size:29"}
{"level":"info","ts":"2026-10-04T09:49:10.797292Z","caller":"traceutil/trace.go:171","msg":"trace[140381194] transaction","detail":"{read_only:false; response_revision:1866; number_of_response:1; }","duration":"2.388641003s","start":"2026-10-04T09:49:08.408615Z","end":"2026-10-04T09:49:10.797256Z","steps":["trace[140381194] 'process raft request'  (duration: 2.387634421s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.797506Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.408602Z","time spent":"2.388783574s","remote":"127.0.0.1:60320","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1471,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-replicas-thqbz\" mod_revision:1833 > success:<request_put:<key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-replicas-thqbz\" value_size:1391 >> failure:<request_range:<key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-replicas-thqbz\" > >"}
{"level":"info","ts":"2026-10-04T09:49:10.819277Z","caller":"traceutil/trace.go:171","msg":"trace[606515105] transaction","detail":"{read_only:false; response_revision:1867; number_of_response:1; }","duration":"2.410417792s","start":"2026-10-04T09:49:08.408822Z","end":"2026-10-04T09:49:10.81924Z","steps":["trace[606515105] 'process raft request'  (duration: 2.388411239s)","trace[606515105] 'compare'  (duration: 21.716309ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:49:10.819319Z","caller":"traceutil/trace.go:171","msg":"trace[871623646] transaction","detail":"{read_only:false; response_revision:1868; number_of_response:1; }","duration":"2.410350471s","start":"2026-10-04T09:49:08.408941Z","end":"2026-10-04T09:49:10.819291Z","steps":["trace[871623646] 'process raft request'  (duration: 2.410160799s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.819421Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.408778Z","time spent":"2.410558934s","remote":"127.0.0.1:60320","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1529,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-hbcfx\" mod_revision:1829 > success:<request_put:<key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-hbcfx\" value_size:1458 >> failure:<request_range:<key:\"/registry/endpointslices/openstack/percona-xtradb-haproxy-hbcfx\" > >"}
{"level":"warn","ts":"2026-10-04T09:49:10.819528Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.40893Z","time spent":"2.410464903s","remote":"127.0.0.1:60214","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":977,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy\" mod_revision:1830 > success:<request_put:<key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy\" value_size:908 >> failure:<request_range:<key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy\" > >"}
{"level":"info","ts":"2026-10-04T09:49:10.820022Z","caller":"traceutil/trace.go:171","msg":"trace[1620271655] transaction","detail":"{read_only:false; response_revision:1869; number_of_response:1; }","duration":"2.410973468s","start":"2026-10-04T09:49:08.409025Z","end":"2026-10-04T09:49:10.819999Z","steps":["trace[1620271655] 'process raft request'  (duration: 2.41018974s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.820184Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.408977Z","time spent":"2.411153431s","remote":"127.0.0.1:60214","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":893,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy-replicas\" mod_revision:1834 > success:<request_put:<key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy-replicas\" value_size:815 >> failure:<request_range:<key:\"/registry/services/endpoints/openstack/percona-xtradb-haproxy-replicas\" > >"}
{"level":"info","ts":"2026-10-04T09:49:10.820423Z","caller":"traceutil/trace.go:171","msg":"trace[361680898] transaction","detail":"{read_only:false; response_revision:1871; number_of_response:1; }","duration":"1.430767161s","start":"2026-10-04T09:49:09.389636Z","end":"2026-10-04T09:49:10.820403Z","steps":["trace[361680898] 'process raft request'  (duration: 1.430378077s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.820534Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:09.389615Z","time spent":"1.430871192s","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:1856 > 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":"info","ts":"2026-10-04T09:49:10.820919Z","caller":"traceutil/trace.go:171","msg":"trace[906909115] transaction","detail":"{read_only:false; response_revision:1872; number_of_response:1; }","duration":"481.911494ms","start":"2026-10-04T09:49:10.338992Z","end":"2026-10-04T09:49:10.820903Z","steps":["trace[906909115] 'process raft request'  (duration: 481.340507ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.82101Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:10.338964Z","time spent":"481.998656ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:1861 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:478 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"info","ts":"2026-10-04T09:49:10.821481Z","caller":"traceutil/trace.go:171","msg":"trace[1989591225] transaction","detail":"{read_only:false; response_revision:1870; number_of_response:1; }","duration":"2.237571796s","start":"2026-10-04T09:49:08.583882Z","end":"2026-10-04T09:49:10.821454Z","steps":["trace[1989591225] 'process raft request'  (duration: 2.235948268s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.821622Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.583857Z","time spent":"2.237694557s","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:1850 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"info","ts":"2026-10-04T09:49:10.822168Z","caller":"traceutil/trace.go:171","msg":"trace[2083889552] linearizableReadLoop","detail":"{readStateIndex:1949; appliedIndex:1943; }","duration":"2.370470533s","start":"2026-10-04T09:49:08.449604Z","end":"2026-10-04T09:49:10.820074Z","steps":["trace[2083889552] 'read index received'  (duration: 396.248093ms)","trace[2083889552] 'applied index is now lower than readState.Index'  (duration: 1.97422082s)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:49:10.822425Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.756644781s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:49:10.822932Z","caller":"traceutil/trace.go:171","msg":"trace[370189059] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gateways/; range_end:/registry/gateway.networking.k8s.io/gateways0; response_count:0; response_revision:1872; }","duration":"1.757194107s","start":"2026-10-04T09:49:09.065723Z","end":"2026-10-04T09:49:10.822918Z","steps":["trace[370189059] 'agreement among raft nodes before linearized reading'  (duration: 1.756660081s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.823062Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:09.065697Z","time spent":"1.757353179s","remote":"127.0.0.1:34888","response type":"/etcdserverpb.KV/Range","request count":0,"request size":96,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gateways/\" range_end:\"/registry/gateway.networking.k8s.io/gateways0\" count_only:true "}
{"level":"warn","ts":"2026-10-04T09:49:10.82316Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.459695742s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-499ad3dd-bb62-487d-ab08-af69eefe3b4d\" ","response":"range_response_count:1 size:3744"}
{"level":"info","ts":"2026-10-04T09:49:10.823259Z","caller":"traceutil/trace.go:171","msg":"trace[479285867] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-499ad3dd-bb62-487d-ab08-af69eefe3b4d; range_end:; response_count:1; response_revision:1872; }","duration":"1.459840115s","start":"2026-10-04T09:49:09.363398Z","end":"2026-10-04T09:49:10.823238Z","steps":["trace[479285867] 'agreement among raft nodes before linearized reading'  (duration: 1.459597612s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.82331Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:09.363355Z","time spent":"1.459940555s","remote":"127.0.0.1:60236","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":1,"response size":3768,"request content":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-499ad3dd-bb62-487d-ab08-af69eefe3b4d\" "}
{"level":"warn","ts":"2026-10-04T09:49:10.82348Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.581414449s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-cainjector-leader-election\" ","response":"range_response_count:1 size:557"}
{"level":"info","ts":"2026-10-04T09:49:10.823515Z","caller":"traceutil/trace.go:171","msg":"trace[1185940686] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-cainjector-leader-election; range_end:; response_count:1; response_revision:1872; }","duration":"1.581481541s","start":"2026-10-04T09:49:09.242021Z","end":"2026-10-04T09:49:10.823503Z","steps":["trace[1185940686] 'agreement among raft nodes before linearized reading'  (duration: 1.581325549s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.823546Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:09.241996Z","time spent":"1.581543711s","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Range","request count":0,"request size":71,"response count":1,"response size":581,"request content":"key:\"/registry/leases/cert-manager/cert-manager-cainjector-leader-election\" "}
{"level":"warn","ts":"2026-10-04T09:49:10.823765Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.3075625s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-10-04T09:49:10.823806Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.456620457s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5444"}
{"level":"info","ts":"2026-10-04T09:49:10.823842Z","caller":"traceutil/trace.go:171","msg":"trace[190991789] range","detail":"{range_begin:/registry/cilium.io/ciliumpodippools/; range_end:/registry/cilium.io/ciliumpodippools0; response_count:0; response_revision:1872; }","duration":"2.307756072s","start":"2026-10-04T09:49:08.516062Z","end":"2026-10-04T09:49:10.823818Z","steps":["trace[190991789] 'agreement among raft nodes before linearized reading'  (duration: 2.306273565s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.823903Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.516031Z","time spent":"2.307853963s","remote":"127.0.0.1:35002","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":0,"response size":29,"request content":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" count_only:true "}
{"level":"warn","ts":"2026-10-04T09:49:10.824107Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"371.733971ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:49:10.824137Z","caller":"traceutil/trace.go:171","msg":"trace[2046672464] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1872; }","duration":"371.822703ms","start":"2026-10-04T09:49:10.452307Z","end":"2026-10-04T09:49:10.82413Z","steps":["trace[2046672464] 'agreement among raft nodes before linearized reading'  (duration: 371.774632ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.824179Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.876430097s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:49:10.824282Z","caller":"traceutil/trace.go:171","msg":"trace[2055919499] range","detail":"{range_begin:/registry/cilium.io/ciliuml2announcementpolicies/; range_end:/registry/cilium.io/ciliuml2announcementpolicies0; response_count:0; response_revision:1872; }","duration":"1.876542748s","start":"2026-10-04T09:49:08.947723Z","end":"2026-10-04T09:49:10.824266Z","steps":["trace[2055919499] 'agreement among raft nodes before linearized reading'  (duration: 1.876400837s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.824289Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.056153201s","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-10-04T09:49:10.824235Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.381761508s","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":"warn","ts":"2026-10-04T09:49:10.824449Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.303115569s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:554"}
{"level":"info","ts":"2026-10-04T09:49:10.824449Z","caller":"traceutil/trace.go:171","msg":"trace[1413145157] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1872; }","duration":"1.382064311s","start":"2026-10-04T09:49:09.442355Z","end":"2026-10-04T09:49:10.824419Z","steps":["trace[1413145157] 'agreement among raft nodes before linearized reading'  (duration: 1.381577036s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.824555Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.943560908s","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-10-04T09:49:10.82461Z","caller":"traceutil/trace.go:171","msg":"trace[2063253452] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1872; }","duration":"1.943655389s","start":"2026-10-04T09:49:08.880941Z","end":"2026-10-04T09:49:10.824597Z","steps":["trace[2063253452] 'agreement among raft nodes before linearized reading'  (duration: 1.943542028s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.824582Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:09.442335Z","time spent":"1.382228084s","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":516,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "}
{"level":"warn","ts":"2026-10-04T09:49:10.824642Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.040777975s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/\" range_end:\"/registry/services/specs0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"warn","ts":"2026-10-04T09:49:10.82466Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.880912Z","time spent":"1.94373223s","remote":"127.0.0.1:60314","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-10-04T09:49:10.824684Z","caller":"traceutil/trace.go:171","msg":"trace[355869988] range","detail":"{range_begin:/registry/services/specs/; range_end:/registry/services/specs0; response_count:0; response_revision:1872; }","duration":"2.040844805s","start":"2026-10-04T09:49:08.783827Z","end":"2026-10-04T09:49:10.824672Z","steps":["trace[355869988] 'agreement among raft nodes before linearized reading'  (duration: 2.040762834s)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:49:10.823853Z","caller":"traceutil/trace.go:171","msg":"trace[1209552613] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1872; }","duration":"1.456712178s","start":"2026-10-04T09:49:09.367127Z","end":"2026-10-04T09:49:10.823839Z","steps":["trace[1209552613] 'agreement among raft nodes before linearized reading'  (duration: 1.456429035s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.824724Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.783811Z","time spent":"2.040899987s","remote":"127.0.0.1:60240","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":15,"response size":31,"request content":"key:\"/registry/services/specs/\" range_end:\"/registry/services/specs0\" count_only:true "}
{"level":"warn","ts":"2026-10-04T09:49:10.824768Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:09.367101Z","time spent":"1.457655349s","remote":"127.0.0.1:40654","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":5468,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" "}
{"level":"warn","ts":"2026-10-04T09:49:10.824163Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:10.45228Z","time spent":"371.878133ms","remote":"127.0.0.1:60078","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-10-04T09:49:10.824503Z","caller":"traceutil/trace.go:171","msg":"trace[1150443778] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:1872; }","duration":"2.30316728s","start":"2026-10-04T09:49:08.521322Z","end":"2026-10-04T09:49:10.824489Z","steps":["trace[1150443778] 'agreement among raft nodes before linearized reading'  (duration: 2.303038808s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.824989Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.521244Z","time spent":"2.303734447s","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":1,"response size":578,"request content":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" "}
{"level":"warn","ts":"2026-10-04T09:49:10.824332Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.947602Z","time spent":"1.87671073s","remote":"127.0.0.1:35018","response type":"/etcdserverpb.KV/Range","request count":0,"request size":104,"response count":0,"response size":29,"request content":"key:\"/registry/cilium.io/ciliuml2announcementpolicies/\" range_end:\"/registry/cilium.io/ciliuml2announcementpolicies0\" count_only:true "}
{"level":"info","ts":"2026-10-04T09:49:10.824353Z","caller":"traceutil/trace.go:171","msg":"trace[1469371030] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1872; }","duration":"2.056274133s","start":"2026-10-04T09:49:08.768059Z","end":"2026-10-04T09:49:10.824333Z","steps":["trace[1469371030] 'agreement among raft nodes before linearized reading'  (duration: 2.056067461s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.825107Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.768026Z","time spent":"2.057072082s","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-10-04T09:49:10.824462Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.922087952s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"}
{"level":"info","ts":"2026-10-04T09:49:10.825392Z","caller":"traceutil/trace.go:171","msg":"trace[16015703] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1872; }","duration":"1.923048922s","start":"2026-10-04T09:49:08.902328Z","end":"2026-10-04T09:49:10.825377Z","steps":["trace[16015703] 'agreement among raft nodes before linearized reading'  (duration: 1.922051921s)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:10.825467Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:08.902308Z","time spent":"1.923143443s","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"info","ts":"2026-10-04T09:49:18.117716Z","caller":"traceutil/trace.go:171","msg":"trace[253478102] transaction","detail":"{read_only:false; response_revision:1943; number_of_response:1; }","duration":"178.122246ms","start":"2026-10-04T09:49:17.939557Z","end":"2026-10-04T09:49:18.117679Z","steps":["trace[253478102] 'process raft request'  (duration: 177.898754ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:44.765335Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"309.880105ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:49:44.765434Z","caller":"traceutil/trace.go:171","msg":"trace[1477892196] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2104; }","duration":"310.073832ms","start":"2026-10-04T09:49:44.455338Z","end":"2026-10-04T09:49:44.765412Z","steps":["trace[1477892196] 'range keys from in-memory index tree'  (duration: 309.788621ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:44.765481Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:49:44.45531Z","time spent":"310.159385ms","remote":"127.0.0.1:60068","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "}
{"level":"warn","ts":"2026-10-04T09:49:44.765837Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.351098ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:49:44.765949Z","caller":"traceutil/trace.go:171","msg":"trace[1845667869] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:2104; }","duration":"237.463462ms","start":"2026-10-04T09:49:44.528472Z","end":"2026-10-04T09:49:44.765935Z","steps":["trace[1845667869] 'range keys from in-memory index tree'  (duration: 237.341388ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:49:44.775769Z","caller":"traceutil/trace.go:171","msg":"trace[2032941109] transaction","detail":"{read_only:false; response_revision:2105; number_of_response:1; }","duration":"173.293555ms","start":"2026-10-04T09:49:44.602459Z","end":"2026-10-04T09:49:44.775752Z","steps":["trace[2032941109] 'process raft request'  (duration: 172.831557ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:49:45.177495Z","caller":"traceutil/trace.go:171","msg":"trace[1055314067] transaction","detail":"{read_only:false; response_revision:2106; number_of_response:1; }","duration":"185.603194ms","start":"2026-10-04T09:49:44.991865Z","end":"2026-10-04T09:49:45.177468Z","steps":["trace[1055314067] 'process raft request'  (duration: 185.378775ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:49:45.260738Z","caller":"traceutil/trace.go:171","msg":"trace[652297779] linearizableReadLoop","detail":"{readStateIndex:2195; appliedIndex:2192; }","duration":"240.543544ms","start":"2026-10-04T09:49:45.020165Z","end":"2026-10-04T09:49:45.260709Z","steps":["trace[652297779] 'read index received'  (duration: 157.060154ms)","trace[652297779] 'applied index is now lower than readState.Index'  (duration: 83.48244ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:49:45.260888Z","caller":"traceutil/trace.go:171","msg":"trace[348158934] transaction","detail":"{read_only:false; response_revision:2108; number_of_response:1; }","duration":"259.091172ms","start":"2026-10-04T09:49:45.001785Z","end":"2026-10-04T09:49:45.260877Z","steps":["trace[348158934] 'process raft request'  (duration: 258.871353ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:49:45.260898Z","caller":"traceutil/trace.go:171","msg":"trace[395684783] transaction","detail":"{read_only:false; response_revision:2107; number_of_response:1; }","duration":"262.121408ms","start":"2026-10-04T09:49:44.998725Z","end":"2026-10-04T09:49:45.260846Z","steps":["trace[395684783] 'process raft request'  (duration: 256.261644ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:45.261342Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"218.587458ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"warn","ts":"2026-10-04T09:49:45.261384Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"241.21107ms","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-10-04T09:49:45.261419Z","caller":"traceutil/trace.go:171","msg":"trace[1046211604] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2108; }","duration":"241.282143ms","start":"2026-10-04T09:49:45.020125Z","end":"2026-10-04T09:49:45.261407Z","steps":["trace[1046211604] 'agreement among raft nodes before linearized reading'  (duration: 241.159228ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:49:45.261421Z","caller":"traceutil/trace.go:171","msg":"trace[2059990752] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2108; }","duration":"218.780646ms","start":"2026-10-04T09:49:45.042621Z","end":"2026-10-04T09:49:45.261402Z","steps":["trace[2059990752] 'agreement among raft nodes before linearized reading'  (duration: 218.523546ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:45.261407Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.173167ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"}
{"level":"warn","ts":"2026-10-04T09:49:45.261446Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.749722ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5444"}
{"level":"info","ts":"2026-10-04T09:49:45.261493Z","caller":"traceutil/trace.go:171","msg":"trace[452762297] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2108; }","duration":"200.315531ms","start":"2026-10-04T09:49:45.061158Z","end":"2026-10-04T09:49:45.261473Z","steps":["trace[452762297] 'agreement among raft nodes before linearized reading'  (duration: 200.072472ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:49:45.261498Z","caller":"traceutil/trace.go:171","msg":"trace[345775178] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2108; }","duration":"177.833205ms","start":"2026-10-04T09:49:45.083648Z","end":"2026-10-04T09:49:45.261481Z","steps":["trace[345775178] 'agreement among raft nodes before linearized reading'  (duration: 177.685979ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:45.261588Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"207.468565ms","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-10-04T09:49:45.261634Z","caller":"traceutil/trace.go:171","msg":"trace[900171645] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2108; }","duration":"207.531876ms","start":"2026-10-04T09:49:45.054092Z","end":"2026-10-04T09:49:45.261624Z","steps":["trace[900171645] 'agreement among raft nodes before linearized reading'  (duration: 207.438403ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:49:45.261723Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.953346ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:553"}
{"level":"info","ts":"2026-10-04T09:49:45.26177Z","caller":"traceutil/trace.go:171","msg":"trace[1566234985] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2108; }","duration":"196.023668ms","start":"2026-10-04T09:49:45.065734Z","end":"2026-10-04T09:49:45.261758Z","steps":["trace[1566234985] 'agreement among raft nodes before linearized reading'  (duration: 195.329512ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:51:26.057064Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"263.535441ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10636553468408553333 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:2748 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-04T09:51:26.05733Z","caller":"traceutil/trace.go:171","msg":"trace[1764486184] linearizableReadLoop","detail":"{readStateIndex:2869; appliedIndex:2867; }","duration":"223.477678ms","start":"2026-10-04T09:51:25.83383Z","end":"2026-10-04T09:51:26.057308Z","steps":["trace[1764486184] 'read index received'  (duration: 179.560521ms)","trace[1764486184] 'applied index is now lower than readState.Index'  (duration: 43.916017ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:51:26.057796Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"223.944359ms","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-10-04T09:51:26.058021Z","caller":"traceutil/trace.go:171","msg":"trace[279295746] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2758; }","duration":"224.220676ms","start":"2026-10-04T09:51:25.83378Z","end":"2026-10-04T09:51:26.058001Z","steps":["trace[279295746] 'agreement among raft nodes before linearized reading'  (duration: 223.824636ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:51:26.05822Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"178.263343ms","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-10-04T09:51:26.058258Z","caller":"traceutil/trace.go:171","msg":"trace[647782600] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2758; }","duration":"178.329465ms","start":"2026-10-04T09:51:25.879918Z","end":"2026-10-04T09:51:26.058247Z","steps":["trace[647782600] 'agreement among raft nodes before linearized reading'  (duration: 177.969456ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:51:26.057862Z","caller":"traceutil/trace.go:171","msg":"trace[431334880] transaction","detail":"{read_only:false; response_revision:2757; number_of_response:1; }","duration":"430.797313ms","start":"2026-10-04T09:51:25.627027Z","end":"2026-10-04T09:51:26.057825Z","steps":["trace[431334880] 'process raft request'  (duration: 166.38567ms)","trace[431334880] 'compare'  (duration: 263.385648ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:51:26.058371Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:51:25.627005Z","time spent":"431.315087ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:2748 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"info","ts":"2026-10-04T09:51:26.057895Z","caller":"traceutil/trace.go:171","msg":"trace[1680962213] transaction","detail":"{read_only:false; response_revision:2758; number_of_response:1; }","duration":"352.46697ms","start":"2026-10-04T09:51:25.705392Z","end":"2026-10-04T09:51:26.057859Z","steps":["trace[1680962213] 'process raft request'  (duration: 351.839435ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:51:26.058689Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:51:25.705353Z","time spent":"353.27187ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:2749 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:478 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-10-04T09:51:26.05804Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.779878ms","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-10-04T09:51:26.058768Z","caller":"traceutil/trace.go:171","msg":"trace[314360775] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2758; }","duration":"209.59511ms","start":"2026-10-04T09:51:25.84915Z","end":"2026-10-04T09:51:26.058745Z","steps":["trace[314360775] 'agreement among raft nodes before linearized reading'  (duration: 208.701107ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:51:26.058108Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.867793ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:554"}
{"level":"info","ts":"2026-10-04T09:51:26.058869Z","caller":"traceutil/trace.go:171","msg":"trace[1446829690] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2758; }","duration":"166.705244ms","start":"2026-10-04T09:51:25.89215Z","end":"2026-10-04T09:51:26.058855Z","steps":["trace[1446829690] 'agreement among raft nodes before linearized reading'  (duration: 165.592416ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:51:26.058087Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"218.525492ms","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-10-04T09:51:26.059128Z","caller":"traceutil/trace.go:171","msg":"trace[557343290] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2758; }","duration":"219.60143ms","start":"2026-10-04T09:51:25.839504Z","end":"2026-10-04T09:51:26.059106Z","steps":["trace[557343290] 'agreement among raft nodes before linearized reading'  (duration: 218.122823ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:55:19.350596Z","caller":"traceutil/trace.go:171","msg":"trace[834691213] transaction","detail":"{read_only:false; response_revision:4143; number_of_response:1; }","duration":"108.550193ms","start":"2026-10-04T09:55:19.242019Z","end":"2026-10-04T09:55:19.350569Z","steps":["trace[834691213] 'process raft request'  (duration: 108.3586ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:55:59.222707Z","caller":"traceutil/trace.go:171","msg":"trace[4971001] transaction","detail":"{read_only:false; response_revision:4876; number_of_response:1; }","duration":"108.699314ms","start":"2026-10-04T09:55:59.113976Z","end":"2026-10-04T09:55:59.222675Z","steps":["trace[4971001] 'process raft request'  (duration: 108.504031ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:56:05.139443Z","caller":"traceutil/trace.go:171","msg":"trace[576373638] linearizableReadLoop","detail":"{readStateIndex:5173; appliedIndex:5172; }","duration":"353.072019ms","start":"2026-10-04T09:56:04.786317Z","end":"2026-10-04T09:56:05.139389Z","steps":["trace[576373638] 'read index received'  (duration: 352.899296ms)","trace[576373638] 'applied index is now lower than readState.Index'  (duration: 171.683µs)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:56:05.13951Z","caller":"traceutil/trace.go:171","msg":"trace[49598305] transaction","detail":"{read_only:false; response_revision:4974; number_of_response:1; }","duration":"362.25099ms","start":"2026-10-04T09:56:04.777229Z","end":"2026-10-04T09:56:05.13948Z","steps":["trace[49598305] 'process raft request'  (duration: 361.964056ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:56:05.139717Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:04.777191Z","time spent":"362.374111ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:4900 > 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-10-04T09:56:05.139779Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"353.456775ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-0590f3a8-8ce7-476d-969d-b97b9ee83aba\" ","response":"range_response_count:1 size:3646"}
{"level":"info","ts":"2026-10-04T09:56:05.139863Z","caller":"traceutil/trace.go:171","msg":"trace[1342799496] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-0590f3a8-8ce7-476d-969d-b97b9ee83aba; range_end:; response_count:1; response_revision:4974; }","duration":"353.591697ms","start":"2026-10-04T09:56:04.786256Z","end":"2026-10-04T09:56:05.139847Z","steps":["trace[1342799496] 'agreement among raft nodes before linearized reading'  (duration: 353.298662ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:56:05.139928Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:04.786239Z","time spent":"353.676869ms","remote":"127.0.0.1:60236","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":1,"response size":3670,"request content":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-0590f3a8-8ce7-476d-969d-b97b9ee83aba\" "}
{"level":"info","ts":"2026-10-04T09:56:05.195015Z","caller":"traceutil/trace.go:171","msg":"trace[1974574293] transaction","detail":"{read_only:false; response_revision:4975; number_of_response:1; }","duration":"298.430199ms","start":"2026-10-04T09:56:04.896524Z","end":"2026-10-04T09:56:05.194954Z","steps":["trace[1974574293] 'process raft request'  (duration: 267.684197ms)","trace[1974574293] 'compare'  (duration: 30.556339ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:56:05.195156Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"300.061604ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/monitoring/kube-prometheus-stack-grafana-6577f7f5b8-t9qsg\" ","response":"range_response_count:1 size:11257"}
{"level":"warn","ts":"2026-10-04T09:56:05.195173Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.650359ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/\" range_end:\"/registry/secrets0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-10-04T09:56:05.195234Z","caller":"traceutil/trace.go:171","msg":"trace[1594261723] range","detail":"{range_begin:/registry/pods/monitoring/kube-prometheus-stack-grafana-6577f7f5b8-t9qsg; range_end:; response_count:1; response_revision:4975; }","duration":"300.232437ms","start":"2026-10-04T09:56:04.894979Z","end":"2026-10-04T09:56:05.195212Z","steps":["trace[1594261723] 'agreement among raft nodes before linearized reading'  (duration: 299.968893ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:56:05.195274Z","caller":"traceutil/trace.go:171","msg":"trace[1086272299] range","detail":"{range_begin:/registry/secrets/; range_end:/registry/secrets0; response_count:0; response_revision:4975; }","duration":"172.848401ms","start":"2026-10-04T09:56:05.022402Z","end":"2026-10-04T09:56:05.19525Z","steps":["trace[1086272299] 'agreement among raft nodes before linearized reading'  (duration: 172.574257ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:56:05.195284Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:04.894951Z","time spent":"300.320729ms","remote":"127.0.0.1:60236","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":11281,"request content":"key:\"/registry/pods/monitoring/kube-prometheus-stack-grafana-6577f7f5b8-t9qsg\" "}
{"level":"warn","ts":"2026-10-04T09:56:05.552124Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.850557ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:56:05.552264Z","caller":"traceutil/trace.go:171","msg":"trace[2006191162] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4981; }","duration":"103.065801ms","start":"2026-10-04T09:56:05.449168Z","end":"2026-10-04T09:56:05.552234Z","steps":["trace[2006191162] 'range keys from in-memory index tree'  (duration: 102.727496ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:56:05.94641Z","caller":"traceutil/trace.go:171","msg":"trace[2044687829] transaction","detail":"{read_only:false; response_revision:4985; number_of_response:1; }","duration":"109.955217ms","start":"2026-10-04T09:56:05.836419Z","end":"2026-10-04T09:56:05.946374Z","steps":["trace[2044687829] 'process raft request'  (duration: 101.930554ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:56:05.94643Z","caller":"traceutil/trace.go:171","msg":"trace[1942536775] transaction","detail":"{read_only:false; response_revision:4986; number_of_response:1; }","duration":"109.211505ms","start":"2026-10-04T09:56:05.83719Z","end":"2026-10-04T09:56:05.946401Z","steps":["trace[1942536775] 'process raft request'  (duration: 109.078413ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:56:17.357238Z","caller":"traceutil/trace.go:171","msg":"trace[458139612] linearizableReadLoop","detail":"{readStateIndex:5339; appliedIndex:5338; }","duration":"339.860347ms","start":"2026-10-04T09:56:17.017344Z","end":"2026-10-04T09:56:17.357205Z","steps":["trace[458139612] 'read index received'  (duration: 339.569362ms)","trace[458139612] 'applied index is now lower than readState.Index'  (duration: 289.175µs)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:56:17.357315Z","caller":"traceutil/trace.go:171","msg":"trace[1580070040] transaction","detail":"{read_only:false; response_revision:5135; number_of_response:1; }","duration":"551.579884ms","start":"2026-10-04T09:56:16.805695Z","end":"2026-10-04T09:56:17.357275Z","steps":["trace[1580070040] 'process raft request'  (duration: 551.188018ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:56:17.357702Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:16.805659Z","time spent":"551.751376ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:5121 > 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":"warn","ts":"2026-10-04T09:56:17.43487Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"417.484549ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:10392"}
{"level":"info","ts":"2026-10-04T09:56:17.435002Z","caller":"traceutil/trace.go:171","msg":"trace[2027035385] transaction","detail":"{read_only:false; response_revision:5136; number_of_response:1; }","duration":"248.102799ms","start":"2026-10-04T09:56:17.186863Z","end":"2026-10-04T09:56:17.434966Z","steps":["trace[2027035385] 'process raft request'  (duration: 216.431087ms)","trace[2027035385] 'compare'  (duration: 30.737988ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:56:17.435075Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"392.58838ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:1865"}
{"level":"info","ts":"2026-10-04T09:56:17.435048Z","caller":"traceutil/trace.go:171","msg":"trace[929329056] range","detail":"{range_begin:/registry/pods/openstack/rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:5135; }","duration":"417.683132ms","start":"2026-10-04T09:56:17.017338Z","end":"2026-10-04T09:56:17.435021Z","steps":["trace[929329056] 'agreement among raft nodes before linearized reading'  (duration: 340.030119ms)","trace[929329056] 'range keys from in-memory index tree'  (duration: 76.692509ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:56:17.435152Z","caller":"traceutil/trace.go:171","msg":"trace[890290954] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:5136; }","duration":"392.724392ms","start":"2026-10-04T09:56:17.042406Z","end":"2026-10-04T09:56:17.43513Z","steps":["trace[890290954] 'agreement among raft nodes before linearized reading'  (duration: 392.492828ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:56:17.435197Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:17.042392Z","time spent":"392.797783ms","remote":"127.0.0.1:60206","response type":"/etcdserverpb.KV/Range","request count":0,"request size":83,"response count":1,"response size":1889,"request content":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" "}
{"level":"warn","ts":"2026-10-04T09:56:17.435257Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:17.017272Z","time spent":"417.968046ms","remote":"127.0.0.1:60236","response type":"/etcdserverpb.KV/Range","request count":0,"request size":53,"response count":1,"response size":10416,"request content":"key:\"/registry/pods/openstack/rabbitmq-keystone-server-0\" "}
{"level":"info","ts":"2026-10-04T09:56:39.596444Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2830}
{"level":"info","ts":"2026-10-04T09:56:39.704855Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2830,"took":"106.539544ms","hash":2399056625,"current-db-size-bytes":51830784,"current-db-size":"52 MB","current-db-size-in-use-bytes":27389952,"current-db-size-in-use":"27 MB"}
{"level":"info","ts":"2026-10-04T09:56:39.704958Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2399056625,"revision":2830,"compact-revision":-1}
{"level":"info","ts":"2026-10-04T09:56:56.009203Z","caller":"traceutil/trace.go:171","msg":"trace[2011958507] transaction","detail":"{read_only:false; response_revision:5496; number_of_response:1; }","duration":"371.081055ms","start":"2026-10-04T09:56:55.638075Z","end":"2026-10-04T09:56:56.009156Z","steps":["trace[2011958507] 'process raft request'  (duration: 370.963764ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:56:56.009263Z","caller":"traceutil/trace.go:171","msg":"trace[236058331] transaction","detail":"{read_only:false; response_revision:5495; number_of_response:1; }","duration":"395.224286ms","start":"2026-10-04T09:56:55.614002Z","end":"2026-10-04T09:56:56.009226Z","steps":["trace[236058331] 'process raft request'  (duration: 306.139515ms)","trace[236058331] 'compare'  (duration: 88.706196ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:56:56.009412Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:55.638017Z","time spent":"371.277458ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:5479 > 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-10-04T09:56:56.009465Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:55.613978Z","time spent":"395.383038ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:5478 > 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":"info","ts":"2026-10-04T09:56:56.036868Z","caller":"traceutil/trace.go:171","msg":"trace[1519402987] linearizableReadLoop","detail":"{readStateIndex:5711; appliedIndex:5708; }","duration":"297.464315ms","start":"2026-10-04T09:56:55.73938Z","end":"2026-10-04T09:56:56.036844Z","steps":["trace[1519402987] 'read index received'  (duration: 180.777471ms)","trace[1519402987] 'applied index is now lower than readState.Index'  (duration: 116.685934ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:56:56.037112Z","caller":"traceutil/trace.go:171","msg":"trace[838791448] transaction","detail":"{read_only:false; response_revision:5497; number_of_response:1; }","duration":"388.674218ms","start":"2026-10-04T09:56:55.648425Z","end":"2026-10-04T09:56:56.0371Z","steps":["trace[838791448] 'process raft request'  (duration: 388.296862ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:56:56.037201Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:56:55.648406Z","time spent":"388.729529ms","remote":"127.0.0.1:60314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":40,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:5480 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:478 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-10-04T09:56:56.037394Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.024133ms","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-10-04T09:56:56.037429Z","caller":"traceutil/trace.go:171","msg":"trace[1925911805] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:5497; }","duration":"298.064153ms","start":"2026-10-04T09:56:55.739352Z","end":"2026-10-04T09:56:56.037416Z","steps":["trace[1925911805] 'agreement among raft nodes before linearized reading'  (duration: 298.001393ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:56:56.037676Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.683264ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/datadir-percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:1853"}
{"level":"info","ts":"2026-10-04T09:56:56.037704Z","caller":"traceutil/trace.go:171","msg":"trace[1377683386] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/datadir-percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:5497; }","duration":"106.711375ms","start":"2026-10-04T09:56:55.930983Z","end":"2026-10-04T09:56:56.037694Z","steps":["trace[1377683386] 'agreement among raft nodes before linearized reading'  (duration: 106.584353ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:56:56.247995Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.57931ms","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-10-04T09:56:56.248214Z","caller":"traceutil/trace.go:171","msg":"trace[1141863670] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:5497; }","duration":"138.821905ms","start":"2026-10-04T09:56:56.109354Z","end":"2026-10-04T09:56:56.248176Z","steps":["trace[1141863670] 'range keys from in-memory index tree'  (duration: 138.335517ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:57:08.224383Z","caller":"traceutil/trace.go:171","msg":"trace[1257781791] transaction","detail":"{read_only:false; response_revision:5583; number_of_response:1; }","duration":"119.72901ms","start":"2026-10-04T09:57:08.104628Z","end":"2026-10-04T09:57:08.224357Z","steps":["trace[1257781791] 'process raft request'  (duration: 119.639598ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T10:01:39.633673Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5306}
{"level":"info","ts":"2026-10-04T10:01:39.734262Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5306,"took":"98.082284ms","hash":709909954,"current-db-size-bytes":51830784,"current-db-size":"52 MB","current-db-size-in-use-bytes":18526208,"current-db-size-in-use":"18 MB"}
{"level":"info","ts":"2026-10-04T10:01:39.734339Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":709909954,"revision":5306,"compact-revision":2830}