{"level":"warn","ts":"2026-04-22T18:21:06.388456Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-04-22T18:21:06.388578Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.31:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.31:2380","--initial-cluster=instance=https://199.19.213.31:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.31:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.31: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-04-22T18:21:06.388667Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-04-22T18:21:06.388705Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.31:2380"]}
{"level":"info","ts":"2026-04-22T18:21:06.388746Z","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-04-22T18:21:06.389361Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.31:2379"]}
{"level":"info","ts":"2026-04-22T18:21:06.389479Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.31:2380"],"listen-peer-urls":["https://199.19.213.31:2380"],"advertise-client-urls":["https://199.19.213.31:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.31:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.31: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-04-22T18:21:06.393786Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.03762ms"}
{"level":"info","ts":"2026-04-22T18:21:06.402685Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"b3aa5b67741e7c5e","cluster-id":"9896be1db1fb000"}
{"level":"info","ts":"2026-04-22T18:21:06.403158Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e switched to configuration voters=()"}
{"level":"info","ts":"2026-04-22T18:21:06.403222Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e became follower at term 0"}
{"level":"info","ts":"2026-04-22T18:21:06.403264Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft b3aa5b67741e7c5e [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-04-22T18:21:06.403368Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e became follower at term 1"}
{"level":"info","ts":"2026-04-22T18:21:06.40345Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e switched to configuration voters=(12946260578717826142)"}
{"level":"warn","ts":"2026-04-22T18:21:06.408741Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-04-22T18:21:06.409791Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-04-22T18:21:06.410748Z","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-04-22T18:21:06.41269Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"b3aa5b67741e7c5e","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-04-22T18:21:06.412901Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"b3aa5b67741e7c5e","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-04-22T18:21:06.413024Z","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-04-22T18:21:06.413087Z","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-04-22T18:21:06.41312Z","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-04-22T18:21:06.413874Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e switched to configuration voters=(12946260578717826142)"}
{"level":"info","ts":"2026-04-22T18:21:06.416859Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"9896be1db1fb000","local-member-id":"b3aa5b67741e7c5e","added-peer-id":"b3aa5b67741e7c5e","added-peer-peer-urls":["https://199.19.213.31:2380"]}
{"level":"info","ts":"2026-04-22T18:21:06.419483Z","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-04-22T18:21:06.419628Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.31:2380"}
{"level":"info","ts":"2026-04-22T18:21:06.419727Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.31:2380"}
{"level":"info","ts":"2026-04-22T18:21:06.419808Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"b3aa5b67741e7c5e","initial-advertise-peer-urls":["https://199.19.213.31:2380"],"listen-peer-urls":["https://199.19.213.31:2380"],"advertise-client-urls":["https://199.19.213.31:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.31:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-04-22T18:21:06.419884Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-04-22T18:21:06.803915Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e is starting a new election at term 1"}
{"level":"info","ts":"2026-04-22T18:21:06.803955Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e became pre-candidate at term 1"}
{"level":"info","ts":"2026-04-22T18:21:06.803987Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e received MsgPreVoteResp from b3aa5b67741e7c5e at term 1"}
{"level":"info","ts":"2026-04-22T18:21:06.804084Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e became candidate at term 2"}
{"level":"info","ts":"2026-04-22T18:21:06.804125Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e received MsgVoteResp from b3aa5b67741e7c5e at term 2"}
{"level":"info","ts":"2026-04-22T18:21:06.804155Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b3aa5b67741e7c5e became leader at term 2"}
{"level":"info","ts":"2026-04-22T18:21:06.804167Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: b3aa5b67741e7c5e elected leader b3aa5b67741e7c5e at term 2"}
{"level":"info","ts":"2026-04-22T18:21:06.805127Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"b3aa5b67741e7c5e","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.31:2379]}","request-path":"/0/members/b3aa5b67741e7c5e/attributes","cluster-id":"9896be1db1fb000","publish-timeout":"7s"}
{"level":"info","ts":"2026-04-22T18:21:06.805286Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-04-22T18:21:06.805266Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-04-22T18:21:06.805398Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-04-22T18:21:06.805444Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-04-22T18:21:06.805378Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-22T18:21:06.807026Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.31:2379"}
{"level":"info","ts":"2026-04-22T18:21:06.807681Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"9896be1db1fb000","local-member-id":"b3aa5b67741e7c5e","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-22T18:21:06.807766Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-22T18:21:06.807809Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-22T18:21:06.808061Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"warn","ts":"2026-04-22T18:21:41.965416Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.568133ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"info","ts":"2026-04-22T18:21:41.965917Z","caller":"traceutil/trace.go:171","msg":"trace[2008397146] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:614; }","duration":"168.108346ms","start":"2026-04-22T18:21:41.797785Z","end":"2026-04-22T18:21:41.965893Z","steps":["trace[2008397146] 'range keys from in-memory index tree'  (duration: 167.406369ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:21:41.965585Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.03177ms","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-04-22T18:21:41.966221Z","caller":"traceutil/trace.go:171","msg":"trace[387944200] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:614; }","duration":"176.714827ms","start":"2026-04-22T18:21:41.789478Z","end":"2026-04-22T18:21:41.966193Z","steps":["trace[387944200] 'range keys from in-memory index tree'  (duration: 175.837326ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:21:42.115356Z","caller":"traceutil/trace.go:171","msg":"trace[145395590] transaction","detail":"{read_only:false; response_revision:615; number_of_response:1; }","duration":"241.884206ms","start":"2026-04-22T18:21:41.873445Z","end":"2026-04-22T18:21:42.115329Z","steps":["trace[145395590] 'process raft request'  (duration: 240.471303ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:21:42.317301Z","caller":"traceutil/trace.go:171","msg":"trace[1902395787] transaction","detail":"{read_only:false; response_revision:617; number_of_response:1; }","duration":"345.957871ms","start":"2026-04-22T18:21:41.971313Z","end":"2026-04-22T18:21:42.317271Z","steps":["trace[1902395787] 'process raft request'  (duration: 345.900893ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:21:42.317421Z","caller":"traceutil/trace.go:171","msg":"trace[1978917490] transaction","detail":"{read_only:false; response_revision:616; number_of_response:1; }","duration":"346.442096ms","start":"2026-04-22T18:21:41.970911Z","end":"2026-04-22T18:21:42.317354Z","steps":["trace[1978917490] 'process raft request'  (duration: 346.184784ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:21:42.317883Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-22T18:21:41.971304Z","time spent":"346.075877ms","remote":"127.0.0.1:41312","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:600 > 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-04-22T18:21:42.317922Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-22T18:21:41.97088Z","time spent":"346.643929ms","remote":"127.0.0.1:41312","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:599 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-04-22T18:21:42.374951Z","caller":"traceutil/trace.go:171","msg":"trace[2047287223] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"192.602851ms","start":"2026-04-22T18:21:42.182299Z","end":"2026-04-22T18:21:42.374902Z","steps":["trace[2047287223] 'process raft request'  (duration: 192.443276ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:21:42.375111Z","caller":"traceutil/trace.go:171","msg":"trace[12619171] transaction","detail":"{read_only:false; response_revision:620; number_of_response:1; }","duration":"114.672058ms","start":"2026-04-22T18:21:42.260427Z","end":"2026-04-22T18:21:42.3751Z","steps":["trace[12619171] 'process raft request'  (duration: 114.368919ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:21:42.374868Z","caller":"traceutil/trace.go:171","msg":"trace[1287490413] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"202.766112ms","start":"2026-04-22T18:21:42.172069Z","end":"2026-04-22T18:21:42.374835Z","steps":["trace[1287490413] 'process raft request'  (duration: 202.565109ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:21:42.868486Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"323.204058ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"}
{"level":"info","ts":"2026-04-22T18:21:42.868564Z","caller":"traceutil/trace.go:171","msg":"trace[442173311] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:620; }","duration":"323.345924ms","start":"2026-04-22T18:21:42.5452Z","end":"2026-04-22T18:21:42.868546Z","steps":["trace[442173311] 'range keys from in-memory index tree'  (duration: 322.994275ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:21:42.868668Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-22T18:21:42.545179Z","time spent":"323.480149ms","remote":"127.0.0.1:41312","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"info","ts":"2026-04-22T18:21:58.260574Z","caller":"traceutil/trace.go:171","msg":"trace[594505657] transaction","detail":"{read_only:false; response_revision:782; number_of_response:1; }","duration":"116.012838ms","start":"2026-04-22T18:21:58.144532Z","end":"2026-04-22T18:21:58.260545Z","steps":["trace[594505657] 'process raft request'  (duration: 115.853113ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:23:11.743414Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"304.152175ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5444"}
{"level":"info","ts":"2026-04-22T18:23:11.743529Z","caller":"traceutil/trace.go:171","msg":"trace[562488202] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1840; }","duration":"304.297131ms","start":"2026-04-22T18:23:11.439204Z","end":"2026-04-22T18:23:11.743501Z","steps":["trace[562488202] 'range keys from in-memory index tree'  (duration: 303.97034ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:23:11.743597Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-22T18:23:11.439185Z","time spent":"304.392198ms","remote":"127.0.0.1:32930","response type":"/etcdserverpb.KV/Range","request count":0,"request size":74,"response count":1,"response size":5467,"request content":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" "}
{"level":"info","ts":"2026-04-22T18:23:11.833194Z","caller":"traceutil/trace.go:171","msg":"trace[573917688] linearizableReadLoop","detail":"{readStateIndex:1912; appliedIndex:1911; }","duration":"181.541697ms","start":"2026-04-22T18:23:11.651626Z","end":"2026-04-22T18:23:11.833168Z","steps":["trace[573917688] 'read index received'  (duration: 181.279545ms)","trace[573917688] 'applied index is now lower than readState.Index'  (duration: 261.082µs)"],"step_count":2}
{"level":"info","ts":"2026-04-22T18:23:11.833222Z","caller":"traceutil/trace.go:171","msg":"trace[1923908107] transaction","detail":"{read_only:false; response_revision:1841; number_of_response:1; }","duration":"347.542146ms","start":"2026-04-22T18:23:11.485652Z","end":"2026-04-22T18:23:11.833194Z","steps":["trace[1923908107] 'process raft request'  (duration: 347.337802ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:23:11.833418Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-22T18:23:11.485626Z","time spent":"347.675652ms","remote":"127.0.0.1:41312","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" mod_revision:1683 > success:<request_put:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" value_size:600 >> failure:<request_range:<key:\"/registry/leases/kube-system/apiserver-f3tcohoifagyom4bbi4wgeu7te\" > >"}
{"level":"warn","ts":"2026-04-22T18:23:11.833436Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.781751ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5444"}
{"level":"info","ts":"2026-04-22T18:23:11.833611Z","caller":"traceutil/trace.go:171","msg":"trace[761530708] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1841; }","duration":"182.014314ms","start":"2026-04-22T18:23:11.651577Z","end":"2026-04-22T18:23:11.833591Z","steps":["trace[761530708] 'agreement among raft nodes before linearized reading'  (duration: 181.694883ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:23:12.264885Z","caller":"traceutil/trace.go:171","msg":"trace[1571472300] transaction","detail":"{read_only:false; response_revision:1842; number_of_response:1; }","duration":"181.402006ms","start":"2026-04-22T18:23:12.083459Z","end":"2026-04-22T18:23:12.264861Z","steps":["trace[1571472300] 'process raft request'  (duration: 181.26374ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:23:12.46908Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.083691ms","expected-duration":"100ms","prefix":"","request":"header:<ID:8961773715346157964 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:1829 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:463 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-22T18:23:12.469157Z","caller":"traceutil/trace.go:171","msg":"trace[992479146] linearizableReadLoop","detail":"{readStateIndex:1914; appliedIndex:1913; }","duration":"189.483301ms","start":"2026-04-22T18:23:12.279663Z","end":"2026-04-22T18:23:12.469146Z","steps":["trace[992479146] 'read index received'  (duration: 32.123098ms)","trace[992479146] 'applied index is now lower than readState.Index'  (duration: 157.359233ms)"],"step_count":2}
{"level":"info","ts":"2026-04-22T18:23:12.469218Z","caller":"traceutil/trace.go:171","msg":"trace[628045011] transaction","detail":"{read_only:false; response_revision:1843; number_of_response:1; }","duration":"199.57857ms","start":"2026-04-22T18:23:12.269632Z","end":"2026-04-22T18:23:12.469211Z","steps":["trace[628045011] 'process raft request'  (duration: 42.148949ms)","trace[628045011] 'compare'  (duration: 156.990634ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-22T18:23:12.469415Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.015397ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-2107df34-3b72-4cbe-9920-c49ab8e5e92e\" ","response":"range_response_count:1 size:3740"}
{"level":"info","ts":"2026-04-22T18:23:12.469516Z","caller":"traceutil/trace.go:171","msg":"trace[1160149917] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-2107df34-3b72-4cbe-9920-c49ab8e5e92e; range_end:; response_count:1; response_revision:1843; }","duration":"150.158963ms","start":"2026-04-22T18:23:12.319333Z","end":"2026-04-22T18:23:12.469492Z","steps":["trace[1160149917] 'agreement among raft nodes before linearized reading'  (duration: 149.93024ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:23:12.469454Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.786353ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-22T18:23:12.469683Z","caller":"traceutil/trace.go:171","msg":"trace[65633133] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1843; }","duration":"190.041385ms","start":"2026-04-22T18:23:12.279633Z","end":"2026-04-22T18:23:12.469675Z","steps":["trace[65633133] 'agreement among raft nodes before linearized reading'  (duration: 189.791542ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:23:46.932582Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.778828ms","expected-duration":"100ms","prefix":"","request":"header:<ID:8961773715346158542 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:2077 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-22T18:23:46.932776Z","caller":"traceutil/trace.go:171","msg":"trace[1381150362] linearizableReadLoop","detail":"{readStateIndex:2167; appliedIndex:2166; }","duration":"158.018779ms","start":"2026-04-22T18:23:46.77474Z","end":"2026-04-22T18:23:46.932759Z","steps":["trace[1381150362] 'read index received'  (duration: 9.92828ms)","trace[1381150362] 'applied index is now lower than readState.Index'  (duration: 148.089179ms)"],"step_count":2}
{"level":"info","ts":"2026-04-22T18:23:46.932997Z","caller":"traceutil/trace.go:171","msg":"trace[1690092814] transaction","detail":"{read_only:false; response_revision:2088; number_of_response:1; }","duration":"204.468948ms","start":"2026-04-22T18:23:46.728493Z","end":"2026-04-22T18:23:46.932962Z","steps":["trace[1690092814] 'process raft request'  (duration: 56.223093ms)","trace[1690092814] 'compare'  (duration: 147.647422ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-22T18:23:46.933208Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.462647ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"}
{"level":"info","ts":"2026-04-22T18:23:46.933264Z","caller":"traceutil/trace.go:171","msg":"trace[2143943902] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2088; }","duration":"158.562224ms","start":"2026-04-22T18:23:46.774688Z","end":"2026-04-22T18:23:46.93325Z","steps":["trace[2143943902] 'agreement among raft nodes before linearized reading'  (duration: 158.311501ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:25:28.132867Z","caller":"traceutil/trace.go:171","msg":"trace[1154049983] linearizableReadLoop","detail":"{readStateIndex:2841; appliedIndex:2839; }","duration":"146.084553ms","start":"2026-04-22T18:25:27.986757Z","end":"2026-04-22T18:25:28.132842Z","steps":["trace[1154049983] 'read index received'  (duration: 75.681471ms)","trace[1154049983] 'applied index is now lower than readState.Index'  (duration: 70.399202ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-22T18:25:28.133097Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.315457ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/auth-system/keycloak-0.18a8c10a4cfd0b67\" ","response":"range_response_count:1 size:781"}
{"level":"info","ts":"2026-04-22T18:25:28.133141Z","caller":"traceutil/trace.go:171","msg":"trace[577666152] range","detail":"{range_begin:/registry/events/auth-system/keycloak-0.18a8c10a4cfd0b67; range_end:; response_count:1; response_revision:2739; }","duration":"146.403744ms","start":"2026-04-22T18:25:27.986727Z","end":"2026-04-22T18:25:28.13313Z","steps":["trace[577666152] 'agreement among raft nodes before linearized reading'  (duration: 146.219619ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:25:28.133441Z","caller":"traceutil/trace.go:171","msg":"trace[1747051747] transaction","detail":"{read_only:false; response_revision:2739; number_of_response:1; }","duration":"169.785966ms","start":"2026-04-22T18:25:27.9636Z","end":"2026-04-22T18:25:28.133386Z","steps":["trace[1747051747] 'process raft request'  (duration: 163.012755ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:18.258127Z","caller":"traceutil/trace.go:171","msg":"trace[937557372] linearizableReadLoop","detail":"{readStateIndex:4788; appliedIndex:4787; }","duration":"120.770352ms","start":"2026-04-22T18:29:18.137327Z","end":"2026-04-22T18:29:18.258098Z","steps":["trace[937557372] 'read index received'  (duration: 89.647979ms)","trace[937557372] 'applied index is now lower than readState.Index'  (duration: 31.121103ms)"],"step_count":2}
{"level":"info","ts":"2026-04-22T18:29:18.258686Z","caller":"traceutil/trace.go:171","msg":"trace[1139420708] transaction","detail":"{read_only:false; response_revision:4614; number_of_response:1; }","duration":"126.121222ms","start":"2026-04-22T18:29:18.132528Z","end":"2026-04-22T18:29:18.258649Z","steps":["trace[1139420708] 'process raft request'  (duration: 94.52039ms)","trace[1139420708] 'compare'  (duration: 30.914509ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-22T18:29:18.258875Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.716773ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-cainjector-leader-election\" ","response":"range_response_count:1 size:558"}
{"level":"info","ts":"2026-04-22T18:29:18.258931Z","caller":"traceutil/trace.go:171","msg":"trace[654966996] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-cainjector-leader-election; range_end:; response_count:1; response_revision:4614; }","duration":"120.81995ms","start":"2026-04-22T18:29:18.138097Z","end":"2026-04-22T18:29:18.258917Z","steps":["trace[654966996] 'agreement among raft nodes before linearized reading'  (duration: 120.539978ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:29:18.258966Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.567562ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-0\" ","response":"range_response_count:1 size:650"}
{"level":"info","ts":"2026-04-22T18:29:18.259081Z","caller":"traceutil/trace.go:171","msg":"trace[387888998] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-0; range_end:; response_count:1; response_revision:4614; }","duration":"121.755047ms","start":"2026-04-22T18:29:18.13731Z","end":"2026-04-22T18:29:18.259065Z","steps":["trace[387888998] 'agreement among raft nodes before linearized reading'  (duration: 121.334228ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:18.386309Z","caller":"traceutil/trace.go:171","msg":"trace[2020807036] linearizableReadLoop","detail":"{readStateIndex:4795; appliedIndex:4789; }","duration":"117.619475ms","start":"2026-04-22T18:29:18.268667Z","end":"2026-04-22T18:29:18.386286Z","steps":["trace[2020807036] 'read index received'  (duration: 34.688591ms)","trace[2020807036] 'applied index is now lower than readState.Index'  (duration: 82.929884ms)"],"step_count":2}
{"level":"info","ts":"2026-04-22T18:29:18.38645Z","caller":"traceutil/trace.go:171","msg":"trace[1236075853] transaction","detail":"{read_only:false; response_revision:4621; number_of_response:1; }","duration":"119.950374ms","start":"2026-04-22T18:29:18.266485Z","end":"2026-04-22T18:29:18.386435Z","steps":["trace[1236075853] 'process raft request'  (duration: 119.696501ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:18.386482Z","caller":"traceutil/trace.go:171","msg":"trace[54432875] transaction","detail":"{read_only:false; response_revision:4620; number_of_response:1; }","duration":"120.46326ms","start":"2026-04-22T18:29:18.265976Z","end":"2026-04-22T18:29:18.386439Z","steps":["trace[54432875] 'process raft request'  (duration: 120.176058ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:18.386702Z","caller":"traceutil/trace.go:171","msg":"trace[2085636467] transaction","detail":"{read_only:false; response_revision:4616; number_of_response:1; }","duration":"120.891469ms","start":"2026-04-22T18:29:18.265793Z","end":"2026-04-22T18:29:18.386684Z","steps":["trace[2085636467] 'process raft request'  (duration: 113.501583ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:18.386956Z","caller":"traceutil/trace.go:171","msg":"trace[2019523462] transaction","detail":"{read_only:false; response_revision:4617; number_of_response:1; }","duration":"121.041785ms","start":"2026-04-22T18:29:18.265901Z","end":"2026-04-22T18:29:18.386942Z","steps":["trace[2019523462] 'process raft request'  (duration: 120.137089ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:18.387099Z","caller":"traceutil/trace.go:171","msg":"trace[2094784053] transaction","detail":"{read_only:false; response_revision:4618; number_of_response:1; }","duration":"121.151532ms","start":"2026-04-22T18:29:18.265938Z","end":"2026-04-22T18:29:18.387089Z","steps":["trace[2094784053] 'process raft request'  (duration: 120.138239ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:18.387374Z","caller":"traceutil/trace.go:171","msg":"trace[1400133408] transaction","detail":"{read_only:false; response_revision:4619; number_of_response:1; }","duration":"121.369718ms","start":"2026-04-22T18:29:18.265961Z","end":"2026-04-22T18:29:18.387331Z","steps":["trace[1400133408] 'process raft request'  (duration: 120.151139ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:18.387507Z","caller":"traceutil/trace.go:171","msg":"trace[94818937] transaction","detail":"{read_only:false; response_revision:4622; number_of_response:1; }","duration":"111.146715ms","start":"2026-04-22T18:29:18.276343Z","end":"2026-04-22T18:29:18.38749Z","steps":["trace[94818937] 'process raft request'  (duration: 109.875808ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:29:18.387644Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.958571ms","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:5"}
{"level":"info","ts":"2026-04-22T18:29:18.387691Z","caller":"traceutil/trace.go:171","msg":"trace[1288292856] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-1; range_end:; response_count:0; response_revision:4622; }","duration":"119.030498ms","start":"2026-04-22T18:29:18.26865Z","end":"2026-04-22T18:29:18.38768Z","steps":["trace[1288292856] 'agreement among raft nodes before linearized reading'  (duration: 118.940111ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:29:18.389401Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.820366ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-22T18:29:18.38949Z","caller":"traceutil/trace.go:171","msg":"trace[1897823626] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4623; }","duration":"108.939803ms","start":"2026-04-22T18:29:18.280533Z","end":"2026-04-22T18:29:18.389473Z","steps":["trace[1897823626] 'agreement among raft nodes before linearized reading'  (duration: 108.772587ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:29:24.66357Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.417866ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:556"}
{"level":"info","ts":"2026-04-22T18:29:24.663667Z","caller":"traceutil/trace.go:171","msg":"trace[1310356813] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:4738; }","duration":"124.570222ms","start":"2026-04-22T18:29:24.539075Z","end":"2026-04-22T18:29:24.663645Z","steps":["trace[1310356813] 'range keys from in-memory index tree'  (duration: 124.231302ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:24.791469Z","caller":"traceutil/trace.go:171","msg":"trace[1028134283] transaction","detail":"{read_only:false; response_revision:4739; number_of_response:1; }","duration":"124.207593ms","start":"2026-04-22T18:29:24.667238Z","end":"2026-04-22T18:29:24.791446Z","steps":["trace[1028134283] 'process raft request'  (duration: 124.069536ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:24.801379Z","caller":"traceutil/trace.go:171","msg":"trace[2031844848] linearizableReadLoop","detail":"{readStateIndex:4917; appliedIndex:4916; }","duration":"109.196046ms","start":"2026-04-22T18:29:24.692153Z","end":"2026-04-22T18:29:24.801349Z","steps":["trace[2031844848] 'read index received'  (duration: 99.286617ms)","trace[2031844848] 'applied index is now lower than readState.Index'  (duration: 9.908539ms)"],"step_count":2}
{"level":"info","ts":"2026-04-22T18:29:24.801501Z","caller":"traceutil/trace.go:171","msg":"trace[860819010] transaction","detail":"{read_only:false; response_revision:4740; number_of_response:1; }","duration":"132.155453ms","start":"2026-04-22T18:29:24.669263Z","end":"2026-04-22T18:29:24.801418Z","steps":["trace[860819010] 'process raft request'  (duration: 131.958718ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:29:24.802011Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.837889ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-f09c3b6c-66a5-48be-b894-bd989fd2cb32\" ","response":"range_response_count:1 size:3645"}
{"level":"info","ts":"2026-04-22T18:29:24.802065Z","caller":"traceutil/trace.go:171","msg":"trace[1996409802] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-f09c3b6c-66a5-48be-b894-bd989fd2cb32; range_end:; response_count:1; response_revision:4740; }","duration":"109.940726ms","start":"2026-04-22T18:29:24.692109Z","end":"2026-04-22T18:29:24.80205Z","steps":["trace[1996409802] 'agreement among raft nodes before linearized reading'  (duration: 109.3756ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:25.09474Z","caller":"traceutil/trace.go:171","msg":"trace[15506754] transaction","detail":"{read_only:false; response_revision:4748; number_of_response:1; }","duration":"123.575889ms","start":"2026-04-22T18:29:24.971143Z","end":"2026-04-22T18:29:25.094719Z","steps":["trace[15506754] 'process raft request'  (duration: 123.355714ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:29:25.215947Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.041916ms","expected-duration":"100ms","prefix":"","request":"header:<ID:8961773715346165346 > lease_revoke:<id:7c5e9db66ca40ae4>","response":"size:28"}
{"level":"info","ts":"2026-04-22T18:29:25.216786Z","caller":"traceutil/trace.go:171","msg":"trace[1478600907] transaction","detail":"{read_only:false; response_revision:4749; number_of_response:1; }","duration":"132.472096ms","start":"2026-04-22T18:29:25.084287Z","end":"2026-04-22T18:29:25.216759Z","steps":["trace[1478600907] 'process raft request'  (duration: 131.868891ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:29:37.015415Z","caller":"traceutil/trace.go:171","msg":"trace[850516986] linearizableReadLoop","detail":"{readStateIndex:5097; appliedIndex:5095; }","duration":"125.726893ms","start":"2026-04-22T18:29:36.889667Z","end":"2026-04-22T18:29:37.015394Z","steps":["trace[850516986] 'read index received'  (duration: 91.604917ms)","trace[850516986] 'applied index is now lower than readState.Index'  (duration: 34.120686ms)"],"step_count":2}
{"level":"info","ts":"2026-04-22T18:29:37.015794Z","caller":"traceutil/trace.go:171","msg":"trace[204039471] transaction","detail":"{read_only:false; response_revision:4913; number_of_response:1; }","duration":"127.625783ms","start":"2026-04-22T18:29:36.888149Z","end":"2026-04-22T18:29:37.015775Z","steps":["trace[204039471] 'process raft request'  (duration: 96.87954ms)","trace[204039471] 'compare'  (duration: 30.153398ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-22T18:29:37.015968Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.277768ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"}
{"level":"info","ts":"2026-04-22T18:29:37.016027Z","caller":"traceutil/trace.go:171","msg":"trace[1313446961] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:4913; }","duration":"126.353066ms","start":"2026-04-22T18:29:36.889661Z","end":"2026-04-22T18:29:37.016014Z","steps":["trace[1313446961] 'agreement among raft nodes before linearized reading'  (duration: 126.146582ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-22T18:29:37.022885Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.421427ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/\" range_end:\"/registry/pxc.percona.com/perconaxtradbclusters0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-04-22T18:29:37.022948Z","caller":"traceutil/trace.go:171","msg":"trace[459437218] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/; range_end:/registry/pxc.percona.com/perconaxtradbclusters0; response_count:0; response_revision:4914; }","duration":"108.520984ms","start":"2026-04-22T18:29:36.914411Z","end":"2026-04-22T18:29:37.022932Z","steps":["trace[459437218] 'agreement among raft nodes before linearized reading'  (duration: 108.406247ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:30:48.88827Z","caller":"traceutil/trace.go:171","msg":"trace[690616174] transaction","detail":"{read_only:false; response_revision:5517; number_of_response:1; }","duration":"161.877545ms","start":"2026-04-22T18:30:48.726363Z","end":"2026-04-22T18:30:48.888241Z","steps":["trace[690616174] 'process raft request'  (duration: 161.726219ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:31:06.872982Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2941}
{"level":"info","ts":"2026-04-22T18:31:06.949475Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2941,"took":"75.423232ms","hash":1412280260,"current-db-size-bytes":54251520,"current-db-size":"54 MB","current-db-size-in-use-bytes":30064640,"current-db-size-in-use":"30 MB"}
{"level":"info","ts":"2026-04-22T18:31:06.949533Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1412280260,"revision":2941,"compact-revision":-1}
{"level":"info","ts":"2026-04-22T18:33:14.72981Z","caller":"traceutil/trace.go:171","msg":"trace[562532471] transaction","detail":"{read_only:false; response_revision:6511; number_of_response:1; }","duration":"142.59419ms","start":"2026-04-22T18:33:14.587188Z","end":"2026-04-22T18:33:14.729782Z","steps":["trace[562532471] 'process raft request'  (duration: 89.303898ms)","trace[562532471] 'compare'  (duration: 53.176735ms)"],"step_count":2}
{"level":"info","ts":"2026-04-22T18:33:15.623692Z","caller":"traceutil/trace.go:171","msg":"trace[1618130487] transaction","detail":"{read_only:false; response_revision:6516; number_of_response:1; }","duration":"119.758649ms","start":"2026-04-22T18:33:15.503892Z","end":"2026-04-22T18:33:15.62365Z","steps":["trace[1618130487] 'process raft request'  (duration: 115.758034ms)"],"step_count":1}
{"level":"info","ts":"2026-04-22T18:36:06.878888Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5654}
{"level":"info","ts":"2026-04-22T18:36:06.953483Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5654,"took":"73.164551ms","hash":558006053,"current-db-size-bytes":54251520,"current-db-size":"54 MB","current-db-size-in-use-bytes":18554880,"current-db-size-in-use":"19 MB"}
{"level":"info","ts":"2026-04-22T18:36:06.953531Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":558006053,"revision":5654,"compact-revision":2941}