{"level":"warn","ts":"2026-08-19T20:28:14.56318Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-08-19T20:28:14.563252Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.61:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.61:2380","--initial-cluster=instance=https://199.19.213.61:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.61:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.61: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-08-19T20:28:14.563313Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-08-19T20:28:14.563326Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.61:2380"]}
{"level":"info","ts":"2026-08-19T20:28:14.563342Z","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-08-19T20:28:14.563976Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.61:2379"]}
{"level":"info","ts":"2026-08-19T20:28:14.564049Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":16,"max-cpu-available":16,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.61:2380"],"listen-peer-urls":["https://199.19.213.61:2380"],"advertise-client-urls":["https://199.19.213.61:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.61:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.61: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-08-19T20:28:14.568522Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.283622ms"}
{"level":"info","ts":"2026-08-19T20:28:14.575875Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"d1484a2210d3c2b8","cluster-id":"27fc2dec3fac595c"}
{"level":"info","ts":"2026-08-19T20:28:14.575949Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 switched to configuration voters=()"}
{"level":"info","ts":"2026-08-19T20:28:14.575972Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 became follower at term 0"}
{"level":"info","ts":"2026-08-19T20:28:14.575982Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft d1484a2210d3c2b8 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-08-19T20:28:14.575991Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 became follower at term 1"}
{"level":"info","ts":"2026-08-19T20:28:14.576024Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 switched to configuration voters=(15080384862421762744)"}
{"level":"warn","ts":"2026-08-19T20:28:14.587286Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-08-19T20:28:14.588757Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-08-19T20:28:14.589884Z","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-08-19T20:28:14.59208Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"d1484a2210d3c2b8","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-08-19T20:28:14.592396Z","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-08-19T20:28:14.592502Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"d1484a2210d3c2b8","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-08-19T20:28:14.592675Z","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-08-19T20:28:14.593347Z","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-08-19T20:28:14.59392Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 switched to configuration voters=(15080384862421762744)"}
{"level":"info","ts":"2026-08-19T20:28:14.594828Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"27fc2dec3fac595c","local-member-id":"d1484a2210d3c2b8","added-peer-id":"d1484a2210d3c2b8","added-peer-peer-urls":["https://199.19.213.61:2380"]}
{"level":"info","ts":"2026-08-19T20:28:14.59742Z","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-08-19T20:28:14.597581Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.61:2380"}
{"level":"info","ts":"2026-08-19T20:28:14.597648Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.61:2380"}
{"level":"info","ts":"2026-08-19T20:28:14.598023Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"d1484a2210d3c2b8","initial-advertise-peer-urls":["https://199.19.213.61:2380"],"listen-peer-urls":["https://199.19.213.61:2380"],"advertise-client-urls":["https://199.19.213.61:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.61:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-08-19T20:28:14.598083Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-08-19T20:28:15.376974Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 is starting a new election at term 1"}
{"level":"info","ts":"2026-08-19T20:28:15.377034Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 became pre-candidate at term 1"}
{"level":"info","ts":"2026-08-19T20:28:15.377075Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 received MsgPreVoteResp from d1484a2210d3c2b8 at term 1"}
{"level":"info","ts":"2026-08-19T20:28:15.377098Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 became candidate at term 2"}
{"level":"info","ts":"2026-08-19T20:28:15.377115Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 received MsgVoteResp from d1484a2210d3c2b8 at term 2"}
{"level":"info","ts":"2026-08-19T20:28:15.37714Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"d1484a2210d3c2b8 became leader at term 2"}
{"level":"info","ts":"2026-08-19T20:28:15.377167Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: d1484a2210d3c2b8 elected leader d1484a2210d3c2b8 at term 2"}
{"level":"info","ts":"2026-08-19T20:28:15.378208Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-08-19T20:28:15.379155Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"d1484a2210d3c2b8","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.61:2379]}","request-path":"/0/members/d1484a2210d3c2b8/attributes","cluster-id":"27fc2dec3fac595c","publish-timeout":"7s"}
{"level":"info","ts":"2026-08-19T20:28:15.37937Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-08-19T20:28:15.379411Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-08-19T20:28:15.379428Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-08-19T20:28:15.379324Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-08-19T20:28:15.37978Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"27fc2dec3fac595c","local-member-id":"d1484a2210d3c2b8","cluster-version":"3.5"}
{"level":"info","ts":"2026-08-19T20:28:15.380017Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-08-19T20:28:15.380079Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-08-19T20:28:15.382834Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.61:2379"}
{"level":"info","ts":"2026-08-19T20:28:15.383106Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-08-19T20:28:35.462732Z","caller":"traceutil/trace.go:171","msg":"trace[1709283528] transaction","detail":"{read_only:false; response_revision:383; number_of_response:1; }","duration":"162.072784ms","start":"2026-08-19T20:28:35.300636Z","end":"2026-08-19T20:28:35.462708Z","steps":["trace[1709283528] 'process raft request'  (duration: 161.90564ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:28:40.944497Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.822073ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"warn","ts":"2026-08-19T20:28:40.944488Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.446177ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"}
{"level":"info","ts":"2026-08-19T20:28:40.944599Z","caller":"traceutil/trace.go:171","msg":"trace[942739915] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:424; }","duration":"100.942145ms","start":"2026-08-19T20:28:40.843638Z","end":"2026-08-19T20:28:40.94458Z","steps":["trace[942739915] 'range keys from in-memory index tree'  (duration: 100.756501ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:28:40.944604Z","caller":"traceutil/trace.go:171","msg":"trace[1061064958] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:424; }","duration":"101.616181ms","start":"2026-08-19T20:28:40.842969Z","end":"2026-08-19T20:28:40.944586Z","steps":["trace[1061064958] 'range keys from in-memory index tree'  (duration: 101.341425ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:28:51.032751Z","caller":"traceutil/trace.go:171","msg":"trace[1416094991] transaction","detail":"{read_only:false; response_revision:484; number_of_response:1; }","duration":"102.120052ms","start":"2026-08-19T20:28:50.930606Z","end":"2026-08-19T20:28:51.032726Z","steps":["trace[1416094991] 'process raft request'  (duration: 101.61494ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:28:51.032844Z","caller":"traceutil/trace.go:171","msg":"trace[1491815674] transaction","detail":"{read_only:false; response_revision:485; number_of_response:1; }","duration":"102.188184ms","start":"2026-08-19T20:28:50.930632Z","end":"2026-08-19T20:28:51.03282Z","steps":["trace[1491815674] 'process raft request'  (duration: 101.709423ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:28:56.995977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.258013ms","expected-duration":"100ms","prefix":"","request":"header:<ID:14031140679947482403 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:571 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >>","response":"size:16"}
{"level":"info","ts":"2026-08-19T20:28:56.996206Z","caller":"traceutil/trace.go:171","msg":"trace[304885848] transaction","detail":"{read_only:false; response_revision:586; number_of_response:1; }","duration":"330.808534ms","start":"2026-08-19T20:28:56.665352Z","end":"2026-08-19T20:28:56.996161Z","steps":["trace[304885848] 'process raft request'  (duration: 211.539737ms)","trace[304885848] 'compare'  (duration: 118.065578ms)"],"step_count":2}
{"level":"warn","ts":"2026-08-19T20:28:56.996389Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:28:56.665326Z","time spent":"330.988399ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:571 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-08-19T20:28:57.359321Z","caller":"traceutil/trace.go:171","msg":"trace[339522806] transaction","detail":"{read_only:false; response_revision:587; number_of_response:1; }","duration":"364.504438ms","start":"2026-08-19T20:28:56.994786Z","end":"2026-08-19T20:28:57.359291Z","steps":["trace[339522806] 'process raft request'  (duration: 363.913294ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:28:57.359529Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:28:56.994754Z","time spent":"364.667002ms","remote":"127.0.0.1:52664","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036285,"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:582 > success:<request_put:<key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" value_size:1036201 >> failure:<request_range:<key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" > >"}
{"level":"info","ts":"2026-08-19T20:28:57.582779Z","caller":"traceutil/trace.go:171","msg":"trace[440664914] linearizableReadLoop","detail":"{readStateIndex:610; appliedIndex:608; }","duration":"504.077142ms","start":"2026-08-19T20:28:57.078679Z","end":"2026-08-19T20:28:57.582756Z","steps":["trace[440664914] 'read index received'  (duration: 279.786684ms)","trace[440664914] 'applied index is now lower than readState.Index'  (duration: 224.289448ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:28:57.582857Z","caller":"traceutil/trace.go:171","msg":"trace[506303143] transaction","detail":"{read_only:false; response_revision:588; number_of_response:1; }","duration":"576.931796ms","start":"2026-08-19T20:28:57.005891Z","end":"2026-08-19T20:28:57.582823Z","steps":["trace[506303143] 'process raft request'  (duration: 568.343984ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:28:57.582997Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"504.307417ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"warn","ts":"2026-08-19T20:28:57.583027Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:28:57.005878Z","time spent":"577.058219ms","remote":"127.0.0.1:52748","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17130,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/cilium-qlzvn\" mod_revision:475 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-qlzvn\" value_size:17081 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-qlzvn\" > >"}
{"level":"info","ts":"2026-08-19T20:28:57.583053Z","caller":"traceutil/trace.go:171","msg":"trace[407801074] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:588; }","duration":"504.41473ms","start":"2026-08-19T20:28:57.078624Z","end":"2026-08-19T20:28:57.583039Z","steps":["trace[407801074] 'agreement among raft nodes before linearized reading'  (duration: 504.249726ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:28:57.583106Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:28:57.078602Z","time spent":"504.490991ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "}
{"level":"warn","ts":"2026-08-19T20:28:57.59257Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"513.153135ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"}
{"level":"info","ts":"2026-08-19T20:28:57.592676Z","caller":"traceutil/trace.go:171","msg":"trace[1073634950] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:589; }","duration":"513.305608ms","start":"2026-08-19T20:28:57.079347Z","end":"2026-08-19T20:28:57.592653Z","steps":["trace[1073634950] 'agreement among raft nodes before linearized reading'  (duration: 513.035482ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:28:57.592715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"333.283512ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:477"}
{"level":"warn","ts":"2026-08-19T20:28:57.592732Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:28:57.079327Z","time spent":"513.39276ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":455,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"info","ts":"2026-08-19T20:28:57.592781Z","caller":"traceutil/trace.go:171","msg":"trace[1023737210] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:589; }","duration":"333.385795ms","start":"2026-08-19T20:28:57.25938Z","end":"2026-08-19T20:28:57.592766Z","steps":["trace[1023737210] 'agreement among raft nodes before linearized reading'  (duration: 333.208791ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:28:57.592805Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:28:57.259355Z","time spent":"333.443657ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":500,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"info","ts":"2026-08-19T20:28:57.593107Z","caller":"traceutil/trace.go:171","msg":"trace[441025301] transaction","detail":"{read_only:false; response_revision:589; number_of_response:1; }","duration":"174.110036ms","start":"2026-08-19T20:28:57.418418Z","end":"2026-08-19T20:28:57.592528Z","steps":["trace[441025301] 'process raft request'  (duration: 173.809179ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:28:58.196376Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.476648ms","expected-duration":"100ms","prefix":"","request":"header:<ID:14031140679947482414 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:440 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:600 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >>","response":"size:16"}
{"level":"info","ts":"2026-08-19T20:28:58.196501Z","caller":"traceutil/trace.go:171","msg":"trace[194303560] transaction","detail":"{read_only:false; response_revision:593; number_of_response:1; }","duration":"471.070115ms","start":"2026-08-19T20:28:57.725411Z","end":"2026-08-19T20:28:58.196481Z","steps":["trace[194303560] 'process raft request'  (duration: 366.354871ms)","trace[194303560] 'compare'  (duration: 104.243563ms)"],"step_count":2}
{"level":"warn","ts":"2026-08-19T20:28:58.19657Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:28:57.725382Z","time spent":"471.152727ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:440 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:600 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >"}
{"level":"info","ts":"2026-08-19T20:28:58.197294Z","caller":"traceutil/trace.go:171","msg":"trace[1802326035] transaction","detail":"{read_only:false; response_revision:594; number_of_response:1; }","duration":"167.748918ms","start":"2026-08-19T20:28:58.029509Z","end":"2026-08-19T20:28:58.197258Z","steps":["trace[1802326035] 'process raft request'  (duration: 167.197234ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:29:47.833673Z","caller":"traceutil/trace.go:171","msg":"trace[967850382] transaction","detail":"{read_only:false; response_revision:1170; number_of_response:1; }","duration":"172.735405ms","start":"2026-08-19T20:29:47.660901Z","end":"2026-08-19T20:29:47.833637Z","steps":["trace[967850382] 'process raft request'  (duration: 172.498519ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:30:07.524635Z","caller":"traceutil/trace.go:171","msg":"trace[806898985] transaction","detail":"{read_only:false; response_revision:1421; number_of_response:1; }","duration":"170.505511ms","start":"2026-08-19T20:30:07.354093Z","end":"2026-08-19T20:30:07.524598Z","steps":["trace[806898985] 'process raft request'  (duration: 162.232123ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:30:32.391388Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.945365ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"}
{"level":"warn","ts":"2026-08-19T20:30:32.391434Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"264.155817ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-08-19T20:30:32.391502Z","caller":"traceutil/trace.go:171","msg":"trace[2068995014] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1825; }","duration":"162.073038ms","start":"2026-08-19T20:30:32.229408Z","end":"2026-08-19T20:30:32.391481Z","steps":["trace[2068995014] 'range keys from in-memory index tree'  (duration: 161.70793ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:30:32.39149Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.901754ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:477"}
{"level":"info","ts":"2026-08-19T20:30:32.391542Z","caller":"traceutil/trace.go:171","msg":"trace[657028974] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1825; }","duration":"264.307541ms","start":"2026-08-19T20:30:32.127197Z","end":"2026-08-19T20:30:32.391505Z","steps":["trace[657028974] 'range keys from in-memory index tree'  (duration: 263.919922ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:30:32.39158Z","caller":"traceutil/trace.go:171","msg":"trace[1798118487] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1825; }","duration":"152.035677ms","start":"2026-08-19T20:30:32.239524Z","end":"2026-08-19T20:30:32.39156Z","steps":["trace[1798118487] 'range keys from in-memory index tree'  (duration: 151.73452ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:30:32.391714Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"283.795468ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-9ff71368-b4e5-40d6-b921-dad12913751f\" ","response":"range_response_count:1 size:3626"}
{"level":"warn","ts":"2026-08-19T20:30:32.391737Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"273.613545ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"}
{"level":"info","ts":"2026-08-19T20:30:32.391772Z","caller":"traceutil/trace.go:171","msg":"trace[1328278755] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1825; }","duration":"273.668156ms","start":"2026-08-19T20:30:32.118094Z","end":"2026-08-19T20:30:32.391762Z","steps":["trace[1328278755] 'range keys from in-memory index tree'  (duration: 273.527123ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:30:32.391774Z","caller":"traceutil/trace.go:171","msg":"trace[1514683417] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-9ff71368-b4e5-40d6-b921-dad12913751f; range_end:; response_count:1; response_revision:1825; }","duration":"283.902021ms","start":"2026-08-19T20:30:32.107855Z","end":"2026-08-19T20:30:32.391757Z","steps":["trace[1514683417] 'range keys from in-memory index tree'  (duration: 283.635935ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:30:32.392484Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.017403ms","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-08-19T20:30:32.392555Z","caller":"traceutil/trace.go:171","msg":"trace[303987023] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1825; }","duration":"141.675658ms","start":"2026-08-19T20:30:32.250863Z","end":"2026-08-19T20:30:32.392539Z","steps":["trace[303987023] 'range keys from in-memory index tree'  (duration: 140.736126ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:30:32.549316Z","caller":"traceutil/trace.go:171","msg":"trace[979992976] transaction","detail":"{read_only:false; response_revision:1826; number_of_response:1; }","duration":"152.917068ms","start":"2026-08-19T20:30:32.396368Z","end":"2026-08-19T20:30:32.549285Z","steps":["trace[979992976] 'process raft request'  (duration: 152.731474ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:30:32.566938Z","caller":"traceutil/trace.go:171","msg":"trace[1847691683] linearizableReadLoop","detail":"{readStateIndex:1899; appliedIndex:1895; }","duration":"133.77978ms","start":"2026-08-19T20:30:32.433112Z","end":"2026-08-19T20:30:32.566891Z","steps":["trace[1847691683] 'read index received'  (duration: 115.968723ms)","trace[1847691683] 'applied index is now lower than readState.Index'  (duration: 17.809997ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:30:32.56703Z","caller":"traceutil/trace.go:171","msg":"trace[1020610593] transaction","detail":"{read_only:false; response_revision:1827; number_of_response:1; }","duration":"170.620504ms","start":"2026-08-19T20:30:32.396371Z","end":"2026-08-19T20:30:32.566992Z","steps":["trace[1020610593] 'process raft request'  (duration: 170.288035ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:30:32.567064Z","caller":"traceutil/trace.go:171","msg":"trace[330001372] transaction","detail":"{read_only:false; response_revision:1829; number_of_response:1; }","duration":"169.576629ms","start":"2026-08-19T20:30:32.397451Z","end":"2026-08-19T20:30:32.567028Z","steps":["trace[330001372] 'process raft request'  (duration: 169.404484ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:30:32.566977Z","caller":"traceutil/trace.go:171","msg":"trace[1289248194] transaction","detail":"{read_only:false; response_revision:1828; number_of_response:1; }","duration":"169.578228ms","start":"2026-08-19T20:30:32.397359Z","end":"2026-08-19T20:30:32.566938Z","steps":["trace[1289248194] 'process raft request'  (duration: 169.457665ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:30:32.567253Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.119558ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-9ff71368-b4e5-40d6-b921-dad12913751f\" ","response":"range_response_count:1 size:3626"}
{"level":"info","ts":"2026-08-19T20:30:32.567333Z","caller":"traceutil/trace.go:171","msg":"trace[1025455305] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-9ff71368-b4e5-40d6-b921-dad12913751f; range_end:; response_count:1; response_revision:1829; }","duration":"134.238302ms","start":"2026-08-19T20:30:32.433071Z","end":"2026-08-19T20:30:32.56731Z","steps":["trace[1025455305] 'agreement among raft nodes before linearized reading'  (duration: 133.991516ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:30:32.686926Z","caller":"traceutil/trace.go:171","msg":"trace[1534185475] transaction","detail":"{read_only:false; response_revision:1830; number_of_response:1; }","duration":"110.4489ms","start":"2026-08-19T20:30:32.576444Z","end":"2026-08-19T20:30:32.686893Z","steps":["trace[1534185475] 'process raft request'  (duration: 54.511348ms)","trace[1534185475] 'compare'  (duration: 55.792409ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:31:21.81119Z","caller":"traceutil/trace.go:171","msg":"trace[753971226] transaction","detail":"{read_only:false; response_revision:2143; number_of_response:1; }","duration":"213.488625ms","start":"2026-08-19T20:31:21.597647Z","end":"2026-08-19T20:31:21.811136Z","steps":["trace[753971226] 'process raft request'  (duration: 213.351662ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:31:22.060811Z","caller":"traceutil/trace.go:171","msg":"trace[254870445] linearizableReadLoop","detail":"{readStateIndex:2226; appliedIndex:2224; }","duration":"292.553329ms","start":"2026-08-19T20:31:21.76823Z","end":"2026-08-19T20:31:22.060783Z","steps":["trace[254870445] 'read index received'  (duration: 42.91533ms)","trace[254870445] 'applied index is now lower than readState.Index'  (duration: 249.637169ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:31:22.060849Z","caller":"traceutil/trace.go:171","msg":"trace[1566965617] transaction","detail":"{read_only:false; response_revision:2144; number_of_response:1; }","duration":"351.267574ms","start":"2026-08-19T20:31:21.709543Z","end":"2026-08-19T20:31:22.060811Z","steps":["trace[1566965617] 'process raft request'  (duration: 351.034008ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:31:22.060959Z","caller":"traceutil/trace.go:171","msg":"trace[2048132663] transaction","detail":"{read_only:false; response_revision:2145; number_of_response:1; }","duration":"321.970508ms","start":"2026-08-19T20:31:21.738975Z","end":"2026-08-19T20:31:22.060945Z","steps":["trace[2048132663] 'process raft request'  (duration: 321.761543ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:31:22.061082Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:31:21.738949Z","time spent":"322.04409ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:2133 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-08-19T20:31:22.061194Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"267.518391ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/networkpolicies/\" range_end:\"/registry/networkpolicies0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-08-19T20:31:22.061293Z","caller":"traceutil/trace.go:171","msg":"trace[1738249684] range","detail":"{range_begin:/registry/networkpolicies/; range_end:/registry/networkpolicies0; response_count:0; response_revision:2145; }","duration":"267.666244ms","start":"2026-08-19T20:31:21.793606Z","end":"2026-08-19T20:31:22.061272Z","steps":["trace[1738249684] 'agreement among raft nodes before linearized reading'  (duration: 267.442459ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:31:22.061368Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.99995ms","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-08-19T20:31:22.061479Z","caller":"traceutil/trace.go:171","msg":"trace[467423507] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2145; }","duration":"166.157843ms","start":"2026-08-19T20:31:21.895292Z","end":"2026-08-19T20:31:22.061449Z","steps":["trace[467423507] 'agreement among raft nodes before linearized reading'  (duration: 165.892547ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:31:22.061456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"293.180913ms","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-08-19T20:31:22.061603Z","caller":"traceutil/trace.go:171","msg":"trace[1499856932] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2145; }","duration":"293.396058ms","start":"2026-08-19T20:31:21.768176Z","end":"2026-08-19T20:31:22.061572Z","steps":["trace[1499856932] 'agreement among raft nodes before linearized reading'  (duration: 292.942208ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:31:22.061423Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:31:21.709517Z","time spent":"351.777295ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:2132 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"info","ts":"2026-08-19T20:31:22.269008Z","caller":"traceutil/trace.go:171","msg":"trace[119818996] transaction","detail":"{read_only:false; response_revision:2146; number_of_response:1; }","duration":"202.192505ms","start":"2026-08-19T20:31:22.066774Z","end":"2026-08-19T20:31:22.268967Z","steps":["trace[119818996] 'process raft request'  (duration: 184.715081ms)","trace[119818996] 'compare'  (duration: 17.143506ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:32:36.440082Z","caller":"traceutil/trace.go:171","msg":"trace[1491517980] transaction","detail":"{read_only:false; response_revision:2745; number_of_response:1; }","duration":"117.145608ms","start":"2026-08-19T20:32:36.3229Z","end":"2026-08-19T20:32:36.440046Z","steps":["trace[1491517980] 'process raft request'  (duration: 116.923093ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:32:36.448552Z","caller":"traceutil/trace.go:171","msg":"trace[1030323422] transaction","detail":"{read_only:false; response_revision:2746; number_of_response:1; }","duration":"122.261447ms","start":"2026-08-19T20:32:36.326235Z","end":"2026-08-19T20:32:36.448497Z","steps":["trace[1030323422] 'process raft request'  (duration: 122.006791ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:32:36.736998Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.38987ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-08-19T20:32:36.737087Z","caller":"traceutil/trace.go:171","msg":"trace[1466644105] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2747; }","duration":"110.517423ms","start":"2026-08-19T20:32:36.626551Z","end":"2026-08-19T20:32:36.737069Z","steps":["trace[1466644105] 'range keys from in-memory index tree'  (duration: 110.198415ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:32:36.737275Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"187.212216ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-08-19T20:32:36.737362Z","caller":"traceutil/trace.go:171","msg":"trace[75233261] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2747; }","duration":"187.355679ms","start":"2026-08-19T20:32:36.549988Z","end":"2026-08-19T20:32:36.737343Z","steps":["trace[75233261] 'range keys from in-memory index tree'  (duration: 187.141294ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:32:37.033015Z","caller":"traceutil/trace.go:171","msg":"trace[2004216702] linearizableReadLoop","detail":"{readStateIndex:2855; appliedIndex:2854; }","duration":"147.475007ms","start":"2026-08-19T20:32:36.885512Z","end":"2026-08-19T20:32:37.032987Z","steps":["trace[2004216702] 'read index received'  (duration: 147.310783ms)","trace[2004216702] 'applied index is now lower than readState.Index'  (duration: 162.894µs)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:32:37.033068Z","caller":"traceutil/trace.go:171","msg":"trace[952487284] transaction","detail":"{read_only:false; response_revision:2749; number_of_response:1; }","duration":"290.844157ms","start":"2026-08-19T20:32:36.742185Z","end":"2026-08-19T20:32:37.03303Z","steps":["trace[952487284] 'process raft request'  (duration: 290.613052ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:32:37.033251Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.723601ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-08-19T20:32:37.033312Z","caller":"traceutil/trace.go:171","msg":"trace[1378128049] range","detail":"{range_begin:/registry/pods/; range_end:/registry/pods0; response_count:0; response_revision:2749; }","duration":"126.849904ms","start":"2026-08-19T20:32:36.906445Z","end":"2026-08-19T20:32:37.033295Z","steps":["trace[1378128049] 'agreement among raft nodes before linearized reading'  (duration: 126.700871ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:32:37.033331Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.785234ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/auth-system/keycloak-headless\" ","response":"range_response_count:1 size:1369"}
{"level":"info","ts":"2026-08-19T20:32:37.033477Z","caller":"traceutil/trace.go:171","msg":"trace[191162224] range","detail":"{range_begin:/registry/services/specs/auth-system/keycloak-headless; range_end:; response_count:1; response_revision:2749; }","duration":"147.973639ms","start":"2026-08-19T20:32:36.885476Z","end":"2026-08-19T20:32:37.03345Z","steps":["trace[191162224] 'agreement among raft nodes before linearized reading'  (duration: 147.629521ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:36:35.45622Z","caller":"traceutil/trace.go:171","msg":"trace[1375496604] transaction","detail":"{read_only:false; response_revision:4960; number_of_response:1; }","duration":"159.399747ms","start":"2026-08-19T20:36:35.296803Z","end":"2026-08-19T20:36:35.456202Z","steps":["trace[1375496604] 'process raft request'  (duration: 159.286275ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:36:35.516109Z","caller":"traceutil/trace.go:171","msg":"trace[1328391588] linearizableReadLoop","detail":"{readStateIndex:5151; appliedIndex:5149; }","duration":"183.825064ms","start":"2026-08-19T20:36:35.33226Z","end":"2026-08-19T20:36:35.516085Z","steps":["trace[1328391588] 'read index received'  (duration: 123.864931ms)","trace[1328391588] 'applied index is now lower than readState.Index'  (duration: 59.959263ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:36:35.516219Z","caller":"traceutil/trace.go:171","msg":"trace[804819130] transaction","detail":"{read_only:false; response_revision:4961; number_of_response:1; }","duration":"217.534606ms","start":"2026-08-19T20:36:35.298676Z","end":"2026-08-19T20:36:35.516211Z","steps":["trace[804819130] 'process raft request'  (duration: 217.28709ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:36:35.516511Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"180.401473ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-1bf4ec5a-0276-4436-9623-cdb6c2fe419c\" ","response":"range_response_count:1 size:3600"}
{"level":"info","ts":"2026-08-19T20:36:35.516588Z","caller":"traceutil/trace.go:171","msg":"trace[934861480] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-1bf4ec5a-0276-4436-9623-cdb6c2fe419c; range_end:; response_count:1; response_revision:4961; }","duration":"180.528926ms","start":"2026-08-19T20:36:35.336039Z","end":"2026-08-19T20:36:35.516568Z","steps":["trace[934861480] 'agreement among raft nodes before linearized reading'  (duration: 180.303831ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:36:35.51667Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.387899ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/monitoring/vector\" ","response":"range_response_count:1 size:894"}
{"level":"warn","ts":"2026-08-19T20:36:35.516681Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.980959ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-1bf4ec5a-0276-4436-9623-cdb6c2fe419c\" ","response":"range_response_count:1 size:3600"}
{"level":"info","ts":"2026-08-19T20:36:35.516735Z","caller":"traceutil/trace.go:171","msg":"trace[1514744046] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-1bf4ec5a-0276-4436-9623-cdb6c2fe419c; range_end:; response_count:1; response_revision:4961; }","duration":"103.082442ms","start":"2026-08-19T20:36:35.413641Z","end":"2026-08-19T20:36:35.516724Z","steps":["trace[1514744046] 'agreement among raft nodes before linearized reading'  (duration: 102.915418ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:36:35.516737Z","caller":"traceutil/trace.go:171","msg":"trace[791878948] range","detail":"{range_begin:/registry/serviceaccounts/monitoring/vector; range_end:; response_count:1; response_revision:4961; }","duration":"184.4941ms","start":"2026-08-19T20:36:35.332224Z","end":"2026-08-19T20:36:35.516718Z","steps":["trace[791878948] 'agreement among raft nodes before linearized reading'  (duration: 184.307726ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:36:47.562866Z","caller":"traceutil/trace.go:171","msg":"trace[1878626490] transaction","detail":"{read_only:false; response_revision:5209; number_of_response:1; }","duration":"101.74324ms","start":"2026-08-19T20:36:47.461059Z","end":"2026-08-19T20:36:47.562802Z","steps":["trace[1878626490] 'process raft request'  (duration: 101.452883ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:36:54.84479Z","caller":"traceutil/trace.go:171","msg":"trace[43920149] linearizableReadLoop","detail":"{readStateIndex:5585; appliedIndex:5580; }","duration":"181.16612ms","start":"2026-08-19T20:36:54.663598Z","end":"2026-08-19T20:36:54.844764Z","steps":["trace[43920149] 'read index received'  (duration: 37.614495ms)","trace[43920149] 'applied index is now lower than readState.Index'  (duration: 143.550255ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:36:54.844903Z","caller":"traceutil/trace.go:171","msg":"trace[333206457] transaction","detail":"{read_only:false; response_revision:5380; number_of_response:1; }","duration":"189.423109ms","start":"2026-08-19T20:36:54.655441Z","end":"2026-08-19T20:36:54.844864Z","steps":["trace[333206457] 'process raft request'  (duration: 189.164833ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:36:54.845051Z","caller":"traceutil/trace.go:171","msg":"trace[1400215766] transaction","detail":"{read_only:false; response_revision:5382; number_of_response:1; }","duration":"185.246329ms","start":"2026-08-19T20:36:54.659774Z","end":"2026-08-19T20:36:54.84502Z","steps":["trace[1400215766] 'process raft request'  (duration: 184.930431ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:36:54.845058Z","caller":"traceutil/trace.go:171","msg":"trace[623158855] transaction","detail":"{read_only:false; response_revision:5381; number_of_response:1; }","duration":"189.506831ms","start":"2026-08-19T20:36:54.655518Z","end":"2026-08-19T20:36:54.845025Z","steps":["trace[623158855] 'process raft request'  (duration: 189.139572ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:36:54.845074Z","caller":"traceutil/trace.go:171","msg":"trace[1673282236] transaction","detail":"{read_only:false; response_revision:5379; number_of_response:1; }","duration":"189.938961ms","start":"2026-08-19T20:36:54.655046Z","end":"2026-08-19T20:36:54.844985Z","steps":["trace[1673282236] 'process raft request'  (duration: 158.223948ms)","trace[1673282236] 'compare'  (duration: 30.954715ms)"],"step_count":2}
{"level":"warn","ts":"2026-08-19T20:36:54.845661Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.261898ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12212"}
{"level":"info","ts":"2026-08-19T20:36:54.845716Z","caller":"traceutil/trace.go:171","msg":"trace[296813945] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:5382; }","duration":"133.468993ms","start":"2026-08-19T20:36:54.712234Z","end":"2026-08-19T20:36:54.845703Z","steps":["trace[296813945] 'agreement among raft nodes before linearized reading'  (duration: 133.112563ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:36:54.84601Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.367429ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/\" range_end:\"/registry/leases0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-08-19T20:36:54.846133Z","caller":"traceutil/trace.go:171","msg":"trace[823765603] range","detail":"{range_begin:/registry/leases/; range_end:/registry/leases0; response_count:0; response_revision:5382; }","duration":"182.528973ms","start":"2026-08-19T20:36:54.663571Z","end":"2026-08-19T20:36:54.8461Z","steps":["trace[823765603] 'agreement among raft nodes before linearized reading'  (duration: 181.519098ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:38:15.420653Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2957}
{"level":"info","ts":"2026-08-19T20:38:15.498109Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2957,"took":"75.504404ms","hash":3318381746,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":34443264,"current-db-size-in-use":"34 MB"}
{"level":"info","ts":"2026-08-19T20:38:15.498253Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3318381746,"revision":2957,"compact-revision":-1}
{"level":"info","ts":"2026-08-19T20:42:48.099829Z","caller":"traceutil/trace.go:171","msg":"trace[817000284] transaction","detail":"{read_only:false; response_revision:8127; number_of_response:1; }","duration":"184.88232ms","start":"2026-08-19T20:42:47.914924Z","end":"2026-08-19T20:42:48.099806Z","steps":["trace[817000284] 'process raft request'  (duration: 184.241975ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:42:58.889931Z","caller":"traceutil/trace.go:171","msg":"trace[1475007193] linearizableReadLoop","detail":"{readStateIndex:8476; appliedIndex:8475; }","duration":"150.465315ms","start":"2026-08-19T20:42:58.739433Z","end":"2026-08-19T20:42:58.889898Z","steps":["trace[1475007193] 'read index received'  (duration: 69.587636ms)","trace[1475007193] 'applied index is now lower than readState.Index'  (duration: 80.875809ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:42:58.889975Z","caller":"traceutil/trace.go:171","msg":"trace[74183867] transaction","detail":"{read_only:false; response_revision:8186; number_of_response:1; }","duration":"184.942732ms","start":"2026-08-19T20:42:58.704996Z","end":"2026-08-19T20:42:58.889939Z","steps":["trace[74183867] 'process raft request'  (duration: 104.017662ms)","trace[74183867] 'compare'  (duration: 80.604883ms)"],"step_count":2}
{"level":"warn","ts":"2026-08-19T20:42:58.890125Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.681732ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"}
{"level":"info","ts":"2026-08-19T20:42:58.890177Z","caller":"traceutil/trace.go:171","msg":"trace[1308085548] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:8186; }","duration":"150.752384ms","start":"2026-08-19T20:42:58.739412Z","end":"2026-08-19T20:42:58.890164Z","steps":["trace[1308085548] 'agreement among raft nodes before linearized reading'  (duration: 150.579398ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:43:00.575733Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"283.161492ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-08-19T20:43:00.575811Z","caller":"traceutil/trace.go:171","msg":"trace[83737237] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:8191; }","duration":"283.276694ms","start":"2026-08-19T20:43:00.292515Z","end":"2026-08-19T20:43:00.575792Z","steps":["trace[83737237] 'range keys from in-memory index tree'  (duration: 282.899615ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:43:00.595751Z","caller":"traceutil/trace.go:171","msg":"trace[1850179878] transaction","detail":"{read_only:false; response_revision:8192; number_of_response:1; }","duration":"164.362933ms","start":"2026-08-19T20:43:00.431341Z","end":"2026-08-19T20:43:00.595704Z","steps":["trace[1850179878] 'process raft request'  (duration: 164.137597ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:43:01.079643Z","caller":"traceutil/trace.go:171","msg":"trace[494823058] transaction","detail":"{read_only:false; response_revision:8197; number_of_response:1; }","duration":"151.085321ms","start":"2026-08-19T20:43:00.928531Z","end":"2026-08-19T20:43:01.079617Z","steps":["trace[494823058] 'process raft request'  (duration: 88.917025ms)","trace[494823058] 'compare'  (duration: 62.077444ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:43:15.43199Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":6111}
{"level":"info","ts":"2026-08-19T20:43:15.534278Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":6111,"took":"100.174028ms","hash":3744274930,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":23093248,"current-db-size-in-use":"23 MB"}
{"level":"info","ts":"2026-08-19T20:43:15.534352Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3744274930,"revision":6111,"compact-revision":2957}
{"level":"warn","ts":"2026-08-19T20:43:27.318404Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"292.329324ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"}
{"level":"info","ts":"2026-08-19T20:43:27.318471Z","caller":"traceutil/trace.go:171","msg":"trace[1020027163] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:8390; }","duration":"292.440048ms","start":"2026-08-19T20:43:27.026016Z","end":"2026-08-19T20:43:27.318456Z","steps":["trace[1020027163] 'range keys from in-memory index tree'  (duration: 292.130479ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:43:27.318557Z","caller":"traceutil/trace.go:171","msg":"trace[495905153] linearizableReadLoop","detail":"{readStateIndex:8689; appliedIndex:8688; }","duration":"124.689402ms","start":"2026-08-19T20:43:27.193842Z","end":"2026-08-19T20:43:27.318532Z","steps":["trace[495905153] 'read index received'  (duration: 118.05177ms)","trace[495905153] 'applied index is now lower than readState.Index'  (duration: 6.636592ms)"],"step_count":2}
{"level":"warn","ts":"2026-08-19T20:43:27.318745Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.863866ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/\" range_end:\"/registry/pxc.percona.com/perconaxtradbclusters0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-08-19T20:43:27.318832Z","caller":"traceutil/trace.go:171","msg":"trace[1970487749] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/; range_end:/registry/pxc.percona.com/perconaxtradbclusters0; response_count:0; response_revision:8391; }","duration":"125.059272ms","start":"2026-08-19T20:43:27.193753Z","end":"2026-08-19T20:43:27.318812Z","steps":["trace[1970487749] 'agreement among raft nodes before linearized reading'  (duration: 124.866947ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:43:27.319191Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.522076ms","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-08-19T20:43:27.319383Z","caller":"traceutil/trace.go:171","msg":"trace[1815842395] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:8393; }","duration":"107.745732ms","start":"2026-08-19T20:43:27.211619Z","end":"2026-08-19T20:43:27.319364Z","steps":["trace[1815842395] 'agreement among raft nodes before linearized reading'  (duration: 107.426384ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:43:27.31867Z","caller":"traceutil/trace.go:171","msg":"trace[1887198598] transaction","detail":"{read_only:false; response_revision:8391; number_of_response:1; }","duration":"223.109178ms","start":"2026-08-19T20:43:27.095495Z","end":"2026-08-19T20:43:27.318605Z","steps":["trace[1887198598] 'process raft request'  (duration: 216.419815ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:43:27.607525Z","caller":"traceutil/trace.go:171","msg":"trace[1337370080] transaction","detail":"{read_only:false; response_revision:8394; number_of_response:1; }","duration":"284.427413ms","start":"2026-08-19T20:43:27.322899Z","end":"2026-08-19T20:43:27.607327Z","steps":["trace[1337370080] 'process raft request'  (duration: 281.236455ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:43:27.633674Z","caller":"traceutil/trace.go:171","msg":"trace[2027129649] transaction","detail":"{read_only:false; response_revision:8395; number_of_response:1; }","duration":"309.378847ms","start":"2026-08-19T20:43:27.32428Z","end":"2026-08-19T20:43:27.633658Z","steps":["trace[2027129649] 'process raft request'  (duration: 309.211123ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:43:27.633878Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:43:27.324262Z","time spent":"309.454278ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:8381 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:410 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"info","ts":"2026-08-19T20:43:39.463168Z","caller":"traceutil/trace.go:171","msg":"trace[568416055] transaction","detail":"{read_only:false; response_revision:8497; number_of_response:1; }","duration":"150.856967ms","start":"2026-08-19T20:43:39.312284Z","end":"2026-08-19T20:43:39.463141Z","steps":["trace[568416055] 'process raft request'  (duration: 150.651772ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:43:39.534897Z","caller":"traceutil/trace.go:171","msg":"trace[8899802] transaction","detail":"{read_only:false; response_revision:8498; number_of_response:1; }","duration":"169.728912ms","start":"2026-08-19T20:43:39.365117Z","end":"2026-08-19T20:43:39.534846Z","steps":["trace[8899802] 'process raft request'  (duration: 157.858755ms)","trace[8899802] 'compare'  (duration: 11.15491ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:43:39.534922Z","caller":"traceutil/trace.go:171","msg":"trace[585592374] transaction","detail":"{read_only:false; response_revision:8499; number_of_response:1; }","duration":"168.649386ms","start":"2026-08-19T20:43:39.366239Z","end":"2026-08-19T20:43:39.534888Z","steps":["trace[585592374] 'process raft request'  (duration: 168.208806ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:43:40.453569Z","caller":"traceutil/trace.go:171","msg":"trace[692192409] transaction","detail":"{read_only:false; response_revision:8504; number_of_response:1; }","duration":"159.824643ms","start":"2026-08-19T20:43:40.293697Z","end":"2026-08-19T20:43:40.453522Z","steps":["trace[692192409] 'process raft request'  (duration: 159.414823ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:43:41.080886Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.802918ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-08-19T20:43:41.080973Z","caller":"traceutil/trace.go:171","msg":"trace[1395961791] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:8508; }","duration":"165.90137ms","start":"2026-08-19T20:43:40.915049Z","end":"2026-08-19T20:43:41.08095Z","steps":["trace[1395961791] 'range keys from in-memory index tree'  (duration: 165.789757ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:43:41.080977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.284841ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingress/\" range_end:\"/registry/ingress0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-08-19T20:43:41.081173Z","caller":"traceutil/trace.go:171","msg":"trace[498529702] range","detail":"{range_begin:/registry/ingress/; range_end:/registry/ingress0; response_count:0; response_revision:8508; }","duration":"150.529348ms","start":"2026-08-19T20:43:40.930614Z","end":"2026-08-19T20:43:41.081143Z","steps":["trace[498529702] 'count revisions from in-memory index tree'  (duration: 150.22255ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:44:21.297908Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-00000000000023ec.wal"}
{"level":"info","ts":"2026-08-19T20:44:52.06081Z","caller":"traceutil/trace.go:171","msg":"trace[1213334610] linearizableReadLoop","detail":"{readStateIndex:9486; appliedIndex:9485; }","duration":"103.952608ms","start":"2026-08-19T20:44:51.956833Z","end":"2026-08-19T20:44:52.060786Z","steps":["trace[1213334610] 'read index received'  (duration: 103.689852ms)","trace[1213334610] 'applied index is now lower than readState.Index'  (duration: 261.656µs)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:44:52.060876Z","caller":"traceutil/trace.go:171","msg":"trace[859396796] transaction","detail":"{read_only:false; response_revision:9165; number_of_response:1; }","duration":"119.568929ms","start":"2026-08-19T20:44:51.941276Z","end":"2026-08-19T20:44:52.060845Z","steps":["trace[859396796] 'process raft request'  (duration: 119.336333ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:44:52.061119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.268905ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-controller\" ","response":"range_response_count:1 size:529"}
{"level":"info","ts":"2026-08-19T20:44:52.06117Z","caller":"traceutil/trace.go:171","msg":"trace[430839515] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-controller; range_end:; response_count:1; response_revision:9165; }","duration":"104.372858ms","start":"2026-08-19T20:44:51.956785Z","end":"2026-08-19T20:44:52.061158Z","steps":["trace[430839515] 'agreement among raft nodes before linearized reading'  (duration: 104.139373ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:44:52.196779Z","caller":"traceutil/trace.go:171","msg":"trace[811941084] transaction","detail":"{read_only:false; response_revision:9166; number_of_response:1; }","duration":"129.5291ms","start":"2026-08-19T20:44:52.06722Z","end":"2026-08-19T20:44:52.196749Z","steps":["trace[811941084] 'process raft request'  (duration: 96.20582ms)","trace[811941084] 'compare'  (duration: 33.161467ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:44:52.196955Z","caller":"traceutil/trace.go:171","msg":"trace[715205286] linearizableReadLoop","detail":"{readStateIndex:9488; appliedIndex:9486; }","duration":"127.332047ms","start":"2026-08-19T20:44:52.069594Z","end":"2026-08-19T20:44:52.196926Z","steps":["trace[715205286] 'read index received'  (duration: 93.848962ms)","trace[715205286] 'applied index is now lower than readState.Index'  (duration: 33.481345ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:44:52.197029Z","caller":"traceutil/trace.go:171","msg":"trace[150764009] transaction","detail":"{read_only:false; response_revision:9167; number_of_response:1; }","duration":"129.55933ms","start":"2026-08-19T20:44:52.067436Z","end":"2026-08-19T20:44:52.196995Z","steps":["trace[150764009] 'process raft request'  (duration: 129.272234ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:44:52.197248Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.624874ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/networkfences.csiaddons.openshift.io\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-08-19T20:44:52.197335Z","caller":"traceutil/trace.go:171","msg":"trace[2098177990] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/networkfences.csiaddons.openshift.io; range_end:; response_count:0; response_revision:9167; }","duration":"127.723846ms","start":"2026-08-19T20:44:52.069591Z","end":"2026-08-19T20:44:52.197315Z","steps":["trace[2098177990] 'agreement among raft nodes before linearized reading'  (duration: 127.574722ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:45:47.476145Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"d1484a2210d3c2b8","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-08-19T20:45:47.483127Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001}
{"level":"info","ts":"2026-08-19T20:45:47.483205Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001}
{"level":"info","ts":"2026-08-19T20:48:15.438812Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":8281}
{"level":"info","ts":"2026-08-19T20:48:15.513193Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":8281,"took":"72.307971ms","hash":1133866166,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":25739264,"current-db-size-in-use":"26 MB"}
{"level":"info","ts":"2026-08-19T20:48:15.513266Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1133866166,"revision":8281,"compact-revision":6111}
{"level":"warn","ts":"2026-08-19T20:48:49.497186Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.366975ms","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-08-19T20:48:49.497287Z","caller":"traceutil/trace.go:171","msg":"trace[690314004] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:11178; }","duration":"137.514819ms","start":"2026-08-19T20:48:49.359755Z","end":"2026-08-19T20:48:49.49727Z","steps":["trace[690314004] 'range keys from in-memory index tree'  (duration: 137.212902ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:48:49.497194Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.851159ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"}
{"level":"info","ts":"2026-08-19T20:48:49.497414Z","caller":"traceutil/trace.go:171","msg":"trace[180210566] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:11178; }","duration":"136.093415ms","start":"2026-08-19T20:48:49.361304Z","end":"2026-08-19T20:48:49.497398Z","steps":["trace[180210566] 'range keys from in-memory index tree'  (duration: 135.675225ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:53:15.4455Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":10809}
{"level":"info","ts":"2026-08-19T20:53:15.523324Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":10809,"took":"75.272312ms","hash":1074823099,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":27701248,"current-db-size-in-use":"28 MB"}
{"level":"info","ts":"2026-08-19T20:53:15.523404Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1074823099,"revision":10809,"compact-revision":8281}
{"level":"info","ts":"2026-08-19T20:55:05.400988Z","caller":"traceutil/trace.go:171","msg":"trace[215990022] transaction","detail":"{read_only:false; response_revision:13707; number_of_response:1; }","duration":"174.11345ms","start":"2026-08-19T20:55:05.226846Z","end":"2026-08-19T20:55:05.40096Z","steps":["trace[215990022] 'process raft request'  (duration: 173.900145ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:55:08.141379Z","caller":"traceutil/trace.go:171","msg":"trace[1395180326] transaction","detail":"{read_only:false; response_revision:13721; number_of_response:1; }","duration":"100.652751ms","start":"2026-08-19T20:55:08.0407Z","end":"2026-08-19T20:55:08.141353Z","steps":["trace[1395180326] 'process raft request'  (duration: 100.480457ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:55:08.144008Z","caller":"traceutil/trace.go:171","msg":"trace[1686337306] transaction","detail":"{read_only:false; response_revision:13722; number_of_response:1; }","duration":"102.750531ms","start":"2026-08-19T20:55:08.041237Z","end":"2026-08-19T20:55:08.143987Z","steps":["trace[1686337306] 'process raft request'  (duration: 102.647879ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:55:27.347568Z","caller":"traceutil/trace.go:171","msg":"trace[326379768] transaction","detail":"{read_only:false; response_revision:13820; number_of_response:1; }","duration":"112.628895ms","start":"2026-08-19T20:55:27.234923Z","end":"2026-08-19T20:55:27.347552Z","steps":["trace[326379768] 'process raft request'  (duration: 112.533413ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:55:42.618834Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":14031140679947516980,"retry-timeout":"500ms"}
{"level":"info","ts":"2026-08-19T20:55:42.708021Z","caller":"traceutil/trace.go:171","msg":"trace[1978251890] transaction","detail":"{read_only:false; response_revision:13911; number_of_response:1; }","duration":"796.036133ms","start":"2026-08-19T20:55:41.911967Z","end":"2026-08-19T20:55:42.708003Z","steps":["trace[1978251890] 'process raft request'  (duration: 795.92443ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:55:42.708132Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:55:41.911938Z","time spent":"796.135045ms","remote":"127.0.0.1:52748","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":12479,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/openstack/openvswitch-bks2k\" mod_revision:13903 > success:<request_put:<key:\"/registry/pods/openstack/openvswitch-bks2k\" value_size:12429 >> failure:<request_range:<key:\"/registry/pods/openstack/openvswitch-bks2k\" > >"}
{"level":"info","ts":"2026-08-19T20:55:42.725329Z","caller":"traceutil/trace.go:171","msg":"trace[1772031578] transaction","detail":"{read_only:false; response_revision:13913; number_of_response:1; }","duration":"444.469114ms","start":"2026-08-19T20:55:42.280843Z","end":"2026-08-19T20:55:42.725312Z","steps":["trace[1772031578] 'process raft request'  (duration: 444.412772ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:55:42.725411Z","caller":"traceutil/trace.go:171","msg":"trace[322464646] linearizableReadLoop","detail":"{readStateIndex:14392; appliedIndex:14388; }","duration":"606.771699ms","start":"2026-08-19T20:55:42.11863Z","end":"2026-08-19T20:55:42.725402Z","steps":["trace[322464646] 'read index received'  (duration: 589.318983ms)","trace[322464646] 'applied index is now lower than readState.Index'  (duration: 17.451616ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:55:42.725509Z","caller":"traceutil/trace.go:171","msg":"trace[1162905333] transaction","detail":"{read_only:false; response_revision:13914; number_of_response:1; }","duration":"364.287599ms","start":"2026-08-19T20:55:42.361183Z","end":"2026-08-19T20:55:42.725471Z","steps":["trace[1162905333] 'process raft request'  (duration: 364.098454ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:55:42.725567Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:55:42.280815Z","time spent":"444.573266ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:13887 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:477 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-08-19T20:55:42.725621Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"385.708071ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:557"}
{"level":"warn","ts":"2026-08-19T20:55:42.725635Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:55:42.361158Z","time spent":"364.412972ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":475,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/ingress-nginx/ingress-nginx-leader\" mod_revision:13860 > success:<request_put:<key:\"/registry/leases/ingress-nginx/ingress-nginx-leader\" value_size:416 >> failure:<request_range:<key:\"/registry/leases/ingress-nginx/ingress-nginx-leader\" > >"}
{"level":"info","ts":"2026-08-19T20:55:42.725333Z","caller":"traceutil/trace.go:171","msg":"trace[2119790283] transaction","detail":"{read_only:false; response_revision:13912; number_of_response:1; }","duration":"451.495014ms","start":"2026-08-19T20:55:42.273807Z","end":"2026-08-19T20:55:42.725302Z","steps":["trace[2119790283] 'process raft request'  (duration: 451.34523ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:55:42.725662Z","caller":"traceutil/trace.go:171","msg":"trace[852891619] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:13914; }","duration":"385.767633ms","start":"2026-08-19T20:55:42.339884Z","end":"2026-08-19T20:55:42.725652Z","steps":["trace[852891619] 'agreement among raft nodes before linearized reading'  (duration: 385.65784ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:55:42.725679Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:55:42.339878Z","time spent":"385.797454ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":1,"response size":580,"request content":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" "}
{"level":"warn","ts":"2026-08-19T20:55:42.725638Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"606.974785ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"warn","ts":"2026-08-19T20:55:42.725682Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"387.573407ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"}
{"level":"warn","ts":"2026-08-19T20:55:42.725727Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:55:42.273782Z","time spent":"451.892563ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:13886 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"info","ts":"2026-08-19T20:55:42.725738Z","caller":"traceutil/trace.go:171","msg":"trace[1315335827] range","detail":"{range_begin:/registry/controllerrevisions/; range_end:/registry/controllerrevisions0; response_count:0; response_revision:13914; }","duration":"607.128458ms","start":"2026-08-19T20:55:42.118581Z","end":"2026-08-19T20:55:42.72571Z","steps":["trace[1315335827] 'agreement among raft nodes before linearized reading'  (duration: 606.883272ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:55:42.725759Z","caller":"traceutil/trace.go:171","msg":"trace[66703297] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:13914; }","duration":"387.69623ms","start":"2026-08-19T20:55:42.338048Z","end":"2026-08-19T20:55:42.725744Z","steps":["trace[66703297] 'agreement among raft nodes before linearized reading'  (duration: 387.528706ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:55:42.725798Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:55:42.338032Z","time spent":"387.756201ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-08-19T20:55:42.725804Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:55:42.11856Z","time spent":"607.23164ms","remote":"127.0.0.1:40082","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":24,"response size":30,"request content":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" count_only:true "}
{"level":"warn","ts":"2026-08-19T20:55:42.725639Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"387.945956ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-08-19T20:55:42.725869Z","caller":"traceutil/trace.go:171","msg":"trace[380155646] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:13914; }","duration":"388.213583ms","start":"2026-08-19T20:55:42.337644Z","end":"2026-08-19T20:55:42.725858Z","steps":["trace[380155646] 'agreement among raft nodes before linearized reading'  (duration: 387.834104ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:55:42.725905Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T20:55:42.337626Z","time spent":"388.270464ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"info","ts":"2026-08-19T20:56:03.943183Z","caller":"traceutil/trace.go:171","msg":"trace[1567282123] transaction","detail":"{read_only:false; response_revision:14214; number_of_response:1; }","duration":"269.18048ms","start":"2026-08-19T20:56:03.673966Z","end":"2026-08-19T20:56:03.943146Z","steps":["trace[1567282123] 'process raft request'  (duration: 268.845172ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:56:03.943399Z","caller":"traceutil/trace.go:171","msg":"trace[138761418] linearizableReadLoop","detail":"{readStateIndex:14704; appliedIndex:14702; }","duration":"213.825471ms","start":"2026-08-19T20:56:03.729526Z","end":"2026-08-19T20:56:03.943352Z","steps":["trace[138761418] 'read index received'  (duration: 134.367654ms)","trace[138761418] 'applied index is now lower than readState.Index'  (duration: 79.454597ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T20:56:03.943533Z","caller":"traceutil/trace.go:171","msg":"trace[1469672656] transaction","detail":"{read_only:false; response_revision:14215; number_of_response:1; }","duration":"113.487737ms","start":"2026-08-19T20:56:03.830011Z","end":"2026-08-19T20:56:03.943499Z","steps":["trace[1469672656] 'process raft request'  (duration: 113.073947ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:56:03.943774Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"185.960102ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"}
{"level":"info","ts":"2026-08-19T20:56:03.943818Z","caller":"traceutil/trace.go:171","msg":"trace[797434203] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:14215; }","duration":"186.072355ms","start":"2026-08-19T20:56:03.75773Z","end":"2026-08-19T20:56:03.943802Z","steps":["trace[797434203] 'agreement among raft nodes before linearized reading'  (duration: 185.8504ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:56:03.943861Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.999272ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/rook-ceph-pdbstatemap\" ","response":"range_response_count:1 size:356"}
{"level":"info","ts":"2026-08-19T20:56:03.943955Z","caller":"traceutil/trace.go:171","msg":"trace[1424229414] range","detail":"{range_begin:/registry/configmaps/openstack/rook-ceph-pdbstatemap; range_end:; response_count:1; response_revision:14215; }","duration":"149.153745ms","start":"2026-08-19T20:56:03.794778Z","end":"2026-08-19T20:56:03.943932Z","steps":["trace[1424229414] 'agreement among raft nodes before linearized reading'  (duration: 148.868378ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:56:03.943911Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"214.357805ms","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-08-19T20:56:03.944153Z","caller":"traceutil/trace.go:171","msg":"trace[1618947709] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:14215; }","duration":"214.651892ms","start":"2026-08-19T20:56:03.729478Z","end":"2026-08-19T20:56:03.94413Z","steps":["trace[1618947709] 'agreement among raft nodes before linearized reading'  (duration: 214.090189ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:57:29.248995Z","caller":"traceutil/trace.go:171","msg":"trace[2000819969] linearizableReadLoop","detail":"{readStateIndex:15530; appliedIndex:15529; }","duration":"134.702423ms","start":"2026-08-19T20:57:29.114269Z","end":"2026-08-19T20:57:29.248971Z","steps":["trace[2000819969] 'read index received'  (duration: 134.652462ms)","trace[2000819969] 'applied index is now lower than readState.Index'  (duration: 49.131µs)"],"step_count":2}
{"level":"warn","ts":"2026-08-19T20:57:29.249208Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.926258ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-compute-default-wprx9\" ","response":"range_response_count:1 size:22128"}
{"level":"info","ts":"2026-08-19T20:57:29.249266Z","caller":"traceutil/trace.go:171","msg":"trace[324584309] range","detail":"{range_begin:/registry/pods/openstack/nova-compute-default-wprx9; range_end:; response_count:1; response_revision:15018; }","duration":"135.040842ms","start":"2026-08-19T20:57:29.114211Z","end":"2026-08-19T20:57:29.249252Z","steps":["trace[324584309] 'agreement among raft nodes before linearized reading'  (duration: 134.860057ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:57:29.249372Z","caller":"traceutil/trace.go:171","msg":"trace[155940485] transaction","detail":"{read_only:false; response_revision:15018; number_of_response:1; }","duration":"144.006459ms","start":"2026-08-19T20:57:29.105059Z","end":"2026-08-19T20:57:29.249065Z","steps":["trace[155940485] 'process raft request'  (duration: 143.756813ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:57:29.256969Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.766895ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumpodippools/\" range_end:\"/registry/cilium.io/ciliumpodippools0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-08-19T20:57:29.25703Z","caller":"traceutil/trace.go:171","msg":"trace[626062167] range","detail":"{range_begin:/registry/cilium.io/ciliumpodippools/; range_end:/registry/cilium.io/ciliumpodippools0; response_count:0; response_revision:15019; }","duration":"102.845617ms","start":"2026-08-19T20:57:29.154173Z","end":"2026-08-19T20:57:29.257018Z","steps":["trace[626062167] 'agreement among raft nodes before linearized reading'  (duration: 102.741574ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:57:29.257009Z","caller":"traceutil/trace.go:171","msg":"trace[569647406] transaction","detail":"{read_only:false; response_revision:15019; number_of_response:1; }","duration":"104.618189ms","start":"2026-08-19T20:57:29.152375Z","end":"2026-08-19T20:57:29.256993Z","steps":["trace[569647406] 'process raft request'  (duration: 104.24528ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:57:29.552524Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.60059ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-db-sync\" ","response":"range_response_count:1 size:5523"}
{"level":"info","ts":"2026-08-19T20:57:29.5526Z","caller":"traceutil/trace.go:171","msg":"trace[956327384] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:15023; }","duration":"134.721494ms","start":"2026-08-19T20:57:29.417861Z","end":"2026-08-19T20:57:29.552583Z","steps":["trace[956327384] 'range keys from in-memory index tree'  (duration: 134.459947ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:57:29.552756Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.555497ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-rabbit-init\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-08-19T20:57:29.552794Z","caller":"traceutil/trace.go:171","msg":"trace[1201650543] range","detail":"{range_begin:/registry/jobs/openstack/nova-rabbit-init; range_end:; response_count:0; response_revision:15023; }","duration":"138.621299ms","start":"2026-08-19T20:57:29.414161Z","end":"2026-08-19T20:57:29.552783Z","steps":["trace[1201650543] 'range keys from in-memory index tree'  (duration: 138.451765ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T20:57:29.552845Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.618416ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/openstack/nova-api\" ","response":"range_response_count:1 size:666"}
{"level":"info","ts":"2026-08-19T20:57:29.552903Z","caller":"traceutil/trace.go:171","msg":"trace[498088703] range","detail":"{range_begin:/registry/services/endpoints/openstack/nova-api; range_end:; response_count:1; response_revision:15023; }","duration":"135.730569ms","start":"2026-08-19T20:57:29.417161Z","end":"2026-08-19T20:57:29.552891Z","steps":["trace[498088703] 'range keys from in-memory index tree'  (duration: 135.481912ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T20:58:15.452612Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":12980}
{"level":"info","ts":"2026-08-19T20:58:15.528609Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":12980,"took":"73.405839ms","hash":3975071704,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":30015488,"current-db-size-in-use":"30 MB"}
{"level":"info","ts":"2026-08-19T20:58:15.528671Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3975071704,"revision":12980,"compact-revision":10809}
{"level":"info","ts":"2026-08-19T21:00:20.000888Z","caller":"traceutil/trace.go:171","msg":"trace[1800414329] linearizableReadLoop","detail":"{readStateIndex:17049; appliedIndex:17047; }","duration":"100.789625ms","start":"2026-08-19T21:00:19.900069Z","end":"2026-08-19T21:00:20.000858Z","steps":["trace[1800414329] 'read index received'  (duration: 20.03777ms)","trace[1800414329] 'applied index is now lower than readState.Index'  (duration: 80.746144ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T21:00:20.000989Z","caller":"traceutil/trace.go:171","msg":"trace[212271280] transaction","detail":"{read_only:false; response_revision:16491; number_of_response:1; }","duration":"137.667116ms","start":"2026-08-19T21:00:19.863282Z","end":"2026-08-19T21:00:20.000949Z","steps":["trace[212271280] 'process raft request'  (duration: 137.351438ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:00:20.00115Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.03024ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephobjectzonegroups/\" range_end:\"/registry/ceph.rook.io/cephobjectzonegroups0\" count_only:true ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-08-19T21:00:20.001455Z","caller":"traceutil/trace.go:171","msg":"trace[1658015955] range","detail":"{range_begin:/registry/ceph.rook.io/cephobjectzonegroups/; range_end:/registry/ceph.rook.io/cephobjectzonegroups0; response_count:0; response_revision:16491; }","duration":"101.348398ms","start":"2026-08-19T21:00:19.900022Z","end":"2026-08-19T21:00:20.001371Z","steps":["trace[1658015955] 'agreement among raft nodes before linearized reading'  (duration: 101.00862ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:02:48.999963Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.195718ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephrbdmirrors/\" range_end:\"/registry/ceph.rook.io/cephrbdmirrors0\" count_only:true ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-08-19T21:02:49.00007Z","caller":"traceutil/trace.go:171","msg":"trace[826536929] range","detail":"{range_begin:/registry/ceph.rook.io/cephrbdmirrors/; range_end:/registry/ceph.rook.io/cephrbdmirrors0; response_count:0; response_revision:17501; }","duration":"122.384163ms","start":"2026-08-19T21:02:48.877663Z","end":"2026-08-19T21:02:49.000047Z","steps":["trace[826536929] 'count revisions from in-memory index tree'  (duration: 122.062545ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:02:49.000157Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"224.306064ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:481"}
{"level":"info","ts":"2026-08-19T21:02:49.000209Z","caller":"traceutil/trace.go:171","msg":"trace[716660398] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:17501; }","duration":"224.387266ms","start":"2026-08-19T21:02:48.775806Z","end":"2026-08-19T21:02:49.000194Z","steps":["trace[716660398] 'range keys from in-memory index tree'  (duration: 224.14102ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:02:49.000521Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.545646ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-08-19T21:02:49.000558Z","caller":"traceutil/trace.go:171","msg":"trace[1261848471] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:17501; }","duration":"221.597148ms","start":"2026-08-19T21:02:48.77895Z","end":"2026-08-19T21:02:49.000547Z","steps":["trace[1261848471] 'range keys from in-memory index tree'  (duration: 221.447074ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:02:49.000785Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.28126ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:509"}
{"level":"info","ts":"2026-08-19T21:02:49.000867Z","caller":"traceutil/trace.go:171","msg":"trace[1127458148] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:17501; }","duration":"221.389063ms","start":"2026-08-19T21:02:48.779459Z","end":"2026-08-19T21:02:49.000848Z","steps":["trace[1127458148] 'range keys from in-memory index tree'  (duration: 221.196368ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:02:49.144704Z","caller":"traceutil/trace.go:171","msg":"trace[1064018337] transaction","detail":"{read_only:false; response_revision:17504; number_of_response:1; }","duration":"133.822381ms","start":"2026-08-19T21:02:49.010857Z","end":"2026-08-19T21:02:49.144679Z","steps":["trace[1064018337] 'process raft request'  (duration: 133.744729ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:02:49.144851Z","caller":"traceutil/trace.go:171","msg":"trace[517317211] transaction","detail":"{read_only:false; response_revision:17503; number_of_response:1; }","duration":"134.018295ms","start":"2026-08-19T21:02:49.010794Z","end":"2026-08-19T21:02:49.144812Z","steps":["trace[517317211] 'process raft request'  (duration: 133.682977ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:02:49.145082Z","caller":"traceutil/trace.go:171","msg":"trace[763528924] transaction","detail":"{read_only:false; response_revision:17506; number_of_response:1; }","duration":"127.116709ms","start":"2026-08-19T21:02:49.017956Z","end":"2026-08-19T21:02:49.145072Z","steps":["trace[763528924] 'process raft request'  (duration: 126.891872ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:02:49.145821Z","caller":"traceutil/trace.go:171","msg":"trace[590968495] transaction","detail":"{read_only:false; response_revision:17505; number_of_response:1; }","duration":"134.032487ms","start":"2026-08-19T21:02:49.010903Z","end":"2026-08-19T21:02:49.144935Z","steps":["trace[590968495] 'process raft request'  (duration: 133.741289ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:03:15.457442Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":15320}
{"level":"info","ts":"2026-08-19T21:03:15.55179Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":15320,"took":"91.808874ms","hash":2814936988,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":32456704,"current-db-size-in-use":"32 MB"}
{"level":"info","ts":"2026-08-19T21:03:15.551874Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2814936988,"revision":15320,"compact-revision":12980}
{"level":"info","ts":"2026-08-19T21:04:09.680522Z","caller":"traceutil/trace.go:171","msg":"trace[278603495] transaction","detail":"{read_only:false; response_revision:18368; number_of_response:1; }","duration":"119.706427ms","start":"2026-08-19T21:04:09.560776Z","end":"2026-08-19T21:04:09.680483Z","steps":["trace[278603495] 'process raft request'  (duration: 119.472682ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:04:09.685187Z","caller":"traceutil/trace.go:171","msg":"trace[1638081567] transaction","detail":"{read_only:false; response_revision:18369; number_of_response:1; }","duration":"123.278934ms","start":"2026-08-19T21:04:09.561874Z","end":"2026-08-19T21:04:09.685153Z","steps":["trace[1638081567] 'process raft request'  (duration: 122.986247ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:04:09.685278Z","caller":"traceutil/trace.go:171","msg":"trace[381701140] linearizableReadLoop","detail":"{readStateIndex:18987; appliedIndex:18985; }","duration":"121.513672ms","start":"2026-08-19T21:04:09.563723Z","end":"2026-08-19T21:04:09.685237Z","steps":["trace[381701140] 'read index received'  (duration: 116.560361ms)","trace[381701140] 'applied index is now lower than readState.Index'  (duration: 4.951581ms)"],"step_count":2}
{"level":"warn","ts":"2026-08-19T21:04:09.685516Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.071283ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumexternalworkloads/\" range_end:\"/registry/cilium.io/ciliumexternalworkloads0\" count_only:true ","response":"range_response_count:0 size:6"}
{"level":"warn","ts":"2026-08-19T21:04:09.685515Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.778418ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"}
{"level":"info","ts":"2026-08-19T21:04:09.685562Z","caller":"traceutil/trace.go:171","msg":"trace[1118402276] range","detail":"{range_begin:/registry/cilium.io/ciliumexternalworkloads/; range_end:/registry/cilium.io/ciliumexternalworkloads0; response_count:0; response_revision:18370; }","duration":"117.184145ms","start":"2026-08-19T21:04:09.568364Z","end":"2026-08-19T21:04:09.685548Z","steps":["trace[1118402276] 'agreement among raft nodes before linearized reading'  (duration: 117.070983ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:04:09.68559Z","caller":"traceutil/trace.go:171","msg":"trace[259402836] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:18370; }","duration":"121.915911ms","start":"2026-08-19T21:04:09.563654Z","end":"2026-08-19T21:04:09.68557Z","steps":["trace[259402836] 'agreement among raft nodes before linearized reading'  (duration: 121.702056ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:06:23.017057Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"d1484a2210d3c2b8","local-member-applied-index":20002,"local-member-snapshot-index":10001,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-08-19T21:06:23.021793Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":20002}
{"level":"info","ts":"2026-08-19T21:06:23.021883Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":15002}
{"level":"info","ts":"2026-08-19T21:08:06.206647Z","caller":"traceutil/trace.go:171","msg":"trace[1208071668] transaction","detail":"{read_only:false; response_revision:20081; number_of_response:1; }","duration":"131.029554ms","start":"2026-08-19T21:08:06.075598Z","end":"2026-08-19T21:08:06.206627Z","steps":["trace[1208071668] 'process raft request'  (duration: 130.920431ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:08:15.463906Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":17803}
{"level":"info","ts":"2026-08-19T21:08:15.597186Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":17803,"took":"127.773534ms","hash":741138190,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":30449664,"current-db-size-in-use":"30 MB"}
{"level":"info","ts":"2026-08-19T21:08:15.597308Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":741138190,"revision":17803,"compact-revision":15320}
{"level":"info","ts":"2026-08-19T21:08:16.696421Z","caller":"traceutil/trace.go:171","msg":"trace[1927348670] transaction","detail":"{read_only:false; response_revision:20133; number_of_response:1; }","duration":"128.802529ms","start":"2026-08-19T21:08:16.567594Z","end":"2026-08-19T21:08:16.696397Z","steps":["trace[1927348670] 'process raft request'  (duration: 128.322276ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:08:22.848927Z","caller":"traceutil/trace.go:171","msg":"trace[1019267642] transaction","detail":"{read_only:false; response_revision:20166; number_of_response:1; }","duration":"136.61887ms","start":"2026-08-19T21:08:22.712283Z","end":"2026-08-19T21:08:22.848902Z","steps":["trace[1019267642] 'process raft request'  (duration: 136.450246ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:08:23.074571Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.331691ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:481"}
{"level":"info","ts":"2026-08-19T21:08:23.074644Z","caller":"traceutil/trace.go:171","msg":"trace[95812931] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:20166; }","duration":"102.450734ms","start":"2026-08-19T21:08:22.972177Z","end":"2026-08-19T21:08:23.074628Z","steps":["trace[95812931] 'range keys from in-memory index tree'  (duration: 102.194368ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:08:23.074678Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.774828ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"}
{"level":"warn","ts":"2026-08-19T21:08:23.0747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.364172ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:509"}
{"level":"info","ts":"2026-08-19T21:08:23.074759Z","caller":"traceutil/trace.go:171","msg":"trace[980210990] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:20166; }","duration":"101.880371ms","start":"2026-08-19T21:08:22.972859Z","end":"2026-08-19T21:08:23.07474Z","steps":["trace[980210990] 'range keys from in-memory index tree'  (duration: 101.634845ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:08:23.074773Z","caller":"traceutil/trace.go:171","msg":"trace[955254260] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:20166; }","duration":"102.508997ms","start":"2026-08-19T21:08:22.972251Z","end":"2026-08-19T21:08:23.07476Z","steps":["trace[955254260] 'range keys from in-memory index tree'  (duration: 102.210248ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:08:23.261335Z","caller":"traceutil/trace.go:171","msg":"trace[2098122215] transaction","detail":"{read_only:false; response_revision:20167; number_of_response:1; }","duration":"181.828645ms","start":"2026-08-19T21:08:23.079472Z","end":"2026-08-19T21:08:23.2613Z","steps":["trace[2098122215] 'process raft request'  (duration: 181.390705ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:08:23.602263Z","caller":"traceutil/trace.go:171","msg":"trace[1900427433] transaction","detail":"{read_only:false; response_revision:20168; number_of_response:1; }","duration":"522.637907ms","start":"2026-08-19T21:08:23.079592Z","end":"2026-08-19T21:08:23.60223Z","steps":["trace[1900427433] 'process raft request'  (duration: 522.310789ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:08:23.602449Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T21:08:23.07957Z","time spent":"522.78517ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":41,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:20158 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:412 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"info","ts":"2026-08-19T21:08:23.603124Z","caller":"traceutil/trace.go:171","msg":"trace[492217344] transaction","detail":"{read_only:false; response_revision:20169; number_of_response:1; }","duration":"523.457397ms","start":"2026-08-19T21:08:23.079642Z","end":"2026-08-19T21:08:23.603099Z","steps":["trace[492217344] 'process raft request'  (duration: 522.519345ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:08:23.603287Z","caller":"traceutil/trace.go:171","msg":"trace[9968965] linearizableReadLoop","detail":"{readStateIndex:20848; appliedIndex:20844; }","duration":"477.232566ms","start":"2026-08-19T21:08:23.126029Z","end":"2026-08-19T21:08:23.603262Z","steps":["trace[9968965] 'read index received'  (duration: 134.420896ms)","trace[9968965] 'applied index is now lower than readState.Index'  (duration: 342.80954ms)"],"step_count":2}
{"level":"info","ts":"2026-08-19T21:08:23.603377Z","caller":"traceutil/trace.go:171","msg":"trace[1642830816] transaction","detail":"{read_only:false; response_revision:20170; number_of_response:1; }","duration":"523.634901ms","start":"2026-08-19T21:08:23.079719Z","end":"2026-08-19T21:08:23.603354Z","steps":["trace[1642830816] 'process raft request'  (duration: 523.291093ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:08:23.603492Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T21:08:23.079692Z","time spent":"523.742933ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":41,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:20160 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:464 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-08-19T21:08:23.603597Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T21:08:23.07961Z","time spent":"523.59386ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":41,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:20156 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"warn","ts":"2026-08-19T21:08:23.603597Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"477.41449ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/monitoring.coreos.com/thanosrulers/\" range_end:\"/registry/monitoring.coreos.com/thanosrulers0\" count_only:true ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-08-19T21:08:23.603745Z","caller":"traceutil/trace.go:171","msg":"trace[176472742] range","detail":"{range_begin:/registry/monitoring.coreos.com/thanosrulers/; range_end:/registry/monitoring.coreos.com/thanosrulers0; response_count:0; response_revision:20170; }","duration":"477.730188ms","start":"2026-08-19T21:08:23.125992Z","end":"2026-08-19T21:08:23.603722Z","steps":["trace[176472742] 'agreement among raft nodes before linearized reading'  (duration: 477.3799ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:08:23.603998Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T21:08:23.125976Z","time spent":"477.932673ms","remote":"127.0.0.1:48292","response type":"/etcdserverpb.KV/Range","request count":0,"request size":96,"response count":0,"response size":29,"request content":"key:\"/registry/monitoring.coreos.com/thanosrulers/\" range_end:\"/registry/monitoring.coreos.com/thanosrulers0\" count_only:true "}
{"level":"info","ts":"2026-08-19T21:08:23.732152Z","caller":"traceutil/trace.go:171","msg":"trace[1259427961] linearizableReadLoop","detail":"{readStateIndex:20849; appliedIndex:20848; }","duration":"128.786668ms","start":"2026-08-19T21:08:23.603341Z","end":"2026-08-19T21:08:23.732128Z","steps":["trace[1259427961] 'read index received'  (duration: 72.79629ms)","trace[1259427961] 'applied index is now lower than readState.Index'  (duration: 55.988068ms)"],"step_count":2}
{"level":"warn","ts":"2026-08-19T21:08:23.732337Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.767357ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"}
{"level":"warn","ts":"2026-08-19T21:08:23.732366Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.319385ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:440"}
{"level":"info","ts":"2026-08-19T21:08:23.732432Z","caller":"traceutil/trace.go:171","msg":"trace[2138883320] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:20171; }","duration":"182.937871ms","start":"2026-08-19T21:08:23.549472Z","end":"2026-08-19T21:08:23.73241Z","steps":["trace[2138883320] 'agreement among raft nodes before linearized reading'  (duration: 182.757087ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:08:23.732453Z","caller":"traceutil/trace.go:171","msg":"trace[1509678473] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:20171; }","duration":"130.431917ms","start":"2026-08-19T21:08:23.601997Z","end":"2026-08-19T21:08:23.732429Z","steps":["trace[1509678473] 'agreement among raft nodes before linearized reading'  (duration: 130.173371ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:08:23.732614Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"539.296004ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-controller\" ","response":"range_response_count:1 size:531"}
{"level":"info","ts":"2026-08-19T21:08:23.732664Z","caller":"traceutil/trace.go:171","msg":"trace[1537063725] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-controller; range_end:; response_count:1; response_revision:20171; }","duration":"539.389606ms","start":"2026-08-19T21:08:23.193262Z","end":"2026-08-19T21:08:23.732651Z","steps":["trace[1537063725] 'agreement among raft nodes before linearized reading'  (duration: 538.989966ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:08:23.732704Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-08-19T21:08:23.193244Z","time spent":"539.451487ms","remote":"127.0.0.1:52832","response type":"/etcdserverpb.KV/Range","request count":0,"request size":55,"response count":1,"response size":554,"request content":"key:\"/registry/leases/cert-manager/cert-manager-controller\" "}
{"level":"warn","ts":"2026-08-19T21:11:57.110109Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.508517ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:440"}
{"level":"info","ts":"2026-08-19T21:11:57.110479Z","caller":"traceutil/trace.go:171","msg":"trace[920771304] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:22504; }","duration":"226.930727ms","start":"2026-08-19T21:11:56.883523Z","end":"2026-08-19T21:11:57.110454Z","steps":["trace[920771304] 'range keys from in-memory index tree'  (duration: 226.273062ms)"],"step_count":1}
{"level":"warn","ts":"2026-08-19T21:11:57.110163Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"224.278193ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:495"}
{"level":"info","ts":"2026-08-19T21:11:57.110782Z","caller":"traceutil/trace.go:171","msg":"trace[139690055] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:22504; }","duration":"224.931759ms","start":"2026-08-19T21:11:56.885822Z","end":"2026-08-19T21:11:57.110754Z","steps":["trace[139690055] 'range keys from in-memory index tree'  (duration: 224.028007ms)"],"step_count":1}
{"level":"info","ts":"2026-08-19T21:13:15.470249Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":20128}
{"level":"info","ts":"2026-08-19T21:13:15.578795Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":20128,"took":"104.429612ms","hash":2201397625,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":43110400,"current-db-size-in-use":"43 MB"}
{"level":"info","ts":"2026-08-19T21:13:15.578859Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2201397625,"revision":20128,"compact-revision":17803}
{"level":"info","ts":"2026-08-19T21:18:15.476786Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":23345}
{"level":"info","ts":"2026-08-19T21:18:15.613956Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":23345,"took":"133.074796ms","hash":98521930,"current-db-size-bytes":59006976,"current-db-size":"59 MB","current-db-size-in-use-bytes":31272960,"current-db-size-in-use":"31 MB"}
{"level":"info","ts":"2026-08-19T21:18:15.614006Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":98521930,"revision":23345,"compact-revision":20128}