{"level":"warn","ts":"2026-02-24T03:54:31.398546Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-02-24T03:54:31.398637Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.195: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.195:2380","--initial-cluster=instance=https://162.253.55.195:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.195:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.195: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-02-24T03:54:31.398703Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-02-24T03:54:31.398715Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.195:2380"]} {"level":"info","ts":"2026-02-24T03:54:31.398731Z","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-02-24T03:54:31.39933Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.195:2379"]} {"level":"info","ts":"2026-02-24T03:54:31.399397Z","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.195:2380"],"listen-peer-urls":["https://162.253.55.195:2380"],"advertise-client-urls":["https://162.253.55.195:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.195:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.195: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-02-24T03:54:31.403072Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.475027ms"} {"level":"info","ts":"2026-02-24T03:54:31.410354Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"b66d12fd59101739","cluster-id":"a64a525934ce8379"} {"level":"info","ts":"2026-02-24T03:54:31.410488Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 switched to configuration voters=()"} {"level":"info","ts":"2026-02-24T03:54:31.410525Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 became follower at term 0"} {"level":"info","ts":"2026-02-24T03:54:31.410545Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft b66d12fd59101739 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-02-24T03:54:31.410561Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 became follower at term 1"} {"level":"info","ts":"2026-02-24T03:54:31.410623Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 switched to configuration voters=(13145183766694598457)"} {"level":"warn","ts":"2026-02-24T03:54:31.416443Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-02-24T03:54:31.417981Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-02-24T03:54:31.419099Z","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-02-24T03:54:31.422992Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"b66d12fd59101739","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-02-24T03:54:31.423218Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"b66d12fd59101739","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-02-24T03:54:31.423337Z","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-02-24T03:54:31.423787Z","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-02-24T03:54:31.423823Z","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-02-24T03:54:31.425498Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 switched to configuration voters=(13145183766694598457)"} {"level":"info","ts":"2026-02-24T03:54:31.426364Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"a64a525934ce8379","local-member-id":"b66d12fd59101739","added-peer-id":"b66d12fd59101739","added-peer-peer-urls":["https://162.253.55.195:2380"]} {"level":"info","ts":"2026-02-24T03:54:31.429366Z","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-02-24T03:54:31.429465Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.195:2380"} {"level":"info","ts":"2026-02-24T03:54:31.429538Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.195:2380"} {"level":"info","ts":"2026-02-24T03:54:31.429771Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"b66d12fd59101739","initial-advertise-peer-urls":["https://162.253.55.195:2380"],"listen-peer-urls":["https://162.253.55.195:2380"],"advertise-client-urls":["https://162.253.55.195:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.195:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-02-24T03:54:31.429821Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-02-24T03:54:31.91141Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 is starting a new election at term 1"} {"level":"info","ts":"2026-02-24T03:54:31.911487Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 became pre-candidate at term 1"} {"level":"info","ts":"2026-02-24T03:54:31.911517Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 received MsgPreVoteResp from b66d12fd59101739 at term 1"} {"level":"info","ts":"2026-02-24T03:54:31.911541Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 became candidate at term 2"} {"level":"info","ts":"2026-02-24T03:54:31.911562Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 received MsgVoteResp from b66d12fd59101739 at term 2"} {"level":"info","ts":"2026-02-24T03:54:31.911586Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b66d12fd59101739 became leader at term 2"} {"level":"info","ts":"2026-02-24T03:54:31.911604Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: b66d12fd59101739 elected leader b66d12fd59101739 at term 2"} {"level":"info","ts":"2026-02-24T03:54:31.912458Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"b66d12fd59101739","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.195:2379]}","request-path":"/0/members/b66d12fd59101739/attributes","cluster-id":"a64a525934ce8379","publish-timeout":"7s"} {"level":"info","ts":"2026-02-24T03:54:31.912492Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-02-24T03:54:31.912617Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-02-24T03:54:31.912672Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-02-24T03:54:31.912945Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-02-24T03:54:31.913003Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-02-24T03:54:31.914311Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.195:2379"} {"level":"info","ts":"2026-02-24T03:54:31.914867Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"a64a525934ce8379","local-member-id":"b66d12fd59101739","cluster-version":"3.5"} {"level":"info","ts":"2026-02-24T03:54:31.915084Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-02-24T03:54:31.915146Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-02-24T03:54:31.916328Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-02-24T03:54:59.399517Z","caller":"traceutil/trace.go:171","msg":"trace[507451155] transaction","detail":"{read_only:false; response_revision:466; number_of_response:1; }","duration":"178.086811ms","start":"2026-02-24T03:54:59.221389Z","end":"2026-02-24T03:54:59.399476Z","steps":["trace[507451155] 'process raft request' (duration: 177.587197ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:55:01.185305Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.708769ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-02-24T03:55:01.185429Z","caller":"traceutil/trace.go:171","msg":"trace[1519122115] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:471; }","duration":"101.882424ms","start":"2026-02-24T03:55:01.083527Z","end":"2026-02-24T03:55:01.18541Z","steps":["trace[1519122115] 'range keys from in-memory index tree' (duration: 101.511324ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:55:01.51371Z","caller":"traceutil/trace.go:171","msg":"trace[37367177] linearizableReadLoop","detail":"{readStateIndex:491; appliedIndex:490; }","duration":"198.161674ms","start":"2026-02-24T03:55:01.315522Z","end":"2026-02-24T03:55:01.513683Z","steps":["trace[37367177] 'read index received' (duration: 198.120133ms)","trace[37367177] 'applied index is now lower than readState.Index' (duration: 40.301µs)"],"step_count":2} {"level":"info","ts":"2026-02-24T03:55:01.513815Z","caller":"traceutil/trace.go:171","msg":"trace[1844032415] transaction","detail":"{read_only:false; response_revision:473; number_of_response:1; }","duration":"235.324676ms","start":"2026-02-24T03:55:01.278449Z","end":"2026-02-24T03:55:01.513773Z","steps":["trace[1844032415] 'process raft request' (duration: 235.08999ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:55:01.513884Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.340688ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T03:55:01.51395Z","caller":"traceutil/trace.go:171","msg":"trace[1632232834] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:473; }","duration":"198.477643ms","start":"2026-02-24T03:55:01.315452Z","end":"2026-02-24T03:55:01.51393Z","steps":["trace[1632232834] 'agreement among raft nodes before linearized reading' (duration: 198.355849ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:55:04.7005Z","caller":"traceutil/trace.go:171","msg":"trace[1751954244] transaction","detail":"{read_only:false; response_revision:501; number_of_response:1; }","duration":"105.782142ms","start":"2026-02-24T03:55:04.594696Z","end":"2026-02-24T03:55:04.700478Z","steps":["trace[1751954244] 'process raft request' (duration: 105.600937ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:55:07.298108Z","caller":"traceutil/trace.go:171","msg":"trace[678708034] transaction","detail":"{read_only:false; response_revision:512; number_of_response:1; }","duration":"110.069669ms","start":"2026-02-24T03:55:07.188007Z","end":"2026-02-24T03:55:07.298077Z","steps":["trace[678708034] 'process raft request' (duration: 109.854573ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:55:07.820763Z","caller":"traceutil/trace.go:171","msg":"trace[1650388780] transaction","detail":"{read_only:false; response_revision:514; number_of_response:1; }","duration":"134.239074ms","start":"2026-02-24T03:55:07.686497Z","end":"2026-02-24T03:55:07.820736Z","steps":["trace[1650388780] 'process raft request' (duration: 134.039308ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:55:07.915113Z","caller":"traceutil/trace.go:171","msg":"trace[942103381] transaction","detail":"{read_only:false; response_revision:515; number_of_response:1; }","duration":"136.588889ms","start":"2026-02-24T03:55:07.778469Z","end":"2026-02-24T03:55:07.915058Z","steps":["trace[942103381] 'process raft request' (duration: 136.419205ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:56:27.94447Z","caller":"traceutil/trace.go:171","msg":"trace[1980769435] transaction","detail":"{read_only:false; response_revision:1586; number_of_response:1; }","duration":"282.311824ms","start":"2026-02-24T03:56:27.662131Z","end":"2026-02-24T03:56:27.944443Z","steps":["trace[1980769435] 'process raft request' (duration: 282.14417ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:56:27.999974Z","caller":"traceutil/trace.go:171","msg":"trace[837104746] transaction","detail":"{read_only:false; response_revision:1587; number_of_response:1; }","duration":"337.27256ms","start":"2026-02-24T03:56:27.66267Z","end":"2026-02-24T03:56:27.999943Z","steps":["trace[837104746] 'process raft request' (duration: 337.086924ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:56:28.000023Z","caller":"traceutil/trace.go:171","msg":"trace[1077103962] linearizableReadLoop","detail":"{readStateIndex:1654; appliedIndex:1649; }","duration":"227.001869ms","start":"2026-02-24T03:56:27.773003Z","end":"2026-02-24T03:56:28.000005Z","steps":["trace[1077103962] 'read index received' (duration: 171.335914ms)","trace[1077103962] 'applied index is now lower than readState.Index' (duration: 55.664915ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T03:56:28.000104Z","caller":"traceutil/trace.go:171","msg":"trace[1440150805] transaction","detail":"{read_only:false; response_revision:1589; number_of_response:1; }","duration":"336.484757ms","start":"2026-02-24T03:56:27.663579Z","end":"2026-02-24T03:56:28.000064Z","steps":["trace[1440150805] 'process raft request' (duration: 336.329813ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:56:28.000329Z","caller":"traceutil/trace.go:171","msg":"trace[1429353664] transaction","detail":"{read_only:false; response_revision:1588; number_of_response:1; }","duration":"337.497166ms","start":"2026-02-24T03:56:27.66279Z","end":"2026-02-24T03:56:28.000287Z","steps":["trace[1429353664] 'process raft request' (duration: 337.072514ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:56:28.000429Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.39793ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5324"} {"level":"info","ts":"2026-02-24T03:56:28.000446Z","caller":"traceutil/trace.go:171","msg":"trace[1519818846] transaction","detail":"{read_only:false; response_revision:1590; number_of_response:1; }","duration":"333.574416ms","start":"2026-02-24T03:56:27.666722Z","end":"2026-02-24T03:56:28.000297Z","steps":["trace[1519818846] 'process raft request' (duration: 333.236887ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:56:28.000509Z","caller":"traceutil/trace.go:171","msg":"trace[1180033774] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1590; }","duration":"227.526224ms","start":"2026-02-24T03:56:27.772967Z","end":"2026-02-24T03:56:28.000493Z","steps":["trace[1180033774] 'agreement among raft nodes before linearized reading' (duration: 227.289967ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:56:28.000391Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.1429ms","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-02-24T03:56:28.000568Z","caller":"traceutil/trace.go:171","msg":"trace[467946038] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1590; }","duration":"206.370187ms","start":"2026-02-24T03:56:27.794183Z","end":"2026-02-24T03:56:28.000553Z","steps":["trace[467946038] 'agreement among raft nodes before linearized reading' (duration: 206.10093ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:56:28.000635Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T03:56:27.662654Z","time spent":"337.407364ms","remote":"127.0.0.1:39184","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1473,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T03:56:28.000754Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T03:56:27.662766Z","time spent":"337.67696ms","remote":"127.0.0.1:47008","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":895,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T03:56:28.001109Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T03:56:27.663555Z","time spent":"337.485585ms","remote":"127.0.0.1:39184","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1531,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T03:56:28.001699Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T03:56:27.666708Z","time spent":"333.811282ms","remote":"127.0.0.1:47028","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3669,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T03:56:28.34256Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.057096ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-02-24T03:56:28.342654Z","caller":"traceutil/trace.go:171","msg":"trace[1387928527] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1592; }","duration":"114.221481ms","start":"2026-02-24T03:56:28.228396Z","end":"2026-02-24T03:56:28.342618Z","steps":["trace[1387928527] 'range keys from in-memory index tree' (duration: 113.86801ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:56:40.27337Z","caller":"traceutil/trace.go:171","msg":"trace[1946048430] transaction","detail":"{read_only:false; response_revision:1688; number_of_response:1; }","duration":"171.625933ms","start":"2026-02-24T03:56:40.101708Z","end":"2026-02-24T03:56:40.273334Z","steps":["trace[1946048430] 'process raft request' (duration: 171.408597ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:56:42.482062Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.834214ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T03:56:42.482227Z","caller":"traceutil/trace.go:171","msg":"trace[655050041] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:1703; }","duration":"120.02576ms","start":"2026-02-24T03:56:42.362179Z","end":"2026-02-24T03:56:42.482205Z","steps":["trace[655050041] 'range keys from in-memory index tree' (duration: 119.808944ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:57:16.706709Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.661024ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12191"} {"level":"info","ts":"2026-02-24T03:57:16.706796Z","caller":"traceutil/trace.go:171","msg":"trace[1140628120] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:1879; }","duration":"142.819068ms","start":"2026-02-24T03:57:16.56396Z","end":"2026-02-24T03:57:16.706779Z","steps":["trace[1140628120] 'range keys from in-memory index tree' (duration: 142.423967ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:57:16.969812Z","caller":"traceutil/trace.go:171","msg":"trace[1747558854] linearizableReadLoop","detail":"{readStateIndex:1956; appliedIndex:1955; }","duration":"254.078892ms","start":"2026-02-24T03:57:16.715703Z","end":"2026-02-24T03:57:16.969782Z","steps":["trace[1747558854] 'read index received' (duration: 253.923448ms)","trace[1747558854] 'applied index is now lower than readState.Index' (duration: 154.164µs)"],"step_count":2} {"level":"info","ts":"2026-02-24T03:57:16.969872Z","caller":"traceutil/trace.go:171","msg":"trace[1978549778] transaction","detail":"{read_only:false; response_revision:1880; number_of_response:1; }","duration":"257.854167ms","start":"2026-02-24T03:57:16.711969Z","end":"2026-02-24T03:57:16.969823Z","steps":["trace[1978549778] 'process raft request' (duration: 257.651452ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:57:16.969974Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.246987ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T03:57:16.970036Z","caller":"traceutil/trace.go:171","msg":"trace[1831061358] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:1880; }","duration":"254.340319ms","start":"2026-02-24T03:57:16.715678Z","end":"2026-02-24T03:57:16.970018Z","steps":["trace[1831061358] 'agreement among raft nodes before linearized reading' (duration: 254.230506ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:57:17.278136Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"263.537622ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-24T03:57:17.278277Z","caller":"traceutil/trace.go:171","msg":"trace[1715852601] transaction","detail":"{read_only:false; response_revision:1881; number_of_response:1; }","duration":"372.6999ms","start":"2026-02-24T03:57:16.905541Z","end":"2026-02-24T03:57:17.27824Z","steps":["trace[1715852601] 'process raft request' (duration: 108.691524ms)","trace[1715852601] 'compare' (duration: 263.397019ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T03:57:17.278357Z","caller":"traceutil/trace.go:171","msg":"trace[198868633] transaction","detail":"{read_only:false; response_revision:1882; number_of_response:1; }","duration":"235.595729ms","start":"2026-02-24T03:57:17.042737Z","end":"2026-02-24T03:57:17.278333Z","steps":["trace[198868633] 'process raft request' (duration: 235.509566ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:57:17.278517Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"305.101109ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T03:57:17.278531Z","caller":"traceutil/trace.go:171","msg":"trace[1467598758] linearizableReadLoop","detail":"{readStateIndex:1957; appliedIndex:1956; }","duration":"304.921584ms","start":"2026-02-24T03:57:16.973403Z","end":"2026-02-24T03:57:17.278325Z","steps":["trace[1467598758] 'read index received' (duration: 40.783055ms)","trace[1467598758] 'applied index is now lower than readState.Index' (duration: 264.135149ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T03:57:17.278586Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T03:57:16.905517Z","time spent":"372.898906ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T03:57:17.278734Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.742116ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-02-24T03:57:17.278784Z","caller":"traceutil/trace.go:171","msg":"trace[1562027077] range","detail":"{range_begin:/registry/roles/; range_end:/registry/roles0; response_count:0; response_revision:1882; }","duration":"146.796358ms","start":"2026-02-24T03:57:17.131976Z","end":"2026-02-24T03:57:17.278773Z","steps":["trace[1562027077] 'agreement among raft nodes before linearized reading' (duration: 146.701355ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:57:17.280101Z","caller":"traceutil/trace.go:171","msg":"trace[1135551871] range","detail":"{range_begin:/registry/services/specs/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:1882; }","duration":"305.244343ms","start":"2026-02-24T03:57:16.973316Z","end":"2026-02-24T03:57:17.27856Z","steps":["trace[1135551871] 'agreement among raft nodes before linearized reading' (duration: 305.120469ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:57:17.280334Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T03:57:16.973299Z","time spent":"306.98441ms","remote":"127.0.0.1:47044","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":0,"response size":29,"request content":"key:\"/registry/services/specs/openstack/percona-xtradb-pitr\" "} {"level":"warn","ts":"2026-02-24T03:57:17.829786Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.490294ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-24T03:57:17.829913Z","caller":"traceutil/trace.go:171","msg":"trace[1016383] transaction","detail":"{read_only:false; response_revision:1884; number_of_response:1; }","duration":"193.794934ms","start":"2026-02-24T03:57:17.636093Z","end":"2026-02-24T03:57:17.829888Z","steps":["trace[1016383] 'process raft request' (duration: 87.122484ms)","trace[1016383] 'compare' (duration: 106.32985ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T03:57:17.91915Z","caller":"traceutil/trace.go:171","msg":"trace[713035118] linearizableReadLoop","detail":"{readStateIndex:1961; appliedIndex:1959; }","duration":"251.095441ms","start":"2026-02-24T03:57:17.668033Z","end":"2026-02-24T03:57:17.919128Z","steps":["trace[713035118] 'read index received' (duration: 55.076986ms)","trace[713035118] 'applied index is now lower than readState.Index' (duration: 196.017755ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T03:57:17.91926Z","caller":"traceutil/trace.go:171","msg":"trace[1275589361] transaction","detail":"{read_only:false; response_revision:1885; number_of_response:1; }","duration":"267.953412ms","start":"2026-02-24T03:57:17.651271Z","end":"2026-02-24T03:57:17.919225Z","steps":["trace[1275589361] 'process raft request' (duration: 267.744487ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:57:17.919342Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"251.296006ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-02-24T03:57:17.919373Z","caller":"traceutil/trace.go:171","msg":"trace[1223527323] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1885; }","duration":"251.382539ms","start":"2026-02-24T03:57:17.667982Z","end":"2026-02-24T03:57:17.919364Z","steps":["trace[1223527323] 'agreement among raft nodes before linearized reading' (duration: 251.255346ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:57:17.919383Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.658449ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/schemareplications/\" range_end:\"/registry/rabbitmq.com/schemareplications0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T03:57:17.919475Z","caller":"traceutil/trace.go:171","msg":"trace[1430739146] range","detail":"{range_begin:/registry/rabbitmq.com/schemareplications/; range_end:/registry/rabbitmq.com/schemareplications0; response_count:0; response_revision:1885; }","duration":"235.799232ms","start":"2026-02-24T03:57:17.68365Z","end":"2026-02-24T03:57:17.919449Z","steps":["trace[1430739146] 'agreement among raft nodes before linearized reading' (duration: 235.634288ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:57:23.417385Z","caller":"traceutil/trace.go:171","msg":"trace[1167814459] linearizableReadLoop","detail":"{readStateIndex:1987; appliedIndex:1986; }","duration":"102.166247ms","start":"2026-02-24T03:57:23.315196Z","end":"2026-02-24T03:57:23.417362Z","steps":["trace[1167814459] 'read index received' (duration: 102.017643ms)","trace[1167814459] 'applied index is now lower than readState.Index' (duration: 147.254µs)"],"step_count":2} {"level":"info","ts":"2026-02-24T03:57:23.417486Z","caller":"traceutil/trace.go:171","msg":"trace[564966145] transaction","detail":"{read_only:false; response_revision:1910; number_of_response:1; }","duration":"118.281726ms","start":"2026-02-24T03:57:23.299172Z","end":"2026-02-24T03:57:23.417453Z","steps":["trace[564966145] 'process raft request' (duration: 117.994979ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T03:57:23.417564Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.346021ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T03:57:23.417632Z","caller":"traceutil/trace.go:171","msg":"trace[703806014] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1910; }","duration":"102.462365ms","start":"2026-02-24T03:57:23.31515Z","end":"2026-02-24T03:57:23.417612Z","steps":["trace[703806014] 'agreement among raft nodes before linearized reading' (duration: 102.356602ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:57:23.671584Z","caller":"traceutil/trace.go:171","msg":"trace[1151092059] transaction","detail":"{read_only:false; response_revision:1911; number_of_response:1; }","duration":"116.277672ms","start":"2026-02-24T03:57:23.555277Z","end":"2026-02-24T03:57:23.671554Z","steps":["trace[1151092059] 'process raft request' (duration: 116.109037ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:57:23.707938Z","caller":"traceutil/trace.go:171","msg":"trace[635475611] transaction","detail":"{read_only:false; response_revision:1912; number_of_response:1; }","duration":"150.769576ms","start":"2026-02-24T03:57:23.557151Z","end":"2026-02-24T03:57:23.707921Z","steps":["trace[635475611] 'process raft request' (duration: 150.689054ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:58:06.842666Z","caller":"traceutil/trace.go:171","msg":"trace[253822695] transaction","detail":"{read_only:false; response_revision:2296; number_of_response:1; }","duration":"111.627845ms","start":"2026-02-24T03:58:06.730987Z","end":"2026-02-24T03:58:06.842615Z","steps":["trace[253822695] 'process raft request' (duration: 111.271375ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:58:37.492144Z","caller":"traceutil/trace.go:171","msg":"trace[1275514292] transaction","detail":"{read_only:false; response_revision:2470; number_of_response:1; }","duration":"118.147496ms","start":"2026-02-24T03:58:37.373964Z","end":"2026-02-24T03:58:37.492111Z","steps":["trace[1275514292] 'process raft request' (duration: 117.958101ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T03:58:37.881762Z","caller":"traceutil/trace.go:171","msg":"trace[1210219384] transaction","detail":"{read_only:false; response_revision:2472; number_of_response:1; }","duration":"190.738934ms","start":"2026-02-24T03:58:37.690989Z","end":"2026-02-24T03:58:37.881728Z","steps":["trace[1210219384] 'process raft request' (duration: 153.31821ms)","trace[1210219384] 'compare' (duration: 37.218468ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:01:39.821237Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.185538ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T04:01:39.821339Z","caller":"traceutil/trace.go:171","msg":"trace[1758650152] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:3547; }","duration":"116.323123ms","start":"2026-02-24T04:01:39.704989Z","end":"2026-02-24T04:01:39.821312Z","steps":["trace[1758650152] 'range keys from in-memory index tree' (duration: 116.091666ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:03:01.299971Z","caller":"traceutil/trace.go:171","msg":"trace[1995915646] transaction","detail":"{read_only:false; response_revision:4719; number_of_response:1; }","duration":"115.237043ms","start":"2026-02-24T04:03:01.184691Z","end":"2026-02-24T04:03:01.299928Z","steps":["trace[1995915646] 'process raft request' (duration: 48.335683ms)","trace[1995915646] 'compare' (duration: 66.541059ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:03:07.981045Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.755653ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/openstack/memcached-metrics\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T04:03:07.981182Z","caller":"traceutil/trace.go:171","msg":"trace[1627580251] range","detail":"{range_begin:/registry/services/specs/openstack/memcached-metrics; range_end:; response_count:0; response_revision:4849; }","duration":"105.957299ms","start":"2026-02-24T04:03:07.875203Z","end":"2026-02-24T04:03:07.98116Z","steps":["trace[1627580251] 'range keys from in-memory index tree' (duration: 105.63115ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:03:08.192434Z","caller":"traceutil/trace.go:171","msg":"trace[1912375547] transaction","detail":"{read_only:false; response_revision:4853; number_of_response:1; }","duration":"127.261621ms","start":"2026-02-24T04:03:08.065136Z","end":"2026-02-24T04:03:08.192398Z","steps":["trace[1912375547] 'process raft request' (duration: 49.911394ms)","trace[1912375547] 'compare' (duration: 77.059229ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:03:08.192759Z","caller":"traceutil/trace.go:171","msg":"trace[1779198501] transaction","detail":"{read_only:false; response_revision:4854; number_of_response:1; }","duration":"127.21224ms","start":"2026-02-24T04:03:08.065347Z","end":"2026-02-24T04:03:08.192559Z","steps":["trace[1779198501] 'process raft request' (duration: 126.963933ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:03:08.193031Z","caller":"traceutil/trace.go:171","msg":"trace[1030033969] transaction","detail":"{read_only:false; response_revision:4855; number_of_response:1; }","duration":"101.28581ms","start":"2026-02-24T04:03:08.091682Z","end":"2026-02-24T04:03:08.192968Z","steps":["trace[1030033969] 'process raft request' (duration: 100.703854ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:03:16.331064Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.266425ms","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-02-24T04:03:16.331153Z","caller":"traceutil/trace.go:171","msg":"trace[2091393446] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:4988; }","duration":"103.410988ms","start":"2026-02-24T04:03:16.227725Z","end":"2026-02-24T04:03:16.331136Z","steps":["trace[2091393446] 'range keys from in-memory index tree' (duration: 103.09057ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:03:16.846351Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.345142ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-02-24T04:03:16.846357Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.813117ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-627d2ecb-4ff0-4dec-a9a9-10c3a5456ede\" ","response":"range_response_count:1 size:3602"} {"level":"info","ts":"2026-02-24T04:03:16.846446Z","caller":"traceutil/trace.go:171","msg":"trace[1570648023] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:4990; }","duration":"192.485946ms","start":"2026-02-24T04:03:16.65394Z","end":"2026-02-24T04:03:16.846426Z","steps":["trace[1570648023] 'range keys from in-memory index tree' (duration: 192.255028ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:03:16.846463Z","caller":"traceutil/trace.go:171","msg":"trace[1317924063] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-627d2ecb-4ff0-4dec-a9a9-10c3a5456ede; range_end:; response_count:1; response_revision:4990; }","duration":"134.982302ms","start":"2026-02-24T04:03:16.711456Z","end":"2026-02-24T04:03:16.846438Z","steps":["trace[1317924063] 'range keys from in-memory index tree' (duration: 134.612352ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:03:17.306818Z","caller":"traceutil/trace.go:171","msg":"trace[142247126] linearizableReadLoop","detail":"{readStateIndex:5188; appliedIndex:5187; }","duration":"406.47974ms","start":"2026-02-24T04:03:16.900313Z","end":"2026-02-24T04:03:17.306793Z","steps":["trace[142247126] 'read index received' (duration: 406.366446ms)","trace[142247126] 'applied index is now lower than readState.Index' (duration: 112.174µs)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:03:17.30691Z","caller":"traceutil/trace.go:171","msg":"trace[233985777] transaction","detail":"{read_only:false; response_revision:4992; number_of_response:1; }","duration":"454.626007ms","start":"2026-02-24T04:03:16.852252Z","end":"2026-02-24T04:03:17.306878Z","steps":["trace[233985777] 'process raft request' (duration: 454.3871ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:03:17.306984Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"456.911589ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T04:03:17.307039Z","caller":"traceutil/trace.go:171","msg":"trace[301564022] range","detail":"{range_begin:/registry/services/specs/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:4992; }","duration":"457.029183ms","start":"2026-02-24T04:03:16.849998Z","end":"2026-02-24T04:03:17.307028Z","steps":["trace[301564022] 'agreement among raft nodes before linearized reading' (duration: 456.91272ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:03:17.307081Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:03:16.849972Z","time spent":"457.100644ms","remote":"127.0.0.1:47044","response type":"/etcdserverpb.KV/Range","request count":0,"request size":56,"response count":0,"response size":29,"request content":"key:\"/registry/services/specs/openstack/percona-xtradb-pitr\" "} {"level":"warn","ts":"2026-02-24T04:03:17.307094Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:03:16.852232Z","time spent":"454.785411ms","remote":"127.0.0.1:47028","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3688,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:03:17.307091Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"439.320528ms","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-02-24T04:03:17.307181Z","caller":"traceutil/trace.go:171","msg":"trace[1098428077] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4992; }","duration":"439.439811ms","start":"2026-02-24T04:03:16.867722Z","end":"2026-02-24T04:03:17.307161Z","steps":["trace[1098428077] 'agreement among raft nodes before linearized reading' (duration: 439.204034ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:03:17.307229Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:03:16.867711Z","time spent":"439.510042ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":504,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-02-24T04:03:17.313684Z","caller":"traceutil/trace.go:171","msg":"trace[1051777008] transaction","detail":"{read_only:false; response_revision:4993; number_of_response:1; }","duration":"132.544255ms","start":"2026-02-24T04:03:17.18112Z","end":"2026-02-24T04:03:17.313664Z","steps":["trace[1051777008] 'process raft request' (duration: 132.36851ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:03:17.313807Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"409.038549ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:9 size:78814"} {"level":"info","ts":"2026-02-24T04:03:17.313851Z","caller":"traceutil/trace.go:171","msg":"trace[330559569] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:9; response_revision:4994; }","duration":"409.127802ms","start":"2026-02-24T04:03:16.904712Z","end":"2026-02-24T04:03:17.31384Z","steps":["trace[330559569] 'agreement among raft nodes before linearized reading' (duration: 408.921576ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:03:17.31389Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:03:16.904691Z","time spent":"409.190913ms","remote":"127.0.0.1:47028","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":9,"response size":78838,"request content":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" "} {"level":"info","ts":"2026-02-24T04:04:32.224942Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2740} {"level":"info","ts":"2026-02-24T04:04:32.360577Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2740,"took":"134.398559ms","hash":4033966500,"current-db-size-bytes":40673280,"current-db-size":"41 MB","current-db-size-in-use-bytes":30461952,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-02-24T04:04:32.360644Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":4033966500,"revision":2740,"compact-revision":-1} {"level":"info","ts":"2026-02-24T04:09:32.236392Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5647} {"level":"info","ts":"2026-02-24T04:09:32.330086Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5647,"took":"91.862008ms","hash":2537884920,"current-db-size-bytes":43286528,"current-db-size":"43 MB","current-db-size-in-use-bytes":23855104,"current-db-size-in-use":"24 MB"} {"level":"info","ts":"2026-02-24T04:09:32.330146Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2537884920,"revision":5647,"compact-revision":2740} {"level":"info","ts":"2026-02-24T04:09:35.186469Z","caller":"traceutil/trace.go:171","msg":"trace[2094200227] transaction","detail":"{read_only:false; response_revision:7735; number_of_response:1; }","duration":"436.091ms","start":"2026-02-24T04:09:34.750353Z","end":"2026-02-24T04:09:35.186444Z","steps":["trace[2094200227] 'process raft request' (duration: 435.907515ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:09:35.186644Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:09:34.750333Z","time spent":"436.213184ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:09:35.201402Z","caller":"traceutil/trace.go:171","msg":"trace[859196851] transaction","detail":"{read_only:false; response_revision:7736; number_of_response:1; }","duration":"347.253826ms","start":"2026-02-24T04:09:34.854103Z","end":"2026-02-24T04:09:35.201357Z","steps":["trace[859196851] 'process raft request' (duration: 347.015039ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:09:35.201657Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:09:34.854075Z","time spent":"347.488312ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:10:02.236731Z","caller":"traceutil/trace.go:171","msg":"trace[1017949911] transaction","detail":"{read_only:false; response_revision:7921; number_of_response:1; }","duration":"433.227811ms","start":"2026-02-24T04:10:01.803471Z","end":"2026-02-24T04:10:02.236699Z","steps":["trace[1017949911] 'process raft request' (duration: 433.070707ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:10:02.236974Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:10:01.803456Z","time spent":"433.385676ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:10:02.244062Z","caller":"traceutil/trace.go:171","msg":"trace[962325922] transaction","detail":"{read_only:false; response_revision:7922; number_of_response:1; }","duration":"357.294932ms","start":"2026-02-24T04:10:01.886748Z","end":"2026-02-24T04:10:02.244043Z","steps":["trace[962325922] 'process raft request' (duration: 357.184579ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:10:02.244191Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:10:01.886733Z","time spent":"357.389724ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:10:05.425775Z","caller":"traceutil/trace.go:171","msg":"trace[1195333470] transaction","detail":"{read_only:false; response_revision:7935; number_of_response:1; }","duration":"137.39042ms","start":"2026-02-24T04:10:05.28836Z","end":"2026-02-24T04:10:05.425751Z","steps":["trace[1195333470] 'process raft request' (duration: 133.3657ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:10:05.457138Z","caller":"traceutil/trace.go:171","msg":"trace[816910581] linearizableReadLoop","detail":"{readStateIndex:8235; appliedIndex:8233; }","duration":"141.617887ms","start":"2026-02-24T04:10:05.315486Z","end":"2026-02-24T04:10:05.457104Z","steps":["trace[816910581] 'read index received' (duration: 106.263535ms)","trace[816910581] 'applied index is now lower than readState.Index' (duration: 35.353432ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:10:05.457185Z","caller":"traceutil/trace.go:171","msg":"trace[893277168] transaction","detail":"{read_only:false; response_revision:7936; number_of_response:1; }","duration":"145.951466ms","start":"2026-02-24T04:10:05.311179Z","end":"2026-02-24T04:10:05.457131Z","steps":["trace[893277168] 'process raft request' (duration: 145.808872ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:10:05.457296Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.795141ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T04:10:05.457329Z","caller":"traceutil/trace.go:171","msg":"trace[1443505543] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:7936; }","duration":"141.869904ms","start":"2026-02-24T04:10:05.315449Z","end":"2026-02-24T04:10:05.457319Z","steps":["trace[1443505543] 'agreement among raft nodes before linearized reading' (duration: 141.795662ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:10:15.905962Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"192.48038ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-24T04:10:15.906074Z","caller":"traceutil/trace.go:171","msg":"trace[1971538123] linearizableReadLoop","detail":"{readStateIndex:8332; appliedIndex:8330; }","duration":"374.793529ms","start":"2026-02-24T04:10:15.531263Z","end":"2026-02-24T04:10:15.906057Z","steps":["trace[1971538123] 'read index received' (duration: 25.233837ms)","trace[1971538123] 'applied index is now lower than readState.Index' (duration: 349.558572ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:10:15.90615Z","caller":"traceutil/trace.go:171","msg":"trace[239098294] transaction","detail":"{read_only:false; response_revision:8028; number_of_response:1; }","duration":"414.65456ms","start":"2026-02-24T04:10:15.491457Z","end":"2026-02-24T04:10:15.906111Z","steps":["trace[239098294] 'process raft request' (duration: 221.933234ms)","trace[239098294] 'compare' (duration: 192.337896ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:10:15.90628Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"375.022885ms","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-02-24T04:10:15.906319Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:10:15.491435Z","time spent":"414.796315ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:10:15.906337Z","caller":"traceutil/trace.go:171","msg":"trace[349571480] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:8028; }","duration":"375.128928ms","start":"2026-02-24T04:10:15.531196Z","end":"2026-02-24T04:10:15.906325Z","steps":["trace[349571480] 'agreement among raft nodes before linearized reading' (duration: 374.951753ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:10:15.906378Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:10:15.531171Z","time spent":"375.19787ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":504,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-02-24T04:10:15.952187Z","caller":"traceutil/trace.go:171","msg":"trace[101125701] transaction","detail":"{read_only:false; response_revision:8029; number_of_response:1; }","duration":"208.515834ms","start":"2026-02-24T04:10:15.74365Z","end":"2026-02-24T04:10:15.952166Z","steps":["trace[101125701] 'process raft request' (duration: 208.400371ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:10:15.952421Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.593716ms","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-02-24T04:10:15.95244Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"267.920966ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephclusters/openstack/ceph\" ","response":"range_response_count:1 size:5124"} {"level":"info","ts":"2026-02-24T04:10:15.952489Z","caller":"traceutil/trace.go:171","msg":"trace[1486249802] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:8029; }","duration":"199.707459ms","start":"2026-02-24T04:10:15.752767Z","end":"2026-02-24T04:10:15.952475Z","steps":["trace[1486249802] 'agreement among raft nodes before linearized reading' (duration: 199.510734ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:10:15.952499Z","caller":"traceutil/trace.go:171","msg":"trace[144601756] range","detail":"{range_begin:/registry/ceph.rook.io/cephclusters/openstack/ceph; range_end:; response_count:1; response_revision:8029; }","duration":"267.975407ms","start":"2026-02-24T04:10:15.684509Z","end":"2026-02-24T04:10:15.952485Z","steps":["trace[144601756] 'agreement among raft nodes before linearized reading' (duration: 267.826583ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:10:15.952831Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.383278ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-jh9w9\" ","response":"range_response_count:1 size:6285"} {"level":"info","ts":"2026-02-24T04:10:15.952909Z","caller":"traceutil/trace.go:171","msg":"trace[1953760205] range","detail":"{range_begin:/registry/pods/openstack/keepalived-jh9w9; range_end:; response_count:1; response_revision:8029; }","duration":"269.013126ms","start":"2026-02-24T04:10:15.683884Z","end":"2026-02-24T04:10:15.952897Z","steps":["trace[1953760205] 'agreement among raft nodes before linearized reading' (duration: 268.341887ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:10:16.165802Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.870721ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-02-24T04:10:16.166032Z","caller":"traceutil/trace.go:171","msg":"trace[1927363202] transaction","detail":"{read_only:false; response_revision:8031; number_of_response:1; }","duration":"209.237374ms","start":"2026-02-24T04:10:15.956762Z","end":"2026-02-24T04:10:16.166Z","steps":["trace[1927363202] 'process raft request' (duration: 84.068194ms)","trace[1927363202] 'compare' (duration: 124.677976ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:10:16.16606Z","caller":"traceutil/trace.go:171","msg":"trace[1076182985] transaction","detail":"{read_only:false; response_revision:8032; number_of_response:1; }","duration":"202.60826ms","start":"2026-02-24T04:10:15.963435Z","end":"2026-02-24T04:10:16.166043Z","steps":["trace[1076182985] 'process raft request' (duration: 202.458886ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:10:16.166077Z","caller":"traceutil/trace.go:171","msg":"trace[1769772010] linearizableReadLoop","detail":"{readStateIndex:8335; appliedIndex:8333; }","duration":"208.640107ms","start":"2026-02-24T04:10:15.957391Z","end":"2026-02-24T04:10:16.166031Z","steps":["trace[1769772010] 'read index received' (duration: 8.647299ms)","trace[1769772010] 'applied index is now lower than readState.Index' (duration: 199.991827ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:10:16.166569Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"209.166431ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:26 size:224113"} {"level":"info","ts":"2026-02-24T04:10:16.166625Z","caller":"traceutil/trace.go:171","msg":"trace[2037365178] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:26; response_revision:8032; }","duration":"209.242402ms","start":"2026-02-24T04:10:15.957369Z","end":"2026-02-24T04:10:16.166612Z","steps":["trace[2037365178] 'agreement among raft nodes before linearized reading' (duration: 208.736869ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:13:42.079791Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"b66d12fd59101739","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-02-24T04:13:42.090983Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001} {"level":"info","ts":"2026-02-24T04:13:42.091083Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001} {"level":"info","ts":"2026-02-24T04:14:32.245634Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":7723} {"level":"info","ts":"2026-02-24T04:14:32.307149Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":7723,"took":"59.361844ms","hash":466050482,"current-db-size-bytes":43286528,"current-db-size":"43 MB","current-db-size-in-use-bytes":26566656,"current-db-size-in-use":"27 MB"} {"level":"info","ts":"2026-02-24T04:14:32.307202Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":466050482,"revision":7723,"compact-revision":5647} {"level":"info","ts":"2026-02-24T04:15:12.705016Z","caller":"traceutil/trace.go:171","msg":"trace[1641201666] transaction","detail":"{read_only:false; response_revision:10464; number_of_response:1; }","duration":"107.046986ms","start":"2026-02-24T04:15:12.597943Z","end":"2026-02-24T04:15:12.70499Z","steps":["trace[1641201666] 'process raft request' (duration: 106.894522ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:15:13.263978Z","caller":"traceutil/trace.go:171","msg":"trace[219547368] transaction","detail":"{read_only:false; response_revision:10466; number_of_response:1; }","duration":"120.887828ms","start":"2026-02-24T04:15:13.143053Z","end":"2026-02-24T04:15:13.263941Z","steps":["trace[219547368] 'process raft request' (duration: 120.710783ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:15:26.767589Z","caller":"traceutil/trace.go:171","msg":"trace[2078645831] linearizableReadLoop","detail":"{readStateIndex:10941; appliedIndex:10940; }","duration":"485.023929ms","start":"2026-02-24T04:15:26.282545Z","end":"2026-02-24T04:15:26.767569Z","steps":["trace[2078645831] 'read index received' (duration: 484.960697ms)","trace[2078645831] 'applied index is now lower than readState.Index' (duration: 62.262µs)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:15:26.76767Z","caller":"traceutil/trace.go:171","msg":"trace[176535350] transaction","detail":"{read_only:false; response_revision:10558; number_of_response:1; }","duration":"489.348257ms","start":"2026-02-24T04:15:26.278279Z","end":"2026-02-24T04:15:26.767627Z","steps":["trace[176535350] 'process raft request' (duration: 489.163782ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.767783Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"485.237605ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/openstack/rook-ceph-pdbstatemap\" ","response":"range_response_count:1 size:356"} {"level":"info","ts":"2026-02-24T04:15:26.767816Z","caller":"traceutil/trace.go:171","msg":"trace[1085100236] range","detail":"{range_begin:/registry/configmaps/openstack/rook-ceph-pdbstatemap; range_end:; response_count:1; response_revision:10558; }","duration":"485.282696ms","start":"2026-02-24T04:15:26.282525Z","end":"2026-02-24T04:15:26.767808Z","steps":["trace[1085100236] 'agreement among raft nodes before linearized reading' (duration: 485.149653ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.767835Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.282454Z","time spent":"485.377249ms","remote":"127.0.0.1:46944","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":380,"request content":"key:\"/registry/configmaps/openstack/rook-ceph-pdbstatemap\" "} {"level":"warn","ts":"2026-02-24T04:15:26.767858Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.278249Z","time spent":"489.504862ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4915,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:15:26.772236Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"471.637821ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-ks-endpoints\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T04:15:26.772291Z","caller":"traceutil/trace.go:171","msg":"trace[148897910] range","detail":"{range_begin:/registry/jobs/openstack/cinder-ks-endpoints; range_end:; response_count:0; response_revision:10559; }","duration":"471.737744ms","start":"2026-02-24T04:15:26.300543Z","end":"2026-02-24T04:15:26.772281Z","steps":["trace[148897910] 'agreement among raft nodes before linearized reading' (duration: 471.6094ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.772314Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.300528Z","time spent":"471.781005ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":0,"response size":29,"request content":"key:\"/registry/jobs/openstack/cinder-ks-endpoints\" "} {"level":"warn","ts":"2026-02-24T04:15:26.772311Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.306556ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-ks-user\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-02-24T04:15:26.772336Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.364529ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/openstack/cinder-api\" ","response":"range_response_count:1 size:670"} {"level":"info","ts":"2026-02-24T04:15:26.77236Z","caller":"traceutil/trace.go:171","msg":"trace[1348862907] range","detail":"{range_begin:/registry/jobs/openstack/cinder-ks-user; range_end:; response_count:0; response_revision:10559; }","duration":"340.369148ms","start":"2026-02-24T04:15:26.431977Z","end":"2026-02-24T04:15:26.772346Z","steps":["trace[1348862907] 'agreement among raft nodes before linearized reading' (duration: 340.287315ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.772382Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"471.665091ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-ks-user\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T04:15:26.77238Z","caller":"traceutil/trace.go:171","msg":"trace[1446374952] range","detail":"{range_begin:/registry/services/endpoints/openstack/cinder-api; range_end:; response_count:1; response_revision:10559; }","duration":"340.43685ms","start":"2026-02-24T04:15:26.431931Z","end":"2026-02-24T04:15:26.772368Z","steps":["trace[1446374952] 'agreement among raft nodes before linearized reading' (duration: 340.243235ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.772373Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.384478ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-storage-init\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-02-24T04:15:26.772427Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"458.50532ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-02-24T04:15:26.772422Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.431923Z","time spent":"340.488862ms","remote":"127.0.0.1:47008","response type":"/etcdserverpb.KV/Range","request count":0,"request size":51,"response count":1,"response size":694,"request content":"key:\"/registry/services/endpoints/openstack/cinder-api\" "} {"level":"info","ts":"2026-02-24T04:15:26.772445Z","caller":"traceutil/trace.go:171","msg":"trace[708231846] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:10559; }","duration":"458.547181ms","start":"2026-02-24T04:15:26.313893Z","end":"2026-02-24T04:15:26.77244Z","steps":["trace[708231846] 'agreement among raft nodes before linearized reading' (duration: 458.52167ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:15:26.772443Z","caller":"traceutil/trace.go:171","msg":"trace[1670356089] range","detail":"{range_begin:/registry/jobs/openstack/cinder-storage-init; range_end:; response_count:0; response_revision:10559; }","duration":"340.501122ms","start":"2026-02-24T04:15:26.431927Z","end":"2026-02-24T04:15:26.772429Z","steps":["trace[1670356089] 'agreement among raft nodes before linearized reading' (duration: 340.362028ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.772458Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.313881Z","time spent":"458.574682ms","remote":"127.0.0.1:46860","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-02-24T04:15:26.772478Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.431906Z","time spent":"340.565604ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":0,"response size":29,"request content":"key:\"/registry/jobs/openstack/cinder-storage-init\" "} {"level":"warn","ts":"2026-02-24T04:15:26.772243Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.10126ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-ks-endpoints\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-02-24T04:15:26.772512Z","caller":"traceutil/trace.go:171","msg":"trace[1856944017] range","detail":"{range_begin:/registry/jobs/openstack/cinder-ks-endpoints; range_end:; response_count:0; response_revision:10559; }","duration":"340.428229ms","start":"2026-02-24T04:15:26.432075Z","end":"2026-02-24T04:15:26.772504Z","steps":["trace[1856944017] 'agreement among raft nodes before linearized reading' (duration: 340.10677ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.772542Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.432055Z","time spent":"340.480081ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":0,"response size":29,"request content":"key:\"/registry/jobs/openstack/cinder-ks-endpoints\" "} {"level":"warn","ts":"2026-02-24T04:15:26.77252Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.660876ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-rabbit-init\" ","response":"range_response_count:1 size:4930"} {"level":"warn","ts":"2026-02-24T04:15:26.7726Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"471.96786ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-rabbit-init\" ","response":"range_response_count:1 size:4930"} {"level":"info","ts":"2026-02-24T04:15:26.772612Z","caller":"traceutil/trace.go:171","msg":"trace[1131874612] range","detail":"{range_begin:/registry/jobs/openstack/cinder-rabbit-init; range_end:; response_count:1; response_revision:10559; }","duration":"340.815881ms","start":"2026-02-24T04:15:26.431776Z","end":"2026-02-24T04:15:26.772592Z","steps":["trace[1131874612] 'agreement among raft nodes before linearized reading' (duration: 340.626256ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:15:26.772403Z","caller":"traceutil/trace.go:171","msg":"trace[1826258637] range","detail":"{range_begin:/registry/jobs/openstack/cinder-ks-user; range_end:; response_count:0; response_revision:10559; }","duration":"471.705693ms","start":"2026-02-24T04:15:26.300688Z","end":"2026-02-24T04:15:26.772394Z","steps":["trace[1826258637] 'agreement among raft nodes before linearized reading' (duration: 471.679502ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:15:26.772643Z","caller":"traceutil/trace.go:171","msg":"trace[918903700] range","detail":"{range_begin:/registry/jobs/openstack/cinder-rabbit-init; range_end:; response_count:1; response_revision:10559; }","duration":"472.031531ms","start":"2026-02-24T04:15:26.300599Z","end":"2026-02-24T04:15:26.77263Z","steps":["trace[918903700] 'agreement among raft nodes before linearized reading' (duration: 471.907728ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.772657Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.431751Z","time spent":"340.897493ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":4954,"request content":"key:\"/registry/jobs/openstack/cinder-rabbit-init\" "} {"level":"warn","ts":"2026-02-24T04:15:26.772639Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"471.898628ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-storage-init\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-02-24T04:15:26.772679Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.30059Z","time spent":"472.083053ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":4954,"request content":"key:\"/registry/jobs/openstack/cinder-rabbit-init\" "} {"level":"info","ts":"2026-02-24T04:15:26.772735Z","caller":"traceutil/trace.go:171","msg":"trace[919201625] range","detail":"{range_begin:/registry/jobs/openstack/cinder-storage-init; range_end:; response_count:0; response_revision:10559; }","duration":"472.019292ms","start":"2026-02-24T04:15:26.300693Z","end":"2026-02-24T04:15:26.772712Z","steps":["trace[919201625] 'agreement among raft nodes before linearized reading' (duration: 471.843277ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:15:26.772667Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.300676Z","time spent":"471.97296ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":0,"response size":29,"request content":"key:\"/registry/jobs/openstack/cinder-ks-user\" "} {"level":"warn","ts":"2026-02-24T04:15:26.77278Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.300685Z","time spent":"472.084873ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":0,"response size":29,"request content":"key:\"/registry/jobs/openstack/cinder-storage-init\" "} {"level":"warn","ts":"2026-02-24T04:15:26.77303Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:15:26.431972Z","time spent":"341.004615ms","remote":"127.0.0.1:47094","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":0,"response size":29,"request content":"key:\"/registry/jobs/openstack/cinder-ks-user\" "} {"level":"info","ts":"2026-02-24T04:19:32.251143Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":10077} {"level":"info","ts":"2026-02-24T04:19:32.329413Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":10077,"took":"75.842643ms","hash":854422681,"current-db-size-bytes":43286528,"current-db-size":"43 MB","current-db-size-in-use-bytes":24072192,"current-db-size-in-use":"24 MB"} {"level":"info","ts":"2026-02-24T04:19:32.329482Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":854422681,"revision":10077,"compact-revision":7723} {"level":"info","ts":"2026-02-24T04:21:01.186925Z","caller":"traceutil/trace.go:171","msg":"trace[489841191] transaction","detail":"{read_only:false; response_revision:12667; number_of_response:1; }","duration":"112.409145ms","start":"2026-02-24T04:21:01.074489Z","end":"2026-02-24T04:21:01.186898Z","steps":["trace[489841191] 'process raft request' (duration: 112.255721ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:21:22.848882Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-00000000000033ba.wal"} {"level":"info","ts":"2026-02-24T04:21:30.172196Z","caller":"traceutil/trace.go:171","msg":"trace[2001066899] transaction","detail":"{read_only:false; response_revision:12810; number_of_response:1; }","duration":"102.73858ms","start":"2026-02-24T04:21:30.069422Z","end":"2026-02-24T04:21:30.172161Z","steps":["trace[2001066899] 'process raft request' (duration: 14.187839ms)","trace[2001066899] 'compare' (duration: 88.17384ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:21:37.969386Z","caller":"traceutil/trace.go:171","msg":"trace[635912298] transaction","detail":"{read_only:false; response_revision:12861; number_of_response:1; }","duration":"113.219869ms","start":"2026-02-24T04:21:37.85612Z","end":"2026-02-24T04:21:37.96934Z","steps":["trace[635912298] 'process raft request' (duration: 67.917375ms)","trace[635912298] 'compare' (duration: 45.070487ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:21:38.352963Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.298417ms","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-02-24T04:21:38.353056Z","caller":"traceutil/trace.go:171","msg":"trace[1950722338] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:12862; }","duration":"146.470242ms","start":"2026-02-24T04:21:38.206563Z","end":"2026-02-24T04:21:38.353033Z","steps":["trace[1950722338] 'range keys from in-memory index tree' (duration: 145.997118ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:21:38.490823Z","caller":"traceutil/trace.go:171","msg":"trace[517374932] transaction","detail":"{read_only:false; response_revision:12863; number_of_response:1; }","duration":"132.512098ms","start":"2026-02-24T04:21:38.358282Z","end":"2026-02-24T04:21:38.490794Z","steps":["trace[517374932] 'process raft request' (duration: 132.334153ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:21:38.532299Z","caller":"traceutil/trace.go:171","msg":"trace[529690845] transaction","detail":"{read_only:false; response_revision:12864; number_of_response:1; }","duration":"106.520384ms","start":"2026-02-24T04:21:38.425742Z","end":"2026-02-24T04:21:38.532263Z","steps":["trace[529690845] 'process raft request' (duration: 106.315209ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:23:25.979728Z","caller":"traceutil/trace.go:171","msg":"trace[355628099] transaction","detail":"{read_only:false; response_revision:14056; number_of_response:1; }","duration":"105.924469ms","start":"2026-02-24T04:23:25.873782Z","end":"2026-02-24T04:23:25.979707Z","steps":["trace[355628099] 'process raft request' (duration: 105.763725ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:23:26.121902Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.610799ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/openstack/nova-api\" ","response":"range_response_count:1 size:670"} {"level":"info","ts":"2026-02-24T04:23:26.121996Z","caller":"traceutil/trace.go:171","msg":"trace[172368107] range","detail":"{range_begin:/registry/services/endpoints/openstack/nova-api; range_end:; response_count:1; response_revision:14056; }","duration":"102.744882ms","start":"2026-02-24T04:23:26.019227Z","end":"2026-02-24T04:23:26.121972Z","steps":["trace[172368107] 'range keys from in-memory index tree' (duration: 102.379642ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:23:26.122323Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.714541ms","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-02-24T04:23:26.12238Z","caller":"traceutil/trace.go:171","msg":"trace[1761124853] range","detail":"{range_begin:/registry/jobs/openstack/nova-rabbit-init; range_end:; response_count:0; response_revision:14056; }","duration":"102.819694ms","start":"2026-02-24T04:23:26.019544Z","end":"2026-02-24T04:23:26.122364Z","steps":["trace[1761124853] 'range keys from in-memory index tree' (duration: 102.638909ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:23:26.122549Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.918739ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-db-sync\" ","response":"range_response_count:1 size:5404"} {"level":"info","ts":"2026-02-24T04:23:26.122664Z","caller":"traceutil/trace.go:171","msg":"trace[547002845] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:14056; }","duration":"102.058153ms","start":"2026-02-24T04:23:26.020579Z","end":"2026-02-24T04:23:26.122637Z","steps":["trace[547002845] 'range keys from in-memory index tree' (duration: 101.812946ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:24:32.258016Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":12098} {"level":"info","ts":"2026-02-24T04:24:32.33845Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":12098,"took":"77.743143ms","hash":2947904769,"current-db-size-bytes":43286528,"current-db-size":"43 MB","current-db-size-in-use-bytes":27377664,"current-db-size-in-use":"27 MB"} {"level":"info","ts":"2026-02-24T04:24:32.338533Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2947904769,"revision":12098,"compact-revision":10077} {"level":"info","ts":"2026-02-24T04:29:06.357812Z","caller":"traceutil/trace.go:171","msg":"trace[655983681] transaction","detail":"{read_only:false; response_revision:16476; number_of_response:1; }","duration":"102.252228ms","start":"2026-02-24T04:29:06.255525Z","end":"2026-02-24T04:29:06.357778Z","steps":["trace[655983681] 'process raft request' (duration: 102.050923ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:29:12.050052Z","caller":"traceutil/trace.go:171","msg":"trace[1729949090] linearizableReadLoop","detail":"{readStateIndex:17103; appliedIndex:17101; }","duration":"106.111574ms","start":"2026-02-24T04:29:11.943905Z","end":"2026-02-24T04:29:12.050017Z","steps":["trace[1729949090] 'read index received' (duration: 54.895753ms)","trace[1729949090] 'applied index is now lower than readState.Index' (duration: 51.214181ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:29:12.050068Z","caller":"traceutil/trace.go:171","msg":"trace[191454087] transaction","detail":"{read_only:false; response_revision:16509; number_of_response:1; }","duration":"114.020823ms","start":"2026-02-24T04:29:11.936021Z","end":"2026-02-24T04:29:12.050042Z","steps":["trace[191454087] 'process raft request' (duration: 79.380209ms)","trace[191454087] 'compare' (duration: 34.449619ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:29:12.050277Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.346471ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/libvirt-libvirt-default-d9txb\" ","response":"range_response_count:1 size:20438"} {"level":"info","ts":"2026-02-24T04:29:12.050325Z","caller":"traceutil/trace.go:171","msg":"trace[2090376067] range","detail":"{range_begin:/registry/pods/openstack/libvirt-libvirt-default-d9txb; range_end:; response_count:1; response_revision:16509; }","duration":"106.436853ms","start":"2026-02-24T04:29:11.943877Z","end":"2026-02-24T04:29:12.050314Z","steps":["trace[2090376067] 'agreement among raft nodes before linearized reading' (duration: 106.262239ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:29:12.315235Z","caller":"traceutil/trace.go:171","msg":"trace[2001808322] transaction","detail":"{read_only:false; response_revision:16510; number_of_response:1; }","duration":"248.383077ms","start":"2026-02-24T04:29:12.066815Z","end":"2026-02-24T04:29:12.315198Z","steps":["trace[2001808322] 'process raft request' (duration: 166.191871ms)","trace[2001808322] 'compare' (duration: 82.052022ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:29:12.315298Z","caller":"traceutil/trace.go:171","msg":"trace[1338738328] transaction","detail":"{read_only:false; response_revision:16511; number_of_response:1; }","duration":"225.646089ms","start":"2026-02-24T04:29:12.089604Z","end":"2026-02-24T04:29:12.31525Z","steps":["trace[1338738328] 'process raft request' (duration: 225.565887ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:29:12.315655Z","caller":"traceutil/trace.go:171","msg":"trace[1711186926] linearizableReadLoop","detail":"{readStateIndex:17104; appliedIndex:17103; }","duration":"247.924494ms","start":"2026-02-24T04:29:12.067692Z","end":"2026-02-24T04:29:12.315616Z","steps":["trace[1711186926] 'read index received' (duration: 165.330488ms)","trace[1711186926] 'applied index is now lower than readState.Index' (duration: 82.589726ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:29:12.315886Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"248.179011ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:508"} {"level":"info","ts":"2026-02-24T04:29:12.315999Z","caller":"traceutil/trace.go:171","msg":"trace[2021655156] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:16511; }","duration":"248.333635ms","start":"2026-02-24T04:29:12.067636Z","end":"2026-02-24T04:29:12.31597Z","steps":["trace[2021655156] 'agreement among raft nodes before linearized reading' (duration: 248.065557ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:29:12.316156Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.876077ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-cell-setup-nn8kd\" ","response":"range_response_count:1 size:9564"} {"level":"info","ts":"2026-02-24T04:29:12.316331Z","caller":"traceutil/trace.go:171","msg":"trace[454132590] range","detail":"{range_begin:/registry/pods/openstack/nova-cell-setup-nn8kd; range_end:; response_count:1; response_revision:16511; }","duration":"123.115793ms","start":"2026-02-24T04:29:12.193179Z","end":"2026-02-24T04:29:12.316295Z","steps":["trace[454132590] 'agreement among raft nodes before linearized reading' (duration: 122.648601ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:29:12.659782Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"191.689034ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-02-24T04:29:12.660024Z","caller":"traceutil/trace.go:171","msg":"trace[1075933329] transaction","detail":"{read_only:false; response_revision:16513; number_of_response:1; }","duration":"277.646582ms","start":"2026-02-24T04:29:12.382362Z","end":"2026-02-24T04:29:12.660008Z","steps":["trace[1075933329] 'process raft request' (duration: 85.64922ms)","trace[1075933329] 'compare' (duration: 191.55805ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:29:32.268871Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":14458} {"level":"info","ts":"2026-02-24T04:29:32.361452Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":14458,"took":"89.487306ms","hash":965956301,"current-db-size-bytes":44974080,"current-db-size":"45 MB","current-db-size-in-use-bytes":29515776,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-02-24T04:29:32.361527Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":965956301,"revision":14458,"compact-revision":12098} {"level":"info","ts":"2026-02-24T04:34:27.509352Z","caller":"traceutil/trace.go:171","msg":"trace[79046628] transaction","detail":"{read_only:false; response_revision:18775; number_of_response:1; }","duration":"107.846138ms","start":"2026-02-24T04:34:27.401419Z","end":"2026-02-24T04:34:27.509265Z","steps":["trace[79046628] 'process raft request' (duration: 107.725015ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:34:27.692293Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.357851ms","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-02-24T04:34:27.692388Z","caller":"traceutil/trace.go:171","msg":"trace[308558436] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:18775; }","duration":"134.477335ms","start":"2026-02-24T04:34:27.557881Z","end":"2026-02-24T04:34:27.692359Z","steps":["trace[308558436] 'range keys from in-memory index tree' (duration: 134.196157ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:34:27.692447Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.596863ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-02-24T04:34:27.692545Z","caller":"traceutil/trace.go:171","msg":"trace[651693546] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:18775; }","duration":"132.721107ms","start":"2026-02-24T04:34:27.559798Z","end":"2026-02-24T04:34:27.692519Z","steps":["trace[651693546] 'range keys from in-memory index tree' (duration: 132.408158ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:34:27.692594Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.775723ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12022"} {"level":"info","ts":"2026-02-24T04:34:27.692668Z","caller":"traceutil/trace.go:171","msg":"trace[1312306552] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:18775; }","duration":"155.890047ms","start":"2026-02-24T04:34:27.536759Z","end":"2026-02-24T04:34:27.692649Z","steps":["trace[1312306552] 'range keys from in-memory index tree' (duration: 155.64166ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:34:27.844382Z","caller":"traceutil/trace.go:171","msg":"trace[1601468839] linearizableReadLoop","detail":"{readStateIndex:19451; appliedIndex:19449; }","duration":"146.848666ms","start":"2026-02-24T04:34:27.697502Z","end":"2026-02-24T04:34:27.844351Z","steps":["trace[1601468839] 'read index received' (duration: 36.53989ms)","trace[1601468839] 'applied index is now lower than readState.Index' (duration: 110.307096ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:34:27.844544Z","caller":"traceutil/trace.go:171","msg":"trace[329395434] transaction","detail":"{read_only:false; response_revision:18777; number_of_response:1; }","duration":"147.751092ms","start":"2026-02-24T04:34:27.696775Z","end":"2026-02-24T04:34:27.844526Z","steps":["trace[329395434] 'process raft request' (duration: 143.359341ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:34:27.844966Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.440102ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:16910"} {"level":"info","ts":"2026-02-24T04:34:27.84507Z","caller":"traceutil/trace.go:171","msg":"trace[44030213] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:18778; }","duration":"147.584676ms","start":"2026-02-24T04:34:27.697463Z","end":"2026-02-24T04:34:27.845047Z","steps":["trace[44030213] 'agreement among raft nodes before linearized reading' (duration: 147.252517ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:34:28.131351Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.689547ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-02-24T04:34:28.13144Z","caller":"traceutil/trace.go:171","msg":"trace[1567490622] range","detail":"{range_begin:/registry/csinodes/; range_end:/registry/csinodes0; response_count:0; response_revision:18779; }","duration":"148.787901ms","start":"2026-02-24T04:34:27.982624Z","end":"2026-02-24T04:34:28.131412Z","steps":["trace[1567490622] 'count revisions from in-memory index tree' (duration: 148.580755ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:34:28.425103Z","caller":"traceutil/trace.go:171","msg":"trace[1854767421] linearizableReadLoop","detail":"{readStateIndex:19454; appliedIndex:19453; }","duration":"109.639049ms","start":"2026-02-24T04:34:28.315438Z","end":"2026-02-24T04:34:28.425077Z","steps":["trace[1854767421] 'read index received' (duration: 109.527106ms)","trace[1854767421] 'applied index is now lower than readState.Index' (duration: 108.203µs)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:34:28.425149Z","caller":"traceutil/trace.go:171","msg":"trace[1194866729] transaction","detail":"{read_only:false; response_revision:18780; number_of_response:1; }","duration":"179.385746ms","start":"2026-02-24T04:34:28.245726Z","end":"2026-02-24T04:34:28.425112Z","steps":["trace[1194866729] 'process raft request' (duration: 179.19719ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:34:28.425228Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.776232ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:34:28.425262Z","caller":"traceutil/trace.go:171","msg":"trace[2054607631] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:18780; }","duration":"109.869834ms","start":"2026-02-24T04:34:28.315383Z","end":"2026-02-24T04:34:28.425252Z","steps":["trace[2054607631] 'agreement among raft nodes before linearized reading' (duration: 109.787602ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:34:32.274505Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":16846} {"level":"info","ts":"2026-02-24T04:34:32.369831Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":16846,"took":"91.727693ms","hash":348399125,"current-db-size-bytes":46256128,"current-db-size":"46 MB","current-db-size-in-use-bytes":29614080,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-02-24T04:34:32.369888Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":348399125,"revision":16846,"compact-revision":14458} {"level":"info","ts":"2026-02-24T04:35:17.640612Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"b66d12fd59101739","local-member-applied-index":20002,"local-member-snapshot-index":10001,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-02-24T04:35:17.650578Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":20002} {"level":"info","ts":"2026-02-24T04:35:17.650688Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":15002} {"level":"info","ts":"2026-02-24T04:38:21.846592Z","caller":"traceutil/trace.go:171","msg":"trace[779723002] transaction","detail":"{read_only:false; response_revision:21072; number_of_response:1; }","duration":"222.547908ms","start":"2026-02-24T04:38:21.624018Z","end":"2026-02-24T04:38:21.846566Z","steps":["trace[779723002] 'process raft request' (duration: 222.381464ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:38:22.063178Z","caller":"traceutil/trace.go:171","msg":"trace[1094705426] linearizableReadLoop","detail":"{readStateIndex:21821; appliedIndex:21819; }","duration":"330.287495ms","start":"2026-02-24T04:38:21.732858Z","end":"2026-02-24T04:38:22.063146Z","steps":["trace[1094705426] 'read index received' (duration: 113.583459ms)","trace[1094705426] 'applied index is now lower than readState.Index' (duration: 216.702746ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:38:22.063289Z","caller":"traceutil/trace.go:171","msg":"trace[149949480] transaction","detail":"{read_only:false; response_revision:21073; number_of_response:1; }","duration":"435.50293ms","start":"2026-02-24T04:38:21.627733Z","end":"2026-02-24T04:38:22.063236Z","steps":["trace[149949480] 'process raft request' (duration: 396.40243ms)","trace[149949480] 'compare' (duration: 38.593936ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:38:22.063623Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.730956ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cert-manager.io/clusterissuers/\" range_end:\"/registry/cert-manager.io/clusterissuers0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-02-24T04:38:22.063732Z","caller":"traceutil/trace.go:171","msg":"trace[1783509141] range","detail":"{range_begin:/registry/cert-manager.io/clusterissuers/; range_end:/registry/cert-manager.io/clusterissuers0; response_count:0; response_revision:21073; }","duration":"330.86912ms","start":"2026-02-24T04:38:21.732843Z","end":"2026-02-24T04:38:22.063712Z","steps":["trace[1783509141] 'agreement among raft nodes before linearized reading' (duration: 330.661625ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:38:22.063777Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:38:21.732785Z","time spent":"330.981134ms","remote":"127.0.0.1:57066","response type":"/etcdserverpb.KV/Range","request count":0,"request size":88,"response count":3,"response size":32,"request content":"key:\"/registry/cert-manager.io/clusterissuers/\" range_end:\"/registry/cert-manager.io/clusterissuers0\" count_only:true "} {"level":"warn","ts":"2026-02-24T04:38:22.063841Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:38:21.62772Z","time spent":"435.87019ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:38:22.119175Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"291.39771ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/daemonsets/\" range_end:\"/registry/daemonsets0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-02-24T04:38:22.119259Z","caller":"traceutil/trace.go:171","msg":"trace[316080228] range","detail":"{range_begin:/registry/daemonsets/; range_end:/registry/daemonsets0; response_count:0; response_revision:21074; }","duration":"291.524463ms","start":"2026-02-24T04:38:21.827713Z","end":"2026-02-24T04:38:22.119237Z","steps":["trace[316080228] 'agreement among raft nodes before linearized reading' (duration: 291.331258ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:39:32.279499Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":18796} {"level":"info","ts":"2026-02-24T04:39:32.37992Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":18796,"took":"96.541808ms","hash":1329281282,"current-db-size-bytes":51232768,"current-db-size":"51 MB","current-db-size-in-use-bytes":37658624,"current-db-size-in-use":"38 MB"} {"level":"info","ts":"2026-02-24T04:39:32.380004Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1329281282,"revision":18796,"compact-revision":16846} {"level":"info","ts":"2026-02-24T04:41:31.271965Z","caller":"traceutil/trace.go:171","msg":"trace[1620228242] transaction","detail":"{read_only:false; response_revision:22962; number_of_response:1; }","duration":"103.796368ms","start":"2026-02-24T04:41:31.168132Z","end":"2026-02-24T04:41:31.271929Z","steps":["trace[1620228242] 'process raft request' (duration: 103.592492ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:41:36.393802Z","caller":"traceutil/trace.go:171","msg":"trace[83490361] transaction","detail":"{read_only:false; response_revision:22998; number_of_response:1; }","duration":"116.323974ms","start":"2026-02-24T04:41:36.277418Z","end":"2026-02-24T04:41:36.393742Z","steps":["trace[83490361] 'process raft request' (duration: 115.83785ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:41:36.647968Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.420337ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12022"} {"level":"info","ts":"2026-02-24T04:41:36.648025Z","caller":"traceutil/trace.go:171","msg":"trace[2095385693] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:22998; }","duration":"124.51872ms","start":"2026-02-24T04:41:36.523494Z","end":"2026-02-24T04:41:36.648013Z","steps":["trace[2095385693] 'range keys from in-memory index tree' (duration: 124.304364ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:41:36.64817Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.022704ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/\" range_end:\"/registry/resourcequotas0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:41:36.648257Z","caller":"traceutil/trace.go:171","msg":"trace[773839825] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:22998; }","duration":"150.121727ms","start":"2026-02-24T04:41:36.498122Z","end":"2026-02-24T04:41:36.648244Z","steps":["trace[773839825] 'count revisions from in-memory index tree' (duration: 149.935811ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:41:36.648283Z","caller":"traceutil/trace.go:171","msg":"trace[311977093] transaction","detail":"{read_only:false; response_revision:22999; number_of_response:1; }","duration":"122.116633ms","start":"2026-02-24T04:41:36.526135Z","end":"2026-02-24T04:41:36.648252Z","steps":["trace[311977093] 'process raft request' (duration: 121.326972ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:41:36.862345Z","caller":"traceutil/trace.go:171","msg":"trace[724548935] linearizableReadLoop","detail":"{readStateIndex:23798; appliedIndex:23797; }","duration":"116.90225ms","start":"2026-02-24T04:41:36.745408Z","end":"2026-02-24T04:41:36.86231Z","steps":["trace[724548935] 'read index received' (duration: 35.81883ms)","trace[724548935] 'applied index is now lower than readState.Index' (duration: 81.08233ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:41:36.862434Z","caller":"traceutil/trace.go:171","msg":"trace[1784970781] transaction","detail":"{read_only:false; response_revision:23000; number_of_response:1; }","duration":"119.547793ms","start":"2026-02-24T04:41:36.742825Z","end":"2026-02-24T04:41:36.862373Z","steps":["trace[1784970781] 'process raft request' (duration: 38.388771ms)","trace[1784970781] 'compare' (duration: 80.924885ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:41:36.862512Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.081435ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:41:36.86293Z","caller":"traceutil/trace.go:171","msg":"trace[5075800] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:23000; }","duration":"117.537088ms","start":"2026-02-24T04:41:36.745374Z","end":"2026-02-24T04:41:36.862911Z","steps":["trace[5075800] 'agreement among raft nodes before linearized reading' (duration: 117.074335ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:41:36.863137Z","caller":"traceutil/trace.go:171","msg":"trace[1787633421] transaction","detail":"{read_only:false; response_revision:23001; number_of_response:1; }","duration":"106.269436ms","start":"2026-02-24T04:41:36.756824Z","end":"2026-02-24T04:41:36.863094Z","steps":["trace[1787633421] 'process raft request' (duration: 106.08219ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:41:36.863176Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.458866ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cert-manager.io/certificates/\" range_end:\"/registry/cert-manager.io/certificates0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-02-24T04:41:36.863251Z","caller":"traceutil/trace.go:171","msg":"trace[1551701388] range","detail":"{range_begin:/registry/cert-manager.io/certificates/; range_end:/registry/cert-manager.io/certificates0; response_count:0; response_revision:23001; }","duration":"104.591989ms","start":"2026-02-24T04:41:36.75864Z","end":"2026-02-24T04:41:36.863232Z","steps":["trace[1551701388] 'agreement among raft nodes before linearized reading' (duration: 104.404444ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:41:47.100431Z","caller":"traceutil/trace.go:171","msg":"trace[1442563465] linearizableReadLoop","detail":"{readStateIndex:23870; appliedIndex:23868; }","duration":"176.872747ms","start":"2026-02-24T04:41:46.923527Z","end":"2026-02-24T04:41:47.1004Z","steps":["trace[1442563465] 'read index received' (duration: 26.007179ms)","trace[1442563465] 'applied index is now lower than readState.Index' (duration: 150.864318ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:41:47.100699Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.162385ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:495"} {"level":"info","ts":"2026-02-24T04:41:47.100665Z","caller":"traceutil/trace.go:171","msg":"trace[1548568923] transaction","detail":"{read_only:false; response_revision:23070; number_of_response:1; }","duration":"201.178938ms","start":"2026-02-24T04:41:46.899403Z","end":"2026-02-24T04:41:47.100582Z","steps":["trace[1548568923] 'process raft request' (duration: 176.731412ms)","trace[1548568923] 'compare' (duration: 24.133797ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:41:47.100749Z","caller":"traceutil/trace.go:171","msg":"trace[1989762371] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:23070; }","duration":"177.272988ms","start":"2026-02-24T04:41:46.923463Z","end":"2026-02-24T04:41:47.100737Z","steps":["trace[1989762371] 'agreement among raft nodes before linearized reading' (duration: 177.086293ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:41:47.100823Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.052915ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12022"} {"level":"info","ts":"2026-02-24T04:41:47.100906Z","caller":"traceutil/trace.go:171","msg":"trace[524666115] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:23070; }","duration":"108.197169ms","start":"2026-02-24T04:41:46.99269Z","end":"2026-02-24T04:41:47.100887Z","steps":["trace[524666115] 'agreement among raft nodes before linearized reading' (duration: 107.920652ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:41:54.931468Z","caller":"traceutil/trace.go:171","msg":"trace[1522722279] transaction","detail":"{read_only:false; response_revision:23181; number_of_response:1; }","duration":"115.11123ms","start":"2026-02-24T04:41:54.816333Z","end":"2026-02-24T04:41:54.931444Z","steps":["trace[1522722279] 'process raft request' (duration: 114.648687ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:42:32.029006Z","caller":"traceutil/trace.go:171","msg":"trace[442423124] transaction","detail":"{read_only:false; response_revision:23487; number_of_response:1; }","duration":"198.199506ms","start":"2026-02-24T04:42:31.830773Z","end":"2026-02-24T04:42:32.028972Z","steps":["trace[442423124] 'process raft request' (duration: 197.863466ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:42:32.404011Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"178.989585ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-02-24T04:42:32.404188Z","caller":"traceutil/trace.go:171","msg":"trace[318654252] linearizableReadLoop","detail":"{readStateIndex:24300; appliedIndex:24298; }","duration":"232.960525ms","start":"2026-02-24T04:42:32.171215Z","end":"2026-02-24T04:42:32.404175Z","steps":["trace[318654252] 'read index received' (duration: 53.707213ms)","trace[318654252] 'applied index is now lower than readState.Index' (duration: 179.252582ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:42:32.404195Z","caller":"traceutil/trace.go:171","msg":"trace[561691797] transaction","detail":"{read_only:false; response_revision:23488; number_of_response:1; }","duration":"290.968928ms","start":"2026-02-24T04:42:32.113199Z","end":"2026-02-24T04:42:32.404168Z","steps":["trace[561691797] 'process raft request' (duration: 111.745606ms)","trace[561691797] 'compare' (duration: 178.880872ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:42:32.404309Z","caller":"traceutil/trace.go:171","msg":"trace[290740011] transaction","detail":"{read_only:false; response_revision:23490; number_of_response:1; }","duration":"193.027232ms","start":"2026-02-24T04:42:32.211271Z","end":"2026-02-24T04:42:32.404298Z","steps":["trace[290740011] 'process raft request' (duration: 192.878347ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:42:32.40424Z","caller":"traceutil/trace.go:171","msg":"trace[1795789240] transaction","detail":"{read_only:false; response_revision:23489; number_of_response:1; }","duration":"242.131198ms","start":"2026-02-24T04:42:32.162057Z","end":"2026-02-24T04:42:32.404188Z","steps":["trace[1795789240] 'process raft request' (duration: 242.048256ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:42:32.404653Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"233.424239ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-02-24T04:42:32.404703Z","caller":"traceutil/trace.go:171","msg":"trace[191016342] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:23490; }","duration":"233.484311ms","start":"2026-02-24T04:42:32.171202Z","end":"2026-02-24T04:42:32.404687Z","steps":["trace[191016342] 'agreement among raft nodes before linearized reading' (duration: 233.293436ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:42:32.404744Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.920065ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:508"} {"level":"info","ts":"2026-02-24T04:42:32.40488Z","caller":"traceutil/trace.go:171","msg":"trace[1058811610] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:23490; }","duration":"233.064508ms","start":"2026-02-24T04:42:32.171764Z","end":"2026-02-24T04:42:32.404828Z","steps":["trace[1058811610] 'agreement among raft nodes before linearized reading' (duration: 232.762639ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:42:32.674442Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.457308ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-02-24T04:42:32.674651Z","caller":"traceutil/trace.go:171","msg":"trace[914686133] transaction","detail":"{read_only:false; response_revision:23492; number_of_response:1; }","duration":"265.148265ms","start":"2026-02-24T04:42:32.409488Z","end":"2026-02-24T04:42:32.674636Z","steps":["trace[914686133] 'process raft request' (duration: 265.103914ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:42:32.675097Z","caller":"traceutil/trace.go:171","msg":"trace[172252324] transaction","detail":"{read_only:false; response_revision:23491; number_of_response:1; }","duration":"266.223365ms","start":"2026-02-24T04:42:32.408587Z","end":"2026-02-24T04:42:32.67481Z","steps":["trace[172252324] 'process raft request' (duration: 128.330326ms)","trace[172252324] 'compare' (duration: 137.21897ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:42:39.404905Z","caller":"traceutil/trace.go:171","msg":"trace[1559444086] transaction","detail":"{read_only:false; response_revision:23537; number_of_response:1; }","duration":"120.379117ms","start":"2026-02-24T04:42:39.284499Z","end":"2026-02-24T04:42:39.404878Z","steps":["trace[1559444086] 'process raft request' (duration: 119.859662ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:42:39.61546Z","caller":"traceutil/trace.go:171","msg":"trace[1396083375] linearizableReadLoop","detail":"{readStateIndex:24351; appliedIndex:24350; }","duration":"109.691013ms","start":"2026-02-24T04:42:39.50575Z","end":"2026-02-24T04:42:39.615441Z","steps":["trace[1396083375] 'read index received' (duration: 14.274145ms)","trace[1396083375] 'applied index is now lower than readState.Index' (duration: 95.415798ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:42:39.615565Z","caller":"traceutil/trace.go:171","msg":"trace[1489255891] transaction","detail":"{read_only:false; response_revision:23539; number_of_response:1; }","duration":"206.060827ms","start":"2026-02-24T04:42:39.409492Z","end":"2026-02-24T04:42:39.615553Z","steps":["trace[1489255891] 'process raft request' (duration: 110.521206ms)","trace[1489255891] 'compare' (duration: 95.335115ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:42:39.615683Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.914459ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/monitoring.coreos.com/alertmanagers/\" range_end:\"/registry/monitoring.coreos.com/alertmanagers0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-02-24T04:42:39.615772Z","caller":"traceutil/trace.go:171","msg":"trace[575958532] range","detail":"{range_begin:/registry/monitoring.coreos.com/alertmanagers/; range_end:/registry/monitoring.coreos.com/alertmanagers0; response_count:0; response_revision:23539; }","duration":"110.052713ms","start":"2026-02-24T04:42:39.505698Z","end":"2026-02-24T04:42:39.615751Z","steps":["trace[575958532] 'agreement among raft nodes before linearized reading' (duration: 109.907399ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:42:39.8517Z","caller":"traceutil/trace.go:171","msg":"trace[917374185] transaction","detail":"{read_only:false; response_revision:23540; number_of_response:1; }","duration":"331.893515ms","start":"2026-02-24T04:42:39.519771Z","end":"2026-02-24T04:42:39.851665Z","steps":["trace[917374185] 'process raft request' (duration: 305.34579ms)","trace[917374185] 'compare' (duration: 26.392241ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:42:39.851874Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:42:39.519755Z","time spent":"332.030468ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":497,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:42:39.852228Z","caller":"traceutil/trace.go:171","msg":"trace[483219756] linearizableReadLoop","detail":"{readStateIndex:24353; appliedIndex:24351; }","duration":"236.665061ms","start":"2026-02-24T04:42:39.615522Z","end":"2026-02-24T04:42:39.852187Z","steps":["trace[483219756] 'read index received' (duration: 209.793359ms)","trace[483219756] 'applied index is now lower than readState.Index' (duration: 26.870922ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:42:39.852432Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"261.22452ms","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-02-24T04:42:39.852268Z","caller":"traceutil/trace.go:171","msg":"trace[196135681] transaction","detail":"{read_only:false; response_revision:23541; number_of_response:1; }","duration":"331.676518ms","start":"2026-02-24T04:42:39.520564Z","end":"2026-02-24T04:42:39.852241Z","steps":["trace[196135681] 'process raft request' (duration: 331.527643ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:42:39.852463Z","caller":"traceutil/trace.go:171","msg":"trace[1808740012] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:23541; }","duration":"261.307342ms","start":"2026-02-24T04:42:39.591148Z","end":"2026-02-24T04:42:39.852455Z","steps":["trace[1808740012] 'agreement among raft nodes before linearized reading' (duration: 261.168279ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:42:39.852628Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:42:39.520551Z","time spent":"331.935204ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:42:43.689069Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.548125ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-02-24T04:42:43.689317Z","caller":"traceutil/trace.go:171","msg":"trace[1327029449] transaction","detail":"{read_only:false; response_revision:23568; number_of_response:1; }","duration":"272.666966ms","start":"2026-02-24T04:42:43.416634Z","end":"2026-02-24T04:42:43.689301Z","steps":["trace[1327029449] 'process raft request' (duration: 131.822484ms)","trace[1327029449] 'compare' (duration: 140.459622ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:42:43.831558Z","caller":"traceutil/trace.go:171","msg":"trace[1498282443] transaction","detail":"{read_only:false; response_revision:23569; number_of_response:1; }","duration":"137.731198ms","start":"2026-02-24T04:42:43.693799Z","end":"2026-02-24T04:42:43.831531Z","steps":["trace[1498282443] 'process raft request' (duration: 120.979475ms)","trace[1498282443] 'compare' (duration: 16.515296ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:43:02.116639Z","caller":"traceutil/trace.go:171","msg":"trace[1815262688] transaction","detail":"{read_only:false; response_revision:23841; number_of_response:1; }","duration":"191.36142ms","start":"2026-02-24T04:43:01.925228Z","end":"2026-02-24T04:43:02.11659Z","steps":["trace[1815262688] 'process raft request' (duration: 116.587423ms)","trace[1815262688] 'compare' (duration: 74.468189ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:43:02.142518Z","caller":"traceutil/trace.go:171","msg":"trace[1686490365] linearizableReadLoop","detail":"{readStateIndex:24661; appliedIndex:24659; }","duration":"204.393129ms","start":"2026-02-24T04:43:01.93809Z","end":"2026-02-24T04:43:02.142483Z","steps":["trace[1686490365] 'read index received' (duration: 103.758168ms)","trace[1686490365] 'applied index is now lower than readState.Index' (duration: 100.633831ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:43:02.142562Z","caller":"traceutil/trace.go:171","msg":"trace[1484433668] transaction","detail":"{read_only:false; response_revision:23842; number_of_response:1; }","duration":"209.125911ms","start":"2026-02-24T04:43:01.933402Z","end":"2026-02-24T04:43:02.142528Z","steps":["trace[1484433668] 'process raft request' (duration: 208.948206ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:43:02.142747Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"197.648743ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:482"} {"level":"warn","ts":"2026-02-24T04:43:02.142754Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.653927ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:495"} {"level":"info","ts":"2026-02-24T04:43:02.142792Z","caller":"traceutil/trace.go:171","msg":"trace[464600952] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:23842; }","duration":"197.728535ms","start":"2026-02-24T04:43:01.945052Z","end":"2026-02-24T04:43:02.142781Z","steps":["trace[464600952] 'agreement among raft nodes before linearized reading' (duration: 197.5723ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:43:02.142814Z","caller":"traceutil/trace.go:171","msg":"trace[1704187393] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:23842; }","duration":"204.76247ms","start":"2026-02-24T04:43:01.938036Z","end":"2026-02-24T04:43:02.142799Z","steps":["trace[1704187393] 'agreement among raft nodes before linearized reading' (duration: 204.567905ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:43:02.329329Z","caller":"traceutil/trace.go:171","msg":"trace[554501285] transaction","detail":"{read_only:false; response_revision:23843; number_of_response:1; }","duration":"182.901606ms","start":"2026-02-24T04:43:02.146389Z","end":"2026-02-24T04:43:02.32929Z","steps":["trace[554501285] 'process raft request' (duration: 110.263128ms)","trace[554501285] 'compare' (duration: 72.364781ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:43:02.329627Z","caller":"traceutil/trace.go:171","msg":"trace[941468053] transaction","detail":"{read_only:false; response_revision:23844; number_of_response:1; }","duration":"182.620438ms","start":"2026-02-24T04:43:02.14698Z","end":"2026-02-24T04:43:02.329601Z","steps":["trace[941468053] 'process raft request' (duration: 182.255418ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:43:42.58668Z","caller":"traceutil/trace.go:171","msg":"trace[227530670] linearizableReadLoop","detail":"{readStateIndex:24978; appliedIndex:24977; }","duration":"251.830011ms","start":"2026-02-24T04:43:42.334821Z","end":"2026-02-24T04:43:42.586651Z","steps":["trace[227530670] 'read index received' (duration: 193.88105ms)","trace[227530670] 'applied index is now lower than readState.Index' (duration: 57.947951ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:43:42.586782Z","caller":"traceutil/trace.go:171","msg":"trace[1217356962] transaction","detail":"{read_only:false; response_revision:24150; number_of_response:1; }","duration":"320.315663ms","start":"2026-02-24T04:43:42.266427Z","end":"2026-02-24T04:43:42.586742Z","steps":["trace[1217356962] 'process raft request' (duration: 262.311311ms)","trace[1217356962] 'compare' (duration: 57.760196ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:43:42.58691Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"252.025696ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rabbitmq.com/queues/\" range_end:\"/registry/rabbitmq.com/queues0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:43:42.586952Z","caller":"traceutil/trace.go:171","msg":"trace[1345796066] range","detail":"{range_begin:/registry/rabbitmq.com/queues/; range_end:/registry/rabbitmq.com/queues0; response_count:0; response_revision:24150; }","duration":"252.15245ms","start":"2026-02-24T04:43:42.334787Z","end":"2026-02-24T04:43:42.586939Z","steps":["trace[1345796066] 'agreement among raft nodes before linearized reading' (duration: 252.024926ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:43:42.586949Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:43:42.266392Z","time spent":"320.471348ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:43:42.586945Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.506446ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/infrastructure.cluster.x-k8s.io/openstackfloatingippools/\" range_end:\"/registry/infrastructure.cluster.x-k8s.io/openstackfloatingippools0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:43:42.587046Z","caller":"traceutil/trace.go:171","msg":"trace[242155353] range","detail":"{range_begin:/registry/infrastructure.cluster.x-k8s.io/openstackfloatingippools/; range_end:/registry/infrastructure.cluster.x-k8s.io/openstackfloatingippools0; response_count:0; response_revision:24150; }","duration":"211.64735ms","start":"2026-02-24T04:43:42.375379Z","end":"2026-02-24T04:43:42.587027Z","steps":["trace[242155353] 'agreement among raft nodes before linearized reading' (duration: 211.445545ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:43:42.992776Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"291.804466ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-02-24T04:43:42.992918Z","caller":"traceutil/trace.go:171","msg":"trace[838769721] transaction","detail":"{read_only:false; response_revision:24152; number_of_response:1; }","duration":"401.120057ms","start":"2026-02-24T04:43:42.591785Z","end":"2026-02-24T04:43:42.992906Z","steps":["trace[838769721] 'process raft request' (duration: 401.070006ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:43:42.99296Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:43:42.591767Z","time spent":"401.175419ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:43:42.992995Z","caller":"traceutil/trace.go:171","msg":"trace[922016279] transaction","detail":"{read_only:false; response_revision:24151; number_of_response:1; }","duration":"402.034752ms","start":"2026-02-24T04:43:42.590917Z","end":"2026-02-24T04:43:42.992951Z","steps":["trace[922016279] 'process raft request' (duration: 109.98552ms)","trace[922016279] 'compare' (duration: 291.723753ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:43:42.993013Z","caller":"traceutil/trace.go:171","msg":"trace[1628626420] linearizableReadLoop","detail":"{readStateIndex:24981; appliedIndex:24978; }","duration":"254.647549ms","start":"2026-02-24T04:43:42.738334Z","end":"2026-02-24T04:43:42.992981Z","steps":["trace[1628626420] 'read index received' (duration: 106.845594ms)","trace[1628626420] 'applied index is now lower than readState.Index' (duration: 147.801045ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:43:42.993111Z","caller":"traceutil/trace.go:171","msg":"trace[453403070] transaction","detail":"{read_only:false; response_revision:24153; number_of_response:1; }","duration":"368.235418ms","start":"2026-02-24T04:43:42.624811Z","end":"2026-02-24T04:43:42.993047Z","steps":["trace[453403070] 'process raft request' (duration: 368.072794ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:43:42.993146Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:43:42.590895Z","time spent":"402.169335ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:43:42.993274Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"254.923487ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:441"} {"level":"warn","ts":"2026-02-24T04:43:42.993296Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:43:42.624785Z","time spent":"368.423853ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":523,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:43:42.993314Z","caller":"traceutil/trace.go:171","msg":"trace[1780947338] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:24153; }","duration":"254.995859ms","start":"2026-02-24T04:43:42.738305Z","end":"2026-02-24T04:43:42.993301Z","steps":["trace[1780947338] 'agreement among raft nodes before linearized reading' (duration: 254.842075ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:43:43.127237Z","caller":"traceutil/trace.go:171","msg":"trace[463397344] linearizableReadLoop","detail":"{readStateIndex:24982; appliedIndex:24981; }","duration":"119.859983ms","start":"2026-02-24T04:43:43.007342Z","end":"2026-02-24T04:43:43.127202Z","steps":["trace[463397344] 'read index received' (duration: 116.376087ms)","trace[463397344] 'applied index is now lower than readState.Index' (duration: 3.482996ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:43:43.127456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.08805ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-02-24T04:43:43.127515Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.10857ms","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-02-24T04:43:43.127529Z","caller":"traceutil/trace.go:171","msg":"trace[934342103] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24154; }","duration":"120.214803ms","start":"2026-02-24T04:43:43.007299Z","end":"2026-02-24T04:43:43.127514Z","steps":["trace[934342103] 'agreement among raft nodes before linearized reading' (duration: 119.993277ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:43:43.127559Z","caller":"traceutil/trace.go:171","msg":"trace[1938718295] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:24154; }","duration":"120.164322ms","start":"2026-02-24T04:43:43.007385Z","end":"2026-02-24T04:43:43.127549Z","steps":["trace[1938718295] 'agreement among raft nodes before linearized reading' (duration: 120.033688ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:43:43.127337Z","caller":"traceutil/trace.go:171","msg":"trace[191791423] transaction","detail":"{read_only:false; response_revision:24154; number_of_response:1; }","duration":"125.261012ms","start":"2026-02-24T04:43:43.002014Z","end":"2026-02-24T04:43:43.127275Z","steps":["trace[191791423] 'process raft request' (duration: 121.770116ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:44:14.994641Z","caller":"traceutil/trace.go:171","msg":"trace[573186] transaction","detail":"{read_only:false; response_revision:24373; number_of_response:1; }","duration":"132.193674ms","start":"2026-02-24T04:44:14.862415Z","end":"2026-02-24T04:44:14.994609Z","steps":["trace[573186] 'process raft request' (duration: 129.092159ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:44:32.286774Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":21838} {"level":"info","ts":"2026-02-24T04:44:32.422391Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":21838,"took":"131.231557ms","hash":361540835,"current-db-size-bytes":53399552,"current-db-size":"53 MB","current-db-size-in-use-bytes":31989760,"current-db-size-in-use":"32 MB"} {"level":"info","ts":"2026-02-24T04:44:32.422452Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":361540835,"revision":21838,"compact-revision":18796} {"level":"warn","ts":"2026-02-24T04:44:45.895934Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.423108ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:44:45.896002Z","caller":"traceutil/trace.go:171","msg":"trace[543996732] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:24588; }","duration":"154.569083ms","start":"2026-02-24T04:44:45.741419Z","end":"2026-02-24T04:44:45.895988Z","steps":["trace[543996732] 'range keys from in-memory index tree' (duration: 153.450371ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:44:46.142729Z","caller":"traceutil/trace.go:171","msg":"trace[1380378250] linearizableReadLoop","detail":"{readStateIndex:25433; appliedIndex:25432; }","duration":"225.212655ms","start":"2026-02-24T04:44:45.917486Z","end":"2026-02-24T04:44:46.142699Z","steps":["trace[1380378250] 'read index received' (duration: 140.002209ms)","trace[1380378250] 'applied index is now lower than readState.Index' (duration: 85.209326ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:44:46.142807Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"242.937615ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:44:46.142886Z","caller":"traceutil/trace.go:171","msg":"trace[86034351] range","detail":"{range_begin:/registry/services/specs/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:24590; }","duration":"243.040109ms","start":"2026-02-24T04:44:45.899825Z","end":"2026-02-24T04:44:46.142865Z","steps":["trace[86034351] 'agreement among raft nodes before linearized reading' (duration: 242.880154ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:44:46.143028Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"275.211558ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:44:46.143078Z","caller":"traceutil/trace.go:171","msg":"trace[606660074] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:24590; }","duration":"275.27558ms","start":"2026-02-24T04:44:45.867791Z","end":"2026-02-24T04:44:46.143067Z","steps":["trace[606660074] 'agreement among raft nodes before linearized reading' (duration: 275.205828ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:44:46.143217Z","caller":"traceutil/trace.go:171","msg":"trace[182290054] transaction","detail":"{read_only:false; response_revision:24590; number_of_response:1; }","duration":"245.28098ms","start":"2026-02-24T04:44:45.897917Z","end":"2026-02-24T04:44:46.143198Z","steps":["trace[182290054] 'process raft request' (duration: 159.685934ms)","trace[182290054] 'compare' (duration: 84.740791ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:44:46.143354Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"275.99719ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:1 size:4963"} {"level":"info","ts":"2026-02-24T04:44:46.143442Z","caller":"traceutil/trace.go:171","msg":"trace[1996932810] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:1; response_revision:24590; }","duration":"276.508693ms","start":"2026-02-24T04:44:45.866919Z","end":"2026-02-24T04:44:46.143427Z","steps":["trace[1996932810] 'agreement among raft nodes before linearized reading' (duration: 275.889766ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:44:46.143358Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.217275ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:44:46.143683Z","caller":"traceutil/trace.go:171","msg":"trace[1527030687] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:24590; }","duration":"276.524764ms","start":"2026-02-24T04:44:45.867091Z","end":"2026-02-24T04:44:46.143615Z","steps":["trace[1527030687] 'agreement among raft nodes before linearized reading' (duration: 276.123413ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:44:46.422217Z","caller":"traceutil/trace.go:171","msg":"trace[1928927231] linearizableReadLoop","detail":"{readStateIndex:25434; appliedIndex:25433; }","duration":"106.436572ms","start":"2026-02-24T04:44:46.315755Z","end":"2026-02-24T04:44:46.422191Z","steps":["trace[1928927231] 'read index received' (duration: 32.116018ms)","trace[1928927231] 'applied index is now lower than readState.Index' (duration: 74.319534ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:44:46.42232Z","caller":"traceutil/trace.go:171","msg":"trace[1221962384] transaction","detail":"{read_only:false; response_revision:24591; number_of_response:1; }","duration":"197.047276ms","start":"2026-02-24T04:44:46.225229Z","end":"2026-02-24T04:44:46.422276Z","steps":["trace[1221962384] 'process raft request' (duration: 122.701892ms)","trace[1221962384] 'compare' (duration: 74.161279ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:44:46.422397Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.574336ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:44:46.422497Z","caller":"traceutil/trace.go:171","msg":"trace[1584940514] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24591; }","duration":"106.713989ms","start":"2026-02-24T04:44:46.315711Z","end":"2026-02-24T04:44:46.422425Z","steps":["trace[1584940514] 'agreement among raft nodes before linearized reading' (duration: 106.579626ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:44:46.75773Z","caller":"traceutil/trace.go:171","msg":"trace[1170845026] transaction","detail":"{read_only:false; response_revision:24592; number_of_response:1; }","duration":"189.084656ms","start":"2026-02-24T04:44:46.568619Z","end":"2026-02-24T04:44:46.757704Z","steps":["trace[1170845026] 'process raft request' (duration: 188.936052ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:44:46.913675Z","caller":"traceutil/trace.go:171","msg":"trace[1532055010] linearizableReadLoop","detail":"{readStateIndex:25436; appliedIndex:25435; }","duration":"120.437379ms","start":"2026-02-24T04:44:46.793215Z","end":"2026-02-24T04:44:46.913653Z","steps":["trace[1532055010] 'read index received' (duration: 78.53816ms)","trace[1532055010] 'applied index is now lower than readState.Index' (duration: 41.898189ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:44:46.913841Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.566892ms","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":"info","ts":"2026-02-24T04:44:46.913874Z","caller":"traceutil/trace.go:171","msg":"trace[911427902] transaction","detail":"{read_only:false; response_revision:24593; number_of_response:1; }","duration":"162.634155ms","start":"2026-02-24T04:44:46.75122Z","end":"2026-02-24T04:44:46.913854Z","steps":["trace[911427902] 'process raft request' (duration: 120.582903ms)","trace[911427902] 'compare' (duration: 41.458876ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:44:46.913913Z","caller":"traceutil/trace.go:171","msg":"trace[148844804] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/; range_end:/registry/pxc.percona.com/perconaxtradbclusters0; response_count:0; response_revision:24593; }","duration":"120.708256ms","start":"2026-02-24T04:44:46.793165Z","end":"2026-02-24T04:44:46.913873Z","steps":["trace[148844804] 'agreement among raft nodes before linearized reading' (duration: 120.577032ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:03.516864Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.572066ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:495"} {"level":"warn","ts":"2026-02-24T04:45:03.516988Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.593985ms","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-02-24T04:45:03.517084Z","caller":"traceutil/trace.go:171","msg":"trace[1694808508] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:24721; }","duration":"162.714828ms","start":"2026-02-24T04:45:03.354347Z","end":"2026-02-24T04:45:03.517062Z","steps":["trace[1694808508] 'range keys from in-memory index tree' (duration: 162.43278ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.517042Z","caller":"traceutil/trace.go:171","msg":"trace[1495451035] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:24721; }","duration":"161.69261ms","start":"2026-02-24T04:45:03.355257Z","end":"2026-02-24T04:45:03.51695Z","steps":["trace[1495451035] 'range keys from in-memory index tree' (duration: 161.471974ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.651535Z","caller":"traceutil/trace.go:171","msg":"trace[1662436215] transaction","detail":"{read_only:false; response_revision:24722; number_of_response:1; }","duration":"131.522765ms","start":"2026-02-24T04:45:03.519983Z","end":"2026-02-24T04:45:03.651506Z","steps":["trace[1662436215] 'process raft request' (duration: 131.32277ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.680007Z","caller":"traceutil/trace.go:171","msg":"trace[1205351503] transaction","detail":"{read_only:false; response_revision:24723; number_of_response:1; }","duration":"158.092311ms","start":"2026-02-24T04:45:03.521884Z","end":"2026-02-24T04:45:03.679976Z","steps":["trace[1205351503] 'process raft request' (duration: 157.910126ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.680162Z","caller":"traceutil/trace.go:171","msg":"trace[599982922] linearizableReadLoop","detail":"{readStateIndex:25570; appliedIndex:25567; }","duration":"157.683679ms","start":"2026-02-24T04:45:03.52245Z","end":"2026-02-24T04:45:03.680134Z","steps":["trace[599982922] 'read index received' (duration: 128.944924ms)","trace[599982922] 'applied index is now lower than readState.Index' (duration: 28.736635ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:03.680239Z","caller":"traceutil/trace.go:171","msg":"trace[1782388584] transaction","detail":"{read_only:false; response_revision:24724; number_of_response:1; }","duration":"158.148813ms","start":"2026-02-24T04:45:03.522015Z","end":"2026-02-24T04:45:03.680164Z","steps":["trace[1782388584] 'process raft request' (duration: 157.920386ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:03.680454Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.986537ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-02-24T04:45:03.680582Z","caller":"traceutil/trace.go:171","msg":"trace[1602881519] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:24724; }","duration":"158.157942ms","start":"2026-02-24T04:45:03.522413Z","end":"2026-02-24T04:45:03.680571Z","steps":["trace[1602881519] 'agreement among raft nodes before linearized reading' (duration: 157.869944ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:03.680597Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.838047ms","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-02-24T04:45:03.680706Z","caller":"traceutil/trace.go:171","msg":"trace[1058604903] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:24724; }","duration":"130.984791ms","start":"2026-02-24T04:45:03.549703Z","end":"2026-02-24T04:45:03.680687Z","steps":["trace[1058604903] 'agreement among raft nodes before linearized reading' (duration: 130.59804ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.842422Z","caller":"traceutil/trace.go:171","msg":"trace[402576427] transaction","detail":"{read_only:false; response_revision:24725; number_of_response:1; }","duration":"157.623787ms","start":"2026-02-24T04:45:03.684773Z","end":"2026-02-24T04:45:03.842397Z","steps":["trace[402576427] 'process raft request' (duration: 150.268413ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.935567Z","caller":"traceutil/trace.go:171","msg":"trace[875986538] linearizableReadLoop","detail":"{readStateIndex:25574; appliedIndex:25570; }","duration":"221.351518ms","start":"2026-02-24T04:45:03.714199Z","end":"2026-02-24T04:45:03.935551Z","steps":["trace[875986538] 'read index received' (duration: 120.857541ms)","trace[875986538] 'applied index is now lower than readState.Index' (duration: 100.493307ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:03.935596Z","caller":"traceutil/trace.go:171","msg":"trace[540238603] transaction","detail":"{read_only:false; response_revision:24727; number_of_response:1; }","duration":"233.437562ms","start":"2026-02-24T04:45:03.702142Z","end":"2026-02-24T04:45:03.93558Z","steps":["trace[540238603] 'process raft request' (duration: 233.36256ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.935589Z","caller":"traceutil/trace.go:171","msg":"trace[868513477] transaction","detail":"{read_only:false; response_revision:24726; number_of_response:1; }","duration":"250.696919ms","start":"2026-02-24T04:45:03.684871Z","end":"2026-02-24T04:45:03.935567Z","steps":["trace[868513477] 'process raft request' (duration: 250.534344ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.935645Z","caller":"traceutil/trace.go:171","msg":"trace[1650763003] transaction","detail":"{read_only:false; response_revision:24728; number_of_response:1; }","duration":"229.433052ms","start":"2026-02-24T04:45:03.706207Z","end":"2026-02-24T04:45:03.93564Z","steps":["trace[1650763003] 'process raft request' (duration: 229.322619ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:03.935741Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.532733ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:45:03.935748Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.454951ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:03.935778Z","caller":"traceutil/trace.go:171","msg":"trace[1080914418] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:24728; }","duration":"221.502012ms","start":"2026-02-24T04:45:03.714267Z","end":"2026-02-24T04:45:03.935769Z","steps":["trace[1080914418] 'agreement among raft nodes before linearized reading' (duration: 221.451851ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:03.935831Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"210.067897ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:1 size:4963"} {"level":"info","ts":"2026-02-24T04:45:03.935843Z","caller":"traceutil/trace.go:171","msg":"trace[2043924840] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:1; response_revision:24728; }","duration":"210.120048ms","start":"2026-02-24T04:45:03.72572Z","end":"2026-02-24T04:45:03.93584Z","steps":["trace[2043924840] 'agreement among raft nodes before linearized reading' (duration: 210.060857ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:03.9359Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.272564ms","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":"info","ts":"2026-02-24T04:45:03.935916Z","caller":"traceutil/trace.go:171","msg":"trace[2018444067] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/; range_end:/registry/pxc.percona.com/perconaxtradbclusters0; response_count:0; response_revision:24728; }","duration":"158.325205ms","start":"2026-02-24T04:45:03.777583Z","end":"2026-02-24T04:45:03.935908Z","steps":["trace[2018444067] 'agreement among raft nodes before linearized reading' (duration: 158.298734ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:03.935885Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.458371ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:03.935973Z","caller":"traceutil/trace.go:171","msg":"trace[1560023722] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:24728; }","duration":"221.582234ms","start":"2026-02-24T04:45:03.714372Z","end":"2026-02-24T04:45:03.935954Z","steps":["trace[1560023722] 'agreement among raft nodes before linearized reading' (duration: 221.441401ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:03.935758Z","caller":"traceutil/trace.go:171","msg":"trace[1873799174] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:24728; }","duration":"221.596905ms","start":"2026-02-24T04:45:03.714156Z","end":"2026-02-24T04:45:03.935753Z","steps":["trace[1873799174] 'agreement among raft nodes before linearized reading' (duration: 221.551774ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:04.2529Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.504217ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:04.252977Z","caller":"traceutil/trace.go:171","msg":"trace[88127097] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:24728; }","duration":"295.62843ms","start":"2026-02-24T04:45:03.957332Z","end":"2026-02-24T04:45:04.252961Z","steps":["trace[88127097] 'range keys from in-memory index tree' (duration: 295.419915ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:04.25336Z","caller":"traceutil/trace.go:171","msg":"trace[217193130] linearizableReadLoop","detail":"{readStateIndex:25575; appliedIndex:25574; }","duration":"112.466198ms","start":"2026-02-24T04:45:04.140862Z","end":"2026-02-24T04:45:04.253328Z","steps":["trace[217193130] 'read index received' (duration: 37.634501ms)","trace[217193130] 'applied index is now lower than readState.Index' (duration: 74.830037ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:04.253531Z","caller":"traceutil/trace.go:171","msg":"trace[1341439887] transaction","detail":"{read_only:false; response_revision:24729; number_of_response:1; }","duration":"271.950757ms","start":"2026-02-24T04:45:03.981562Z","end":"2026-02-24T04:45:04.253513Z","steps":["trace[1341439887] 'process raft request' (duration: 196.930774ms)","trace[1341439887] 'compare' (duration: 74.589621ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:45:04.25388Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.997144ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-neutron-server-0\" ","response":"range_response_count:1 size:1862"} {"level":"info","ts":"2026-02-24T04:45:04.253969Z","caller":"traceutil/trace.go:171","msg":"trace[1990291054] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-neutron-server-0; range_end:; response_count:1; response_revision:24729; }","duration":"113.086546ms","start":"2026-02-24T04:45:04.140829Z","end":"2026-02-24T04:45:04.253915Z","steps":["trace[1990291054] 'agreement among raft nodes before linearized reading' (duration: 112.919312ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:08.777397Z","caller":"traceutil/trace.go:171","msg":"trace[2105792621] transaction","detail":"{read_only:false; response_revision:24765; number_of_response:1; }","duration":"172.195679ms","start":"2026-02-24T04:45:08.604928Z","end":"2026-02-24T04:45:08.777124Z","steps":["trace[2105792621] 'process raft request' (duration: 171.873341ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:25.265171Z","caller":"traceutil/trace.go:171","msg":"trace[1094126229] linearizableReadLoop","detail":"{readStateIndex:25739; appliedIndex:25738; }","duration":"107.258614ms","start":"2026-02-24T04:45:25.157887Z","end":"2026-02-24T04:45:25.265146Z","steps":["trace[1094126229] 'read index received' (duration: 107.025468ms)","trace[1094126229] 'applied index is now lower than readState.Index' (duration: 232.176µs)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:45:25.265741Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.83421ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:1866"} {"level":"info","ts":"2026-02-24T04:45:25.265795Z","caller":"traceutil/trace.go:171","msg":"trace[1422102293] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:24889; }","duration":"107.937163ms","start":"2026-02-24T04:45:25.157841Z","end":"2026-02-24T04:45:25.265778Z","steps":["trace[1422102293] 'agreement among raft nodes before linearized reading' (duration: 107.749778ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:25.265781Z","caller":"traceutil/trace.go:171","msg":"trace[2061648248] transaction","detail":"{read_only:false; response_revision:24889; number_of_response:1; }","duration":"187.661217ms","start":"2026-02-24T04:45:25.078075Z","end":"2026-02-24T04:45:25.265736Z","steps":["trace[2061648248] 'process raft request' (duration: 186.906967ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:25.569529Z","caller":"traceutil/trace.go:171","msg":"trace[1827149347] transaction","detail":"{read_only:false; response_revision:24891; number_of_response:1; }","duration":"188.204244ms","start":"2026-02-24T04:45:25.3813Z","end":"2026-02-24T04:45:25.569505Z","steps":["trace[1827149347] 'process raft request' (duration: 188.108691ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:25.569552Z","caller":"traceutil/trace.go:171","msg":"trace[1324075158] linearizableReadLoop","detail":"{readStateIndex:25741; appliedIndex:25740; }","duration":"256.428049ms","start":"2026-02-24T04:45:25.313088Z","end":"2026-02-24T04:45:25.569516Z","steps":["trace[1324075158] 'read index received' (duration: 222.586213ms)","trace[1324075158] 'applied index is now lower than readState.Index' (duration: 33.838316ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:25.569516Z","caller":"traceutil/trace.go:171","msg":"trace[208679741] transaction","detail":"{read_only:false; response_revision:24890; number_of_response:1; }","duration":"268.341737ms","start":"2026-02-24T04:45:25.301082Z","end":"2026-02-24T04:45:25.569423Z","steps":["trace[208679741] 'process raft request' (duration: 234.503272ms)","trace[208679741] 'compare' (duration: 33.689091ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:45:25.569757Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"256.644305ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:25.569816Z","caller":"traceutil/trace.go:171","msg":"trace[1834528506] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:24891; }","duration":"256.729887ms","start":"2026-02-24T04:45:25.313071Z","end":"2026-02-24T04:45:25.569801Z","steps":["trace[1834528506] 'agreement among raft nodes before linearized reading' (duration: 256.601873ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:25.569819Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.448065ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:25.569872Z","caller":"traceutil/trace.go:171","msg":"trace[2064716310] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:24891; }","duration":"198.551508ms","start":"2026-02-24T04:45:25.371308Z","end":"2026-02-24T04:45:25.56986Z","steps":["trace[2064716310] 'agreement among raft nodes before linearized reading' (duration: 198.427945ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:25.569957Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.785949ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:1 size:4963"} {"level":"warn","ts":"2026-02-24T04:45:25.569956Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.276661ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:45:25.569982Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"198.543108ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:25.570025Z","caller":"traceutil/trace.go:171","msg":"trace[1518788195] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:1; response_revision:24891; }","duration":"196.877651ms","start":"2026-02-24T04:45:25.373132Z","end":"2026-02-24T04:45:25.57001Z","steps":["trace[1518788195] 'agreement among raft nodes before linearized reading' (duration: 196.672716ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:25.570041Z","caller":"traceutil/trace.go:171","msg":"trace[624286764] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:24891; }","duration":"198.6088ms","start":"2026-02-24T04:45:25.371416Z","end":"2026-02-24T04:45:25.570025Z","steps":["trace[624286764] 'agreement among raft nodes before linearized reading' (duration: 198.471836ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:25.570041Z","caller":"traceutil/trace.go:171","msg":"trace[1010792979] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:24891; }","duration":"198.411665ms","start":"2026-02-24T04:45:25.37161Z","end":"2026-02-24T04:45:25.570022Z","steps":["trace[1010792979] 'agreement among raft nodes before linearized reading' (duration: 198.25518ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:51.122427Z","caller":"traceutil/trace.go:171","msg":"trace[1309315640] transaction","detail":"{read_only:false; response_revision:25065; number_of_response:1; }","duration":"128.292276ms","start":"2026-02-24T04:45:50.9941Z","end":"2026-02-24T04:45:51.122393Z","steps":["trace[1309315640] 'process raft request' (duration: 128.104051ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:56.496968Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.260117ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:56.497066Z","caller":"traceutil/trace.go:171","msg":"trace[366388594] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:25102; }","duration":"119.36564ms","start":"2026-02-24T04:45:56.377675Z","end":"2026-02-24T04:45:56.49704Z","steps":["trace[366388594] 'range keys from in-memory index tree' (duration: 119.105373ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:56.497075Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.112683ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:56.497154Z","caller":"traceutil/trace.go:171","msg":"trace[227356066] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:25102; }","duration":"119.214596ms","start":"2026-02-24T04:45:56.377918Z","end":"2026-02-24T04:45:56.497133Z","steps":["trace[227356066] 'range keys from in-memory index tree' (duration: 119.065952ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:56.497227Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"251.80475ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"} {"level":"warn","ts":"2026-02-24T04:45:56.497248Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.268021ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:56.497301Z","caller":"traceutil/trace.go:171","msg":"trace[1123490565] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:25102; }","duration":"251.918404ms","start":"2026-02-24T04:45:56.245362Z","end":"2026-02-24T04:45:56.497281Z","steps":["trace[1123490565] 'range keys from in-memory index tree' (duration: 251.577664ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:56.497328Z","caller":"traceutil/trace.go:171","msg":"trace[1884885746] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:25102; }","duration":"181.396664ms","start":"2026-02-24T04:45:56.315912Z","end":"2026-02-24T04:45:56.497308Z","steps":["trace[1884885746] 'range keys from in-memory index tree' (duration: 181.165948ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:56.497561Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.946516ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:45:56.49759Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.911985ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:1 size:4963"} {"level":"info","ts":"2026-02-24T04:45:56.497594Z","caller":"traceutil/trace.go:171","msg":"trace[68404415] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:25102; }","duration":"120.020028ms","start":"2026-02-24T04:45:56.377564Z","end":"2026-02-24T04:45:56.497584Z","steps":["trace[68404415] 'range keys from in-memory index tree' (duration: 119.842633ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:56.497618Z","caller":"traceutil/trace.go:171","msg":"trace[1039161341] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:1; response_revision:25102; }","duration":"119.980977ms","start":"2026-02-24T04:45:56.377629Z","end":"2026-02-24T04:45:56.49761Z","steps":["trace[1039161341] 'range keys from in-memory index tree' (duration: 119.73753ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:56.773036Z","caller":"traceutil/trace.go:171","msg":"trace[150720742] linearizableReadLoop","detail":"{readStateIndex:25961; appliedIndex:25960; }","duration":"254.761593ms","start":"2026-02-24T04:45:56.518244Z","end":"2026-02-24T04:45:56.773006Z","steps":["trace[150720742] 'read index received' (duration: 254.548077ms)","trace[150720742] 'applied index is now lower than readState.Index' (duration: 210.816µs)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:56.773059Z","caller":"traceutil/trace.go:171","msg":"trace[460758335] transaction","detail":"{read_only:false; response_revision:25104; number_of_response:1; }","duration":"271.240808ms","start":"2026-02-24T04:45:56.501763Z","end":"2026-02-24T04:45:56.773004Z","steps":["trace[460758335] 'process raft request' (duration: 270.96221ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:56.773156Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"274.96838ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:45:56.773235Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.071687ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/addons.cluster.x-k8s.io/clusterresourcesetbindings/\" range_end:\"/registry/addons.cluster.x-k8s.io/clusterresourcesetbindings0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:56.773234Z","caller":"traceutil/trace.go:171","msg":"trace[312184799] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:25105; }","duration":"275.074423ms","start":"2026-02-24T04:45:56.498142Z","end":"2026-02-24T04:45:56.773217Z","steps":["trace[312184799] 'agreement among raft nodes before linearized reading' (duration: 274.9505ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:56.773281Z","caller":"traceutil/trace.go:171","msg":"trace[839384299] range","detail":"{range_begin:/registry/addons.cluster.x-k8s.io/clusterresourcesetbindings/; range_end:/registry/addons.cluster.x-k8s.io/clusterresourcesetbindings0; response_count:0; response_revision:25105; }","duration":"244.168089ms","start":"2026-02-24T04:45:56.529099Z","end":"2026-02-24T04:45:56.773267Z","steps":["trace[839384299] 'agreement among raft nodes before linearized reading' (duration: 244.058706ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:56.7733Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.870694ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-02-24T04:45:56.773358Z","caller":"traceutil/trace.go:171","msg":"trace[518460473] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:25105; }","duration":"157.985257ms","start":"2026-02-24T04:45:56.615358Z","end":"2026-02-24T04:45:56.773344Z","steps":["trace[518460473] 'agreement among raft nodes before linearized reading' (duration: 157.856083ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:56.773479Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.343393ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/controlplane.cluster.x-k8s.io/kubeadmcontrolplanes/\" range_end:\"/registry/controlplane.cluster.x-k8s.io/kubeadmcontrolplanes0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:56.773575Z","caller":"traceutil/trace.go:171","msg":"trace[430442269] range","detail":"{range_begin:/registry/controlplane.cluster.x-k8s.io/kubeadmcontrolplanes/; range_end:/registry/controlplane.cluster.x-k8s.io/kubeadmcontrolplanes0; response_count:0; response_revision:25105; }","duration":"100.474737ms","start":"2026-02-24T04:45:56.673081Z","end":"2026-02-24T04:45:56.773556Z","steps":["trace[430442269] 'agreement among raft nodes before linearized reading' (duration: 100.121787ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:57.318834Z","caller":"traceutil/trace.go:171","msg":"trace[333711048] transaction","detail":"{read_only:false; response_revision:25106; number_of_response:1; }","duration":"293.912034ms","start":"2026-02-24T04:45:57.024898Z","end":"2026-02-24T04:45:57.31881Z","steps":["trace[333711048] 'process raft request' (duration: 293.76295ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:57.540614Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"159.812207ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-02-24T04:45:57.54125Z","caller":"traceutil/trace.go:171","msg":"trace[1225661772] transaction","detail":"{read_only:false; response_revision:25107; number_of_response:1; }","duration":"492.820852ms","start":"2026-02-24T04:45:57.04841Z","end":"2026-02-24T04:45:57.541231Z","steps":["trace[1225661772] 'process raft request' (duration: 332.12033ms)","trace[1225661772] 'compare' (duration: 159.593272ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:57.54125Z","caller":"traceutil/trace.go:171","msg":"trace[1099155173] transaction","detail":"{read_only:false; response_revision:25108; number_of_response:1; }","duration":"402.203466ms","start":"2026-02-24T04:45:57.139015Z","end":"2026-02-24T04:45:57.541219Z","steps":["trace[1099155173] 'process raft request' (duration: 402.067433ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:57.541405Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:57.13899Z","time spent":"402.33359ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":496,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:45:57.541482Z","caller":"traceutil/trace.go:171","msg":"trace[272025743] transaction","detail":"{read_only:false; response_revision:25109; number_of_response:1; }","duration":"165.176266ms","start":"2026-02-24T04:45:57.376271Z","end":"2026-02-24T04:45:57.541448Z","steps":["trace[272025743] 'process raft request' (duration: 164.884477ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:57.541603Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"456.19326ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-cinder-server-0\" ","response":"range_response_count:1 size:1858"} {"level":"info","ts":"2026-02-24T04:45:57.541672Z","caller":"traceutil/trace.go:171","msg":"trace[989075257] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-cinder-server-0; range_end:; response_count:1; response_revision:25109; }","duration":"456.291212ms","start":"2026-02-24T04:45:57.085361Z","end":"2026-02-24T04:45:57.541653Z","steps":["trace[989075257] 'agreement among raft nodes before linearized reading' (duration: 456.052106ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:57.541722Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:57.085319Z","time spent":"456.392576ms","remote":"127.0.0.1:47006","response type":"/etcdserverpb.KV/Range","request count":0,"request size":81,"response count":1,"response size":1882,"request content":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-cinder-server-0\" "} {"level":"info","ts":"2026-02-24T04:45:57.541199Z","caller":"traceutil/trace.go:171","msg":"trace[1978178602] linearizableReadLoop","detail":"{readStateIndex:25964; appliedIndex:25962; }","duration":"455.770887ms","start":"2026-02-24T04:45:57.085411Z","end":"2026-02-24T04:45:57.541182Z","steps":["trace[1978178602] 'read index received' (duration: 233.295818ms)","trace[1978178602] 'applied index is now lower than readState.Index' (duration: 222.474129ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:45:57.541999Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:57.048388Z","time spent":"492.909514ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":627,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:45:57.818357Z","caller":"traceutil/trace.go:171","msg":"trace[1050239761] transaction","detail":"{read_only:false; response_revision:25111; number_of_response:1; }","duration":"148.877125ms","start":"2026-02-24T04:45:57.669447Z","end":"2026-02-24T04:45:57.818324Z","steps":["trace[1050239761] 'process raft request' (duration: 148.729491ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:57.818617Z","caller":"traceutil/trace.go:171","msg":"trace[2121199888] linearizableReadLoop","detail":"{readStateIndex:25967; appliedIndex:25966; }","duration":"276.724518ms","start":"2026-02-24T04:45:57.541877Z","end":"2026-02-24T04:45:57.818601Z","steps":["trace[2121199888] 'read index received' (duration: 254.475954ms)","trace[2121199888] 'applied index is now lower than readState.Index' (duration: 22.246754ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:45:57.818767Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"492.091791ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"warn","ts":"2026-02-24T04:45:57.818799Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"491.713732ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/\" range_end:\"/registry/minions0\" ","response":"range_response_count:1 size:16991"} {"level":"warn","ts":"2026-02-24T04:45:57.818811Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"389.775964ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12022"} {"level":"info","ts":"2026-02-24T04:45:57.818852Z","caller":"traceutil/trace.go:171","msg":"trace[1244615916] range","detail":"{range_begin:/registry/minions/; range_end:/registry/minions0; response_count:1; response_revision:25111; }","duration":"491.783314ms","start":"2026-02-24T04:45:57.327057Z","end":"2026-02-24T04:45:57.81884Z","steps":["trace[1244615916] 'agreement among raft nodes before linearized reading' (duration: 491.608758ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:57.81885Z","caller":"traceutil/trace.go:171","msg":"trace[1967286514] range","detail":"{range_begin:/registry/statefulsets/; range_end:/registry/statefulsets0; response_count:0; response_revision:25111; }","duration":"492.218476ms","start":"2026-02-24T04:45:57.326613Z","end":"2026-02-24T04:45:57.818832Z","steps":["trace[1967286514] 'agreement among raft nodes before linearized reading' (duration: 492.05825ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:57.818876Z","caller":"traceutil/trace.go:171","msg":"trace[595515921] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:25111; }","duration":"389.889207ms","start":"2026-02-24T04:45:57.42897Z","end":"2026-02-24T04:45:57.818859Z","steps":["trace[595515921] 'agreement among raft nodes before linearized reading' (duration: 389.689771ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:57.818889Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:57.327051Z","time spent":"491.830155ms","remote":"127.0.0.1:47020","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":1,"response size":17015,"request content":"key:\"/registry/minions/\" range_end:\"/registry/minions0\" "} {"level":"warn","ts":"2026-02-24T04:45:57.818888Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"273.713695ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/pvc-d7508d0e-10c8-4769-a67b-71c19b8d2d84\" ","response":"range_response_count:1 size:1319"} {"level":"warn","ts":"2026-02-24T04:45:57.818899Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:57.326599Z","time spent":"492.286347ms","remote":"127.0.0.1:39364","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":22,"response size":32,"request content":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" count_only:true "} {"level":"warn","ts":"2026-02-24T04:45:57.818913Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:57.428941Z","time spent":"389.96506ms","remote":"127.0.0.1:47028","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":12046,"request content":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" "} {"level":"info","ts":"2026-02-24T04:45:57.81894Z","caller":"traceutil/trace.go:171","msg":"trace[527422506] range","detail":"{range_begin:/registry/persistentvolumes/pvc-d7508d0e-10c8-4769-a67b-71c19b8d2d84; range_end:; response_count:1; response_revision:25111; }","duration":"273.791288ms","start":"2026-02-24T04:45:57.545132Z","end":"2026-02-24T04:45:57.818923Z","steps":["trace[527422506] 'agreement among raft nodes before linearized reading' (duration: 273.581341ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:57.818969Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.074829ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:1 size:4963"} {"level":"info","ts":"2026-02-24T04:45:57.819031Z","caller":"traceutil/trace.go:171","msg":"trace[983117609] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:1; response_revision:25111; }","duration":"167.177971ms","start":"2026-02-24T04:45:57.651834Z","end":"2026-02-24T04:45:57.819012Z","steps":["trace[983117609] 'agreement among raft nodes before linearized reading' (duration: 167.004367ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:57.81886Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.78745ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:45:57.819054Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.032987ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:57.819085Z","caller":"traceutil/trace.go:171","msg":"trace[418929439] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:25111; }","duration":"167.075108ms","start":"2026-02-24T04:45:57.652002Z","end":"2026-02-24T04:45:57.819077Z","steps":["trace[418929439] 'agreement among raft nodes before linearized reading' (duration: 166.718497ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:57.81911Z","caller":"traceutil/trace.go:171","msg":"trace[1077157239] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:25111; }","duration":"167.10304ms","start":"2026-02-24T04:45:57.65199Z","end":"2026-02-24T04:45:57.819093Z","steps":["trace[1077157239] 'agreement among raft nodes before linearized reading' (duration: 167.016367ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:57.819236Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.445768ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:57.819276Z","caller":"traceutil/trace.go:171","msg":"trace[1819675711] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:25111; }","duration":"167.51911ms","start":"2026-02-24T04:45:57.651745Z","end":"2026-02-24T04:45:57.819264Z","steps":["trace[1819675711] 'agreement among raft nodes before linearized reading' (duration: 167.453139ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:57.819322Z","caller":"traceutil/trace.go:171","msg":"trace[1451407868] transaction","detail":"{read_only:false; response_revision:25110; number_of_response:1; }","duration":"328.921551ms","start":"2026-02-24T04:45:57.489572Z","end":"2026-02-24T04:45:57.818494Z","steps":["trace[1451407868] 'process raft request' (duration: 306.77724ms)","trace[1451407868] 'compare' (duration: 21.555515ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:45:57.819625Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:57.489552Z","time spent":"329.808826ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:45:58.059333Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.003391ms","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-02-24T04:45:58.059507Z","caller":"traceutil/trace.go:171","msg":"trace[1969698285] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:25111; }","duration":"101.208477ms","start":"2026-02-24T04:45:57.958252Z","end":"2026-02-24T04:45:58.059461Z","steps":["trace[1969698285] 'range keys from in-memory index tree' (duration: 100.802886ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.059739Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.4725ms","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-02-24T04:45:58.059854Z","caller":"traceutil/trace.go:171","msg":"trace[816176145] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:25111; }","duration":"120.633685ms","start":"2026-02-24T04:45:57.939198Z","end":"2026-02-24T04:45:58.059831Z","steps":["trace[816176145] 'range keys from in-memory index tree' (duration: 120.281193ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.19385Z","caller":"traceutil/trace.go:171","msg":"trace[1888016953] transaction","detail":"{read_only:false; response_revision:25112; number_of_response:1; }","duration":"130.887957ms","start":"2026-02-24T04:45:58.062941Z","end":"2026-02-24T04:45:58.193829Z","steps":["trace[1888016953] 'process raft request' (duration: 130.697012ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.403554Z","caller":"traceutil/trace.go:171","msg":"trace[496479773] transaction","detail":"{read_only:false; response_revision:25114; number_of_response:1; }","duration":"340.041289ms","start":"2026-02-24T04:45:58.063489Z","end":"2026-02-24T04:45:58.403531Z","steps":["trace[496479773] 'process raft request' (duration: 339.893465ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.403572Z","caller":"traceutil/trace.go:171","msg":"trace[1176035205] transaction","detail":"{read_only:false; response_revision:25113; number_of_response:1; }","duration":"340.109251ms","start":"2026-02-24T04:45:58.06343Z","end":"2026-02-24T04:45:58.403539Z","steps":["trace[1176035205] 'process raft request' (duration: 339.586547ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.40369Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:58.063485Z","time spent":"340.135621ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:45:58.403734Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:58.063416Z","time spent":"340.223424ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:45:58.403859Z","caller":"traceutil/trace.go:171","msg":"trace[2014459679] transaction","detail":"{read_only:false; response_revision:25115; number_of_response:1; }","duration":"235.746886ms","start":"2026-02-24T04:45:58.168101Z","end":"2026-02-24T04:45:58.403848Z","steps":["trace[2014459679] 'process raft request' (duration: 235.371846ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.403889Z","caller":"traceutil/trace.go:171","msg":"trace[1503042834] transaction","detail":"{read_only:false; response_revision:25116; number_of_response:1; }","duration":"224.827625ms","start":"2026-02-24T04:45:58.179038Z","end":"2026-02-24T04:45:58.403866Z","steps":["trace[1503042834] 'process raft request' (duration: 224.703911ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.403875Z","caller":"traceutil/trace.go:171","msg":"trace[1519982924] linearizableReadLoop","detail":"{readStateIndex:25971; appliedIndex:25968; }","duration":"297.256536ms","start":"2026-02-24T04:45:58.106576Z","end":"2026-02-24T04:45:58.403833Z","steps":["trace[1519982924] 'read index received' (duration: 87.122237ms)","trace[1519982924] 'applied index is now lower than readState.Index' (duration: 210.133189ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:45:58.403998Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"297.398911ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:58.404054Z","caller":"traceutil/trace.go:171","msg":"trace[2042520282] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:25116; }","duration":"297.506644ms","start":"2026-02-24T04:45:58.106533Z","end":"2026-02-24T04:45:58.404039Z","steps":["trace[2042520282] 'agreement among raft nodes before linearized reading' (duration: 297.397961ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.404091Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"297.496453ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:58.404122Z","caller":"traceutil/trace.go:171","msg":"trace[1391331375] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:25116; }","duration":"297.532454ms","start":"2026-02-24T04:45:58.106581Z","end":"2026-02-24T04:45:58.404113Z","steps":["trace[1391331375] 'agreement among raft nodes before linearized reading' (duration: 297.475832ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.404279Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"289.05709ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:508"} {"level":"warn","ts":"2026-02-24T04:45:58.404326Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"294.030147ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:1 size:4963"} {"level":"info","ts":"2026-02-24T04:45:58.404351Z","caller":"traceutil/trace.go:171","msg":"trace[1018660044] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:25116; }","duration":"289.195065ms","start":"2026-02-24T04:45:58.115138Z","end":"2026-02-24T04:45:58.404333Z","steps":["trace[1018660044] 'agreement among raft nodes before linearized reading' (duration: 288.986538ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.404359Z","caller":"traceutil/trace.go:171","msg":"trace[1550266223] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:1; response_revision:25116; }","duration":"294.074758ms","start":"2026-02-24T04:45:58.110273Z","end":"2026-02-24T04:45:58.404348Z","steps":["trace[1550266223] 'agreement among raft nodes before linearized reading' (duration: 293.951144ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.404401Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"297.700099ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:58.404447Z","caller":"traceutil/trace.go:171","msg":"trace[1115467389] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:25116; }","duration":"297.826283ms","start":"2026-02-24T04:45:58.106607Z","end":"2026-02-24T04:45:58.404433Z","steps":["trace[1115467389] 'agreement among raft nodes before linearized reading' (duration: 297.755951ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.40454Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.716778ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ceph.rook.io/cephobjectstoreusers/\" range_end:\"/registry/ceph.rook.io/cephobjectstoreusers0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:58.404572Z","caller":"traceutil/trace.go:171","msg":"trace[1617910604] range","detail":"{range_begin:/registry/ceph.rook.io/cephobjectstoreusers/; range_end:/registry/ceph.rook.io/cephobjectstoreusers0; response_count:0; response_revision:25116; }","duration":"145.78265ms","start":"2026-02-24T04:45:58.25878Z","end":"2026-02-24T04:45:58.404563Z","steps":["trace[1617910604] 'agreement among raft nodes before linearized reading' (duration: 145.727118ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.673363Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.490489ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-02-24T04:45:58.673607Z","caller":"traceutil/trace.go:171","msg":"trace[1500121047] transaction","detail":"{read_only:false; response_revision:25117; number_of_response:1; }","duration":"264.559333ms","start":"2026-02-24T04:45:58.409029Z","end":"2026-02-24T04:45:58.673589Z","steps":["trace[1500121047] 'process raft request' (duration: 121.776326ms)","trace[1500121047] 'compare' (duration: 142.20532ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:58.673625Z","caller":"traceutil/trace.go:171","msg":"trace[783086669] linearizableReadLoop","detail":"{readStateIndex:25974; appliedIndex:25973; }","duration":"171.847481ms","start":"2026-02-24T04:45:58.501749Z","end":"2026-02-24T04:45:58.673597Z","steps":["trace[783086669] 'read index received' (duration: 29.077675ms)","trace[783086669] 'applied index is now lower than readState.Index' (duration: 142.767446ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:45:58.673794Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.025516ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:45:58.673831Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"170.623176ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:45:58.673868Z","caller":"traceutil/trace.go:171","msg":"trace[1297362168] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:25118; }","duration":"172.136189ms","start":"2026-02-24T04:45:58.50171Z","end":"2026-02-24T04:45:58.673846Z","steps":["trace[1297362168] 'agreement among raft nodes before linearized reading' (duration: 172.009295ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.673881Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.729718ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:45:58.673883Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.044736ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:1 size:4963"} {"level":"info","ts":"2026-02-24T04:45:58.673906Z","caller":"traceutil/trace.go:171","msg":"trace[433755766] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:25118; }","duration":"171.781549ms","start":"2026-02-24T04:45:58.502117Z","end":"2026-02-24T04:45:58.673899Z","steps":["trace[433755766] 'agreement among raft nodes before linearized reading' (duration: 171.735978ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.673909Z","caller":"traceutil/trace.go:171","msg":"trace[288218160] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:25118; }","duration":"170.75825ms","start":"2026-02-24T04:45:58.50313Z","end":"2026-02-24T04:45:58.673889Z","steps":["trace[288218160] 'agreement among raft nodes before linearized reading' (duration: 170.617876ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.673925Z","caller":"traceutil/trace.go:171","msg":"trace[1559825981] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:1; response_revision:25118; }","duration":"172.131829ms","start":"2026-02-24T04:45:58.501778Z","end":"2026-02-24T04:45:58.67391Z","steps":["trace[1559825981] 'agreement among raft nodes before linearized reading' (duration: 171.962084ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:58.67411Z","caller":"traceutil/trace.go:171","msg":"trace[1409898379] transaction","detail":"{read_only:false; response_revision:25118; number_of_response:1; }","duration":"150.450209ms","start":"2026-02-24T04:45:58.523043Z","end":"2026-02-24T04:45:58.673493Z","steps":["trace[1409898379] 'process raft request' (duration: 150.398758ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:58.909947Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.48413ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-02-24T04:45:58.909983Z","caller":"traceutil/trace.go:171","msg":"trace[1940389056] transaction","detail":"{read_only:false; response_revision:25119; number_of_response:1; }","duration":"131.29302ms","start":"2026-02-24T04:45:58.778659Z","end":"2026-02-24T04:45:58.909952Z","steps":["trace[1940389056] 'process raft request' (duration: 71.410595ms)","trace[1940389056] 'compare' (duration: 59.750881ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:58.910014Z","caller":"traceutil/trace.go:171","msg":"trace[1832028577] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:25118; }","duration":"133.566502ms","start":"2026-02-24T04:45:58.776433Z","end":"2026-02-24T04:45:58.91Z","steps":["trace[1832028577] 'range keys from in-memory index tree' (duration: 133.272044ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:45:59.090671Z","caller":"traceutil/trace.go:171","msg":"trace[23359912] transaction","detail":"{read_only:false; response_revision:25120; number_of_response:1; }","duration":"175.497571ms","start":"2026-02-24T04:45:58.915141Z","end":"2026-02-24T04:45:59.090638Z","steps":["trace[23359912] 'process raft request' (duration: 126.901908ms)","trace[23359912] 'compare' (duration: 48.439448ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:45:59.878292Z","caller":"traceutil/trace.go:171","msg":"trace[243044185] transaction","detail":"{read_only:false; response_revision:25122; number_of_response:1; }","duration":"331.72504ms","start":"2026-02-24T04:45:59.546542Z","end":"2026-02-24T04:45:59.878267Z","steps":["trace[243044185] 'process raft request' (duration: 331.538995ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:45:59.878544Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:45:59.546509Z","time spent":"331.949637ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:45:59.88642Z","caller":"traceutil/trace.go:171","msg":"trace[1666410232] transaction","detail":"{read_only:false; response_revision:25123; number_of_response:1; }","duration":"295.764666ms","start":"2026-02-24T04:45:59.590627Z","end":"2026-02-24T04:45:59.886392Z","steps":["trace[1666410232] 'process raft request' (duration: 295.648642ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:46:00.413645Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.313113ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:46:00.413724Z","caller":"traceutil/trace.go:171","msg":"trace[155426002] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:25125; }","duration":"100.442006ms","start":"2026-02-24T04:46:00.313264Z","end":"2026-02-24T04:46:00.413706Z","steps":["trace[155426002] 'range keys from in-memory index tree' (duration: 100.22394ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:46:00.752513Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.996874ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-02-24T04:46:00.752671Z","caller":"traceutil/trace.go:171","msg":"trace[1876693509] linearizableReadLoop","detail":"{readStateIndex:25984; appliedIndex:25983; }","duration":"337.849809ms","start":"2026-02-24T04:46:00.414808Z","end":"2026-02-24T04:46:00.752657Z","steps":["trace[1876693509] 'read index received' (duration: 66.153069ms)","trace[1876693509] 'applied index is now lower than readState.Index' (duration: 271.69599ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:46:00.752666Z","caller":"traceutil/trace.go:171","msg":"trace[307203608] transaction","detail":"{read_only:false; response_revision:25127; number_of_response:1; }","duration":"343.533585ms","start":"2026-02-24T04:46:00.409108Z","end":"2026-02-24T04:46:00.752641Z","steps":["trace[307203608] 'process raft request' (duration: 230.345596ms)","trace[307203608] 'compare' (duration: 112.902001ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:46:00.752774Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:46:00.409091Z","time spent":"343.625028ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":522,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:46:00.752767Z","caller":"traceutil/trace.go:171","msg":"trace[423873858] transaction","detail":"{read_only:false; response_revision:25129; number_of_response:1; }","duration":"335.147554ms","start":"2026-02-24T04:46:00.417593Z","end":"2026-02-24T04:46:00.752741Z","steps":["trace[423873858] 'process raft request' (duration: 335.034341ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:00.752845Z","caller":"traceutil/trace.go:171","msg":"trace[951364198] transaction","detail":"{read_only:false; response_revision:25128; number_of_response:1; }","duration":"335.391871ms","start":"2026-02-24T04:46:00.417445Z","end":"2026-02-24T04:46:00.752837Z","steps":["trace[951364198] 'process raft request' (duration: 335.146344ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:46:00.752815Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"337.990362ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:46:00.752878Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:46:00.417579Z","time spent":"335.240887ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-02-24T04:46:00.752884Z","caller":"traceutil/trace.go:171","msg":"trace[1349593681] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:25129; }","duration":"338.079185ms","start":"2026-02-24T04:46:00.414792Z","end":"2026-02-24T04:46:00.752871Z","steps":["trace[1349593681] 'agreement among raft nodes before linearized reading' (duration: 337.959811ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:46:00.752886Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:46:00.417422Z","time spent":"335.443102ms","remote":"127.0.0.1:39174","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":42,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-02-24T04:46:00.752916Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:46:00.414781Z","time spent":"338.129447ms","remote":"127.0.0.1:46874","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":30,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-02-24T04:46:00.906561Z","caller":"traceutil/trace.go:171","msg":"trace[1197241355] linearizableReadLoop","detail":"{readStateIndex:25988; appliedIndex:25987; }","duration":"153.845662ms","start":"2026-02-24T04:46:00.75269Z","end":"2026-02-24T04:46:00.906535Z","steps":["trace[1197241355] 'read index received' (duration: 74.313913ms)","trace[1197241355] 'applied index is now lower than readState.Index' (duration: 79.527759ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:46:00.906671Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.810078ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-user\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:46:00.906707Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.868299ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-ks-endpoints\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:46:00.90674Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"392.923051ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cluster.x-k8s.io/clusters/\" range_end:\"/registry/cluster.x-k8s.io/clusters0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:46:00.906731Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.561329ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-db-sync\" ","response":"range_response_count:1 size:4963"} {"level":"info","ts":"2026-02-24T04:46:00.906752Z","caller":"traceutil/trace.go:171","msg":"trace[1432507288] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-endpoints; range_end:; response_count:0; response_revision:25130; }","duration":"227.957161ms","start":"2026-02-24T04:46:00.678784Z","end":"2026-02-24T04:46:00.906741Z","steps":["trace[1432507288] 'agreement among raft nodes before linearized reading' (duration: 227.873589ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:00.906775Z","caller":"traceutil/trace.go:171","msg":"trace[1725952572] range","detail":"{range_begin:/registry/cluster.x-k8s.io/clusters/; range_end:/registry/cluster.x-k8s.io/clusters0; response_count:0; response_revision:25130; }","duration":"393.008353ms","start":"2026-02-24T04:46:00.513758Z","end":"2026-02-24T04:46:00.906766Z","steps":["trace[1725952572] 'agreement among raft nodes before linearized reading' (duration: 392.938601ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:00.906788Z","caller":"traceutil/trace.go:171","msg":"trace[1949272019] range","detail":"{range_begin:/registry/jobs/openstack/manila-db-sync; range_end:; response_count:1; response_revision:25130; }","duration":"227.635852ms","start":"2026-02-24T04:46:00.679139Z","end":"2026-02-24T04:46:00.906775Z","steps":["trace[1949272019] 'agreement among raft nodes before linearized reading' (duration: 227.441367ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:46:00.906795Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.886269ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/manila-rabbit-init\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:46:00.906807Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-24T04:46:00.513736Z","time spent":"393.061935ms","remote":"127.0.0.1:49556","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":0,"response size":30,"request content":"key:\"/registry/cluster.x-k8s.io/clusters/\" range_end:\"/registry/cluster.x-k8s.io/clusters0\" count_only:true "} {"level":"info","ts":"2026-02-24T04:46:00.906825Z","caller":"traceutil/trace.go:171","msg":"trace[858091240] range","detail":"{range_begin:/registry/jobs/openstack/manila-rabbit-init; range_end:; response_count:0; response_revision:25130; }","duration":"227.91533ms","start":"2026-02-24T04:46:00.678902Z","end":"2026-02-24T04:46:00.906817Z","steps":["trace[858091240] 'agreement among raft nodes before linearized reading' (duration: 227.872199ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:00.906746Z","caller":"traceutil/trace.go:171","msg":"trace[890771490] range","detail":"{range_begin:/registry/jobs/openstack/manila-ks-user; range_end:; response_count:0; response_revision:25130; }","duration":"227.909871ms","start":"2026-02-24T04:46:00.678819Z","end":"2026-02-24T04:46:00.906729Z","steps":["trace[890771490] 'agreement among raft nodes before linearized reading' (duration: 227.748086ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:46:00.906998Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.235727ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:508"} {"level":"info","ts":"2026-02-24T04:46:00.907031Z","caller":"traceutil/trace.go:171","msg":"trace[1045286650] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:25130; }","duration":"229.296038ms","start":"2026-02-24T04:46:00.677726Z","end":"2026-02-24T04:46:00.907022Z","steps":["trace[1045286650] 'agreement among raft nodes before linearized reading' (duration: 229.205575ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:01.170828Z","caller":"traceutil/trace.go:171","msg":"trace[960765031] linearizableReadLoop","detail":"{readStateIndex:25990; appliedIndex:25988; }","duration":"235.179591ms","start":"2026-02-24T04:46:00.935606Z","end":"2026-02-24T04:46:01.170786Z","steps":["trace[960765031] 'read index received' (duration: 40.352147ms)","trace[960765031] 'applied index is now lower than readState.Index' (duration: 194.825484ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:46:01.171132Z","caller":"traceutil/trace.go:171","msg":"trace[614008020] transaction","detail":"{read_only:false; response_revision:25132; number_of_response:1; }","duration":"257.081747ms","start":"2026-02-24T04:46:00.914017Z","end":"2026-02-24T04:46:01.171099Z","steps":["trace[614008020] 'process raft request' (duration: 244.297594ms)","trace[614008020] 'compare' (duration: 12.143725ms)"],"step_count":2} {"level":"warn","ts":"2026-02-24T04:46:01.171184Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.548041ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/openstack.k-orc.cloud/keypairs/\" range_end:\"/registry/openstack.k-orc.cloud/keypairs0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-02-24T04:46:01.171207Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"217.261235ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cluster.x-k8s.io/machinehealthchecks/\" range_end:\"/registry/cluster.x-k8s.io/machinehealthchecks0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:46:01.171265Z","caller":"traceutil/trace.go:171","msg":"trace[2065734999] range","detail":"{range_begin:/registry/openstack.k-orc.cloud/keypairs/; range_end:/registry/openstack.k-orc.cloud/keypairs0; response_count:0; response_revision:25132; }","duration":"235.673435ms","start":"2026-02-24T04:46:00.93557Z","end":"2026-02-24T04:46:01.171243Z","steps":["trace[2065734999] 'agreement among raft nodes before linearized reading' (duration: 235.5117ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:01.171285Z","caller":"traceutil/trace.go:171","msg":"trace[133996926] range","detail":"{range_begin:/registry/cluster.x-k8s.io/machinehealthchecks/; range_end:/registry/cluster.x-k8s.io/machinehealthchecks0; response_count:0; response_revision:25132; }","duration":"217.386658ms","start":"2026-02-24T04:46:00.953878Z","end":"2026-02-24T04:46:01.171265Z","steps":["trace[133996926] 'agreement among raft nodes before linearized reading' (duration: 217.236594ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:46:01.558501Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"243.81686ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:46:01.558563Z","caller":"traceutil/trace.go:171","msg":"trace[1600051717] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:25133; }","duration":"243.927193ms","start":"2026-02-24T04:46:01.314621Z","end":"2026-02-24T04:46:01.558549Z","steps":["trace[1600051717] 'range keys from in-memory index tree' (duration: 243.751007ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:01.712042Z","caller":"traceutil/trace.go:171","msg":"trace[860043870] transaction","detail":"{read_only:false; response_revision:25134; number_of_response:1; }","duration":"117.436676ms","start":"2026-02-24T04:46:01.594549Z","end":"2026-02-24T04:46:01.711986Z","steps":["trace[860043870] 'process raft request' (duration: 117.171049ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:23.08742Z","caller":"traceutil/trace.go:171","msg":"trace[420056816] transaction","detail":"{read_only:false; response_revision:25296; number_of_response:1; }","duration":"128.006198ms","start":"2026-02-24T04:46:22.959376Z","end":"2026-02-24T04:46:23.087382Z","steps":["trace[420056816] 'process raft request' (duration: 65.731956ms)","trace[420056816] 'compare' (duration: 62.067975ms)"],"step_count":2} {"level":"info","ts":"2026-02-24T04:46:23.261156Z","caller":"traceutil/trace.go:171","msg":"trace[1476842098] transaction","detail":"{read_only:false; response_revision:25297; number_of_response:1; }","duration":"100.734745ms","start":"2026-02-24T04:46:23.160393Z","end":"2026-02-24T04:46:23.261127Z","steps":["trace[1476842098] 'process raft request' (duration: 100.587341ms)"],"step_count":1} {"level":"warn","ts":"2026-02-24T04:46:23.975714Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.468098ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/bootstrap.cluster.x-k8s.io/kubeadmconfigs/\" range_end:\"/registry/bootstrap.cluster.x-k8s.io/kubeadmconfigs0\" count_only:true ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-02-24T04:46:23.975796Z","caller":"traceutil/trace.go:171","msg":"trace[1258936246] range","detail":"{range_begin:/registry/bootstrap.cluster.x-k8s.io/kubeadmconfigs/; range_end:/registry/bootstrap.cluster.x-k8s.io/kubeadmconfigs0; response_count:0; response_revision:25300; }","duration":"121.603372ms","start":"2026-02-24T04:46:23.854173Z","end":"2026-02-24T04:46:23.975776Z","steps":["trace[1258936246] 'count revisions from in-memory index tree' (duration: 121.319394ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:24.238365Z","caller":"traceutil/trace.go:171","msg":"trace[1180784880] transaction","detail":"{read_only:false; response_revision:25302; number_of_response:1; }","duration":"143.594598ms","start":"2026-02-24T04:46:24.094734Z","end":"2026-02-24T04:46:24.238328Z","steps":["trace[1180784880] 'process raft request' (duration: 143.361932ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:46:24.503739Z","caller":"traceutil/trace.go:171","msg":"trace[1157346408] transaction","detail":"{read_only:false; response_revision:25303; number_of_response:1; }","duration":"152.431253ms","start":"2026-02-24T04:46:24.351267Z","end":"2026-02-24T04:46:24.503698Z","steps":["trace[1157346408] 'process raft request' (duration: 152.220137ms)"],"step_count":1} {"level":"info","ts":"2026-02-24T04:49:32.29222Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":24494} {"level":"info","ts":"2026-02-24T04:49:32.415214Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":24494,"took":"118.31556ms","hash":3802738273,"current-db-size-bytes":53399552,"current-db-size":"53 MB","current-db-size-in-use-bytes":33648640,"current-db-size-in-use":"34 MB"} {"level":"info","ts":"2026-02-24T04:49:32.415263Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3802738273,"revision":24494,"compact-revision":21838} {"level":"info","ts":"2026-02-24T04:54:18.296737Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"b66d12fd59101739","local-member-applied-index":30003,"local-member-snapshot-index":20002,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-02-24T04:54:18.302022Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":30003} {"level":"info","ts":"2026-02-24T04:54:18.302119Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":25003} {"level":"info","ts":"2026-02-24T04:54:32.298676Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":27037} {"level":"info","ts":"2026-02-24T04:54:32.419693Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":27037,"took":"117.419036ms","hash":12236685,"current-db-size-bytes":53399552,"current-db-size":"53 MB","current-db-size-in-use-bytes":30400512,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-02-24T04:54:32.419745Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":12236685,"revision":27037,"compact-revision":24494} {"level":"info","ts":"2026-02-24T04:59:32.303758Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":29130} {"level":"info","ts":"2026-02-24T04:59:32.420161Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":29130,"took":"112.176431ms","hash":1217343477,"current-db-size-bytes":53399552,"current-db-size":"53 MB","current-db-size-in-use-bytes":28962816,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-02-24T04:59:32.420277Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1217343477,"revision":29130,"compact-revision":27037} {"level":"info","ts":"2026-02-24T05:04:32.3102Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":31256} {"level":"info","ts":"2026-02-24T05:04:32.454887Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":31256,"took":"140.374779ms","hash":1934273281,"current-db-size-bytes":55930880,"current-db-size":"56 MB","current-db-size-in-use-bytes":29446144,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-02-24T05:04:32.454946Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1934273281,"revision":31256,"compact-revision":29130} {"level":"info","ts":"2026-02-24T05:06:07.745907Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000002-00000000000089f1.wal"} {"level":"info","ts":"2026-02-24T05:09:32.319838Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":33468} {"level":"info","ts":"2026-02-24T05:09:32.457169Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":33468,"took":"130.924267ms","hash":616067726,"current-db-size-bytes":57618432,"current-db-size":"58 MB","current-db-size-in-use-bytes":29757440,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-02-24T05:09:32.457234Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":616067726,"revision":33468,"compact-revision":31256} {"level":"info","ts":"2026-02-24T05:14:32.325983Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":35583} {"level":"info","ts":"2026-02-24T05:14:32.441381Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":35583,"took":"111.667015ms","hash":3767578508,"current-db-size-bytes":57618432,"current-db-size":"58 MB","current-db-size-in-use-bytes":28192768,"current-db-size-in-use":"28 MB"} {"level":"info","ts":"2026-02-24T05:14:32.441441Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3767578508,"revision":35583,"compact-revision":33468}