{"level":"warn","ts":"2026-09-16T21:36:08.523205Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-09-16T21:36:08.523357Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.114: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.114:2380","--initial-cluster=instance=https://162.253.55.114:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.114:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.114: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-09-16T21:36:08.52344Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-09-16T21:36:08.523456Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.114:2380"]}
{"level":"info","ts":"2026-09-16T21:36:08.523474Z","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-09-16T21:36:08.524252Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.114:2379"]}
{"level":"info","ts":"2026-09-16T21:36:08.524336Z","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.114:2380"],"listen-peer-urls":["https://162.253.55.114:2380"],"advertise-client-urls":["https://162.253.55.114:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.114:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.114: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-09-16T21:36:08.529002Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.418874ms"}
{"level":"info","ts":"2026-09-16T21:36:08.538594Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"3bc1eef27555bbee","cluster-id":"8fe2b95d877f0557"}
{"level":"info","ts":"2026-09-16T21:36:08.538715Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee switched to configuration voters=()"}
{"level":"info","ts":"2026-09-16T21:36:08.538753Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee became follower at term 0"}
{"level":"info","ts":"2026-09-16T21:36:08.538768Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 3bc1eef27555bbee [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-09-16T21:36:08.538778Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee became follower at term 1"}
{"level":"info","ts":"2026-09-16T21:36:08.538829Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee switched to configuration voters=(4305985443860954094)"}
{"level":"warn","ts":"2026-09-16T21:36:08.548547Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-09-16T21:36:08.553408Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-09-16T21:36:08.555091Z","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-09-16T21:36:08.560017Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"3bc1eef27555bbee","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-09-16T21:36:08.566726Z","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-09-16T21:36:08.566902Z","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-09-16T21:36:08.566918Z","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-09-16T21:36:08.56944Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee switched to configuration voters=(4305985443860954094)"}
{"level":"info","ts":"2026-09-16T21:36:08.569663Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"8fe2b95d877f0557","local-member-id":"3bc1eef27555bbee","added-peer-id":"3bc1eef27555bbee","added-peer-peer-urls":["https://162.253.55.114:2380"]}
{"level":"info","ts":"2026-09-16T21:36:08.569851Z","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-09-16T21:36:08.570067Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"3bc1eef27555bbee","initial-advertise-peer-urls":["https://162.253.55.114:2380"],"listen-peer-urls":["https://162.253.55.114:2380"],"advertise-client-urls":["https://162.253.55.114:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.114:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-09-16T21:36:08.570095Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-09-16T21:36:08.570209Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.114:2380"}
{"level":"info","ts":"2026-09-16T21:36:08.570223Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.114:2380"}
{"level":"info","ts":"2026-09-16T21:36:08.568654Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"3bc1eef27555bbee","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-09-16T21:36:09.339748Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee is starting a new election at term 1"}
{"level":"info","ts":"2026-09-16T21:36:09.339813Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee became pre-candidate at term 1"}
{"level":"info","ts":"2026-09-16T21:36:09.339836Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee received MsgPreVoteResp from 3bc1eef27555bbee at term 1"}
{"level":"info","ts":"2026-09-16T21:36:09.339864Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee became candidate at term 2"}
{"level":"info","ts":"2026-09-16T21:36:09.339871Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee received MsgVoteResp from 3bc1eef27555bbee at term 2"}
{"level":"info","ts":"2026-09-16T21:36:09.339882Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3bc1eef27555bbee became leader at term 2"}
{"level":"info","ts":"2026-09-16T21:36:09.339891Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 3bc1eef27555bbee elected leader 3bc1eef27555bbee at term 2"}
{"level":"info","ts":"2026-09-16T21:36:09.341137Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-16T21:36:09.342631Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"3bc1eef27555bbee","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.114:2379]}","request-path":"/0/members/3bc1eef27555bbee/attributes","cluster-id":"8fe2b95d877f0557","publish-timeout":"7s"}
{"level":"info","ts":"2026-09-16T21:36:09.342805Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-09-16T21:36:09.342832Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-09-16T21:36:09.343166Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-09-16T21:36:09.343185Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-09-16T21:36:09.343639Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"8fe2b95d877f0557","local-member-id":"3bc1eef27555bbee","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-16T21:36:09.343734Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-16T21:36:09.343763Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-16T21:36:09.3463Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.114:2379"}
{"level":"info","ts":"2026-09-16T21:36:09.346984Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"warn","ts":"2026-09-16T21:36:12.570487Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"222.497672ms","expected-duration":"100ms","prefix":"","request":"header:<ID:13541937790782495884 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/clusterrolebindings/system:controller:generic-garbage-collector\" mod_revision:0 > success:<request_put:<key:\"/registry/clusterrolebindings/system:controller:generic-garbage-collector\" value_size:679 >> failure:<>>","response":"size:16"}
{"level":"info","ts":"2026-09-16T21:36:12.57069Z","caller":"traceutil/trace.go:171","msg":"trace[1220490889] linearizableReadLoop","detail":"{readStateIndex:164; appliedIndex:163; }","duration":"350.71062ms","start":"2026-09-16T21:36:12.219964Z","end":"2026-09-16T21:36:12.570674Z","steps":["trace[1220490889] 'read index received'  (duration: 127.761544ms)","trace[1220490889] 'applied index is now lower than readState.Index'  (duration: 222.948206ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:36:12.571176Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"351.196975ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-node-lease/instance\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:36:12.571529Z","caller":"traceutil/trace.go:171","msg":"trace[1788314948] transaction","detail":"{read_only:false; response_revision:160; number_of_response:1; }","duration":"371.456055ms","start":"2026-09-16T21:36:12.199348Z","end":"2026-09-16T21:36:12.570804Z","steps":["trace[1788314948] 'process raft request'  (duration: 148.310907ms)","trace[1788314948] 'compare'  (duration: 222.369441ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:36:12.571609Z","caller":"traceutil/trace.go:171","msg":"trace[53700355] range","detail":"{range_begin:/registry/leases/kube-node-lease/instance; range_end:; response_count:0; response_revision:160; }","duration":"351.553809ms","start":"2026-09-16T21:36:12.219898Z","end":"2026-09-16T21:36:12.571451Z","steps":["trace[53700355] 'agreement among raft nodes before linearized reading'  (duration: 350.854802ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:12.571704Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:12.219872Z","time spent":"351.821521ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Range","request count":0,"request size":43,"response count":0,"response size":28,"request content":"key:\"/registry/leases/kube-node-lease/instance\" "}
{"level":"warn","ts":"2026-09-16T21:36:12.571705Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:12.199327Z","time spent":"372.299183ms","remote":"127.0.0.1:56004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":760,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/clusterrolebindings/system:controller:generic-garbage-collector\" mod_revision:0 > success:<request_put:<key:\"/registry/clusterrolebindings/system:controller:generic-garbage-collector\" value_size:679 >> failure:<>"}
{"level":"warn","ts":"2026-09-16T21:36:12.892293Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"215.342281ms","expected-duration":"100ms","prefix":"","request":"header:<ID:13541937790782495885 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/pods/kube-system/kube-controller-manager-instance\" mod_revision:0 > success:<request_put:<key:\"/registry/pods/kube-system/kube-controller-manager-instance\" value_size:5431 >> failure:<>>","response":"size:16"}
{"level":"info","ts":"2026-09-16T21:36:12.892422Z","caller":"traceutil/trace.go:171","msg":"trace[1612446272] linearizableReadLoop","detail":"{readStateIndex:165; appliedIndex:164; }","duration":"315.105718ms","start":"2026-09-16T21:36:12.577297Z","end":"2026-09-16T21:36:12.892403Z","steps":["trace[1612446272] 'read index received'  (duration: 99.382963ms)","trace[1612446272] 'applied index is now lower than readState.Index'  (duration: 215.721575ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:36:12.892606Z","caller":"traceutil/trace.go:171","msg":"trace[718551067] transaction","detail":"{read_only:false; response_revision:161; number_of_response:1; }","duration":"520.174928ms","start":"2026-09-16T21:36:12.372343Z","end":"2026-09-16T21:36:12.892518Z","steps":["trace[718551067] 'process raft request'  (duration: 304.517624ms)","trace[718551067] 'compare'  (duration: 215.178549ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:36:12.892734Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"315.428622ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:3492"}
{"level":"warn","ts":"2026-09-16T21:36:12.89272Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"314.487932ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/system:controller:horizontal-pod-autoscaler\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-09-16T21:36:12.892827Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"260.240705ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:36:12.892829Z","caller":"traceutil/trace.go:171","msg":"trace[1634770111] range","detail":"{range_begin:/registry/clusterrolebindings/system:controller:horizontal-pod-autoscaler; range_end:; response_count:0; response_revision:161; }","duration":"314.638884ms","start":"2026-09-16T21:36:12.578161Z","end":"2026-09-16T21:36:12.8928Z","steps":["trace[1634770111] 'agreement among raft nodes before linearized reading'  (duration: 314.429742ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:36:12.892854Z","caller":"traceutil/trace.go:171","msg":"trace[1776140718] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:161; }","duration":"260.338176ms","start":"2026-09-16T21:36:12.632508Z","end":"2026-09-16T21:36:12.892847Z","steps":["trace[1776140718] 'agreement among raft nodes before linearized reading'  (duration: 260.296976ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:12.892841Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:12.372316Z","time spent":"520.40811ms","remote":"127.0.0.1:55860","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5498,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/kube-controller-manager-instance\" mod_revision:0 > success:<request_put:<key:\"/registry/pods/kube-system/kube-controller-manager-instance\" value_size:5431 >> failure:<>"}
{"level":"warn","ts":"2026-09-16T21:36:12.893028Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:12.578153Z","time spent":"314.721434ms","remote":"127.0.0.1:56004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":75,"response count":0,"response size":28,"request content":"key:\"/registry/clusterrolebindings/system:controller:horizontal-pod-autoscaler\" "}
{"level":"info","ts":"2026-09-16T21:36:12.892772Z","caller":"traceutil/trace.go:171","msg":"trace[2145695173] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:161; }","duration":"315.500242ms","start":"2026-09-16T21:36:12.577259Z","end":"2026-09-16T21:36:12.892759Z","steps":["trace[2145695173] 'agreement among raft nodes before linearized reading'  (duration: 315.24057ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:12.893228Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:12.577243Z","time spent":"315.964567ms","remote":"127.0.0.1:55850","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":1,"response size":3515,"request content":"key:\"/registry/minions/instance\" "}
{"level":"info","ts":"2026-09-16T21:36:52.040119Z","caller":"traceutil/trace.go:171","msg":"trace[607075254] transaction","detail":"{read_only:false; response_revision:496; number_of_response:1; }","duration":"110.03113ms","start":"2026-09-16T21:36:51.930067Z","end":"2026-09-16T21:36:52.040098Z","steps":["trace[607075254] 'process raft request'  (duration: 109.894225ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:36:52.320147Z","caller":"traceutil/trace.go:171","msg":"trace[1880186366] transaction","detail":"{read_only:false; response_revision:526; number_of_response:1; }","duration":"127.727107ms","start":"2026-09-16T21:36:52.192383Z","end":"2026-09-16T21:36:52.32011Z","steps":["trace[1880186366] 'process raft request'  (duration: 113.96156ms)","trace[1880186366] 'compare'  (duration: 13.564579ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:36:52.3214Z","caller":"traceutil/trace.go:171","msg":"trace[473333914] transaction","detail":"{read_only:false; response_revision:527; number_of_response:1; }","duration":"119.965305ms","start":"2026-09-16T21:36:52.200238Z","end":"2026-09-16T21:36:52.320204Z","steps":["trace[473333914] 'process raft request'  (duration: 119.794889ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:36:52.32167Z","caller":"traceutil/trace.go:171","msg":"trace[342517059] transaction","detail":"{read_only:false; response_revision:528; number_of_response:1; }","duration":"112.758954ms","start":"2026-09-16T21:36:52.208891Z","end":"2026-09-16T21:36:52.32165Z","steps":["trace[342517059] 'process raft request'  (duration: 111.220547ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:59.08857Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"300.988476ms","expected-duration":"100ms","prefix":"","request":"header:<ID:13541937790782496813 > lease_revoke:<id:3beea0ac26075efa>","response":"size:28"}
{"level":"info","ts":"2026-09-16T21:36:59.088714Z","caller":"traceutil/trace.go:171","msg":"trace[98084339] linearizableReadLoop","detail":"{readStateIndex:633; appliedIndex:632; }","duration":"439.469049ms","start":"2026-09-16T21:36:58.649224Z","end":"2026-09-16T21:36:59.088693Z","steps":["trace[98084339] 'read index received'  (duration: 138.375989ms)","trace[98084339] 'applied index is now lower than readState.Index'  (duration: 301.091429ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:36:59.088955Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"439.714627ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"info","ts":"2026-09-16T21:36:59.089005Z","caller":"traceutil/trace.go:171","msg":"trace[1477447851] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:605; }","duration":"439.820041ms","start":"2026-09-16T21:36:58.649171Z","end":"2026-09-16T21:36:59.088991Z","steps":["trace[1477447851] 'agreement among raft nodes before linearized reading'  (duration: 439.605703ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:59.089085Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:58.649146Z","time spent":"439.928445ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"info","ts":"2026-09-16T21:36:59.196785Z","caller":"traceutil/trace.go:171","msg":"trace[486635516] transaction","detail":"{read_only:false; response_revision:606; number_of_response:1; }","duration":"334.371968ms","start":"2026-09-16T21:36:58.862395Z","end":"2026-09-16T21:36:59.196767Z","steps":["trace[486635516] 'process raft request'  (duration: 332.591826ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:36:59.196774Z","caller":"traceutil/trace.go:171","msg":"trace[1013127229] linearizableReadLoop","detail":"{readStateIndex:634; appliedIndex:633; }","duration":"107.973638ms","start":"2026-09-16T21:36:59.088745Z","end":"2026-09-16T21:36:59.196719Z","steps":["trace[1013127229] 'read index received'  (duration: 103.000184ms)","trace[1013127229] 'applied index is now lower than readState.Index'  (duration: 4.972454ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:36:59.196958Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.550432ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-pqcnj\" ","response":"range_response_count:1 size:16965"}
{"level":"info","ts":"2026-09-16T21:36:59.197002Z","caller":"traceutil/trace.go:171","msg":"trace[739935200] range","detail":"{range_begin:/registry/pods/kube-system/cilium-pqcnj; range_end:; response_count:1; response_revision:606; }","duration":"253.643586ms","start":"2026-09-16T21:36:58.943348Z","end":"2026-09-16T21:36:59.196991Z","steps":["trace[739935200] 'agreement among raft nodes before linearized reading'  (duration: 253.47002ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:59.197188Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:58.862369Z","time spent":"334.464901ms","remote":"127.0.0.1:55774","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036305,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" mod_revision:601 > success:<request_put:<key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" value_size:1036221 >> failure:<request_range:<key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" > >"}
{"level":"warn","ts":"2026-09-16T21:36:59.602646Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.145073ms","expected-duration":"100ms","prefix":"","request":"header:<ID:13541937790782496816 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:591 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-16T21:36:59.602776Z","caller":"traceutil/trace.go:171","msg":"trace[1805745025] linearizableReadLoop","detail":"{readStateIndex:635; appliedIndex:634; }","duration":"405.781888ms","start":"2026-09-16T21:36:59.196951Z","end":"2026-09-16T21:36:59.602733Z","steps":["trace[1805745025] 'read index received'  (duration: 213.297853ms)","trace[1805745025] 'applied index is now lower than readState.Index'  (duration: 192.482965ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:36:59.602794Z","caller":"traceutil/trace.go:171","msg":"trace[1465827921] transaction","detail":"{read_only:false; response_revision:607; number_of_response:1; }","duration":"508.398598ms","start":"2026-09-16T21:36:59.094366Z","end":"2026-09-16T21:36:59.602765Z","steps":["trace[1465827921] 'process raft request'  (duration: 315.798029ms)","trace[1465827921] 'compare'  (duration: 191.996438ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:36:59.602955Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:59.094336Z","time spent":"508.524782ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:591 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"warn","ts":"2026-09-16T21:36:59.603291Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"490.390108ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-09-16T21:36:59.603343Z","caller":"traceutil/trace.go:171","msg":"trace[303175574] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:607; }","duration":"490.494402ms","start":"2026-09-16T21:36:59.112837Z","end":"2026-09-16T21:36:59.603331Z","steps":["trace[303175574] 'agreement among raft nodes before linearized reading'  (duration: 490.008315ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:59.603375Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:59.1128Z","time spent":"490.566074ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"info","ts":"2026-09-16T21:36:59.623675Z","caller":"traceutil/trace.go:171","msg":"trace[1782454991] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"411.203317ms","start":"2026-09-16T21:36:59.212364Z","end":"2026-09-16T21:36:59.623568Z","steps":["trace[1782454991] 'process raft request'  (duration: 410.983999ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:59.623882Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:59.212342Z","time spent":"411.455876ms","remote":"127.0.0.1:55860","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/cilium-pqcnj\" mod_revision:486 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-pqcnj\" value_size:17085 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-pqcnj\" > >"}
{"level":"info","ts":"2026-09-16T21:36:59.623965Z","caller":"traceutil/trace.go:171","msg":"trace[302532936] transaction","detail":"{read_only:false; response_revision:609; number_of_response:1; }","duration":"379.955834ms","start":"2026-09-16T21:36:59.243932Z","end":"2026-09-16T21:36:59.623888Z","steps":["trace[302532936] 'process raft request'  (duration: 379.55253ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:36:59.624149Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:59.243914Z","time spent":"380.138521ms","remote":"127.0.0.1:55900","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":39,"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":"info","ts":"2026-09-16T21:37:00.424861Z","caller":"traceutil/trace.go:171","msg":"trace[2077084823] linearizableReadLoop","detail":"{readStateIndex:640; appliedIndex:639; }","duration":"270.889195ms","start":"2026-09-16T21:37:00.153945Z","end":"2026-09-16T21:37:00.424834Z","steps":["trace[2077084823] 'read index received'  (duration: 235.861201ms)","trace[2077084823] 'applied index is now lower than readState.Index'  (duration: 35.027134ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:37:00.425039Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"271.084281ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:37:00.425066Z","caller":"traceutil/trace.go:171","msg":"trace[1768814671] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:612; }","duration":"271.128053ms","start":"2026-09-16T21:37:00.15393Z","end":"2026-09-16T21:37:00.425058Z","steps":["trace[1768814671] 'agreement among raft nodes before linearized reading'  (duration: 271.0371ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:37:00.42505Z","caller":"traceutil/trace.go:171","msg":"trace[1093230903] transaction","detail":"{read_only:false; response_revision:612; number_of_response:1; }","duration":"739.652204ms","start":"2026-09-16T21:36:59.685363Z","end":"2026-09-16T21:37:00.425015Z","steps":["trace[1093230903] 'process raft request'  (duration: 704.524537ms)","trace[1093230903] 'compare'  (duration: 34.548307ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:37:00.42518Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:36:59.685331Z","time spent":"739.781849ms","remote":"127.0.0.1:55860","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2735,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-c4v8l\" mod_revision:0 > success:<request_put:<key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-c4v8l\" value_size:2651 >> failure:<>"}
{"level":"info","ts":"2026-09-16T21:38:08.483805Z","caller":"traceutil/trace.go:171","msg":"trace[766780065] transaction","detail":"{read_only:false; response_revision:1431; number_of_response:1; }","duration":"123.187625ms","start":"2026-09-16T21:38:08.360596Z","end":"2026-09-16T21:38:08.483783Z","steps":["trace[766780065] 'process raft request'  (duration: 123.036232ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:20.448268Z","caller":"traceutil/trace.go:171","msg":"trace[347142164] linearizableReadLoop","detail":"{readStateIndex:1723; appliedIndex:1722; }","duration":"136.395161ms","start":"2026-09-16T21:38:20.311856Z","end":"2026-09-16T21:38:20.448251Z","steps":["trace[347142164] 'read index received'  (duration: 67.856389ms)","trace[347142164] 'applied index is now lower than readState.Index'  (duration: 68.537892ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:38:20.448346Z","caller":"traceutil/trace.go:171","msg":"trace[76729519] transaction","detail":"{read_only:false; response_revision:1657; number_of_response:1; }","duration":"138.824918ms","start":"2026-09-16T21:38:20.309515Z","end":"2026-09-16T21:38:20.44834Z","steps":["trace[76729519] 'process raft request'  (duration: 70.260745ms)","trace[76729519] 'compare'  (duration: 68.383749ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:38:20.448457Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.583714ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusterrestores/\" range_end:\"/registry/pxc.percona.com/perconaxtradbclusterrestores0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:38:20.448483Z","caller":"traceutil/trace.go:171","msg":"trace[1467800338] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusterrestores/; range_end:/registry/pxc.percona.com/perconaxtradbclusterrestores0; response_count:0; response_revision:1657; }","duration":"136.746258ms","start":"2026-09-16T21:38:20.31173Z","end":"2026-09-16T21:38:20.448476Z","steps":["trace[1467800338] 'agreement among raft nodes before linearized reading'  (duration: 136.687007ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:38:20.449198Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.545757ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/exchanges/\" range_end:\"/registry/rabbitmq.com/exchanges0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:38:20.449226Z","caller":"traceutil/trace.go:171","msg":"trace[386015033] range","detail":"{range_begin:/registry/rabbitmq.com/exchanges/; range_end:/registry/rabbitmq.com/exchanges0; response_count:0; response_revision:1658; }","duration":"121.609508ms","start":"2026-09-16T21:38:20.32761Z","end":"2026-09-16T21:38:20.449219Z","steps":["trace[386015033] 'agreement among raft nodes before linearized reading'  (duration: 121.553607ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:38:20.450003Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.553851ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/bindings/\" range_end:\"/registry/rabbitmq.com/bindings0\" limit:500 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:38:20.45003Z","caller":"traceutil/trace.go:171","msg":"trace[1582312068] range","detail":"{range_begin:/registry/rabbitmq.com/bindings/; range_end:/registry/rabbitmq.com/bindings0; response_count:0; response_revision:1658; }","duration":"104.580872ms","start":"2026-09-16T21:38:20.345442Z","end":"2026-09-16T21:38:20.450023Z","steps":["trace[1582312068] 'agreement among raft nodes before linearized reading'  (duration: 104.542641ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:38:20.450139Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.310506ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/bindings/\" range_end:\"/registry/rabbitmq.com/bindings0\" limit:10000 ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:38:20.450168Z","caller":"traceutil/trace.go:171","msg":"trace[923746803] range","detail":"{range_begin:/registry/rabbitmq.com/bindings/; range_end:/registry/rabbitmq.com/bindings0; response_count:0; response_revision:1658; }","duration":"105.382348ms","start":"2026-09-16T21:38:20.344777Z","end":"2026-09-16T21:38:20.450159Z","steps":["trace[923746803] 'agreement among raft nodes before linearized reading'  (duration: 105.334427ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:38:20.450183Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.330737ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/bindings/\" range_end:\"/registry/rabbitmq.com/bindings0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:38:20.450218Z","caller":"traceutil/trace.go:171","msg":"trace[644488953] range","detail":"{range_begin:/registry/rabbitmq.com/bindings/; range_end:/registry/rabbitmq.com/bindings0; response_count:0; response_revision:1658; }","duration":"105.377837ms","start":"2026-09-16T21:38:20.34483Z","end":"2026-09-16T21:38:20.450207Z","steps":["trace[644488953] 'agreement among raft nodes before linearized reading'  (duration: 105.315066ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:38:20.450314Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.491625ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/exchanges/\" range_end:\"/registry/rabbitmq.com/exchanges0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:38:20.450341Z","caller":"traceutil/trace.go:171","msg":"trace[1597145410] range","detail":"{range_begin:/registry/rabbitmq.com/exchanges/; range_end:/registry/rabbitmq.com/exchanges0; response_count:0; response_revision:1658; }","duration":"122.523896ms","start":"2026-09-16T21:38:20.327807Z","end":"2026-09-16T21:38:20.450331Z","steps":["trace[1597145410] 'agreement among raft nodes before linearized reading'  (duration: 122.489565ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:20.783545Z","caller":"traceutil/trace.go:171","msg":"trace[1566332917] transaction","detail":"{read_only:false; response_revision:1660; number_of_response:1; }","duration":"161.38381ms","start":"2026-09-16T21:38:20.622139Z","end":"2026-09-16T21:38:20.783522Z","steps":["trace[1566332917] 'process raft request'  (duration: 153.808505ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:23.855787Z","caller":"traceutil/trace.go:171","msg":"trace[272961571] transaction","detail":"{read_only:false; response_revision:1687; number_of_response:1; }","duration":"136.377472ms","start":"2026-09-16T21:38:23.719373Z","end":"2026-09-16T21:38:23.855751Z","steps":["trace[272961571] 'process raft request'  (duration: 81.990516ms)","trace[272961571] 'compare'  (duration: 54.240193ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:38:26.056808Z","caller":"traceutil/trace.go:171","msg":"trace[626196811] transaction","detail":"{read_only:false; response_revision:1718; number_of_response:1; }","duration":"101.208086ms","start":"2026-09-16T21:38:25.955575Z","end":"2026-09-16T21:38:26.056783Z","steps":["trace[626196811] 'process raft request'  (duration: 79.289519ms)","trace[626196811] 'compare'  (duration: 20.488311ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:38:26.058452Z","caller":"traceutil/trace.go:171","msg":"trace[975048165] transaction","detail":"{read_only:false; response_revision:1720; number_of_response:1; }","duration":"102.779344ms","start":"2026-09-16T21:38:25.955638Z","end":"2026-09-16T21:38:26.058417Z","steps":["trace[975048165] 'process raft request'  (duration: 102.268395ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:26.058894Z","caller":"traceutil/trace.go:171","msg":"trace[1562745503] transaction","detail":"{read_only:false; response_revision:1721; number_of_response:1; }","duration":"103.170432ms","start":"2026-09-16T21:38:25.955708Z","end":"2026-09-16T21:38:26.058878Z","steps":["trace[1562745503] 'process raft request'  (duration: 102.321446ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:26.059043Z","caller":"traceutil/trace.go:171","msg":"trace[309165805] transaction","detail":"{read_only:false; response_revision:1724; number_of_response:1; }","duration":"102.897077ms","start":"2026-09-16T21:38:25.956126Z","end":"2026-09-16T21:38:26.059023Z","steps":["trace[309165805] 'process raft request'  (duration: 102.839756ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:26.059464Z","caller":"traceutil/trace.go:171","msg":"trace[1184596591] transaction","detail":"{read_only:false; response_revision:1723; number_of_response:1; }","duration":"103.392436ms","start":"2026-09-16T21:38:25.956057Z","end":"2026-09-16T21:38:26.059449Z","steps":["trace[1184596591] 'process raft request'  (duration: 102.841366ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:26.060116Z","caller":"traceutil/trace.go:171","msg":"trace[917631141] transaction","detail":"{read_only:false; response_revision:1722; number_of_response:1; }","duration":"104.048708ms","start":"2026-09-16T21:38:25.956045Z","end":"2026-09-16T21:38:26.060094Z","steps":["trace[917631141] 'process raft request'  (duration: 102.096092ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:33.595708Z","caller":"traceutil/trace.go:171","msg":"trace[455117754] linearizableReadLoop","detail":"{readStateIndex:1910; appliedIndex:1909; }","duration":"349.221139ms","start":"2026-09-16T21:38:33.246442Z","end":"2026-09-16T21:38:33.595663Z","steps":["trace[455117754] 'read index received'  (duration: 349.076817ms)","trace[455117754] 'applied index is now lower than readState.Index'  (duration: 143.132µs)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:38:33.595739Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:38:33.245594Z","time spent":"350.139916ms","remote":"127.0.0.1:55708","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""}
{"level":"warn","ts":"2026-09-16T21:38:33.595923Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"349.470683ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-f3226a4a-40d5-4012-a0c1-857087ddc84a\" ","response":"range_response_count:1 size:3627"}
{"level":"info","ts":"2026-09-16T21:38:33.595991Z","caller":"traceutil/trace.go:171","msg":"trace[1375207395] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-f3226a4a-40d5-4012-a0c1-857087ddc84a; range_end:; response_count:1; response_revision:1837; }","duration":"349.573855ms","start":"2026-09-16T21:38:33.246401Z","end":"2026-09-16T21:38:33.595975Z","steps":["trace[1375207395] 'agreement among raft nodes before linearized reading'  (duration: 349.389782ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:38:33.596027Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:38:33.243907Z","time spent":"352.110461ms","remote":"127.0.0.1:55860","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":1,"response size":3650,"request content":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-f3226a4a-40d5-4012-a0c1-857087ddc84a\" "}
{"level":"warn","ts":"2026-09-16T21:38:33.596183Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"185.858447ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/openstack/datadir-percona-xtradb-pxc-0.18d5eae87c3eadd9\" ","response":"range_response_count:1 size:982"}
{"level":"info","ts":"2026-09-16T21:38:33.596247Z","caller":"traceutil/trace.go:171","msg":"trace[1680171788] range","detail":"{range_begin:/registry/events/openstack/datadir-percona-xtradb-pxc-0.18d5eae87c3eadd9; range_end:; response_count:1; response_revision:1837; }","duration":"185.934458ms","start":"2026-09-16T21:38:33.410285Z","end":"2026-09-16T21:38:33.596219Z","steps":["trace[1680171788] 'agreement among raft nodes before linearized reading'  (duration: 185.816666ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:38:33.596671Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"183.065887ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-f3226a4a-40d5-4012-a0c1-857087ddc84a\" ","response":"range_response_count:1 size:3627"}
{"level":"info","ts":"2026-09-16T21:38:33.59674Z","caller":"traceutil/trace.go:171","msg":"trace[83520034] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-f3226a4a-40d5-4012-a0c1-857087ddc84a; range_end:; response_count:1; response_revision:1837; }","duration":"183.149618ms","start":"2026-09-16T21:38:33.413577Z","end":"2026-09-16T21:38:33.596726Z","steps":["trace[83520034] 'agreement among raft nodes before linearized reading'  (duration: 182.976545ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:39.952364Z","caller":"traceutil/trace.go:171","msg":"trace[2065446620] transaction","detail":"{read_only:false; response_revision:1904; number_of_response:1; }","duration":"108.101948ms","start":"2026-09-16T21:38:39.844226Z","end":"2026-09-16T21:38:39.952328Z","steps":["trace[2065446620] 'process raft request'  (duration: 107.786963ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:38:46.415952Z","caller":"traceutil/trace.go:171","msg":"trace[1851213128] transaction","detail":"{read_only:false; response_revision:1942; number_of_response:1; }","duration":"193.683499ms","start":"2026-09-16T21:38:46.222219Z","end":"2026-09-16T21:38:46.415902Z","steps":["trace[1851213128] 'process raft request'  (duration: 193.490565ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:39:06.958005Z","caller":"traceutil/trace.go:171","msg":"trace[1174125235] transaction","detail":"{read_only:false; response_revision:2073; number_of_response:1; }","duration":"173.073305ms","start":"2026-09-16T21:39:06.784895Z","end":"2026-09-16T21:39:06.957968Z","steps":["trace[1174125235] 'process raft request'  (duration: 162.10806ms)","trace[1174125235] 'compare'  (duration: 10.832543ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:39:12.714691Z","caller":"traceutil/trace.go:171","msg":"trace[1411682089] linearizableReadLoop","detail":"{readStateIndex:2181; appliedIndex:2180; }","duration":"117.828731ms","start":"2026-09-16T21:39:12.59684Z","end":"2026-09-16T21:39:12.714668Z","steps":["trace[1411682089] 'read index received'  (duration: 117.711559ms)","trace[1411682089] 'applied index is now lower than readState.Index'  (duration: 116.132µs)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:39:12.714893Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.048335ms","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-09-16T21:39:12.714952Z","caller":"traceutil/trace.go:171","msg":"trace[1974594084] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2100; }","duration":"118.159196ms","start":"2026-09-16T21:39:12.596782Z","end":"2026-09-16T21:39:12.714941Z","steps":["trace[1974594084] 'agreement among raft nodes before linearized reading'  (duration: 118.004814ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:39:12.714852Z","caller":"traceutil/trace.go:171","msg":"trace[1811659552] transaction","detail":"{read_only:false; response_revision:2100; number_of_response:1; }","duration":"155.337221ms","start":"2026-09-16T21:39:12.559426Z","end":"2026-09-16T21:39:12.714763Z","steps":["trace[1811659552] 'process raft request'  (duration: 155.127437ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:39:12.893343Z","caller":"traceutil/trace.go:171","msg":"trace[1237275767] transaction","detail":"{read_only:false; response_revision:2101; number_of_response:1; }","duration":"174.755336ms","start":"2026-09-16T21:39:12.718564Z","end":"2026-09-16T21:39:12.893319Z","steps":["trace[1237275767] 'process raft request'  (duration: 174.577154ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:39:12.914591Z","caller":"traceutil/trace.go:171","msg":"trace[1108972543] linearizableReadLoop","detail":"{readStateIndex:2184; appliedIndex:2181; }","duration":"173.09455ms","start":"2026-09-16T21:39:12.741476Z","end":"2026-09-16T21:39:12.914571Z","steps":["trace[1108972543] 'read index received'  (duration: 151.627793ms)","trace[1108972543] 'applied index is now lower than readState.Index'  (duration: 21.465957ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:39:12.914762Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.267093ms","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-09-16T21:39:12.914782Z","caller":"traceutil/trace.go:171","msg":"trace[342687620] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2104; }","duration":"173.347004ms","start":"2026-09-16T21:39:12.741427Z","end":"2026-09-16T21:39:12.914774Z","steps":["trace[342687620] 'agreement among raft nodes before linearized reading'  (duration: 173.215251ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:39:12.915044Z","caller":"traceutil/trace.go:171","msg":"trace[1257510533] transaction","detail":"{read_only:false; response_revision:2102; number_of_response:1; }","duration":"195.684225ms","start":"2026-09-16T21:39:12.719354Z","end":"2026-09-16T21:39:12.915038Z","steps":["trace[1257510533] 'process raft request'  (duration: 195.047055ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:39:12.915125Z","caller":"traceutil/trace.go:171","msg":"trace[549761064] transaction","detail":"{read_only:false; response_revision:2103; number_of_response:1; }","duration":"195.501992ms","start":"2026-09-16T21:39:12.719617Z","end":"2026-09-16T21:39:12.915119Z","steps":["trace[549761064] 'process raft request'  (duration: 194.901852ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:13.91906Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"721.302923ms","expected-duration":"100ms","prefix":"","request":"header:<ID:13541937790782499909 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:2092 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-16T21:39:13.919214Z","caller":"traceutil/trace.go:171","msg":"trace[1354469584] linearizableReadLoop","detail":"{readStateIndex:2186; appliedIndex:2185; }","duration":"936.861472ms","start":"2026-09-16T21:39:12.982327Z","end":"2026-09-16T21:39:13.919189Z","steps":["trace[1354469584] 'read index received'  (duration: 215.217134ms)","trace[1354469584] 'applied index is now lower than readState.Index'  (duration: 721.642698ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:39:13.919612Z","caller":"traceutil/trace.go:171","msg":"trace[6766579] transaction","detail":"{read_only:false; response_revision:2105; number_of_response:1; }","duration":"1.000874378s","start":"2026-09-16T21:39:12.918717Z","end":"2026-09-16T21:39:13.919591Z","steps":["trace[6766579] 'process raft request'  (duration: 278.938574ms)","trace[6766579] 'compare'  (duration: 721.003889ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:39:13.919718Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:12.918693Z","time spent":"1.00097212s","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:2092 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"warn","ts":"2026-09-16T21:39:13.920084Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"937.762416ms","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-09-16T21:39:13.920138Z","caller":"traceutil/trace.go:171","msg":"trace[1689153839] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2105; }","duration":"937.880318ms","start":"2026-09-16T21:39:12.982243Z","end":"2026-09-16T21:39:13.920124Z","steps":["trace[1689153839] 'agreement among raft nodes before linearized reading'  (duration: 937.693295ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:13.920186Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:12.982217Z","time spent":"937.95758ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "}
{"level":"warn","ts":"2026-09-16T21:39:13.920341Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"684.881622ms","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-09-16T21:39:13.920405Z","caller":"traceutil/trace.go:171","msg":"trace[1964700725] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2105; }","duration":"684.989794ms","start":"2026-09-16T21:39:13.235398Z","end":"2026-09-16T21:39:13.920388Z","steps":["trace[1964700725] 'agreement among raft nodes before linearized reading'  (duration: 684.794141ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:13.920454Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:13.235372Z","time spent":"685.069915ms","remote":"127.0.0.1:45504","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":5467,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" "}
{"level":"warn","ts":"2026-09-16T21:39:13.920709Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"675.726239ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.114\" ","response":"range_response_count:1 size:135"}
{"level":"info","ts":"2026-09-16T21:39:13.920769Z","caller":"traceutil/trace.go:171","msg":"trace[10394098] range","detail":"{range_begin:/registry/masterleases/162.253.55.114; range_end:; response_count:1; response_revision:2105; }","duration":"675.841351ms","start":"2026-09-16T21:39:13.244913Z","end":"2026-09-16T21:39:13.920754Z","steps":["trace[10394098] 'agreement among raft nodes before linearized reading'  (duration: 675.702459ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:13.920818Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:13.244879Z","time spent":"675.927232ms","remote":"127.0.0.1:55708","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":158,"request content":"key:\"/registry/masterleases/162.253.55.114\" "}
{"level":"warn","ts":"2026-09-16T21:39:13.921521Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"619.786163ms","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-09-16T21:39:13.921597Z","caller":"traceutil/trace.go:171","msg":"trace[1240210382] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2105; }","duration":"619.914494ms","start":"2026-09-16T21:39:13.301673Z","end":"2026-09-16T21:39:13.921588Z","steps":["trace[1240210382] 'agreement among raft nodes before linearized reading'  (duration: 618.724915ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:13.921674Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:13.301641Z","time spent":"619.976646ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"info","ts":"2026-09-16T21:39:14.374513Z","caller":"traceutil/trace.go:171","msg":"trace[1967927137] transaction","detail":"{read_only:false; response_revision:2107; number_of_response:1; }","duration":"447.01264ms","start":"2026-09-16T21:39:13.927482Z","end":"2026-09-16T21:39:14.374495Z","steps":["trace[1967927137] 'process raft request'  (duration: 446.97718ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:14.374659Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:13.927451Z","time spent":"447.148642ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:2094 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-09-16T21:39:14.374845Z","caller":"traceutil/trace.go:171","msg":"trace[308796719] transaction","detail":"{read_only:false; response_revision:2106; number_of_response:1; }","duration":"447.472037ms","start":"2026-09-16T21:39:13.927316Z","end":"2026-09-16T21:39:14.374788Z","steps":["trace[308796719] 'process raft request'  (duration: 447.00575ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:14.375079Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:13.927218Z","time spent":"447.729842ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:2096 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:430 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-09-16T21:39:14.536411Z","caller":"traceutil/trace.go:171","msg":"trace[2063459651] linearizableReadLoop","detail":"{readStateIndex:2190; appliedIndex:2187; }","duration":"381.229478ms","start":"2026-09-16T21:39:14.155156Z","end":"2026-09-16T21:39:14.536386Z","steps":["trace[2063459651] 'read index received'  (duration: 219.238867ms)","trace[2063459651] 'applied index is now lower than readState.Index'  (duration: 161.988611ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:39:14.536438Z","caller":"traceutil/trace.go:171","msg":"trace[1852847970] transaction","detail":"{read_only:false; response_revision:2108; number_of_response:1; }","duration":"517.979926ms","start":"2026-09-16T21:39:14.018424Z","end":"2026-09-16T21:39:14.536404Z","steps":["trace[1852847970] 'process raft request'  (duration: 462.454428ms)","trace[1852847970] 'compare'  (duration: 55.262894ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:39:14.536579Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"381.401531ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-09-16T21:39:14.536628Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:14.018394Z","time spent":"518.109387ms","remote":"127.0.0.1:55708","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/masterleases/162.253.55.114\" mod_revision:2053 > success:<request_put:<key:\"/registry/masterleases/162.253.55.114\" value_size:67 lease:4318565753927724104 >> failure:<request_range:<key:\"/registry/masterleases/162.253.55.114\" > >"}
{"level":"info","ts":"2026-09-16T21:39:14.536667Z","caller":"traceutil/trace.go:171","msg":"trace[279193752] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2108; }","duration":"381.544883ms","start":"2026-09-16T21:39:14.155103Z","end":"2026-09-16T21:39:14.536648Z","steps":["trace[279193752] 'agreement among raft nodes before linearized reading'  (duration: 381.3702ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:14.536699Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:14.155069Z","time spent":"381.625174ms","remote":"127.0.0.1:55666","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "}
{"level":"warn","ts":"2026-09-16T21:39:14.536719Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"378.211821ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:555"}
{"level":"info","ts":"2026-09-16T21:39:14.536764Z","caller":"traceutil/trace.go:171","msg":"trace[868905233] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2108; }","duration":"378.269282ms","start":"2026-09-16T21:39:14.158481Z","end":"2026-09-16T21:39:14.536751Z","steps":["trace[868905233] 'agreement among raft nodes before linearized reading'  (duration: 378.094899ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:39:14.536804Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:39:14.158419Z","time spent":"378.371914ms","remote":"127.0.0.1:55924","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":"info","ts":"2026-09-16T21:40:50.726859Z","caller":"traceutil/trace.go:171","msg":"trace[61072229] transaction","detail":"{read_only:false; response_revision:2727; number_of_response:1; }","duration":"246.232541ms","start":"2026-09-16T21:40:50.480577Z","end":"2026-09-16T21:40:50.72681Z","steps":["trace[61072229] 'process raft request'  (duration: 246.056574ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:40:50.756249Z","caller":"traceutil/trace.go:171","msg":"trace[2116643407] transaction","detail":"{read_only:false; response_revision:2728; number_of_response:1; }","duration":"231.343782ms","start":"2026-09-16T21:40:50.52487Z","end":"2026-09-16T21:40:50.756214Z","steps":["trace[2116643407] 'process raft request'  (duration: 231.024459ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:40:51.100464Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.637989ms","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-09-16T21:40:51.100533Z","caller":"traceutil/trace.go:171","msg":"trace[959029340] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/datadir-percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:2729; }","duration":"227.759544ms","start":"2026-09-16T21:40:50.872757Z","end":"2026-09-16T21:40:51.100517Z","steps":["trace[959029340] 'range keys from in-memory index tree'  (duration: 227.43221ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:40:51.100916Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.46648ms","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-09-16T21:40:51.100982Z","caller":"traceutil/trace.go:171","msg":"trace[1938927159] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2729; }","duration":"182.573724ms","start":"2026-09-16T21:40:50.918395Z","end":"2026-09-16T21:40:51.100968Z","steps":["trace[1938927159] 'range keys from in-memory index tree'  (duration: 182.336475ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:40:51.101155Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.552597ms","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-09-16T21:40:51.10118Z","caller":"traceutil/trace.go:171","msg":"trace[743929618] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2729; }","duration":"102.576978ms","start":"2026-09-16T21:40:50.998596Z","end":"2026-09-16T21:40:51.101173Z","steps":["trace[743929618] 'range keys from in-memory index tree'  (duration: 102.428221ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:40:51.343536Z","caller":"traceutil/trace.go:171","msg":"trace[426508026] transaction","detail":"{read_only:false; response_revision:2730; number_of_response:1; }","duration":"238.457791ms","start":"2026-09-16T21:40:51.105051Z","end":"2026-09-16T21:40:51.343509Z","steps":["trace[426508026] 'process raft request'  (duration: 238.340376ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:40:51.414804Z","caller":"traceutil/trace.go:171","msg":"trace[2062149853] transaction","detail":"{read_only:false; response_revision:2732; number_of_response:1; }","duration":"309.090746ms","start":"2026-09-16T21:40:51.105691Z","end":"2026-09-16T21:40:51.414781Z","steps":["trace[2062149853] 'process raft request'  (duration: 309.029823ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:40:51.414995Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:40:51.105681Z","time spent":"309.194179ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:2718 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:430 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-09-16T21:40:51.415282Z","caller":"traceutil/trace.go:171","msg":"trace[1162419491] transaction","detail":"{read_only:false; response_revision:2731; number_of_response:1; }","duration":"309.851407ms","start":"2026-09-16T21:40:51.105179Z","end":"2026-09-16T21:40:51.41503Z","steps":["trace[1162419491] 'process raft request'  (duration: 301.826425ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:40:51.415418Z","caller":"traceutil/trace.go:171","msg":"trace[2056993764] linearizableReadLoop","detail":"{readStateIndex:2836; appliedIndex:2834; }","duration":"259.536493ms","start":"2026-09-16T21:40:51.155666Z","end":"2026-09-16T21:40:51.415202Z","steps":["trace[2056993764] 'read index received'  (duration: 188.627628ms)","trace[2056993764] 'applied index is now lower than readState.Index'  (duration: 70.908055ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:40:51.415505Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"259.830746ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-09-16T21:40:51.415504Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-16T21:40:51.105163Z","time spent":"310.246833ms","remote":"127.0.0.1:55924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:2719 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:464 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >"}
{"level":"info","ts":"2026-09-16T21:40:51.415317Z","caller":"traceutil/trace.go:171","msg":"trace[1919314737] transaction","detail":"{read_only:false; response_revision:2733; number_of_response:1; }","duration":"125.183592ms","start":"2026-09-16T21:40:51.290114Z","end":"2026-09-16T21:40:51.415298Z","steps":["trace[1919314737] 'process raft request'  (duration: 124.717263ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:40:51.415553Z","caller":"traceutil/trace.go:171","msg":"trace[555090043] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2734; }","duration":"259.918859ms","start":"2026-09-16T21:40:51.15562Z","end":"2026-09-16T21:40:51.415539Z","steps":["trace[555090043] 'agreement among raft nodes before linearized reading'  (duration: 259.849326ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:40:51.416109Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"209.008052ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"info","ts":"2026-09-16T21:40:51.416157Z","caller":"traceutil/trace.go:171","msg":"trace[1793630077] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:2734; }","duration":"209.093656ms","start":"2026-09-16T21:40:51.20705Z","end":"2026-09-16T21:40:51.416143Z","steps":["trace[1793630077] 'agreement among raft nodes before linearized reading'  (duration: 208.962401ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:42:56.349813Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.123775ms","expected-duration":"100ms","prefix":"","request":"header:<ID:13541937790782503500 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:3368 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:429 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-16T21:42:56.349927Z","caller":"traceutil/trace.go:171","msg":"trace[29598932] linearizableReadLoop","detail":"{readStateIndex:3508; appliedIndex:3507; }","duration":"112.314234ms","start":"2026-09-16T21:42:56.237596Z","end":"2026-09-16T21:42:56.34991Z","steps":["trace[29598932] 'read index received'  (duration: 5.993564ms)","trace[29598932] 'applied index is now lower than readState.Index'  (duration: 106.31914ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:42:56.350067Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.477378ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/\" range_end:\"/registry/mutatingwebhookconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-09-16T21:42:56.350104Z","caller":"traceutil/trace.go:171","msg":"trace[1690241991] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/; range_end:/registry/mutatingwebhookconfigurations0; response_count:0; response_revision:3378; }","duration":"112.511309ms","start":"2026-09-16T21:42:56.237578Z","end":"2026-09-16T21:42:56.350089Z","steps":["trace[1690241991] 'agreement among raft nodes before linearized reading'  (duration: 112.418377ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:42:56.350065Z","caller":"traceutil/trace.go:171","msg":"trace[1927975011] transaction","detail":"{read_only:false; response_revision:3378; number_of_response:1; }","duration":"124.832827ms","start":"2026-09-16T21:42:56.225125Z","end":"2026-09-16T21:42:56.349958Z","steps":["trace[1927975011] 'process raft request'  (duration: 18.473486ms)","trace[1927975011] 'compare'  (duration: 105.915509ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:43:02.576771Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.002022ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"}
{"level":"info","ts":"2026-09-16T21:43:02.576848Z","caller":"traceutil/trace.go:171","msg":"trace[1057175190] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:3408; }","duration":"111.130225ms","start":"2026-09-16T21:43:02.465702Z","end":"2026-09-16T21:43:02.576832Z","steps":["trace[1057175190] 'range keys from in-memory index tree'  (duration: 110.768786ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:43:04.715099Z","caller":"traceutil/trace.go:171","msg":"trace[799659735] transaction","detail":"{read_only:false; response_revision:3420; number_of_response:1; }","duration":"108.881973ms","start":"2026-09-16T21:43:04.606187Z","end":"2026-09-16T21:43:04.715069Z","steps":["trace[799659735] 'process raft request'  (duration: 108.693739ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:43:04.730344Z","caller":"traceutil/trace.go:171","msg":"trace[242708327] linearizableReadLoop","detail":"{readStateIndex:3553; appliedIndex:3551; }","duration":"111.316475ms","start":"2026-09-16T21:43:04.619008Z","end":"2026-09-16T21:43:04.730325Z","steps":["trace[242708327] 'read index received'  (duration: 95.876816ms)","trace[242708327] 'applied index is now lower than readState.Index'  (duration: 15.432999ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:43:04.730526Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.51163ms","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-09-16T21:43:04.730473Z","caller":"traceutil/trace.go:171","msg":"trace[1299699769] transaction","detail":"{read_only:false; response_revision:3421; number_of_response:1; }","duration":"123.465321ms","start":"2026-09-16T21:43:04.606957Z","end":"2026-09-16T21:43:04.730423Z","steps":["trace[1299699769] 'process raft request'  (duration: 123.251396ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:43:04.730546Z","caller":"traceutil/trace.go:171","msg":"trace[282723603] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:3421; }","duration":"111.580441ms","start":"2026-09-16T21:43:04.618959Z","end":"2026-09-16T21:43:04.73054Z","steps":["trace[282723603] 'agreement among raft nodes before linearized reading'  (duration: 111.463928ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:43:06.236175Z","caller":"traceutil/trace.go:171","msg":"trace[1488823829] transaction","detail":"{read_only:false; response_revision:3426; number_of_response:1; }","duration":"113.818182ms","start":"2026-09-16T21:43:06.122319Z","end":"2026-09-16T21:43:06.236138Z","steps":["trace[1488823829] 'process raft request'  (duration: 113.556366ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:34.54641Z","caller":"traceutil/trace.go:171","msg":"trace[2070061910] transaction","detail":"{read_only:false; response_revision:4806; number_of_response:1; }","duration":"112.665142ms","start":"2026-09-16T21:45:34.433722Z","end":"2026-09-16T21:45:34.546388Z","steps":["trace[2070061910] 'process raft request'  (duration: 51.597486ms)","trace[2070061910] 'compare'  (duration: 60.556087ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:45:36.765213Z","caller":"traceutil/trace.go:171","msg":"trace[2098790296] transaction","detail":"{read_only:false; response_revision:4832; number_of_response:1; }","duration":"287.142724ms","start":"2026-09-16T21:45:36.478049Z","end":"2026-09-16T21:45:36.765191Z","steps":["trace[2098790296] 'process raft request'  (duration: 287.007111ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:36.813792Z","caller":"traceutil/trace.go:171","msg":"trace[1453337038] linearizableReadLoop","detail":"{readStateIndex:5019; appliedIndex:5017; }","duration":"143.671379ms","start":"2026-09-16T21:45:36.670096Z","end":"2026-09-16T21:45:36.813767Z","steps":["trace[1453337038] 'read index received'  (duration: 94.95023ms)","trace[1453337038] 'applied index is now lower than readState.Index'  (duration: 48.719859ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:45:36.814083Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.968604ms","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-09-16T21:45:36.814161Z","caller":"traceutil/trace.go:171","msg":"trace[1727722366] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4833; }","duration":"144.098007ms","start":"2026-09-16T21:45:36.670047Z","end":"2026-09-16T21:45:36.814145Z","steps":["trace[1727722366] 'agreement among raft nodes before linearized reading'  (duration: 143.846582ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:36.814346Z","caller":"traceutil/trace.go:171","msg":"trace[25653392] transaction","detail":"{read_only:false; response_revision:4833; number_of_response:1; }","duration":"217.784781ms","start":"2026-09-16T21:45:36.596077Z","end":"2026-09-16T21:45:36.813862Z","steps":["trace[25653392] 'process raft request'  (duration: 217.563887ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:45:36.856214Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.11532ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-2b4faf80-3d55-4374-a8a3-1fa55f3aaee6\" ","response":"range_response_count:1 size:4067"}
{"level":"info","ts":"2026-09-16T21:45:36.856498Z","caller":"traceutil/trace.go:171","msg":"trace[994613352] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-2b4faf80-3d55-4374-a8a3-1fa55f3aaee6; range_end:; response_count:1; response_revision:4834; }","duration":"184.422456ms","start":"2026-09-16T21:45:36.67205Z","end":"2026-09-16T21:45:36.856473Z","steps":["trace[994613352] 'agreement among raft nodes before linearized reading'  (duration: 183.712302ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:39.693526Z","caller":"traceutil/trace.go:171","msg":"trace[1753732417] linearizableReadLoop","detail":"{readStateIndex:5116; appliedIndex:5114; }","duration":"116.065756ms","start":"2026-09-16T21:45:39.577437Z","end":"2026-09-16T21:45:39.693503Z","steps":["trace[1753732417] 'read index received'  (duration: 33.580818ms)","trace[1753732417] 'applied index is now lower than readState.Index'  (duration: 82.484018ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:45:39.693668Z","caller":"traceutil/trace.go:171","msg":"trace[538922480] transaction","detail":"{read_only:false; response_revision:4926; number_of_response:1; }","duration":"144.25224ms","start":"2026-09-16T21:45:39.549404Z","end":"2026-09-16T21:45:39.693656Z","steps":["trace[538922480] 'process raft request'  (duration: 112.705021ms)","trace[538922480] 'compare'  (duration: 31.304635ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:45:39.694553Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.096495ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/monitoring/\" range_end:\"/registry/configmaps/monitoring0\" ","response":"range_response_count:47 size:2362739"}
{"level":"info","ts":"2026-09-16T21:45:39.694616Z","caller":"traceutil/trace.go:171","msg":"trace[1902687304] range","detail":"{range_begin:/registry/configmaps/monitoring/; range_end:/registry/configmaps/monitoring0; response_count:47; response_revision:4926; }","duration":"117.197046ms","start":"2026-09-16T21:45:39.577401Z","end":"2026-09-16T21:45:39.694598Z","steps":["trace[1902687304] 'agreement among raft nodes before linearized reading'  (duration: 116.189117ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:46.717068Z","caller":"traceutil/trace.go:171","msg":"trace[598587561] linearizableReadLoop","detail":"{readStateIndex:5171; appliedIndex:5170; }","duration":"213.413475ms","start":"2026-09-16T21:45:46.503628Z","end":"2026-09-16T21:45:46.717041Z","steps":["trace[598587561] 'read index received'  (duration: 213.211821ms)","trace[598587561] 'applied index is now lower than readState.Index'  (duration: 200.484µs)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:45:46.717133Z","caller":"traceutil/trace.go:171","msg":"trace[310926063] transaction","detail":"{read_only:false; response_revision:4979; number_of_response:1; }","duration":"216.345941ms","start":"2026-09-16T21:45:46.500758Z","end":"2026-09-16T21:45:46.717104Z","steps":["trace[310926063] 'process raft request'  (duration: 216.096236ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:45:46.717353Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"213.687761ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/monitoring/kube-prometheus-stack-grafana-59b49dd79-gqcll.18d5eb4d98f6a667\" ","response":"range_response_count:1 size:895"}
{"level":"warn","ts":"2026-09-16T21:45:46.717352Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.260259ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:45:46.71739Z","caller":"traceutil/trace.go:171","msg":"trace[1843523359] range","detail":"{range_begin:/registry/events/monitoring/kube-prometheus-stack-grafana-59b49dd79-gqcll.18d5eb4d98f6a667; range_end:; response_count:1; response_revision:4979; }","duration":"213.779752ms","start":"2026-09-16T21:45:46.503598Z","end":"2026-09-16T21:45:46.717378Z","steps":["trace[1843523359] 'agreement among raft nodes before linearized reading'  (duration: 213.602229ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:46.71741Z","caller":"traceutil/trace.go:171","msg":"trace[1184745429] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:4979; }","duration":"172.360421ms","start":"2026-09-16T21:45:46.545036Z","end":"2026-09-16T21:45:46.717396Z","steps":["trace[1184745429] 'agreement among raft nodes before linearized reading'  (duration: 172.230838ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:45:46.717561Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.284307ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/monitoring/alertmanager-kube-prometheus-stack-alertmanager-db-alertmanager-kube-prometheus-stack-alertmanager-0\" ","response":"range_response_count:1 size:1935"}
{"level":"info","ts":"2026-09-16T21:45:46.717633Z","caller":"traceutil/trace.go:171","msg":"trace[1487273965] range","detail":"{range_begin:/registry/persistentvolumeclaims/monitoring/alertmanager-kube-prometheus-stack-alertmanager-db-alertmanager-kube-prometheus-stack-alertmanager-0; range_end:; response_count:1; response_revision:4979; }","duration":"130.336528ms","start":"2026-09-16T21:45:46.587256Z","end":"2026-09-16T21:45:46.717592Z","steps":["trace[1487273965] 'agreement among raft nodes before linearized reading'  (duration: 130.091144ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:47.106279Z","caller":"traceutil/trace.go:171","msg":"trace[51329621] transaction","detail":"{read_only:false; response_revision:4989; number_of_response:1; }","duration":"172.008422ms","start":"2026-09-16T21:45:46.934251Z","end":"2026-09-16T21:45:47.10626Z","steps":["trace[51329621] 'process raft request'  (duration: 171.964561ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:47.106354Z","caller":"traceutil/trace.go:171","msg":"trace[2043286812] transaction","detail":"{read_only:false; response_revision:4988; number_of_response:1; }","duration":"178.020306ms","start":"2026-09-16T21:45:46.928301Z","end":"2026-09-16T21:45:47.106321Z","steps":["trace[2043286812] 'process raft request'  (duration: 177.7159ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:47.143608Z","caller":"traceutil/trace.go:171","msg":"trace[1561724055] transaction","detail":"{read_only:false; response_revision:4990; number_of_response:1; }","duration":"166.142321ms","start":"2026-09-16T21:45:46.977445Z","end":"2026-09-16T21:45:47.143587Z","steps":["trace[1561724055] 'process raft request'  (duration: 165.941168ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:47.145073Z","caller":"traceutil/trace.go:171","msg":"trace[209951918] transaction","detail":"{read_only:false; response_revision:4991; number_of_response:1; }","duration":"146.356908ms","start":"2026-09-16T21:45:46.998694Z","end":"2026-09-16T21:45:47.145051Z","steps":["trace[209951918] 'process raft request'  (duration: 144.847359ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:47.403103Z","caller":"traceutil/trace.go:171","msg":"trace[780835554] transaction","detail":"{read_only:false; response_revision:4998; number_of_response:1; }","duration":"167.791791ms","start":"2026-09-16T21:45:47.235286Z","end":"2026-09-16T21:45:47.403078Z","steps":["trace[780835554] 'process raft request'  (duration: 167.552747ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:59.653669Z","caller":"traceutil/trace.go:171","msg":"trace[1753673665] transaction","detail":"{read_only:false; response_revision:5198; number_of_response:1; }","duration":"125.11583ms","start":"2026-09-16T21:45:59.528531Z","end":"2026-09-16T21:45:59.653647Z","steps":["trace[1753673665] 'process raft request'  (duration: 124.936967ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:59.938331Z","caller":"traceutil/trace.go:171","msg":"trace[1323271959] transaction","detail":"{read_only:false; response_revision:5206; number_of_response:1; }","duration":"113.83549ms","start":"2026-09-16T21:45:59.824469Z","end":"2026-09-16T21:45:59.938304Z","steps":["trace[1323271959] 'process raft request'  (duration: 61.410583ms)","trace[1323271959] 'compare'  (duration: 52.136851ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:45:59.938827Z","caller":"traceutil/trace.go:171","msg":"trace[747381589] transaction","detail":"{read_only:false; response_revision:5207; number_of_response:1; }","duration":"114.192187ms","start":"2026-09-16T21:45:59.824605Z","end":"2026-09-16T21:45:59.938798Z","steps":["trace[747381589] 'process raft request'  (duration: 113.620676ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:59.939783Z","caller":"traceutil/trace.go:171","msg":"trace[384598914] transaction","detail":"{read_only:false; response_revision:5209; number_of_response:1; }","duration":"114.128575ms","start":"2026-09-16T21:45:59.825635Z","end":"2026-09-16T21:45:59.939763Z","steps":["trace[384598914] 'process raft request'  (duration: 113.118146ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:59.93896Z","caller":"traceutil/trace.go:171","msg":"trace[1258503011] transaction","detail":"{read_only:false; response_revision:5208; number_of_response:1; }","duration":"114.237867ms","start":"2026-09-16T21:45:59.824695Z","end":"2026-09-16T21:45:59.938933Z","steps":["trace[1258503011] 'process raft request'  (duration: 113.83815ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:45:59.940095Z","caller":"traceutil/trace.go:171","msg":"trace[516712587] transaction","detail":"{read_only:false; response_revision:5210; number_of_response:1; }","duration":"112.883072ms","start":"2026-09-16T21:45:59.8272Z","end":"2026-09-16T21:45:59.940083Z","steps":["trace[516712587] 'process raft request'  (duration: 112.182629ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:46:09.383023Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2824}
{"level":"info","ts":"2026-09-16T21:46:09.474766Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2824,"took":"90.287636ms","hash":1205480301,"current-db-size-bytes":52711424,"current-db-size":"53 MB","current-db-size-in-use-bytes":27860992,"current-db-size-in-use":"28 MB"}
{"level":"info","ts":"2026-09-16T21:46:09.474836Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1205480301,"revision":2824,"compact-revision":-1}
{"level":"warn","ts":"2026-09-16T21:49:17.395277Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.835045ms","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-09-16T21:49:17.395364Z","caller":"traceutil/trace.go:171","msg":"trace[1833226420] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:6672; }","duration":"199.998701ms","start":"2026-09-16T21:49:17.195348Z","end":"2026-09-16T21:49:17.395346Z","steps":["trace[1833226420] 'range keys from in-memory index tree'  (duration: 199.514672ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:49:17.3954Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"287.814155ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:556"}
{"level":"warn","ts":"2026-09-16T21:49:17.395514Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.302149ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:49:17.395537Z","caller":"traceutil/trace.go:171","msg":"trace[2142244562] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:6672; }","duration":"288.003373ms","start":"2026-09-16T21:49:17.107512Z","end":"2026-09-16T21:49:17.395515Z","steps":["trace[2142244562] 'range keys from in-memory index tree'  (duration: 287.605286ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:49:17.395588Z","caller":"traceutil/trace.go:171","msg":"trace[237877364] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6672; }","duration":"244.417034ms","start":"2026-09-16T21:49:17.151152Z","end":"2026-09-16T21:49:17.395569Z","steps":["trace[237877364] 'range keys from in-memory index tree'  (duration: 244.201965ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:49:17.396755Z","caller":"traceutil/trace.go:171","msg":"trace[356498867] transaction","detail":"{read_only:false; response_revision:6673; number_of_response:1; }","duration":"160.262288ms","start":"2026-09-16T21:49:17.236469Z","end":"2026-09-16T21:49:17.396731Z","steps":["trace[356498867] 'process raft request'  (duration: 160.127312ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:49:56.557396Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.487013ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12216"}
{"level":"info","ts":"2026-09-16T21:49:56.557509Z","caller":"traceutil/trace.go:171","msg":"trace[1170366700] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:6952; }","duration":"104.67088ms","start":"2026-09-16T21:49:56.452818Z","end":"2026-09-16T21:49:56.557489Z","steps":["trace[1170366700] 'range keys from in-memory index tree'  (duration: 104.294955ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:51:09.388895Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5275}
{"level":"info","ts":"2026-09-16T21:51:09.472453Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5275,"took":"82.154585ms","hash":3498876461,"current-db-size-bytes":52711424,"current-db-size":"53 MB","current-db-size-in-use-bytes":18747392,"current-db-size-in-use":"19 MB"}
{"level":"info","ts":"2026-09-16T21:51:09.472505Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3498876461,"revision":5275,"compact-revision":2824}
{"level":"info","ts":"2026-09-16T21:53:57.237808Z","caller":"traceutil/trace.go:171","msg":"trace[117611229] linearizableReadLoop","detail":"{readStateIndex:8509; appliedIndex:8508; }","duration":"107.616259ms","start":"2026-09-16T21:53:57.13017Z","end":"2026-09-16T21:53:57.237786Z","steps":["trace[117611229] 'read index received'  (duration: 91.041605ms)","trace[117611229] 'applied index is now lower than readState.Index'  (duration: 16.573874ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-16T21:53:57.237984Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.802144ms","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-09-16T21:53:57.237912Z","caller":"traceutil/trace.go:171","msg":"trace[564669188] transaction","detail":"{read_only:false; response_revision:8201; number_of_response:1; }","duration":"109.997961ms","start":"2026-09-16T21:53:57.127879Z","end":"2026-09-16T21:53:57.237877Z","steps":["trace[564669188] 'process raft request'  (duration: 93.404617ms)","trace[564669188] 'compare'  (duration: 16.41617ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:53:57.238021Z","caller":"traceutil/trace.go:171","msg":"trace[1805605263] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:8201; }","duration":"107.884066ms","start":"2026-09-16T21:53:57.130128Z","end":"2026-09-16T21:53:57.238012Z","steps":["trace[1805605263] 'agreement among raft nodes before linearized reading'  (duration: 107.762893ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:54:01.527277Z","caller":"traceutil/trace.go:171","msg":"trace[992769205] transaction","detail":"{read_only:false; response_revision:8223; number_of_response:1; }","duration":"122.877605ms","start":"2026-09-16T21:54:01.404313Z","end":"2026-09-16T21:54:01.52719Z","steps":["trace[992769205] 'process raft request'  (duration: 122.735802ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:54:01.570862Z","caller":"traceutil/trace.go:171","msg":"trace[2036916821] transaction","detail":"{read_only:false; response_revision:8224; number_of_response:1; }","duration":"134.369895ms","start":"2026-09-16T21:54:01.436463Z","end":"2026-09-16T21:54:01.570833Z","steps":["trace[2036916821] 'process raft request'  (duration: 119.178299ms)","trace[2036916821] 'compare'  (duration: 15.073103ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:54:31.872568Z","caller":"traceutil/trace.go:171","msg":"trace[82867207] transaction","detail":"{read_only:false; response_revision:8373; number_of_response:1; }","duration":"112.161259ms","start":"2026-09-16T21:54:31.760377Z","end":"2026-09-16T21:54:31.872538Z","steps":["trace[82867207] 'process raft request'  (duration: 111.964254ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:54:32.033618Z","caller":"traceutil/trace.go:171","msg":"trace[592475013] transaction","detail":"{read_only:false; response_revision:8375; number_of_response:1; }","duration":"108.740312ms","start":"2026-09-16T21:54:31.924849Z","end":"2026-09-16T21:54:32.033589Z","steps":["trace[592475013] 'process raft request'  (duration: 108.544307ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-16T21:54:32.095449Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.52593ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/acme.cert-manager.io/challenges/\" range_end:\"/registry/acme.cert-manager.io/challenges0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-16T21:54:32.095504Z","caller":"traceutil/trace.go:171","msg":"trace[365350634] range","detail":"{range_begin:/registry/acme.cert-manager.io/challenges/; range_end:/registry/acme.cert-manager.io/challenges0; response_count:0; response_revision:8376; }","duration":"126.590072ms","start":"2026-09-16T21:54:31.9689Z","end":"2026-09-16T21:54:32.09549Z","steps":["trace[365350634] 'agreement among raft nodes before linearized reading'  (duration: 126.461778ms)"],"step_count":1}
{"level":"info","ts":"2026-09-16T21:54:32.095674Z","caller":"traceutil/trace.go:171","msg":"trace[1344498790] transaction","detail":"{read_only:false; response_revision:8376; number_of_response:1; }","duration":"112.885505ms","start":"2026-09-16T21:54:31.982767Z","end":"2026-09-16T21:54:32.095652Z","steps":["trace[1344498790] 'process raft request'  (duration: 87.918484ms)","trace[1344498790] 'compare'  (duration: 24.56367ms)"],"step_count":2}
{"level":"info","ts":"2026-09-16T21:56:09.396494Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":7354}
{"level":"info","ts":"2026-09-16T21:56:09.463943Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":7354,"took":"62.774125ms","hash":4292482755,"current-db-size-bytes":52711424,"current-db-size":"53 MB","current-db-size-in-use-bytes":15446016,"current-db-size-in-use":"15 MB"}
{"level":"info","ts":"2026-09-16T21:56:09.464009Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":4292482755,"revision":7354,"compact-revision":5275}