{"level":"warn","ts":"2026-10-14T17:48:33.341588Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-10-14T17:48:33.341738Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.45:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://162.253.55.45:2380","--initial-cluster=instance=https://162.253.55.45:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.45:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.45:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]}
{"level":"warn","ts":"2026-10-14T17:48:33.34182Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-10-14T17:48:33.341838Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.45:2380"]}
{"level":"info","ts":"2026-10-14T17:48:33.341871Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]}
{"level":"info","ts":"2026-10-14T17:48:33.342682Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.45:2379"]}
{"level":"info","ts":"2026-10-14T17:48:33.34282Z","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://162.253.55.45:2380"],"listen-peer-urls":["https://162.253.55.45:2380"],"advertise-client-urls":["https://162.253.55.45:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.45:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.45:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"}
{"level":"info","ts":"2026-10-14T17:48:33.354171Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"11.066633ms"}
{"level":"info","ts":"2026-10-14T17:48:33.367842Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"fbe9b088d8de907a","cluster-id":"332637b4e3714c3a"}
{"level":"info","ts":"2026-10-14T17:48:33.368031Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a switched to configuration voters=()"}
{"level":"info","ts":"2026-10-14T17:48:33.368073Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a became follower at term 0"}
{"level":"info","ts":"2026-10-14T17:48:33.368315Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft fbe9b088d8de907a [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-10-14T17:48:33.368331Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a became follower at term 1"}
{"level":"info","ts":"2026-10-14T17:48:33.368394Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a switched to configuration voters=(18152233874894000250)"}
{"level":"warn","ts":"2026-10-14T17:48:33.393894Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-10-14T17:48:33.406088Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-10-14T17:48:33.416919Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"}
{"level":"info","ts":"2026-10-14T17:48:33.425639Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"fbe9b088d8de907a","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-10-14T17:48:33.425977Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"fbe9b088d8de907a","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-10-14T17:48:33.42618Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"}
{"level":"info","ts":"2026-10-14T17:48:33.42632Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"}
{"level":"info","ts":"2026-10-14T17:48:33.426343Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"}
{"level":"info","ts":"2026-10-14T17:48:33.432012Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]}
{"level":"info","ts":"2026-10-14T17:48:33.432195Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.45:2380"}
{"level":"info","ts":"2026-10-14T17:48:33.432393Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.45:2380"}
{"level":"info","ts":"2026-10-14T17:48:33.432542Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"fbe9b088d8de907a","initial-advertise-peer-urls":["https://162.253.55.45:2380"],"listen-peer-urls":["https://162.253.55.45:2380"],"advertise-client-urls":["https://162.253.55.45:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.45:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-10-14T17:48:33.432623Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-10-14T17:48:33.435433Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a switched to configuration voters=(18152233874894000250)"}
{"level":"info","ts":"2026-10-14T17:48:33.435655Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"332637b4e3714c3a","local-member-id":"fbe9b088d8de907a","added-peer-id":"fbe9b088d8de907a","added-peer-peer-urls":["https://162.253.55.45:2380"]}
{"level":"info","ts":"2026-10-14T17:48:33.569753Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a is starting a new election at term 1"}
{"level":"info","ts":"2026-10-14T17:48:33.569847Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a became pre-candidate at term 1"}
{"level":"info","ts":"2026-10-14T17:48:33.569913Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a received MsgPreVoteResp from fbe9b088d8de907a at term 1"}
{"level":"info","ts":"2026-10-14T17:48:33.570003Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a became candidate at term 2"}
{"level":"info","ts":"2026-10-14T17:48:33.570027Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a received MsgVoteResp from fbe9b088d8de907a at term 2"}
{"level":"info","ts":"2026-10-14T17:48:33.570116Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"fbe9b088d8de907a became leader at term 2"}
{"level":"info","ts":"2026-10-14T17:48:33.570136Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: fbe9b088d8de907a elected leader fbe9b088d8de907a at term 2"}
{"level":"info","ts":"2026-10-14T17:48:33.575074Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-14T17:48:33.575561Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"fbe9b088d8de907a","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.45:2379]}","request-path":"/0/members/fbe9b088d8de907a/attributes","cluster-id":"332637b4e3714c3a","publish-timeout":"7s"}
{"level":"info","ts":"2026-10-14T17:48:33.575621Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-10-14T17:48:33.575664Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-10-14T17:48:33.576137Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-10-14T17:48:33.576242Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-10-14T17:48:33.57912Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.45:2379"}
{"level":"info","ts":"2026-10-14T17:48:33.579271Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-10-14T17:48:33.584081Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"332637b4e3714c3a","local-member-id":"fbe9b088d8de907a","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-14T17:48:33.584267Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-14T17:48:33.584395Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"warn","ts":"2026-10-14T17:48:57.981356Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"139.443959ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10410810765672635295 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:388 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-14T17:48:57.981565Z","caller":"traceutil/trace.go:171","msg":"trace[1523375312] transaction","detail":"{read_only:false; response_revision:394; number_of_response:1; }","duration":"190.826056ms","start":"2026-10-14T17:48:57.790709Z","end":"2026-10-14T17:48:57.981535Z","steps":["trace[1523375312] 'process raft request'  (duration: 50.467487ms)","trace[1523375312] 'compare'  (duration: 139.279835ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:49:25.258864Z","caller":"traceutil/trace.go:171","msg":"trace[173486476] transaction","detail":"{read_only:false; response_revision:608; number_of_response:1; }","duration":"161.463065ms","start":"2026-10-14T17:49:25.097331Z","end":"2026-10-14T17:49:25.258794Z","steps":["trace[173486476] 'process raft request'  (duration: 160.398541ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:49:25.589306Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.733405ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10410810765672635685 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/pods/kube-system/cilium-9lh7r\" mod_revision:500 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-9lh7r\" value_size:17081 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-9lh7r\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-14T17:49:25.589532Z","caller":"traceutil/trace.go:171","msg":"trace[599792226] transaction","detail":"{read_only:false; response_revision:610; number_of_response:1; }","duration":"234.065144ms","start":"2026-10-14T17:49:25.355445Z","end":"2026-10-14T17:49:25.58951Z","steps":["trace[599792226] 'process raft request'  (duration: 233.997403ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:49:25.589638Z","caller":"traceutil/trace.go:171","msg":"trace[643419198] transaction","detail":"{read_only:false; response_revision:609; number_of_response:1; }","duration":"305.489177ms","start":"2026-10-14T17:49:25.284051Z","end":"2026-10-14T17:49:25.58954Z","steps":["trace[643419198] 'process raft request'  (duration: 132.399395ms)","trace[643419198] 'compare'  (duration: 172.537551ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T17:49:25.589973Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T17:49:25.284Z","time spent":"305.803573ms","remote":"127.0.0.1:35890","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-9lh7r\" mod_revision:500 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-9lh7r\" value_size:17081 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-9lh7r\" > >"}
{"level":"warn","ts":"2026-10-14T17:49:26.118122Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"399.653247ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-14T17:49:26.118242Z","caller":"traceutil/trace.go:171","msg":"trace[1020378764] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:610; }","duration":"399.866621ms","start":"2026-10-14T17:49:25.718353Z","end":"2026-10-14T17:49:26.11822Z","steps":["trace[1020378764] 'range keys from in-memory index tree'  (duration: 399.512454ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:49:26.118232Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.165195ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"}
{"level":"warn","ts":"2026-10-14T17:49:26.118291Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T17:49:25.718322Z","time spent":"399.958593ms","remote":"127.0.0.1:50926","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-10-14T17:49:26.118335Z","caller":"traceutil/trace.go:171","msg":"trace[1728388727] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:610; }","duration":"173.328748ms","start":"2026-10-14T17:49:25.94498Z","end":"2026-10-14T17:49:26.118309Z","steps":["trace[1728388727] 'range keys from in-memory index tree'  (duration: 172.828148ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:51:02.931429Z","caller":"traceutil/trace.go:171","msg":"trace[1938219900] transaction","detail":"{read_only:false; response_revision:1906; number_of_response:1; }","duration":"110.783583ms","start":"2026-10-14T17:51:02.820609Z","end":"2026-10-14T17:51:02.931393Z","steps":["trace[1938219900] 'process raft request'  (duration: 52.399073ms)","trace[1938219900] 'compare'  (duration: 58.189046ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:51:02.945464Z","caller":"traceutil/trace.go:171","msg":"trace[244563161] transaction","detail":"{read_only:false; response_revision:1907; number_of_response:1; }","duration":"124.730119ms","start":"2026-10-14T17:51:02.820718Z","end":"2026-10-14T17:51:02.945448Z","steps":["trace[244563161] 'process raft request'  (duration: 124.568435ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:51:02.945794Z","caller":"traceutil/trace.go:171","msg":"trace[958372123] transaction","detail":"{read_only:false; response_revision:1908; number_of_response:1; }","duration":"117.884873ms","start":"2026-10-14T17:51:02.827874Z","end":"2026-10-14T17:51:02.945759Z","steps":["trace[958372123] 'process raft request'  (duration: 117.513096ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:51:39.310962Z","caller":"traceutil/trace.go:171","msg":"trace[1173101759] transaction","detail":"{read_only:false; response_revision:2171; number_of_response:1; }","duration":"106.095504ms","start":"2026-10-14T17:51:39.204837Z","end":"2026-10-14T17:51:39.310933Z","steps":["trace[1173101759] 'process raft request'  (duration: 105.90382ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:51:44.70838Z","caller":"traceutil/trace.go:171","msg":"trace[794606653] transaction","detail":"{read_only:false; response_revision:2208; number_of_response:1; }","duration":"132.708059ms","start":"2026-10-14T17:51:44.57564Z","end":"2026-10-14T17:51:44.708348Z","steps":["trace[794606653] 'process raft request'  (duration: 132.521275ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:52:19.525376Z","caller":"traceutil/trace.go:171","msg":"trace[799855143] transaction","detail":"{read_only:false; response_revision:2498; number_of_response:1; }","duration":"185.996476ms","start":"2026-10-14T17:52:19.339336Z","end":"2026-10-14T17:52:19.525333Z","steps":["trace[799855143] 'process raft request'  (duration: 185.72259ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:52:52.188375Z","caller":"traceutil/trace.go:171","msg":"trace[188869054] transaction","detail":"{read_only:false; response_revision:2723; number_of_response:1; }","duration":"117.787234ms","start":"2026-10-14T17:52:52.070566Z","end":"2026-10-14T17:52:52.188353Z","steps":["trace[188869054] 'process raft request'  (duration: 117.60451ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:52:52.415935Z","caller":"traceutil/trace.go:171","msg":"trace[1956882228] linearizableReadLoop","detail":"{readStateIndex:2833; appliedIndex:2832; }","duration":"109.712484ms","start":"2026-10-14T17:52:52.306202Z","end":"2026-10-14T17:52:52.415914Z","steps":["trace[1956882228] 'read index received'  (duration: 11.178115ms)","trace[1956882228] 'applied index is now lower than readState.Index'  (duration: 98.533579ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:52:52.416012Z","caller":"traceutil/trace.go:171","msg":"trace[1566972143] transaction","detail":"{read_only:false; response_revision:2725; number_of_response:1; }","duration":"168.253184ms","start":"2026-10-14T17:52:52.247735Z","end":"2026-10-14T17:52:52.415988Z","steps":["trace[1566972143] 'process raft request'  (duration: 69.754575ms)","trace[1566972143] 'compare'  (duration: 98.302265ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T17:52:52.41613Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.939069ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:659"}
{"level":"info","ts":"2026-10-14T17:52:52.4162Z","caller":"traceutil/trace.go:171","msg":"trace[1263638781] range","detail":"{range_begin:/registry/configmaps/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:2725; }","duration":"110.02696ms","start":"2026-10-14T17:52:52.306135Z","end":"2026-10-14T17:52:52.416162Z","steps":["trace[1263638781] 'agreement among raft nodes before linearized reading'  (duration: 109.867687ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:54:04.193825Z","caller":"traceutil/trace.go:171","msg":"trace[203278297] transaction","detail":"{read_only:false; response_revision:3384; number_of_response:1; }","duration":"125.651346ms","start":"2026-10-14T17:54:04.06813Z","end":"2026-10-14T17:54:04.193782Z","steps":["trace[203278297] 'process raft request'  (duration: 125.476332ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:54:04.278794Z","caller":"traceutil/trace.go:171","msg":"trace[1147593266] transaction","detail":"{read_only:false; response_revision:3385; number_of_response:1; }","duration":"210.384876ms","start":"2026-10-14T17:54:04.068386Z","end":"2026-10-14T17:54:04.278771Z","steps":["trace[1147593266] 'process raft request'  (duration: 210.252334ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:17.602086Z","caller":"traceutil/trace.go:171","msg":"trace[841359888] transaction","detail":"{read_only:false; response_revision:4541; number_of_response:1; }","duration":"154.169051ms","start":"2026-10-14T17:55:17.44789Z","end":"2026-10-14T17:55:17.602059Z","steps":["trace[841359888] 'process raft request'  (duration: 130.502908ms)","trace[841359888] 'compare'  (duration: 23.477639ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:55:17.616288Z","caller":"traceutil/trace.go:171","msg":"trace[1482007173] transaction","detail":"{read_only:false; response_revision:4542; number_of_response:1; }","duration":"128.165078ms","start":"2026-10-14T17:55:17.488083Z","end":"2026-10-14T17:55:17.616248Z","steps":["trace[1482007173] 'process raft request'  (duration: 127.651806ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:20.505041Z","caller":"traceutil/trace.go:171","msg":"trace[942591139] linearizableReadLoop","detail":"{readStateIndex:4806; appliedIndex:4805; }","duration":"210.733556ms","start":"2026-10-14T17:55:20.294275Z","end":"2026-10-14T17:55:20.505008Z","steps":["trace[942591139] 'read index received'  (duration: 133.904721ms)","trace[942591139] 'applied index is now lower than readState.Index'  (duration: 76.827305ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:55:20.505167Z","caller":"traceutil/trace.go:171","msg":"trace[2083670523] transaction","detail":"{read_only:false; response_revision:4610; number_of_response:1; }","duration":"220.025348ms","start":"2026-10-14T17:55:20.285116Z","end":"2026-10-14T17:55:20.505142Z","steps":["trace[2083670523] 'process raft request'  (duration: 143.183532ms)","trace[2083670523] 'compare'  (duration: 76.57134ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T17:55:20.505297Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"210.999951ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"}
{"level":"info","ts":"2026-10-14T17:55:20.505336Z","caller":"traceutil/trace.go:171","msg":"trace[2076527209] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4610; }","duration":"211.084513ms","start":"2026-10-14T17:55:20.294242Z","end":"2026-10-14T17:55:20.505327Z","steps":["trace[2076527209] 'agreement among raft nodes before linearized reading'  (duration: 210.90469ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:36.582552Z","caller":"traceutil/trace.go:171","msg":"trace[2071795609] transaction","detail":"{read_only:false; response_revision:4883; number_of_response:1; }","duration":"249.910117ms","start":"2026-10-14T17:55:36.332611Z","end":"2026-10-14T17:55:36.582521Z","steps":["trace[2071795609] 'process raft request'  (duration: 249.708423ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:37.526424Z","caller":"traceutil/trace.go:171","msg":"trace[1253357421] linearizableReadLoop","detail":"{readStateIndex:5131; appliedIndex:5129; }","duration":"103.892763ms","start":"2026-10-14T17:55:37.422506Z","end":"2026-10-14T17:55:37.526398Z","steps":["trace[1253357421] 'read index received'  (duration: 61.58431ms)","trace[1253357421] 'applied index is now lower than readState.Index'  (duration: 42.307663ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:55:37.526444Z","caller":"traceutil/trace.go:171","msg":"trace[2066727869] transaction","detail":"{read_only:false; response_revision:4921; number_of_response:1; }","duration":"143.06667ms","start":"2026-10-14T17:55:37.38335Z","end":"2026-10-14T17:55:37.526416Z","steps":["trace[2066727869] 'process raft request'  (duration: 100.749167ms)","trace[2066727869] 'compare'  (duration: 42.094688ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:55:37.526576Z","caller":"traceutil/trace.go:171","msg":"trace[1802239409] transaction","detail":"{read_only:false; response_revision:4922; number_of_response:1; }","duration":"131.191483ms","start":"2026-10-14T17:55:37.395353Z","end":"2026-10-14T17:55:37.526545Z","steps":["trace[1802239409] 'process raft request'  (duration: 131.005558ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:55:37.526655Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.137368ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/monitoring/storage-loki-0\" ","response":"range_response_count:1 size:1781"}
{"level":"info","ts":"2026-10-14T17:55:37.52671Z","caller":"traceutil/trace.go:171","msg":"trace[1017592846] range","detail":"{range_begin:/registry/persistentvolumeclaims/monitoring/storage-loki-0; range_end:; response_count:1; response_revision:4922; }","duration":"104.20244ms","start":"2026-10-14T17:55:37.422492Z","end":"2026-10-14T17:55:37.526694Z","steps":["trace[1017592846] 'agreement among raft nodes before linearized reading'  (duration: 104.002376ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:55:48.963939Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.866967ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"}
{"level":"warn","ts":"2026-10-14T17:55:48.963961Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.519494ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-14T17:55:48.964027Z","caller":"traceutil/trace.go:171","msg":"trace[699006337] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:5121; }","duration":"163.01444ms","start":"2026-10-14T17:55:48.800995Z","end":"2026-10-14T17:55:48.964009Z","steps":["trace[699006337] 'range keys from in-memory index tree'  (duration: 162.656233ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:48.964047Z","caller":"traceutil/trace.go:171","msg":"trace[1601526264] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xmeshes/; range_end:/registry/gateway.networking.x-k8s.io/xmeshes0; response_count:0; response_revision:5121; }","duration":"134.676139ms","start":"2026-10-14T17:55:48.829349Z","end":"2026-10-14T17:55:48.964025Z","steps":["trace[1601526264] 'count revisions from in-memory index tree'  (duration: 134.405473ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.207202Z","caller":"traceutil/trace.go:171","msg":"trace[1037772239] transaction","detail":"{read_only:false; response_revision:5122; number_of_response:1; }","duration":"238.837838ms","start":"2026-10-14T17:55:48.968327Z","end":"2026-10-14T17:55:49.207165Z","steps":["trace[1037772239] 'process raft request'  (duration: 238.531091ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.29405Z","caller":"traceutil/trace.go:171","msg":"trace[14520038] linearizableReadLoop","detail":"{readStateIndex:5338; appliedIndex:5336; }","duration":"317.224232ms","start":"2026-10-14T17:55:48.976785Z","end":"2026-10-14T17:55:49.29401Z","steps":["trace[14520038] 'read index received'  (duration: 230.1063ms)","trace[14520038] 'applied index is now lower than readState.Index'  (duration: 87.116791ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:55:49.294338Z","caller":"traceutil/trace.go:171","msg":"trace[2119964953] transaction","detail":"{read_only:false; response_revision:5123; number_of_response:1; }","duration":"323.553648ms","start":"2026-10-14T17:55:48.970753Z","end":"2026-10-14T17:55:49.294307Z","steps":["trace[2119964953] 'process raft request'  (duration: 315.820531ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.294258Z","caller":"traceutil/trace.go:171","msg":"trace[1701361388] transaction","detail":"{read_only:false; response_revision:5124; number_of_response:1; }","duration":"203.956325ms","start":"2026-10-14T17:55:49.090285Z","end":"2026-10-14T17:55:49.294221Z","steps":["trace[1701361388] 'process raft request'  (duration: 203.671808ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:55:49.294494Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T17:55:48.970739Z","time spent":"323.670351ms","remote":"127.0.0.1:35966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:5030 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >"}
{"level":"warn","ts":"2026-10-14T17:55:49.294738Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.971287ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:645"}
{"level":"info","ts":"2026-10-14T17:55:49.294831Z","caller":"traceutil/trace.go:171","msg":"trace[359569906] range","detail":"{range_begin:/registry/configmaps/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:5124; }","duration":"299.085599ms","start":"2026-10-14T17:55:48.995705Z","end":"2026-10-14T17:55:49.294791Z","steps":["trace[359569906] 'agreement among raft nodes before linearized reading'  (duration: 298.885795ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:55:49.294999Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"318.188862ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:660"}
{"level":"info","ts":"2026-10-14T17:55:49.295087Z","caller":"traceutil/trace.go:171","msg":"trace[212834873] range","detail":"{range_begin:/registry/configmaps/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:5124; }","duration":"318.321525ms","start":"2026-10-14T17:55:48.976742Z","end":"2026-10-14T17:55:49.295064Z","steps":["trace[212834873] 'agreement among raft nodes before linearized reading'  (duration: 318.030469ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:55:49.295139Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T17:55:48.976723Z","time spent":"318.402525ms","remote":"127.0.0.1:35796","response type":"/etcdserverpb.KV/Range","request count":0,"request size":76,"response count":1,"response size":683,"request content":"key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" "}
{"level":"warn","ts":"2026-10-14T17:55:49.295Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.34666ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/monitoring/prometheus-kube-prometheus-stack-prometheus-0\" ","response":"range_response_count:1 size:17207"}
{"level":"info","ts":"2026-10-14T17:55:49.295302Z","caller":"traceutil/trace.go:171","msg":"trace[1060100466] range","detail":"{range_begin:/registry/pods/monitoring/prometheus-kube-prometheus-stack-prometheus-0; range_end:; response_count:1; response_revision:5124; }","duration":"295.658675ms","start":"2026-10-14T17:55:48.999595Z","end":"2026-10-14T17:55:49.295254Z","steps":["trace[1060100466] 'agreement among raft nodes before linearized reading'  (duration: 295.268207ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:55:49.295017Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.714678ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"info","ts":"2026-10-14T17:55:49.295495Z","caller":"traceutil/trace.go:171","msg":"trace[1332946684] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:5124; }","duration":"159.268199ms","start":"2026-10-14T17:55:49.136208Z","end":"2026-10-14T17:55:49.295476Z","steps":["trace[1332946684] 'agreement among raft nodes before linearized reading'  (duration: 158.542035ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.642102Z","caller":"traceutil/trace.go:171","msg":"trace[1531732639] transaction","detail":"{read_only:false; response_revision:5134; number_of_response:1; }","duration":"121.598757ms","start":"2026-10-14T17:55:49.52046Z","end":"2026-10-14T17:55:49.642059Z","steps":["trace[1531732639] 'process raft request'  (duration: 82.160935ms)","trace[1531732639] 'compare'  (duration: 39.053064ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:55:49.642107Z","caller":"traceutil/trace.go:171","msg":"trace[989115935] transaction","detail":"{read_only:false; response_revision:5135; number_of_response:1; }","duration":"120.016852ms","start":"2026-10-14T17:55:49.522064Z","end":"2026-10-14T17:55:49.642081Z","steps":["trace[989115935] 'process raft request'  (duration: 119.90074ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.648295Z","caller":"traceutil/trace.go:171","msg":"trace[636551215] transaction","detail":"{read_only:false; response_revision:5136; number_of_response:1; }","duration":"124.934599ms","start":"2026-10-14T17:55:49.523325Z","end":"2026-10-14T17:55:49.648259Z","steps":["trace[636551215] 'process raft request'  (duration: 124.726894ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.648495Z","caller":"traceutil/trace.go:171","msg":"trace[56460261] transaction","detail":"{read_only:false; response_revision:5137; number_of_response:1; }","duration":"124.842707ms","start":"2026-10-14T17:55:49.523632Z","end":"2026-10-14T17:55:49.648475Z","steps":["trace[56460261] 'process raft request'  (duration: 124.529429ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.648848Z","caller":"traceutil/trace.go:171","msg":"trace[996609892] transaction","detail":"{read_only:false; response_revision:5139; number_of_response:1; }","duration":"115.486624ms","start":"2026-10-14T17:55:49.533347Z","end":"2026-10-14T17:55:49.648833Z","steps":["trace[996609892] 'process raft request'  (duration: 115.361672ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.648941Z","caller":"traceutil/trace.go:171","msg":"trace[437056354] transaction","detail":"{read_only:false; response_revision:5138; number_of_response:1; }","duration":"115.788201ms","start":"2026-10-14T17:55:49.533134Z","end":"2026-10-14T17:55:49.648922Z","steps":["trace[437056354] 'process raft request'  (duration: 115.26643ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:55:49.778629Z","caller":"traceutil/trace.go:171","msg":"trace[1512280419] transaction","detail":"{read_only:false; response_revision:5140; number_of_response:1; }","duration":"107.132593ms","start":"2026-10-14T17:55:49.671464Z","end":"2026-10-14T17:55:49.778597Z","steps":["trace[1512280419] 'process raft request'  (duration: 77.80563ms)","trace[1512280419] 'compare'  (duration: 29.1734ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:55:49.779455Z","caller":"traceutil/trace.go:171","msg":"trace[1899481200] linearizableReadLoop","detail":"{readStateIndex:5356; appliedIndex:5354; }","duration":"100.998581ms","start":"2026-10-14T17:55:49.678436Z","end":"2026-10-14T17:55:49.779434Z","steps":["trace[1899481200] 'read index received'  (duration: 70.82912ms)","trace[1899481200] 'applied index is now lower than readState.Index'  (duration: 30.168201ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T17:55:49.779709Z","caller":"traceutil/trace.go:171","msg":"trace[1586479956] transaction","detail":"{read_only:false; response_revision:5141; number_of_response:1; }","duration":"106.401188ms","start":"2026-10-14T17:55:49.67329Z","end":"2026-10-14T17:55:49.779691Z","steps":["trace[1586479956] 'process raft request'  (duration: 106.0334ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T17:55:49.779771Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.310878ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:11496"}
{"level":"info","ts":"2026-10-14T17:55:49.779951Z","caller":"traceutil/trace.go:171","msg":"trace[1996102588] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:5141; }","duration":"101.501122ms","start":"2026-10-14T17:55:49.678389Z","end":"2026-10-14T17:55:49.77989Z","steps":["trace[1996102588] 'agreement among raft nodes before linearized reading'  (duration: 101.230037ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T17:58:34.001031Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":3165}
{"level":"info","ts":"2026-10-14T17:58:34.132581Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":3165,"took":"129.890221ms","hash":753755796,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":33996800,"current-db-size-in-use":"34 MB"}
{"level":"info","ts":"2026-10-14T17:58:34.132685Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":753755796,"revision":3165,"compact-revision":-1}
{"level":"info","ts":"2026-10-14T18:01:45.463038Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-00000000000021f6.wal"}
{"level":"info","ts":"2026-10-14T18:01:50.245643Z","caller":"traceutil/trace.go:171","msg":"trace[49634868] transaction","detail":"{read_only:false; response_revision:8360; number_of_response:1; }","duration":"340.594211ms","start":"2026-10-14T18:01:49.905022Z","end":"2026-10-14T18:01:50.245616Z","steps":["trace[49634868] 'process raft request'  (duration: 340.431838ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:01:50.245804Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T18:01:49.905001Z","time spent":"340.715463ms","remote":"127.0.0.1:35966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:8348 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >"}
{"level":"warn","ts":"2026-10-14T18:02:01.663257Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.857406ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/08db1feb.percona.com\" ","response":"range_response_count:1 size:526"}
{"level":"info","ts":"2026-10-14T18:02:01.663426Z","caller":"traceutil/trace.go:171","msg":"trace[1067790045] range","detail":"{range_begin:/registry/leases/openstack/08db1feb.percona.com; range_end:; response_count:1; response_revision:8434; }","duration":"200.02816ms","start":"2026-10-14T18:02:01.463368Z","end":"2026-10-14T18:02:01.663397Z","steps":["trace[1067790045] 'range keys from in-memory index tree'  (duration: 199.690092ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:01.669099Z","caller":"traceutil/trace.go:171","msg":"trace[1834336855] transaction","detail":"{read_only:false; response_revision:8435; number_of_response:1; }","duration":"115.035617ms","start":"2026-10-14T18:02:01.554044Z","end":"2026-10-14T18:02:01.669079Z","steps":["trace[1834336855] 'process raft request'  (duration: 114.744392ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:04.478863Z","caller":"traceutil/trace.go:171","msg":"trace[1948991538] transaction","detail":"{read_only:false; response_revision:8453; number_of_response:1; }","duration":"122.449616ms","start":"2026-10-14T18:02:04.35635Z","end":"2026-10-14T18:02:04.4788Z","steps":["trace[1948991538] 'process raft request'  (duration: 122.136119ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:04.478998Z","caller":"traceutil/trace.go:171","msg":"trace[1209184150] linearizableReadLoop","detail":"{readStateIndex:8831; appliedIndex:8830; }","duration":"102.291924ms","start":"2026-10-14T18:02:04.376403Z","end":"2026-10-14T18:02:04.478695Z","steps":["trace[1209184150] 'read index received'  (duration: 102.015289ms)","trace[1209184150] 'applied index is now lower than readState.Index'  (duration: 275.425µs)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T18:02:04.479151Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.728863ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-8x8tl\" ","response":"range_response_count:1 size:6526"}
{"level":"info","ts":"2026-10-14T18:02:04.479234Z","caller":"traceutil/trace.go:171","msg":"trace[1993869304] range","detail":"{range_begin:/registry/pods/openstack/keepalived-8x8tl; range_end:; response_count:1; response_revision:8453; }","duration":"102.960209ms","start":"2026-10-14T18:02:04.376255Z","end":"2026-10-14T18:02:04.479216Z","steps":["trace[1993869304] 'agreement among raft nodes before linearized reading'  (duration: 102.682993ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:29.67157Z","caller":"traceutil/trace.go:171","msg":"trace[1813364254] linearizableReadLoop","detail":"{readStateIndex:9060; appliedIndex:9059; }","duration":"335.553996ms","start":"2026-10-14T18:02:29.335995Z","end":"2026-10-14T18:02:29.671549Z","steps":["trace[1813364254] 'read index received'  (duration: 335.390133ms)","trace[1813364254] 'applied index is now lower than readState.Index'  (duration: 162.923µs)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T18:02:29.671767Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"335.76289ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"info","ts":"2026-10-14T18:02:29.671808Z","caller":"traceutil/trace.go:171","msg":"trace[1117084229] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:8671; }","duration":"335.853742ms","start":"2026-10-14T18:02:29.335944Z","end":"2026-10-14T18:02:29.671798Z","steps":["trace[1117084229] 'agreement among raft nodes before linearized reading'  (duration: 335.725219ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:02:29.671836Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T18:02:29.335927Z","time spent":"335.900714ms","remote":"127.0.0.1:35966","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-10-14T18:02:29.671748Z","caller":"traceutil/trace.go:171","msg":"trace[299463857] transaction","detail":"{read_only:false; response_revision:8671; number_of_response:1; }","duration":"347.81844ms","start":"2026-10-14T18:02:29.323847Z","end":"2026-10-14T18:02:29.671666Z","steps":["trace[299463857] 'process raft request'  (duration: 347.552245ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:02:29.67212Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"240.697763ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"}
{"level":"warn","ts":"2026-10-14T18:02:29.672123Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T18:02:29.323828Z","time spent":"348.149305ms","remote":"127.0.0.1:35966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-scheduler\" mod_revision:8657 > success:<request_put:<key:\"/registry/leases/kube-system/kube-scheduler\" value_size:413 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-scheduler\" > >"}
{"level":"info","ts":"2026-10-14T18:02:29.672186Z","caller":"traceutil/trace.go:171","msg":"trace[1227856776] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:8671; }","duration":"240.807174ms","start":"2026-10-14T18:02:29.431363Z","end":"2026-10-14T18:02:29.67217Z","steps":["trace[1227856776] 'agreement among raft nodes before linearized reading'  (duration: 240.566589ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:31.735791Z","caller":"traceutil/trace.go:171","msg":"trace[261360189] transaction","detail":"{read_only:false; response_revision:8684; number_of_response:1; }","duration":"107.171939ms","start":"2026-10-14T18:02:31.62859Z","end":"2026-10-14T18:02:31.735762Z","steps":["trace[261360189] 'process raft request'  (duration: 106.895193ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:43.537715Z","caller":"traceutil/trace.go:171","msg":"trace[552380595] linearizableReadLoop","detail":"{readStateIndex:9203; appliedIndex:9202; }","duration":"224.486365ms","start":"2026-10-14T18:02:43.3132Z","end":"2026-10-14T18:02:43.537686Z","steps":["trace[552380595] 'read index received'  (duration: 224.234589ms)","trace[552380595] 'applied index is now lower than readState.Index'  (duration: 250.526µs)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:02:43.538111Z","caller":"traceutil/trace.go:171","msg":"trace[665231847] transaction","detail":"{read_only:false; response_revision:8805; number_of_response:1; }","duration":"225.991867ms","start":"2026-10-14T18:02:43.312097Z","end":"2026-10-14T18:02:43.538089Z","steps":["trace[665231847] 'process raft request'  (duration: 225.414824ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:02:43.538755Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"225.514257ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumendpoints/openstack/rook-ceph-detect-version-t8hpp\" ","response":"range_response_count:1 size:2804"}
{"level":"info","ts":"2026-10-14T18:02:43.538911Z","caller":"traceutil/trace.go:171","msg":"trace[2136482421] range","detail":"{range_begin:/registry/cilium.io/ciliumendpoints/openstack/rook-ceph-detect-version-t8hpp; range_end:; response_count:1; response_revision:8805; }","duration":"225.697331ms","start":"2026-10-14T18:02:43.31317Z","end":"2026-10-14T18:02:43.538868Z","steps":["trace[2136482421] 'agreement among raft nodes before linearized reading'  (duration: 225.15357ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:43.648534Z","caller":"traceutil/trace.go:171","msg":"trace[211486481] transaction","detail":"{read_only:false; number_of_response:1; response_revision:8806; }","duration":"107.233959ms","start":"2026-10-14T18:02:43.54126Z","end":"2026-10-14T18:02:43.648494Z","steps":["trace[211486481] 'process raft request'  (duration: 73.052786ms)","trace[211486481] 'compare'  (duration: 33.840386ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:02:44.472538Z","caller":"traceutil/trace.go:171","msg":"trace[388562067] transaction","detail":"{read_only:false; response_revision:8816; number_of_response:1; }","duration":"108.552098ms","start":"2026-10-14T18:02:44.363964Z","end":"2026-10-14T18:02:44.472516Z","steps":["trace[388562067] 'process raft request'  (duration: 108.065158ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:45.007058Z","caller":"traceutil/trace.go:171","msg":"trace[597674165] transaction","detail":"{read_only:false; response_revision:8819; number_of_response:1; }","duration":"170.242141ms","start":"2026-10-14T18:02:44.836783Z","end":"2026-10-14T18:02:45.007025Z","steps":["trace[597674165] 'process raft request'  (duration: 169.983175ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:02:45.06757Z","caller":"traceutil/trace.go:171","msg":"trace[1056691788] transaction","detail":"{read_only:false; response_revision:8820; number_of_response:1; }","duration":"138.0155ms","start":"2026-10-14T18:02:44.929515Z","end":"2026-10-14T18:02:45.067531Z","steps":["trace[1056691788] 'process raft request'  (duration: 112.335839ms)","trace[1056691788] 'compare'  (duration: 25.222201ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:03:34.008711Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":6523}
{"level":"info","ts":"2026-10-14T18:03:34.122226Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":6523,"took":"111.518732ms","hash":4049992064,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":25878528,"current-db-size-in-use":"26 MB"}
{"level":"info","ts":"2026-10-14T18:03:34.122301Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":4049992064,"revision":6523,"compact-revision":3165}
{"level":"info","ts":"2026-10-14T18:03:55.390992Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"fbe9b088d8de907a","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-10-14T18:03:55.396671Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001}
{"level":"info","ts":"2026-10-14T18:03:55.396781Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001}
{"level":"info","ts":"2026-10-14T18:04:01.51577Z","caller":"traceutil/trace.go:171","msg":"trace[795778989] linearizableReadLoop","detail":"{readStateIndex:10040; appliedIndex:10039; }","duration":"160.691747ms","start":"2026-10-14T18:04:01.355055Z","end":"2026-10-14T18:04:01.515747Z","steps":["trace[795778989] 'read index received'  (duration: 160.499693ms)","trace[795778989] 'applied index is now lower than readState.Index'  (duration: 191.214µs)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:04:01.515834Z","caller":"traceutil/trace.go:171","msg":"trace[1485453231] transaction","detail":"{read_only:false; response_revision:9606; number_of_response:1; }","duration":"172.606853ms","start":"2026-10-14T18:04:01.343198Z","end":"2026-10-14T18:04:01.515805Z","steps":["trace[1485453231] 'process raft request'  (duration: 172.401267ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:04:01.516037Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.966632ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:645"}
{"level":"info","ts":"2026-10-14T18:04:01.516101Z","caller":"traceutil/trace.go:171","msg":"trace[1421189353] range","detail":"{range_begin:/registry/configmaps/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:9606; }","duration":"161.072014ms","start":"2026-10-14T18:04:01.355011Z","end":"2026-10-14T18:04:01.516083Z","steps":["trace[1421189353] 'agreement among raft nodes before linearized reading'  (duration: 160.88109ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:04:01.516123Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.146317ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:660"}
{"level":"info","ts":"2026-10-14T18:04:01.516185Z","caller":"traceutil/trace.go:171","msg":"trace[104136414] range","detail":"{range_begin:/registry/configmaps/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:9606; }","duration":"155.24665ms","start":"2026-10-14T18:04:01.360917Z","end":"2026-10-14T18:04:01.516163Z","steps":["trace[104136414] 'agreement among raft nodes before linearized reading'  (duration: 155.067096ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:04:01.789837Z","caller":"traceutil/trace.go:171","msg":"trace[709568304] transaction","detail":"{read_only:false; response_revision:9608; number_of_response:1; }","duration":"266.900994ms","start":"2026-10-14T18:04:01.522884Z","end":"2026-10-14T18:04:01.789785Z","steps":["trace[709568304] 'process raft request'  (duration: 249.697125ms)","trace[709568304] 'compare'  (duration: 16.386072ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:04:01.789618Z","caller":"traceutil/trace.go:171","msg":"trace[649062238] transaction","detail":"{read_only:false; response_revision:9609; number_of_response:1; }","duration":"266.052317ms","start":"2026-10-14T18:04:01.523527Z","end":"2026-10-14T18:04:01.789579Z","steps":["trace[649062238] 'process raft request'  (duration: 265.910694ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:07:46.327314Z","caller":"traceutil/trace.go:171","msg":"trace[310771089] transaction","detail":"{read_only:false; number_of_response:0; response_revision:11823; }","duration":"137.054355ms","start":"2026-10-14T18:07:46.190226Z","end":"2026-10-14T18:07:46.32728Z","steps":["trace[310771089] 'process raft request'  (duration: 136.976083ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:08:34.016612Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":9309}
{"level":"info","ts":"2026-10-14T18:08:34.110088Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":9309,"took":"91.161434ms","hash":1393805262,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":28065792,"current-db-size-in-use":"28 MB"}
{"level":"info","ts":"2026-10-14T18:08:34.110169Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1393805262,"revision":9309,"compact-revision":6523}
{"level":"info","ts":"2026-10-14T18:13:34.023545Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":12235}
{"level":"info","ts":"2026-10-14T18:13:34.126697Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":12235,"took":"100.596355ms","hash":1574530819,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":25731072,"current-db-size-in-use":"26 MB"}
{"level":"info","ts":"2026-10-14T18:13:34.12677Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1574530819,"revision":12235,"compact-revision":9309}
{"level":"warn","ts":"2026-10-14T18:14:09.762208Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.179857ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10410810765672673888 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:14927 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:371 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-14T18:14:09.762606Z","caller":"traceutil/trace.go:171","msg":"trace[1537059041] transaction","detail":"{read_only:false; response_revision:14939; number_of_response:1; }","duration":"202.193652ms","start":"2026-10-14T18:14:09.560339Z","end":"2026-10-14T18:14:09.762533Z","steps":["trace[1537059041] 'process raft request'  (duration: 86.602175ms)","trace[1537059041] 'compare'  (duration: 115.031405ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T18:14:15.41576Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"238.142453ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:660"}
{"level":"info","ts":"2026-10-14T18:14:15.415849Z","caller":"traceutil/trace.go:171","msg":"trace[604118214] range","detail":"{range_begin:/registry/configmaps/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:14972; }","duration":"238.283246ms","start":"2026-10-14T18:14:15.177547Z","end":"2026-10-14T18:14:15.41583Z","steps":["trace[604118214] 'range keys from in-memory index tree'  (duration: 237.972679ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:14:15.415874Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.671412ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:645"}
{"level":"info","ts":"2026-10-14T18:14:15.416142Z","caller":"traceutil/trace.go:171","msg":"trace[85677033] range","detail":"{range_begin:/registry/configmaps/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:14972; }","duration":"237.940949ms","start":"2026-10-14T18:14:15.178165Z","end":"2026-10-14T18:14:15.416106Z","steps":["trace[85677033] 'range keys from in-memory index tree'  (duration: 237.555219ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:14:15.709914Z","caller":"traceutil/trace.go:171","msg":"trace[1233568710] transaction","detail":"{read_only:false; response_revision:14974; number_of_response:1; }","duration":"285.324963ms","start":"2026-10-14T18:14:15.424561Z","end":"2026-10-14T18:14:15.709886Z","steps":["trace[1233568710] 'process raft request'  (duration: 271.245001ms)","trace[1233568710] 'compare'  (duration: 13.419688ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:14:15.709923Z","caller":"traceutil/trace.go:171","msg":"trace[1948535661] linearizableReadLoop","detail":"{readStateIndex:15675; appliedIndex:15674; }","duration":"220.310022ms","start":"2026-10-14T18:14:15.48958Z","end":"2026-10-14T18:14:15.70989Z","steps":["trace[1948535661] 'read index received'  (duration: 206.223719ms)","trace[1948535661] 'applied index is now lower than readState.Index'  (duration: 14.084252ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T18:14:15.710151Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"220.551137ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:567"}
{"level":"info","ts":"2026-10-14T18:14:15.71016Z","caller":"traceutil/trace.go:171","msg":"trace[174396281] transaction","detail":"{read_only:false; response_revision:14975; number_of_response:1; }","duration":"118.045749ms","start":"2026-10-14T18:14:15.592024Z","end":"2026-10-14T18:14:15.71007Z","steps":["trace[174396281] 'process raft request'  (duration: 117.780763ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:14:15.710207Z","caller":"traceutil/trace.go:171","msg":"trace[1829213969] range","detail":"{range_begin:/registry/leases/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:14975; }","duration":"220.658849ms","start":"2026-10-14T18:14:15.489533Z","end":"2026-10-14T18:14:15.710192Z","steps":["trace[1829213969] 'agreement among raft nodes before linearized reading'  (duration: 220.444795ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:14:15.720747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.519867ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"warn","ts":"2026-10-14T18:14:15.720754Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.261686ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"}
{"level":"info","ts":"2026-10-14T18:14:15.72082Z","caller":"traceutil/trace.go:171","msg":"trace[207283996] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:14976; }","duration":"179.648789ms","start":"2026-10-14T18:14:15.541153Z","end":"2026-10-14T18:14:15.720801Z","steps":["trace[207283996] 'agreement among raft nodes before linearized reading'  (duration: 179.443525ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:14:15.720838Z","caller":"traceutil/trace.go:171","msg":"trace[1775255608] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:14976; }","duration":"175.386667ms","start":"2026-10-14T18:14:15.545429Z","end":"2026-10-14T18:14:15.720816Z","steps":["trace[1775255608] 'agreement among raft nodes before linearized reading'  (duration: 175.140482ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:14:15.920189Z","caller":"traceutil/trace.go:171","msg":"trace[1621668962] transaction","detail":"{read_only:false; response_revision:14977; number_of_response:1; }","duration":"205.472163ms","start":"2026-10-14T18:14:15.714687Z","end":"2026-10-14T18:14:15.92016Z","steps":["trace[1621668962] 'process raft request'  (duration: 205.3261ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:14:15.920209Z","caller":"traceutil/trace.go:171","msg":"trace[1123254012] linearizableReadLoop","detail":"{readStateIndex:15678; appliedIndex:15677; }","duration":"199.663109ms","start":"2026-10-14T18:14:15.72051Z","end":"2026-10-14T18:14:15.920173Z","steps":["trace[1123254012] 'read index received'  (duration: 199.621748ms)","trace[1123254012] 'applied index is now lower than readState.Index'  (duration: 38.961µs)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T18:14:15.920441Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.742964ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-14T18:14:15.920516Z","caller":"traceutil/trace.go:171","msg":"trace[30302392] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:14977; }","duration":"202.850446ms","start":"2026-10-14T18:14:15.717632Z","end":"2026-10-14T18:14:15.920483Z","steps":["trace[30302392] 'agreement among raft nodes before linearized reading'  (duration: 202.683812ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:14:15.920676Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"205.770469ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:552"}
{"level":"info","ts":"2026-10-14T18:14:15.920774Z","caller":"traceutil/trace.go:171","msg":"trace[449284422] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:14977; }","duration":"205.915822ms","start":"2026-10-14T18:14:15.714835Z","end":"2026-10-14T18:14:15.92075Z","steps":["trace[449284422] 'agreement among raft nodes before linearized reading'  (duration: 205.631186ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:14:15.921976Z","caller":"traceutil/trace.go:171","msg":"trace[983152810] transaction","detail":"{read_only:false; response_revision:14978; number_of_response:1; }","duration":"196.596203ms","start":"2026-10-14T18:14:15.725363Z","end":"2026-10-14T18:14:15.921959Z","steps":["trace[983152810] 'process raft request'  (duration: 196.472231ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:14:15.922114Z","caller":"traceutil/trace.go:171","msg":"trace[1100823564] transaction","detail":"{read_only:false; response_revision:14979; number_of_response:1; }","duration":"196.588423ms","start":"2026-10-14T18:14:15.725489Z","end":"2026-10-14T18:14:15.922077Z","steps":["trace[1100823564] 'process raft request'  (duration: 196.429619ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:14:15.922275Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.294349ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" count_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-14T18:14:15.92231Z","caller":"traceutil/trace.go:171","msg":"trace[1876968470] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:14979; }","duration":"198.36253ms","start":"2026-10-14T18:14:15.723937Z","end":"2026-10-14T18:14:15.9223Z","steps":["trace[1876968470] 'agreement among raft nodes before linearized reading'  (duration: 198.291029ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:14:15.922312Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.436338ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/08db1feb.percona.com\" ","response":"range_response_count:1 size:526"}
{"level":"info","ts":"2026-10-14T18:14:15.922365Z","caller":"traceutil/trace.go:171","msg":"trace[513424487] range","detail":"{range_begin:/registry/leases/openstack/08db1feb.percona.com; range_end:; response_count:1; response_revision:14979; }","duration":"132.54156ms","start":"2026-10-14T18:14:15.789807Z","end":"2026-10-14T18:14:15.922349Z","steps":["trace[513424487] 'agreement among raft nodes before linearized reading'  (duration: 132.403867ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:14:15.922567Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.200365ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:439"}
{"level":"info","ts":"2026-10-14T18:14:15.922603Z","caller":"traceutil/trace.go:171","msg":"trace[1894844344] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:14979; }","duration":"133.280255ms","start":"2026-10-14T18:14:15.789314Z","end":"2026-10-14T18:14:15.922595Z","steps":["trace[1894844344] 'agreement among raft nodes before linearized reading'  (duration: 133.175463ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:16:02.773203Z","caller":"traceutil/trace.go:171","msg":"trace[1451443208] transaction","detail":"{read_only:false; response_revision:16229; number_of_response:1; }","duration":"202.235391ms","start":"2026-10-14T18:16:02.570923Z","end":"2026-10-14T18:16:02.773158Z","steps":["trace[1451443208] 'process raft request'  (duration: 158.715848ms)","trace[1451443208] 'compare'  (duration: 43.047853ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:16:02.773318Z","caller":"traceutil/trace.go:171","msg":"trace[737966246] linearizableReadLoop","detail":"{readStateIndex:16988; appliedIndex:16985; }","duration":"200.479794ms","start":"2026-10-14T18:16:02.572784Z","end":"2026-10-14T18:16:02.773264Z","steps":["trace[737966246] 'read index received'  (duration: 23.378462ms)","trace[737966246] 'applied index is now lower than readState.Index'  (duration: 177.095682ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:16:02.773238Z","caller":"traceutil/trace.go:171","msg":"trace[607227621] transaction","detail":"{read_only:false; response_revision:16230; number_of_response:1; }","duration":"202.094189ms","start":"2026-10-14T18:16:02.571075Z","end":"2026-10-14T18:16:02.77317Z","steps":["trace[607227621] 'process raft request'  (duration: 201.775802ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:16:02.773729Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.970122ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-db-sync\" ","response":"range_response_count:1 size:5520"}
{"level":"info","ts":"2026-10-14T18:16:02.773814Z","caller":"traceutil/trace.go:171","msg":"trace[1947218203] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:16230; }","duration":"145.169006ms","start":"2026-10-14T18:16:02.628618Z","end":"2026-10-14T18:16:02.773787Z","steps":["trace[1947218203] 'agreement among raft nodes before linearized reading'  (duration: 144.89958ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:16:02.773813Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.449667ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/openstack/nova-api\" ","response":"range_response_count:1 size:667"}
{"level":"warn","ts":"2026-10-14T18:16:02.773841Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"152.735238ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-db-sync\" ","response":"range_response_count:1 size:5520"}
{"level":"info","ts":"2026-10-14T18:16:02.773876Z","caller":"traceutil/trace.go:171","msg":"trace[1970878346] range","detail":"{range_begin:/registry/services/endpoints/openstack/nova-api; range_end:; response_count:1; response_revision:16230; }","duration":"154.526886ms","start":"2026-10-14T18:16:02.61933Z","end":"2026-10-14T18:16:02.773856Z","steps":["trace[1970878346] 'agreement among raft nodes before linearized reading'  (duration: 154.374783ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:16:02.773912Z","caller":"traceutil/trace.go:171","msg":"trace[1402734971] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:16230; }","duration":"152.82334ms","start":"2026-10-14T18:16:02.621071Z","end":"2026-10-14T18:16:02.773894Z","steps":["trace[1402734971] 'agreement among raft nodes before linearized reading'  (duration: 152.599165ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:16:02.773613Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.754593ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-ks-user\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-10-14T18:16:02.774232Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.417184ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/openstack/nova-api\" ","response":"range_response_count:1 size:667"}
{"level":"info","ts":"2026-10-14T18:16:02.774278Z","caller":"traceutil/trace.go:171","msg":"trace[1827977640] range","detail":"{range_begin:/registry/jobs/openstack/nova-ks-user; range_end:; response_count:0; response_revision:16230; }","duration":"169.474259ms","start":"2026-10-14T18:16:02.604785Z","end":"2026-10-14T18:16:02.774259Z","steps":["trace[1827977640] 'agreement among raft nodes before linearized reading'  (duration: 168.736873ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:16:02.774323Z","caller":"traceutil/trace.go:171","msg":"trace[846772959] range","detail":"{range_begin:/registry/services/endpoints/openstack/nova-api; range_end:; response_count:1; response_revision:16230; }","duration":"201.547906ms","start":"2026-10-14T18:16:02.572752Z","end":"2026-10-14T18:16:02.7743Z","steps":["trace[846772959] 'agreement among raft nodes before linearized reading'  (duration: 200.605185ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:16:02.773621Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.447076ms","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-10-14T18:16:02.774473Z","caller":"traceutil/trace.go:171","msg":"trace[502839280] range","detail":"{range_begin:/registry/jobs/openstack/nova-rabbit-init; range_end:; response_count:0; response_revision:16230; }","duration":"155.353435ms","start":"2026-10-14T18:16:02.619102Z","end":"2026-10-14T18:16:02.774455Z","steps":["trace[502839280] 'agreement among raft nodes before linearized reading'  (duration: 154.440905ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:16:02.773667Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.152619ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-ks-endpoints\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-14T18:16:02.774659Z","caller":"traceutil/trace.go:171","msg":"trace[656169415] range","detail":"{range_begin:/registry/jobs/openstack/nova-ks-endpoints; range_end:; response_count:0; response_revision:16230; }","duration":"169.10671ms","start":"2026-10-14T18:16:02.605485Z","end":"2026-10-14T18:16:02.774592Z","steps":["trace[656169415] 'agreement among raft nodes before linearized reading'  (duration: 168.1551ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:16:02.773701Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.854424ms","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-10-14T18:16:02.77478Z","caller":"traceutil/trace.go:171","msg":"trace[1816083170] range","detail":"{range_begin:/registry/jobs/openstack/nova-rabbit-init; range_end:; response_count:0; response_revision:16230; }","duration":"169.954798ms","start":"2026-10-14T18:16:02.604814Z","end":"2026-10-14T18:16:02.774769Z","steps":["trace[1816083170] 'agreement among raft nodes before linearized reading'  (duration: 168.868875ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:18:34.035256Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":14680}
{"level":"info","ts":"2026-10-14T18:18:34.147894Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":14680,"took":"109.985781ms","hash":3556980243,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":29483008,"current-db-size-in-use":"30 MB"}
{"level":"info","ts":"2026-10-14T18:18:34.147965Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3556980243,"revision":14680,"compact-revision":12235}
{"level":"info","ts":"2026-10-14T18:21:18.884149Z","caller":"traceutil/trace.go:171","msg":"trace[572088937] linearizableReadLoop","detail":"{readStateIndex:19976; appliedIndex:19974; }","duration":"296.272613ms","start":"2026-10-14T18:21:18.587848Z","end":"2026-10-14T18:21:18.88412Z","steps":["trace[572088937] 'read index received'  (duration: 12.884236ms)","trace[572088937] 'applied index is now lower than readState.Index'  (duration: 283.387317ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:21:18.884294Z","caller":"traceutil/trace.go:171","msg":"trace[419050548] transaction","detail":"{read_only:false; response_revision:19076; number_of_response:1; }","duration":"335.381781ms","start":"2026-10-14T18:21:18.548889Z","end":"2026-10-14T18:21:18.884271Z","steps":["trace[419050548] 'process raft request'  (duration: 330.121338ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:21:18.884383Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"296.486118ms","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:8"}
{"level":"warn","ts":"2026-10-14T18:21:18.884484Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T18:21:18.548852Z","time spent":"335.508453ms","remote":"127.0.0.1:35966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":41,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:19061 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"info","ts":"2026-10-14T18:21:18.884529Z","caller":"traceutil/trace.go:171","msg":"trace[2015765015] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/; range_end:/registry/pxc.percona.com/perconaxtradbclusters0; response_count:0; response_revision:19076; }","duration":"296.718964ms","start":"2026-10-14T18:21:18.587781Z","end":"2026-10-14T18:21:18.8845Z","steps":["trace[2015765015] 'agreement among raft nodes before linearized reading'  (duration: 296.476109ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:21:18.884868Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.508455ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/libvirt-libvirt-default-f7v8k\" ","response":"range_response_count:1 size:20735"}
{"level":"info","ts":"2026-10-14T18:21:18.884917Z","caller":"traceutil/trace.go:171","msg":"trace[1503766752] range","detail":"{range_begin:/registry/pods/openstack/libvirt-libvirt-default-f7v8k; range_end:; response_count:1; response_revision:19076; }","duration":"138.600388ms","start":"2026-10-14T18:21:18.746302Z","end":"2026-10-14T18:21:18.884903Z","steps":["trace[1503766752] 'agreement among raft nodes before linearized reading'  (duration: 137.985045ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:19.073936Z","caller":"traceutil/trace.go:171","msg":"trace[474164202] linearizableReadLoop","detail":"{readStateIndex:19978; appliedIndex:19977; }","duration":"115.320019ms","start":"2026-10-14T18:21:18.958575Z","end":"2026-10-14T18:21:19.073895Z","steps":["trace[474164202] 'read index received'  (duration: 114.927681ms)","trace[474164202] 'applied index is now lower than readState.Index'  (duration: 390.918µs)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:21:19.074417Z","caller":"traceutil/trace.go:171","msg":"trace[1197809492] transaction","detail":"{read_only:false; response_revision:19078; number_of_response:1; }","duration":"164.158974ms","start":"2026-10-14T18:21:18.910208Z","end":"2026-10-14T18:21:19.074367Z","steps":["trace[1197809492] 'process raft request'  (duration: 163.347756ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:21:19.074691Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.092896ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:662"}
{"level":"info","ts":"2026-10-14T18:21:19.074784Z","caller":"traceutil/trace.go:171","msg":"trace[221744822] range","detail":"{range_begin:/registry/configmaps/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:19078; }","duration":"116.245939ms","start":"2026-10-14T18:21:18.958514Z","end":"2026-10-14T18:21:19.07476Z","steps":["trace[221744822] 'agreement among raft nodes before linearized reading'  (duration: 115.927973ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:20.832876Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"fbe9b088d8de907a","local-member-applied-index":20002,"local-member-snapshot-index":10001,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-10-14T18:21:20.841349Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":20002}
{"level":"info","ts":"2026-10-14T18:21:20.84151Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":15002}
{"level":"info","ts":"2026-10-14T18:21:27.519149Z","caller":"traceutil/trace.go:171","msg":"trace[1453722764] transaction","detail":"{read_only:false; response_revision:19233; number_of_response:1; }","duration":"104.417647ms","start":"2026-10-14T18:21:27.414694Z","end":"2026-10-14T18:21:27.519112Z","steps":["trace[1453722764] 'process raft request'  (duration: 104.165261ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:27.519348Z","caller":"traceutil/trace.go:171","msg":"trace[1703408127] transaction","detail":"{read_only:false; number_of_response:1; response_revision:19233; }","duration":"103.788082ms","start":"2026-10-14T18:21:27.415525Z","end":"2026-10-14T18:21:27.519313Z","steps":["trace[1703408127] 'process raft request'  (duration: 103.540837ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:27.893684Z","caller":"traceutil/trace.go:171","msg":"trace[1224282294] transaction","detail":"{read_only:false; response_revision:19249; number_of_response:1; }","duration":"132.225301ms","start":"2026-10-14T18:21:27.761429Z","end":"2026-10-14T18:21:27.893654Z","steps":["trace[1224282294] 'process raft request'  (duration: 132.006377ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:27.893745Z","caller":"traceutil/trace.go:171","msg":"trace[309865961] transaction","detail":"{read_only:false; response_revision:19247; number_of_response:1; }","duration":"132.602239ms","start":"2026-10-14T18:21:27.761126Z","end":"2026-10-14T18:21:27.893728Z","steps":["trace[309865961] 'process raft request'  (duration: 132.19891ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:27.893827Z","caller":"traceutil/trace.go:171","msg":"trace[2112372709] transaction","detail":"{read_only:false; response_revision:19251; number_of_response:1; }","duration":"124.085887ms","start":"2026-10-14T18:21:27.769697Z","end":"2026-10-14T18:21:27.893783Z","steps":["trace[2112372709] 'process raft request'  (duration: 123.780981ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:27.89386Z","caller":"traceutil/trace.go:171","msg":"trace[1277019546] transaction","detail":"{read_only:false; response_revision:19248; number_of_response:1; }","duration":"132.63204ms","start":"2026-10-14T18:21:27.761217Z","end":"2026-10-14T18:21:27.893849Z","steps":["trace[1277019546] 'process raft request'  (duration: 132.194691ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:27.893974Z","caller":"traceutil/trace.go:171","msg":"trace[491874387] linearizableReadLoop","detail":"{readStateIndex:20157; appliedIndex:20151; }","duration":"128.596063ms","start":"2026-10-14T18:21:27.765371Z","end":"2026-10-14T18:21:27.893967Z","steps":["trace[491874387] 'read index received'  (duration: 10.721209ms)","trace[491874387] 'applied index is now lower than readState.Index'  (duration: 117.874074ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T18:21:27.894029Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.653184ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-1\" ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-10-14T18:21:27.894051Z","caller":"traceutil/trace.go:171","msg":"trace[1898327512] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-1; range_end:; response_count:0; response_revision:19252; }","duration":"128.725386ms","start":"2026-10-14T18:21:27.765319Z","end":"2026-10-14T18:21:27.894045Z","steps":["trace[1898327512] 'agreement among raft nodes before linearized reading'  (duration: 128.670995ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:27.894143Z","caller":"traceutil/trace.go:171","msg":"trace[732098713] transaction","detail":"{read_only:false; response_revision:19246; number_of_response:1; }","duration":"133.07129ms","start":"2026-10-14T18:21:27.761066Z","end":"2026-10-14T18:21:27.894137Z","steps":["trace[732098713] 'process raft request'  (duration: 121.261856ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:21:27.894141Z","caller":"traceutil/trace.go:171","msg":"trace[1085379881] transaction","detail":"{read_only:false; response_revision:19250; number_of_response:1; }","duration":"130.389432ms","start":"2026-10-14T18:21:27.763718Z","end":"2026-10-14T18:21:27.894107Z","steps":["trace[1085379881] 'process raft request'  (duration: 129.743198ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:23:34.043051Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":17556}
{"level":"info","ts":"2026-10-14T18:23:34.153608Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":17556,"took":"107.152983ms","hash":1883305295,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":35192832,"current-db-size-in-use":"35 MB"}
{"level":"info","ts":"2026-10-14T18:23:34.153754Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1883305295,"revision":17556,"compact-revision":14680}
{"level":"info","ts":"2026-10-14T18:28:34.054446Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":20582}
{"level":"info","ts":"2026-10-14T18:28:34.194391Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":20582,"took":"135.683291ms","hash":1243841977,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":32591872,"current-db-size-in-use":"33 MB"}
{"level":"info","ts":"2026-10-14T18:28:34.194461Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1243841977,"revision":20582,"compact-revision":17556}
{"level":"warn","ts":"2026-10-14T18:29:10.996894Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.783267ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10410810765672701899 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:23547 > 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:18"}
{"level":"info","ts":"2026-10-14T18:29:10.997213Z","caller":"traceutil/trace.go:171","msg":"trace[2098341936] linearizableReadLoop","detail":"{readStateIndex:24677; appliedIndex:24674; }","duration":"227.737383ms","start":"2026-10-14T18:29:10.769452Z","end":"2026-10-14T18:29:10.997189Z","steps":["trace[2098341936] 'read index received'  (duration: 226.304632ms)","trace[2098341936] 'applied index is now lower than readState.Index'  (duration: 1.431751ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:29:10.99731Z","caller":"traceutil/trace.go:171","msg":"trace[1068836966] transaction","detail":"{read_only:false; response_revision:23562; number_of_response:1; }","duration":"249.940087ms","start":"2026-10-14T18:29:10.747342Z","end":"2026-10-14T18:29:10.997282Z","steps":["trace[1068836966] 'process raft request'  (duration: 249.703092ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:29:10.997349Z","caller":"traceutil/trace.go:171","msg":"trace[468786754] transaction","detail":"{read_only:false; response_revision:23563; number_of_response:1; }","duration":"248.64847ms","start":"2026-10-14T18:29:10.748638Z","end":"2026-10-14T18:29:10.997287Z","steps":["trace[468786754] 'process raft request'  (duration: 248.487546ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:29:10.997438Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.970758ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:662"}
{"level":"info","ts":"2026-10-14T18:29:10.997456Z","caller":"traceutil/trace.go:171","msg":"trace[310174391] transaction","detail":"{read_only:false; response_revision:23561; number_of_response:1; }","duration":"251.796497ms","start":"2026-10-14T18:29:10.745635Z","end":"2026-10-14T18:29:10.997432Z","steps":["trace[310174391] 'process raft request'  (duration: 21.291834ms)","trace[310174391] 'compare'  (duration: 229.388059ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:29:10.997498Z","caller":"traceutil/trace.go:171","msg":"trace[1245949018] range","detail":"{range_begin:/registry/configmaps/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:23563; }","duration":"228.070781ms","start":"2026-10-14T18:29:10.769412Z","end":"2026-10-14T18:29:10.997483Z","steps":["trace[1245949018] 'agreement among raft nodes before linearized reading'  (duration: 227.854126ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:29:11.184729Z","caller":"traceutil/trace.go:171","msg":"trace[1707208191] transaction","detail":"{read_only:false; response_revision:23564; number_of_response:1; }","duration":"177.594081ms","start":"2026-10-14T18:29:11.007102Z","end":"2026-10-14T18:29:11.184696Z","steps":["trace[1707208191] 'process raft request'  (duration: 172.086274ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:29:11.347606Z","caller":"traceutil/trace.go:171","msg":"trace[803637983] transaction","detail":"{read_only:false; response_revision:23566; number_of_response:1; }","duration":"155.384767ms","start":"2026-10-14T18:29:11.192197Z","end":"2026-10-14T18:29:11.347581Z","steps":["trace[803637983] 'process raft request'  (duration: 153.575528ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:29:11.692834Z","caller":"traceutil/trace.go:171","msg":"trace[425717473] transaction","detail":"{read_only:false; response_revision:23568; number_of_response:1; }","duration":"103.626739ms","start":"2026-10-14T18:29:11.58916Z","end":"2026-10-14T18:29:11.692787Z","steps":["trace[425717473] 'process raft request'  (duration: 103.395124ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:29:11.71267Z","caller":"traceutil/trace.go:171","msg":"trace[2096120369] transaction","detail":"{read_only:false; response_revision:23569; number_of_response:1; }","duration":"122.340469ms","start":"2026-10-14T18:29:11.590299Z","end":"2026-10-14T18:29:11.71264Z","steps":["trace[2096120369] 'process raft request'  (duration: 122.175606ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:32:41.488418Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000002-0000000000006a53.wal"}
{"level":"info","ts":"2026-10-14T18:32:49.0543Z","caller":"traceutil/trace.go:171","msg":"trace[1700125875] transaction","detail":"{read_only:false; response_revision:26245; number_of_response:1; }","duration":"135.524209ms","start":"2026-10-14T18:32:48.918703Z","end":"2026-10-14T18:32:49.054227Z","steps":["trace[1700125875] 'process raft request'  (duration: 129.773147ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:32:49.38336Z","caller":"traceutil/trace.go:171","msg":"trace[86714480] transaction","detail":"{read_only:false; response_revision:26246; number_of_response:1; }","duration":"193.95154ms","start":"2026-10-14T18:32:49.189355Z","end":"2026-10-14T18:32:49.383307Z","steps":["trace[86714480] 'process raft request'  (duration: 193.692895ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:33:34.063072Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":23324}
{"level":"info","ts":"2026-10-14T18:33:34.199711Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":23324,"took":"130.205676ms","hash":2350847458,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":44756992,"current-db-size-in-use":"45 MB"}
{"level":"info","ts":"2026-10-14T18:33:34.200021Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2350847458,"revision":23324,"compact-revision":20582}
{"level":"warn","ts":"2026-10-14T18:36:21.129895Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.172341ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/glance-api\" ","response":"range_response_count:1 size:11828"}
{"level":"info","ts":"2026-10-14T18:36:21.130042Z","caller":"traceutil/trace.go:171","msg":"trace[917057411] range","detail":"{range_begin:/registry/deployments/openstack/glance-api; range_end:; response_count:1; response_revision:28663; }","duration":"120.324654ms","start":"2026-10-14T18:36:21.00966Z","end":"2026-10-14T18:36:21.129985Z","steps":["trace[917057411] 'range keys from in-memory index tree'  (duration: 119.707042ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:36:21.563544Z","caller":"traceutil/trace.go:171","msg":"trace[1274846157] linearizableReadLoop","detail":"{readStateIndex:29984; appliedIndex:29983; }","duration":"159.616475ms","start":"2026-10-14T18:36:21.403898Z","end":"2026-10-14T18:36:21.563514Z","steps":["trace[1274846157] 'read index received'  (duration: 155.902905ms)","trace[1274846157] 'applied index is now lower than readState.Index'  (duration: 3.71228ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:36:21.563758Z","caller":"traceutil/trace.go:171","msg":"trace[1520769634] transaction","detail":"{read_only:false; response_revision:28665; number_of_response:1; }","duration":"257.887489ms","start":"2026-10-14T18:36:21.305844Z","end":"2026-10-14T18:36:21.563731Z","steps":["trace[1520769634] 'process raft request'  (duration: 253.965504ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:36:21.563882Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"159.967132ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:482"}
{"level":"info","ts":"2026-10-14T18:36:21.563926Z","caller":"traceutil/trace.go:171","msg":"trace[1482723619] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:28665; }","duration":"160.048655ms","start":"2026-10-14T18:36:21.403864Z","end":"2026-10-14T18:36:21.563913Z","steps":["trace[1482723619] 'agreement among raft nodes before linearized reading'  (duration: 159.869381ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:36:21.857606Z","caller":"traceutil/trace.go:171","msg":"trace[119509290] linearizableReadLoop","detail":"{readStateIndex:29986; appliedIndex:29985; }","duration":"211.864613ms","start":"2026-10-14T18:36:21.645715Z","end":"2026-10-14T18:36:21.857579Z","steps":["trace[119509290] 'read index received'  (duration: 190.809754ms)","trace[119509290] 'applied index is now lower than readState.Index'  (duration: 21.053899ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:36:21.85786Z","caller":"traceutil/trace.go:171","msg":"trace[127856419] transaction","detail":"{read_only:false; response_revision:28667; number_of_response:1; }","duration":"289.401313ms","start":"2026-10-14T18:36:21.568446Z","end":"2026-10-14T18:36:21.857847Z","steps":["trace[127856419] 'process raft request'  (duration: 268.136158ms)","trace[127856419] 'compare'  (duration: 20.886837ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T18:36:21.858071Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"212.331883ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/openstack.k-orc.cloud/networks/\" range_end:\"/registry/openstack.k-orc.cloud/networks0\" count_only:true ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-10-14T18:36:21.858117Z","caller":"traceutil/trace.go:171","msg":"trace[1164323600] range","detail":"{range_begin:/registry/openstack.k-orc.cloud/networks/; range_end:/registry/openstack.k-orc.cloud/networks0; response_count:0; response_revision:28667; }","duration":"212.423206ms","start":"2026-10-14T18:36:21.645679Z","end":"2026-10-14T18:36:21.858103Z","steps":["trace[1164323600] 'agreement among raft nodes before linearized reading'  (duration: 212.338283ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:36:21.858294Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.003566ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-10-14T18:36:21.858354Z","caller":"traceutil/trace.go:171","msg":"trace[784170516] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:28667; }","duration":"141.081689ms","start":"2026-10-14T18:36:21.717264Z","end":"2026-10-14T18:36:21.858345Z","steps":["trace[784170516] 'agreement among raft nodes before linearized reading'  (duration: 141.005217ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:36:22.7872Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"fbe9b088d8de907a","local-member-applied-index":30003,"local-member-snapshot-index":20002,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-10-14T18:36:22.794022Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":30003}
{"level":"info","ts":"2026-10-14T18:36:22.794144Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":25003}
{"level":"info","ts":"2026-10-14T18:37:23.168909Z","caller":"traceutil/trace.go:171","msg":"trace[618804604] transaction","detail":"{read_only:false; response_revision:29310; number_of_response:1; }","duration":"158.150054ms","start":"2026-10-14T18:37:23.010733Z","end":"2026-10-14T18:37:23.168883Z","steps":["trace[618804604] 'process raft request'  (duration: 143.44938ms)","trace[618804604] 'compare'  (duration: 14.426328ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:37:23.49724Z","caller":"traceutil/trace.go:171","msg":"trace[1932428579] linearizableReadLoop","detail":"{readStateIndex:30657; appliedIndex:30656; }","duration":"275.160958ms","start":"2026-10-14T18:37:23.222055Z","end":"2026-10-14T18:37:23.497216Z","steps":["trace[1932428579] 'read index received'  (duration: 274.927853ms)","trace[1932428579] 'applied index is now lower than readState.Index'  (duration: 232.235µs)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:37:23.497275Z","caller":"traceutil/trace.go:171","msg":"trace[59482473] transaction","detail":"{read_only:false; response_revision:29312; number_of_response:1; }","duration":"323.663946ms","start":"2026-10-14T18:37:23.173581Z","end":"2026-10-14T18:37:23.497244Z","steps":["trace[59482473] 'process raft request'  (duration: 323.476352ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:37:23.497468Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"280.824259ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:662"}
{"level":"info","ts":"2026-10-14T18:37:23.497529Z","caller":"traceutil/trace.go:171","msg":"trace[92538259] range","detail":"{range_begin:/registry/configmaps/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:29312; }","duration":"280.942412ms","start":"2026-10-14T18:37:23.216571Z","end":"2026-10-14T18:37:23.497513Z","steps":["trace[92538259] 'agreement among raft nodes before linearized reading'  (duration: 280.671506ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:37:23.49756Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"321.131382ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/glance-api\" ","response":"range_response_count:1 size:11828"}
{"level":"info","ts":"2026-10-14T18:37:23.497652Z","caller":"traceutil/trace.go:171","msg":"trace[1061586141] range","detail":"{range_begin:/registry/deployments/openstack/glance-api; range_end:; response_count:1; response_revision:29312; }","duration":"321.341667ms","start":"2026-10-14T18:37:23.176288Z","end":"2026-10-14T18:37:23.497629Z","steps":["trace[1061586141] 'agreement among raft nodes before linearized reading'  (duration: 321.059841ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:37:23.497648Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T18:37:23.173565Z","time spent":"323.970903ms","remote":"127.0.0.1:35966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":537,"response count":0,"response size":41,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:29293 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:461 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-10-14T18:37:23.497695Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-14T18:37:23.176276Z","time spent":"321.411207ms","remote":"127.0.0.1:36108","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":11851,"request content":"key:\"/registry/deployments/openstack/glance-api\" "}
{"level":"warn","ts":"2026-10-14T18:37:23.498227Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"273.098255ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/pvc-14d2ec47-65e7-4f15-a4d6-238850b10b45\" ","response":"range_response_count:1 size:1316"}
{"level":"info","ts":"2026-10-14T18:37:23.498989Z","caller":"traceutil/trace.go:171","msg":"trace[1002231933] range","detail":"{range_begin:/registry/persistentvolumes/pvc-14d2ec47-65e7-4f15-a4d6-238850b10b45; range_end:; response_count:1; response_revision:29312; }","duration":"273.888582ms","start":"2026-10-14T18:37:23.225068Z","end":"2026-10-14T18:37:23.498957Z","steps":["trace[1002231933] 'agreement among raft nodes before linearized reading'  (duration: 272.381949ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:37:23.800058Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.010171ms","expected-duration":"100ms","prefix":"","request":"header:<ID:10410810765672717282 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" mod_revision:29296 > success:<request_put:<key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" value_size:562 >> failure:<request_range:<key:\"/registry/configmaps/openstack/messaging-topology-operator-leader-election\" > >>","response":"size:18"}
{"level":"info","ts":"2026-10-14T18:37:23.800353Z","caller":"traceutil/trace.go:171","msg":"trace[444514037] transaction","detail":"{read_only:false; response_revision:29313; number_of_response:1; }","duration":"294.40907ms","start":"2026-10-14T18:37:23.505911Z","end":"2026-10-14T18:37:23.80032Z","steps":["trace[444514037] 'process raft request'  (duration: 57.008711ms)","trace[444514037] 'compare'  (duration: 236.659973ms)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:37:23.800529Z","caller":"traceutil/trace.go:171","msg":"trace[999737981] transaction","detail":"{read_only:false; response_revision:29314; number_of_response:1; }","duration":"239.183908ms","start":"2026-10-14T18:37:23.561332Z","end":"2026-10-14T18:37:23.800515Z","steps":["trace[999737981] 'process raft request'  (duration: 238.847051ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:37:23.800545Z","caller":"traceutil/trace.go:171","msg":"trace[953646414] linearizableReadLoop","detail":"{readStateIndex:30659; appliedIndex:30657; }","duration":"149.608671ms","start":"2026-10-14T18:37:23.650908Z","end":"2026-10-14T18:37:23.800517Z","steps":["trace[953646414] 'read index received'  (duration: 17.624677ms)","trace[953646414] 'applied index is now lower than readState.Index'  (duration: 131.981744ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-14T18:37:23.800756Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.827347ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/users/\" range_end:\"/registry/rabbitmq.com/users0\" count_only:true ","response":"range_response_count:0 size:6"}
{"level":"info","ts":"2026-10-14T18:37:23.800798Z","caller":"traceutil/trace.go:171","msg":"trace[1675785218] range","detail":"{range_begin:/registry/rabbitmq.com/users/; range_end:/registry/rabbitmq.com/users0; response_count:0; response_revision:29314; }","duration":"149.917167ms","start":"2026-10-14T18:37:23.65087Z","end":"2026-10-14T18:37:23.800787Z","steps":["trace[1675785218] 'agreement among raft nodes before linearized reading'  (duration: 149.829276ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:37:23.800907Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.958919ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controllerrevisions/\" range_end:\"/registry/controllerrevisions0\" count_only:true ","response":"range_response_count:0 size:8"}
{"level":"info","ts":"2026-10-14T18:37:23.800986Z","caller":"traceutil/trace.go:171","msg":"trace[1734207002] range","detail":"{range_begin:/registry/controllerrevisions/; range_end:/registry/controllerrevisions0; response_count:0; response_revision:29314; }","duration":"107.090242ms","start":"2026-10-14T18:37:23.693877Z","end":"2026-10-14T18:37:23.800967Z","steps":["trace[1734207002] 'agreement among raft nodes before linearized reading'  (duration: 106.883937ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:37:24.120177Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"209.38884ms","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-10-14T18:37:24.120254Z","caller":"traceutil/trace.go:171","msg":"trace[2097037483] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:29315; }","duration":"209.503243ms","start":"2026-10-14T18:37:23.910735Z","end":"2026-10-14T18:37:24.120238Z","steps":["trace[2097037483] 'range keys from in-memory index tree'  (duration: 209.219387ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:37:24.120396Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.457227ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:441"}
{"level":"info","ts":"2026-10-14T18:37:24.120486Z","caller":"traceutil/trace.go:171","msg":"trace[1393899708] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:29315; }","duration":"198.57833ms","start":"2026-10-14T18:37:23.921875Z","end":"2026-10-14T18:37:24.120453Z","steps":["trace[1393899708] 'range keys from in-memory index tree'  (duration: 198.259872ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:37:24.203797Z","caller":"traceutil/trace.go:171","msg":"trace[1172749640] linearizableReadLoop","detail":"{readStateIndex:30661; appliedIndex:30660; }","duration":"120.335685ms","start":"2026-10-14T18:37:24.083445Z","end":"2026-10-14T18:37:24.203781Z","steps":["trace[1172749640] 'read index received'  (duration: 120.266573ms)","trace[1172749640] 'applied index is now lower than readState.Index'  (duration: 68.162µs)"],"step_count":2}
{"level":"info","ts":"2026-10-14T18:37:24.203868Z","caller":"traceutil/trace.go:171","msg":"trace[446474859] transaction","detail":"{read_only:false; response_revision:29316; number_of_response:1; }","duration":"141.635861ms","start":"2026-10-14T18:37:24.062195Z","end":"2026-10-14T18:37:24.203831Z","steps":["trace[446474859] 'process raft request'  (duration: 141.454997ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-14T18:37:24.203965Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.519078ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:11497"}
{"level":"info","ts":"2026-10-14T18:37:24.203998Z","caller":"traceutil/trace.go:171","msg":"trace[461032178] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:29316; }","duration":"120.5958ms","start":"2026-10-14T18:37:24.083393Z","end":"2026-10-14T18:37:24.203989Z","steps":["trace[461032178] 'agreement among raft nodes before linearized reading'  (duration: 120.475408ms)"],"step_count":1}
{"level":"info","ts":"2026-10-14T18:38:34.07009Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":26718}
{"level":"info","ts":"2026-10-14T18:38:34.220468Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":26718,"took":"145.311139ms","hash":2111626820,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":43163648,"current-db-size-in-use":"43 MB"}
{"level":"info","ts":"2026-10-14T18:38:34.22054Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2111626820,"revision":26718,"compact-revision":23324}
{"level":"info","ts":"2026-10-14T18:43:34.077954Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":30101}
{"level":"info","ts":"2026-10-14T18:43:34.243442Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":30101,"took":"160.503865ms","hash":191807834,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":37220352,"current-db-size-in-use":"37 MB"}
{"level":"info","ts":"2026-10-14T18:43:34.243516Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":191807834,"revision":30101,"compact-revision":26718}
{"level":"info","ts":"2026-10-14T18:48:34.084663Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":33235}
{"level":"info","ts":"2026-10-14T18:48:34.232891Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":33235,"took":"143.643186ms","hash":68826399,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":34516992,"current-db-size-in-use":"34 MB"}
{"level":"info","ts":"2026-10-14T18:48:34.232967Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":68826399,"revision":33235,"compact-revision":30101}
{"level":"info","ts":"2026-10-14T18:52:53.26267Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"fbe9b088d8de907a","local-member-applied-index":40004,"local-member-snapshot-index":30003,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-10-14T18:52:53.268278Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":40004}
{"level":"info","ts":"2026-10-14T18:52:53.268482Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":35004}
{"level":"info","ts":"2026-10-14T18:53:34.092075Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":35912}
{"level":"info","ts":"2026-10-14T18:53:34.229394Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":35912,"took":"132.942969ms","hash":3369315487,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":34476032,"current-db-size-in-use":"34 MB"}
{"level":"info","ts":"2026-10-14T18:53:34.229473Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3369315487,"revision":35912,"compact-revision":33235}
{"level":"info","ts":"2026-10-14T18:58:34.102635Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":38625}
{"level":"info","ts":"2026-10-14T18:58:34.268822Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":38625,"took":"161.176452ms","hash":2858229022,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":35069952,"current-db-size-in-use":"35 MB"}
{"level":"info","ts":"2026-10-14T18:58:34.268938Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2858229022,"revision":38625,"compact-revision":35912}
{"level":"info","ts":"2026-10-14T19:03:34.110033Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":41367}
{"level":"info","ts":"2026-10-14T19:03:34.263951Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":41367,"took":"149.491093ms","hash":1044913463,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":34152448,"current-db-size-in-use":"34 MB"}
{"level":"info","ts":"2026-10-14T19:03:34.264021Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1044913463,"revision":41367,"compact-revision":38625}
{"level":"info","ts":"2026-10-14T19:08:34.117307Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":44105}
{"level":"info","ts":"2026-10-14T19:08:34.266495Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":44105,"took":"142.784468ms","hash":1455385153,"current-db-size-bytes":61124608,"current-db-size":"61 MB","current-db-size-in-use-bytes":33329152,"current-db-size-in-use":"33 MB"}
{"level":"info","ts":"2026-10-14T19:08:34.266596Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1455385153,"revision":44105,"compact-revision":41367}