{"level":"warn","ts":"2026-05-25T05:59:11.825773Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-25T05:59:11.82586Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.132:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.132:2380","--initial-cluster=instance=https://199.204.45.132:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.132:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.132: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-05-25T05:59:11.825937Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-25T05:59:11.825952Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.132:2380"]} {"level":"info","ts":"2026-05-25T05:59:11.82597Z","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-05-25T05:59:11.826681Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.132:2379"]} {"level":"info","ts":"2026-05-25T05:59:11.826757Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":16,"max-cpu-available":16,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.132:2380"],"listen-peer-urls":["https://199.204.45.132:2380"],"advertise-client-urls":["https://199.204.45.132:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.132:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.132: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-05-25T05:59:11.831695Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.733928ms"} {"level":"info","ts":"2026-05-25T05:59:11.838433Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"56c01ea8fdc90390","cluster-id":"c930fe821aab8609"} {"level":"info","ts":"2026-05-25T05:59:11.838537Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 switched to configuration voters=()"} {"level":"info","ts":"2026-05-25T05:59:11.838605Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became follower at term 0"} {"level":"info","ts":"2026-05-25T05:59:11.838626Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 56c01ea8fdc90390 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-25T05:59:11.838639Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became follower at term 1"} {"level":"info","ts":"2026-05-25T05:59:11.838708Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 switched to configuration voters=(6251029993951396752)"} {"level":"warn","ts":"2026-05-25T05:59:11.848318Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-25T05:59:11.849675Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-25T05:59:11.850755Z","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-05-25T05:59:11.853472Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"56c01ea8fdc90390","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-25T05:59:11.853651Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"56c01ea8fdc90390","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-25T05:59:11.853898Z","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-05-25T05:59:11.854051Z","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-05-25T05:59:11.854081Z","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-05-25T05:59:11.855019Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 switched to configuration voters=(6251029993951396752)"} {"level":"info","ts":"2026-05-25T05:59:11.855799Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"c930fe821aab8609","local-member-id":"56c01ea8fdc90390","added-peer-id":"56c01ea8fdc90390","added-peer-peer-urls":["https://199.204.45.132:2380"]} {"level":"info","ts":"2026-05-25T05:59:11.858332Z","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-05-25T05:59:11.85848Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.132:2380"} {"level":"info","ts":"2026-05-25T05:59:11.858561Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.132:2380"} {"level":"info","ts":"2026-05-25T05:59:11.858584Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"56c01ea8fdc90390","initial-advertise-peer-urls":["https://199.204.45.132:2380"],"listen-peer-urls":["https://199.204.45.132:2380"],"advertise-client-urls":["https://199.204.45.132:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.132:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-25T05:59:11.858636Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-25T05:59:12.539983Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 is starting a new election at term 1"} {"level":"info","ts":"2026-05-25T05:59:12.540179Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became pre-candidate at term 1"} {"level":"info","ts":"2026-05-25T05:59:12.540244Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 received MsgPreVoteResp from 56c01ea8fdc90390 at term 1"} {"level":"info","ts":"2026-05-25T05:59:12.540265Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became candidate at term 2"} {"level":"info","ts":"2026-05-25T05:59:12.540281Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 received MsgVoteResp from 56c01ea8fdc90390 at term 2"} {"level":"info","ts":"2026-05-25T05:59:12.540297Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"56c01ea8fdc90390 became leader at term 2"} {"level":"info","ts":"2026-05-25T05:59:12.540316Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 56c01ea8fdc90390 elected leader 56c01ea8fdc90390 at term 2"} {"level":"info","ts":"2026-05-25T05:59:12.543091Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-25T05:59:12.543918Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-25T05:59:12.543966Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-25T05:59:12.543873Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"56c01ea8fdc90390","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.132:2379]}","request-path":"/0/members/56c01ea8fdc90390/attributes","cluster-id":"c930fe821aab8609","publish-timeout":"7s"} {"level":"info","ts":"2026-05-25T05:59:12.544284Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"c930fe821aab8609","local-member-id":"56c01ea8fdc90390","cluster-version":"3.5"} {"level":"info","ts":"2026-05-25T05:59:12.544318Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-25T05:59:12.544393Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-25T05:59:12.544459Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-25T05:59:12.544506Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-25T05:59:12.545594Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.132:2379"} {"level":"info","ts":"2026-05-25T05:59:12.546657Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"warn","ts":"2026-05-25T05:59:26.060922Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.892092ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-25T05:59:26.061273Z","caller":"traceutil/trace.go:171","msg":"trace[638085659] transaction","detail":"{read_only:false; response_revision:409; number_of_response:1; }","duration":"313.665931ms","start":"2026-05-25T05:59:25.74757Z","end":"2026-05-25T05:59:26.061236Z","steps":["trace[638085659] 'process raft request' (duration: 41.850903ms)","trace[638085659] 'compare' (duration: 269.73932ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T05:59:26.061373Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-25T05:59:25.747543Z","time spent":"313.781835ms","remote":"127.0.0.1:57544","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-25T05:59:26.061431Z","caller":"traceutil/trace.go:171","msg":"trace[374618207] transaction","detail":"{read_only:false; response_revision:410; number_of_response:1; }","duration":"311.944749ms","start":"2026-05-25T05:59:25.749455Z","end":"2026-05-25T05:59:26.0614Z","steps":["trace[374618207] 'process raft request' (duration: 311.715104ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T05:59:26.061555Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-25T05:59:25.74943Z","time spent":"312.055112ms","remote":"127.0.0.1:57806","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-25T05:59:26.410372Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"218.97263ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-25T05:59:26.410495Z","caller":"traceutil/trace.go:171","msg":"trace[1537780381] linearizableReadLoop","detail":"{readStateIndex:426; appliedIndex:425; }","duration":"208.886031ms","start":"2026-05-25T05:59:26.201589Z","end":"2026-05-25T05:59:26.410475Z","steps":["trace[1537780381] 'read index received' (duration: 37.821µs)","trace[1537780381] 'applied index is now lower than readState.Index' (duration: 208.84652ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T05:59:26.410596Z","caller":"traceutil/trace.go:171","msg":"trace[1664733305] transaction","detail":"{read_only:false; response_revision:411; number_of_response:1; }","duration":"326.117155ms","start":"2026-05-25T05:59:26.084459Z","end":"2026-05-25T05:59:26.410576Z","steps":["trace[1664733305] 'process raft request' (duration: 106.832349ms)","trace[1664733305] 'compare' (duration: 218.834268ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T05:59:26.410718Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-25T05:59:26.084444Z","time spent":"326.223797ms","remote":"127.0.0.1:57806","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-25T05:59:26.410791Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.217197ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-scheduler-instance\" ","response":"range_response_count:1 size:4325"} {"level":"info","ts":"2026-05-25T05:59:26.41089Z","caller":"traceutil/trace.go:171","msg":"trace[2037649198] range","detail":"{range_begin:/registry/pods/kube-system/kube-scheduler-instance; range_end:; response_count:1; response_revision:411; }","duration":"193.35906ms","start":"2026-05-25T05:59:26.217507Z","end":"2026-05-25T05:59:26.410866Z","steps":["trace[2037649198] 'agreement among raft nodes before linearized reading' (duration: 193.206277ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T05:59:26.41108Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"209.488752ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:477"} {"level":"info","ts":"2026-05-25T05:59:26.411119Z","caller":"traceutil/trace.go:171","msg":"trace[567242851] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:411; }","duration":"209.551092ms","start":"2026-05-25T05:59:26.201559Z","end":"2026-05-25T05:59:26.411111Z","steps":["trace[567242851] 'agreement among raft nodes before linearized reading' (duration: 209.484011ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T05:59:53.941397Z","caller":"traceutil/trace.go:171","msg":"trace[102796824] transaction","detail":"{read_only:false; response_revision:625; number_of_response:1; }","duration":"221.247548ms","start":"2026-05-25T05:59:53.720104Z","end":"2026-05-25T05:59:53.941351Z","steps":["trace[102796824] 'process raft request' (duration: 219.133328ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T05:59:54.459632Z","caller":"traceutil/trace.go:171","msg":"trace[2118921060] transaction","detail":"{read_only:false; response_revision:631; number_of_response:1; }","duration":"157.703779ms","start":"2026-05-25T05:59:54.301895Z","end":"2026-05-25T05:59:54.459599Z","steps":["trace[2118921060] 'process raft request' (duration: 134.871182ms)","trace[2118921060] 'compare' (duration: 22.612803ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T05:59:54.523929Z","caller":"traceutil/trace.go:171","msg":"trace[49001358] transaction","detail":"{read_only:false; response_revision:632; number_of_response:1; }","duration":"110.367294ms","start":"2026-05-25T05:59:54.413527Z","end":"2026-05-25T05:59:54.523894Z","steps":["trace[49001358] 'process raft request' (duration: 109.561969ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T05:59:54.832625Z","caller":"traceutil/trace.go:171","msg":"trace[508286411] linearizableReadLoop","detail":"{readStateIndex:656; appliedIndex:655; }","duration":"221.675215ms","start":"2026-05-25T05:59:54.610915Z","end":"2026-05-25T05:59:54.83259Z","steps":["trace[508286411] 'read index received' (duration: 217.744102ms)","trace[508286411] 'applied index is now lower than readState.Index' (duration: 3.929733ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T05:59:54.832684Z","caller":"traceutil/trace.go:171","msg":"trace[1112776998] transaction","detail":"{read_only:false; response_revision:633; number_of_response:1; }","duration":"239.589332ms","start":"2026-05-25T05:59:54.593063Z","end":"2026-05-25T05:59:54.832652Z","steps":["trace[1112776998] 'process raft request' (duration: 235.653818ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T05:59:54.833096Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"222.165745ms","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-05-25T05:59:54.833187Z","caller":"traceutil/trace.go:171","msg":"trace[740594447] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:633; }","duration":"222.284767ms","start":"2026-05-25T05:59:54.61088Z","end":"2026-05-25T05:59:54.833165Z","steps":["trace[740594447] 'agreement among raft nodes before linearized reading' (duration: 221.928671ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T05:59:54.833327Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.398468ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-05-25T05:59:54.833463Z","caller":"traceutil/trace.go:171","msg":"trace[2091469308] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:633; }","duration":"208.572501ms","start":"2026-05-25T05:59:54.624839Z","end":"2026-05-25T05:59:54.833412Z","steps":["trace[2091469308] 'agreement among raft nodes before linearized reading' (duration: 208.323266ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T05:59:54.993133Z","caller":"traceutil/trace.go:171","msg":"trace[1056782528] transaction","detail":"{read_only:false; response_revision:634; number_of_response:1; }","duration":"154.727823ms","start":"2026-05-25T05:59:54.838372Z","end":"2026-05-25T05:59:54.9931Z","steps":["trace[1056782528] 'process raft request' (duration: 135.157737ms)","trace[1056782528] 'compare' (duration: 19.342801ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T05:59:54.993332Z","caller":"traceutil/trace.go:171","msg":"trace[291860431] transaction","detail":"{read_only:false; response_revision:635; number_of_response:1; }","duration":"154.57486ms","start":"2026-05-25T05:59:54.838743Z","end":"2026-05-25T05:59:54.993318Z","steps":["trace[291860431] 'process raft request' (duration: 154.300086ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T05:59:54.993313Z","caller":"traceutil/trace.go:171","msg":"trace[794159449] linearizableReadLoop","detail":"{readStateIndex:658; appliedIndex:656; }","duration":"149.389803ms","start":"2026-05-25T05:59:54.843887Z","end":"2026-05-25T05:59:54.993277Z","steps":["trace[794159449] 'read index received' (duration: 129.750736ms)","trace[794159449] 'applied index is now lower than readState.Index' (duration: 19.636987ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T05:59:54.993431Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.523855ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-25T05:59:54.993487Z","caller":"traceutil/trace.go:171","msg":"trace[1351204941] range","detail":"{range_begin:/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:635; }","duration":"149.626707ms","start":"2026-05-25T05:59:54.843847Z","end":"2026-05-25T05:59:54.993473Z","steps":["trace[1351204941] 'agreement among raft nodes before linearized reading' (duration: 149.524935ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:00:49.402208Z","caller":"traceutil/trace.go:171","msg":"trace[1335341449] transaction","detail":"{read_only:false; response_revision:1227; number_of_response:1; }","duration":"115.131772ms","start":"2026-05-25T06:00:49.287053Z","end":"2026-05-25T06:00:49.402185Z","steps":["trace[1335341449] 'process raft request' (duration: 114.963759ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:00:49.403281Z","caller":"traceutil/trace.go:171","msg":"trace[1815204439] transaction","detail":"{read_only:false; response_revision:1228; number_of_response:1; }","duration":"114.40652ms","start":"2026-05-25T06:00:49.288845Z","end":"2026-05-25T06:00:49.403251Z","steps":["trace[1815204439] 'process raft request' (duration: 114.218166ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:01:35.105354Z","caller":"traceutil/trace.go:171","msg":"trace[2089057425] transaction","detail":"{read_only:false; response_revision:1898; number_of_response:1; }","duration":"264.911054ms","start":"2026-05-25T06:01:34.840416Z","end":"2026-05-25T06:01:35.105327Z","steps":["trace[2089057425] 'process raft request' (duration: 264.745611ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:01:35.107139Z","caller":"traceutil/trace.go:171","msg":"trace[354688045] transaction","detail":"{read_only:false; response_revision:1899; number_of_response:1; }","duration":"235.514484ms","start":"2026-05-25T06:01:34.871595Z","end":"2026-05-25T06:01:35.107109Z","steps":["trace[354688045] 'process raft request' (duration: 235.154108ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:01:35.107447Z","caller":"traceutil/trace.go:171","msg":"trace[475470571] transaction","detail":"{read_only:false; response_revision:1900; number_of_response:1; }","duration":"235.255809ms","start":"2026-05-25T06:01:34.872143Z","end":"2026-05-25T06:01:35.107399Z","steps":["trace[475470571] 'process raft request' (duration: 234.893632ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:01:35.107461Z","caller":"traceutil/trace.go:171","msg":"trace[1895635280] transaction","detail":"{read_only:false; response_revision:1901; number_of_response:1; }","duration":"225.10569ms","start":"2026-05-25T06:01:34.88234Z","end":"2026-05-25T06:01:35.107445Z","steps":["trace[1895635280] 'process raft request' (duration: 224.955377ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:03:17.300718Z","caller":"traceutil/trace.go:171","msg":"trace[123157306] transaction","detail":"{read_only:false; response_revision:2674; number_of_response:1; }","duration":"143.434194ms","start":"2026-05-25T06:03:17.157243Z","end":"2026-05-25T06:03:17.300678Z","steps":["trace[123157306] 'process raft request' (duration: 143.089378ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:07:42.653169Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"194.984946ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-05-25T06:07:42.653948Z","caller":"traceutil/trace.go:171","msg":"trace[300751500] transaction","detail":"{read_only:false; response_revision:5017; number_of_response:1; }","duration":"115.161077ms","start":"2026-05-25T06:07:42.538753Z","end":"2026-05-25T06:07:42.653914Z","steps":["trace[300751500] 'process raft request' (duration: 115.098486ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:42.654435Z","caller":"traceutil/trace.go:171","msg":"trace[925955066] transaction","detail":"{read_only:false; response_revision:5014; number_of_response:1; }","duration":"324.865412ms","start":"2026-05-25T06:07:42.329526Z","end":"2026-05-25T06:07:42.654391Z","steps":["trace[925955066] 'process raft request' (duration: 128.586451ms)","trace[925955066] 'compare' (duration: 194.820114ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:07:42.654525Z","caller":"traceutil/trace.go:171","msg":"trace[1697339950] linearizableReadLoop","detail":"{readStateIndex:5204; appliedIndex:5203; }","duration":"310.874927ms","start":"2026-05-25T06:07:42.343638Z","end":"2026-05-25T06:07:42.654513Z","steps":["trace[1697339950] 'read index received' (duration: 114.420263ms)","trace[1697339950] 'applied index is now lower than readState.Index' (duration: 196.453014ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:07:42.654647Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-25T06:07:42.329501Z","time spent":"325.025665ms","remote":"127.0.0.1:46872","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2571,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-25T06:07:42.654893Z","caller":"traceutil/trace.go:171","msg":"trace[1483271594] transaction","detail":"{read_only:false; response_revision:5016; number_of_response:1; }","duration":"119.615462ms","start":"2026-05-25T06:07:42.535261Z","end":"2026-05-25T06:07:42.654877Z","steps":["trace[1483271594] 'process raft request' (duration: 118.539501ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:07:42.655022Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"311.357717ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/monitoring/prometheus-kube-prometheus-stack-prometheus-db-prometheus-kube-prometheus-stack-prometheus-0\" ","response":"range_response_count:1 size:2082"} {"level":"info","ts":"2026-05-25T06:07:42.655083Z","caller":"traceutil/trace.go:171","msg":"trace[935384683] range","detail":"{range_begin:/registry/persistentvolumeclaims/monitoring/prometheus-kube-prometheus-stack-prometheus-db-prometheus-kube-prometheus-stack-prometheus-0; range_end:; response_count:1; response_revision:5017; }","duration":"311.466289ms","start":"2026-05-25T06:07:42.343598Z","end":"2026-05-25T06:07:42.655064Z","steps":["trace[935384683] 'agreement among raft nodes before linearized reading' (duration: 311.280786ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:42.654474Z","caller":"traceutil/trace.go:171","msg":"trace[760360573] transaction","detail":"{read_only:false; response_revision:5015; number_of_response:1; }","duration":"194.534678ms","start":"2026-05-25T06:07:42.459916Z","end":"2026-05-25T06:07:42.654451Z","steps":["trace[760360573] 'process raft request' (duration: 193.650742ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:07:42.655127Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-25T06:07:42.343578Z","time spent":"311.53957ms","remote":"127.0.0.1:57692","response type":"/etcdserverpb.KV/Range","request count":0,"request size":139,"response count":1,"response size":2105,"request content":"key:\"/registry/persistentvolumeclaims/monitoring/prometheus-kube-prometheus-stack-prometheus-db-prometheus-kube-prometheus-stack-prometheus-0\" "} {"level":"warn","ts":"2026-05-25T06:07:42.655397Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.618579ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/monitoring/kube-prometheus-stack-prometheus\" ","response":"range_response_count:1 size:1219"} {"level":"info","ts":"2026-05-25T06:07:42.6555Z","caller":"traceutil/trace.go:171","msg":"trace[128237849] range","detail":"{range_begin:/registry/serviceaccounts/monitoring/kube-prometheus-stack-prometheus; range_end:; response_count:1; response_revision:5017; }","duration":"204.758151ms","start":"2026-05-25T06:07:42.450714Z","end":"2026-05-25T06:07:42.655472Z","steps":["trace[128237849] 'agreement among raft nodes before linearized reading' (duration: 204.461485ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:07:42.655617Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.467815ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/\" range_end:\"/registry/events0\" count_only:true ","response":"range_response_count:0 size:8"} {"level":"info","ts":"2026-05-25T06:07:42.655692Z","caller":"traceutil/trace.go:171","msg":"trace[1544993678] range","detail":"{range_begin:/registry/events/; range_end:/registry/events0; response_count:0; response_revision:5017; }","duration":"132.576506ms","start":"2026-05-25T06:07:42.523099Z","end":"2026-05-25T06:07:42.655675Z","steps":["trace[1544993678] 'agreement among raft nodes before linearized reading' (duration: 132.171489ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:44.783357Z","caller":"traceutil/trace.go:171","msg":"trace[1971064494] transaction","detail":"{read_only:false; response_revision:5061; number_of_response:1; }","duration":"122.11396ms","start":"2026-05-25T06:07:44.661227Z","end":"2026-05-25T06:07:44.783341Z","steps":["trace[1971064494] 'process raft request' (duration: 121.983407ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:44.783551Z","caller":"traceutil/trace.go:171","msg":"trace[437366381] transaction","detail":"{read_only:false; response_revision:5062; number_of_response:1; }","duration":"120.907637ms","start":"2026-05-25T06:07:44.662637Z","end":"2026-05-25T06:07:44.783544Z","steps":["trace[437366381] 'process raft request' (duration: 120.675132ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:50.918697Z","caller":"traceutil/trace.go:171","msg":"trace[857618704] transaction","detail":"{read_only:false; response_revision:5193; number_of_response:1; }","duration":"117.39422ms","start":"2026-05-25T06:07:50.801279Z","end":"2026-05-25T06:07:50.918673Z","steps":["trace[857618704] 'process raft request' (duration: 61.267599ms)","trace[857618704] 'compare' (duration: 55.729353ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:07:50.91876Z","caller":"traceutil/trace.go:171","msg":"trace[1912143904] transaction","detail":"{read_only:false; response_revision:5194; number_of_response:1; }","duration":"117.272887ms","start":"2026-05-25T06:07:50.801465Z","end":"2026-05-25T06:07:50.918738Z","steps":["trace[1912143904] 'process raft request' (duration: 116.978472ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:51.241921Z","caller":"traceutil/trace.go:171","msg":"trace[2009125720] linearizableReadLoop","detail":"{readStateIndex:5401; appliedIndex:5400; }","duration":"100.9516ms","start":"2026-05-25T06:07:51.140942Z","end":"2026-05-25T06:07:51.241893Z","steps":["trace[2009125720] 'read index received' (duration: 95.468376ms)","trace[2009125720] 'applied index is now lower than readState.Index' (duration: 5.482054ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:07:51.242046Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.095202ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus-tls-assets-1\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-25T06:07:51.242119Z","caller":"traceutil/trace.go:171","msg":"trace[1784304422] range","detail":"{range_begin:/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus-tls-assets-1; range_end:; response_count:0; response_revision:5204; }","duration":"101.146683ms","start":"2026-05-25T06:07:51.140923Z","end":"2026-05-25T06:07:51.24207Z","steps":["trace[1784304422] 'agreement among raft nodes before linearized reading' (duration: 101.067431ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:51.242247Z","caller":"traceutil/trace.go:171","msg":"trace[735429348] transaction","detail":"{read_only:false; response_revision:5204; number_of_response:1; }","duration":"102.727523ms","start":"2026-05-25T06:07:51.139505Z","end":"2026-05-25T06:07:51.242232Z","steps":["trace[735429348] 'process raft request' (duration: 96.985264ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:56.272552Z","caller":"traceutil/trace.go:171","msg":"trace[1182514081] transaction","detail":"{read_only:false; response_revision:5282; number_of_response:1; }","duration":"130.290443ms","start":"2026-05-25T06:07:56.142237Z","end":"2026-05-25T06:07:56.272528Z","steps":["trace[1182514081] 'process raft request' (duration: 130.101999ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:07:56.465512Z","caller":"traceutil/trace.go:171","msg":"trace[1233942542] transaction","detail":"{read_only:false; response_revision:5283; number_of_response:1; }","duration":"191.304376ms","start":"2026-05-25T06:07:56.274163Z","end":"2026-05-25T06:07:56.465467Z","steps":["trace[1233942542] 'process raft request' (duration: 104.511186ms)","trace[1233942542] 'compare' (duration: 86.511055ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:08:01.087307Z","caller":"traceutil/trace.go:171","msg":"trace[615375398] transaction","detail":"{read_only:false; response_revision:5364; number_of_response:1; }","duration":"137.262415ms","start":"2026-05-25T06:08:00.950016Z","end":"2026-05-25T06:08:01.087278Z","steps":["trace[615375398] 'process raft request' (duration: 97.058196ms)","trace[615375398] 'compare' (duration: 40.011166ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:08:04.493741Z","caller":"traceutil/trace.go:171","msg":"trace[584479533] transaction","detail":"{read_only:false; response_revision:5482; number_of_response:1; }","duration":"129.381336ms","start":"2026-05-25T06:08:04.36431Z","end":"2026-05-25T06:08:04.493692Z","steps":["trace[584479533] 'process raft request' (duration: 129.158512ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:08:04.547463Z","caller":"traceutil/trace.go:171","msg":"trace[227200373] transaction","detail":"{read_only:false; response_revision:5483; number_of_response:1; }","duration":"102.625461ms","start":"2026-05-25T06:08:04.444815Z","end":"2026-05-25T06:08:04.547441Z","steps":["trace[227200373] 'process raft request' (duration: 102.515978ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:09:12.570569Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":3001} {"level":"info","ts":"2026-05-25T06:09:12.650978Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":3001,"took":"78.97288ms","hash":2498969282,"current-db-size-bytes":57569280,"current-db-size":"58 MB","current-db-size-in-use-bytes":31789056,"current-db-size-in-use":"32 MB"} {"level":"info","ts":"2026-05-25T06:09:12.651047Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2498969282,"revision":3001,"compact-revision":-1} {"level":"info","ts":"2026-05-25T06:14:11.047642Z","caller":"traceutil/trace.go:171","msg":"trace[1010955575] linearizableReadLoop","detail":"{readStateIndex:8577; appliedIndex:8576; }","duration":"140.649625ms","start":"2026-05-25T06:14:10.906963Z","end":"2026-05-25T06:14:11.047612Z","steps":["trace[1010955575] 'read index received' (duration: 140.46582ms)","trace[1010955575] 'applied index is now lower than readState.Index' (duration: 182.675µs)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:14:11.047712Z","caller":"traceutil/trace.go:171","msg":"trace[122058248] transaction","detail":"{read_only:false; response_revision:8289; number_of_response:1; }","duration":"236.195448ms","start":"2026-05-25T06:14:10.81148Z","end":"2026-05-25T06:14:11.047675Z","steps":["trace[122058248] 'process raft request' (duration: 235.960263ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:14:11.047878Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.890159ms","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-05-25T06:14:11.047956Z","caller":"traceutil/trace.go:171","msg":"trace[1361930818] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:8289; }","duration":"141.027902ms","start":"2026-05-25T06:14:10.906916Z","end":"2026-05-25T06:14:11.047944Z","steps":["trace[1361930818] 'agreement among raft nodes before linearized reading' (duration: 140.818558ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:14:11.165185Z","caller":"traceutil/trace.go:171","msg":"trace[1225940010] transaction","detail":"{read_only:false; response_revision:8290; number_of_response:1; }","duration":"112.629365ms","start":"2026-05-25T06:14:11.05253Z","end":"2026-05-25T06:14:11.165159Z","steps":["trace[1225940010] 'process raft request' (duration: 112.504453ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:14:12.576195Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":6093} {"level":"info","ts":"2026-05-25T06:14:12.670259Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":6093,"took":"92.094258ms","hash":498829048,"current-db-size-bytes":57569280,"current-db-size":"58 MB","current-db-size-in-use-bytes":23470080,"current-db-size-in-use":"24 MB"} {"level":"info","ts":"2026-05-25T06:14:12.670343Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":498829048,"revision":6093,"compact-revision":3001} {"level":"info","ts":"2026-05-25T06:14:22.648536Z","caller":"traceutil/trace.go:171","msg":"trace[1972719127] transaction","detail":"{read_only:false; response_revision:8349; number_of_response:1; }","duration":"276.023629ms","start":"2026-05-25T06:14:22.372487Z","end":"2026-05-25T06:14:22.64851Z","steps":["trace[1972719127] 'process raft request' (duration: 275.859776ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:14:22.654352Z","caller":"traceutil/trace.go:171","msg":"trace[1742283290] transaction","detail":"{read_only:false; response_revision:8350; number_of_response:1; }","duration":"278.421355ms","start":"2026-05-25T06:14:22.375891Z","end":"2026-05-25T06:14:22.654313Z","steps":["trace[1742283290] 'process raft request' (duration: 278.283752ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:14:22.654633Z","caller":"traceutil/trace.go:171","msg":"trace[483669528] transaction","detail":"{read_only:false; response_revision:8351; number_of_response:1; }","duration":"179.074068ms","start":"2026-05-25T06:14:22.475538Z","end":"2026-05-25T06:14:22.654612Z","steps":["trace[483669528] 'process raft request' (duration: 178.745622ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:14:23.498173Z","caller":"traceutil/trace.go:171","msg":"trace[1296323030] linearizableReadLoop","detail":"{readStateIndex:8647; appliedIndex:8646; }","duration":"244.175688ms","start":"2026-05-25T06:14:23.253977Z","end":"2026-05-25T06:14:23.498153Z","steps":["trace[1296323030] 'read index received' (duration: 244.064186ms)","trace[1296323030] 'applied index is now lower than readState.Index' (duration: 109.972µs)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:14:23.498252Z","caller":"traceutil/trace.go:171","msg":"trace[1041110756] transaction","detail":"{read_only:false; response_revision:8354; number_of_response:1; }","duration":"256.793865ms","start":"2026-05-25T06:14:23.241407Z","end":"2026-05-25T06:14:23.4982Z","steps":["trace[1041110756] 'process raft request' (duration: 256.620212ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:14:23.498342Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.34071ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/\" range_end:\"/registry/jobs0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-25T06:14:23.498433Z","caller":"traceutil/trace.go:171","msg":"trace[223026170] range","detail":"{range_begin:/registry/jobs/; range_end:/registry/jobs0; response_count:0; response_revision:8354; }","duration":"244.473013ms","start":"2026-05-25T06:14:23.253942Z","end":"2026-05-25T06:14:23.498415Z","steps":["trace[223026170] 'agreement among raft nodes before linearized reading' (duration: 244.28522ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:14:51.295063Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.227521ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-05-25T06:14:51.295152Z","caller":"traceutil/trace.go:171","msg":"trace[1127140934] linearizableReadLoop","detail":"{readStateIndex:8856; appliedIndex:8855; }","duration":"246.97697ms","start":"2026-05-25T06:14:51.048159Z","end":"2026-05-25T06:14:51.295136Z","steps":["trace[1127140934] 'read index received' (duration: 101.628557ms)","trace[1127140934] 'applied index is now lower than readState.Index' (duration: 145.347043ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:14:51.29527Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"247.110983ms","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-05-25T06:14:51.295303Z","caller":"traceutil/trace.go:171","msg":"trace[332812252] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:8555; }","duration":"247.202245ms","start":"2026-05-25T06:14:51.048091Z","end":"2026-05-25T06:14:51.295293Z","steps":["trace[332812252] 'agreement among raft nodes before linearized reading' (duration: 247.134254ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:14:54.57104Z","caller":"traceutil/trace.go:171","msg":"trace[755286786] transaction","detail":"{read_only:false; response_revision:8574; number_of_response:1; }","duration":"169.727564ms","start":"2026-05-25T06:14:54.401285Z","end":"2026-05-25T06:14:54.571013Z","steps":["trace[755286786] 'process raft request' (duration: 169.50256ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:15:03.912923Z","caller":"traceutil/trace.go:171","msg":"trace[1655004093] transaction","detail":"{read_only:false; response_revision:8668; number_of_response:1; }","duration":"195.203834ms","start":"2026-05-25T06:15:03.717691Z","end":"2026-05-25T06:15:03.912895Z","steps":["trace[1655004093] 'process raft request' (duration: 195.093772ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:15:03.913007Z","caller":"traceutil/trace.go:171","msg":"trace[1951049703] transaction","detail":"{read_only:false; response_revision:8667; number_of_response:1; }","duration":"195.626042ms","start":"2026-05-25T06:15:03.717324Z","end":"2026-05-25T06:15:03.91295Z","steps":["trace[1951049703] 'process raft request' (duration: 176.496461ms)","trace[1951049703] 'compare' (duration: 18.805495ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:15:03.9131Z","caller":"traceutil/trace.go:171","msg":"trace[573595130] linearizableReadLoop","detail":"{readStateIndex:8975; appliedIndex:8971; }","duration":"151.890117ms","start":"2026-05-25T06:15:03.761189Z","end":"2026-05-25T06:15:03.913079Z","steps":["trace[573595130] 'read index received' (duration: 25.163775ms)","trace[573595130] 'applied index is now lower than readState.Index' (duration: 126.725472ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:15:03.913264Z","caller":"traceutil/trace.go:171","msg":"trace[1085297933] transaction","detail":"{read_only:false; response_revision:8669; number_of_response:1; }","duration":"195.391027ms","start":"2026-05-25T06:15:03.717846Z","end":"2026-05-25T06:15:03.913237Z","steps":["trace[1085297933] 'process raft request' (duration: 194.98861ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:15:03.913286Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"152.080091ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-4bj4h\" ","response":"range_response_count:1 size:6524"} {"level":"info","ts":"2026-05-25T06:15:03.913325Z","caller":"traceutil/trace.go:171","msg":"trace[1181148334] range","detail":"{range_begin:/registry/pods/openstack/keepalived-4bj4h; range_end:; response_count:1; response_revision:8669; }","duration":"152.168612ms","start":"2026-05-25T06:15:03.761146Z","end":"2026-05-25T06:15:03.913315Z","steps":["trace[1181148334] 'agreement among raft nodes before linearized reading' (duration: 152.019619ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:15:04.962209Z","caller":"traceutil/trace.go:171","msg":"trace[167052162] transaction","detail":"{read_only:false; response_revision:8677; number_of_response:1; }","duration":"108.481946ms","start":"2026-05-25T06:15:04.853688Z","end":"2026-05-25T06:15:04.96217Z","steps":["trace[167052162] 'process raft request' (duration: 91.416704ms)","trace[167052162] 'compare' (duration: 16.831528ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:15:28.443935Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-0000000000002434.wal"} {"level":"info","ts":"2026-05-25T06:16:08.21003Z","caller":"traceutil/trace.go:171","msg":"trace[378193883] linearizableReadLoop","detail":"{readStateIndex:9673; appliedIndex:9672; }","duration":"102.474906ms","start":"2026-05-25T06:16:08.107524Z","end":"2026-05-25T06:16:08.209999Z","steps":["trace[378193883] 'read index received' (duration: 14.566705ms)","trace[378193883] 'applied index is now lower than readState.Index' (duration: 87.907161ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:16:08.210201Z","caller":"traceutil/trace.go:171","msg":"trace[2043503268] transaction","detail":"{read_only:false; response_revision:9349; number_of_response:1; }","duration":"108.628151ms","start":"2026-05-25T06:16:08.101539Z","end":"2026-05-25T06:16:08.210167Z","steps":["trace[2043503268] 'process raft request' (duration: 20.633969ms)","trace[2043503268] 'compare' (duration: 87.699286ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:16:08.210259Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.71508ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/runtimeclasses/\" range_end:\"/registry/runtimeclasses0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-25T06:16:08.210346Z","caller":"traceutil/trace.go:171","msg":"trace[65524120] range","detail":"{range_begin:/registry/runtimeclasses/; range_end:/registry/runtimeclasses0; response_count:0; response_revision:9349; }","duration":"102.851432ms","start":"2026-05-25T06:16:08.107477Z","end":"2026-05-25T06:16:08.210328Z","steps":["trace[65524120] 'agreement among raft nodes before linearized reading' (duration: 102.684819ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:16:54.356115Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"56c01ea8fdc90390","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-05-25T06:16:54.362129Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001} {"level":"info","ts":"2026-05-25T06:16:54.362224Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001} {"level":"info","ts":"2026-05-25T06:19:12.580808Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":8298} {"level":"info","ts":"2026-05-25T06:19:12.666952Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":8298,"took":"83.958248ms","hash":1950269628,"current-db-size-bytes":57569280,"current-db-size":"58 MB","current-db-size-in-use-bytes":26595328,"current-db-size-in-use":"27 MB"} {"level":"info","ts":"2026-05-25T06:19:12.667038Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1950269628,"revision":8298,"compact-revision":6093} {"level":"info","ts":"2026-05-25T06:19:45.591588Z","caller":"traceutil/trace.go:171","msg":"trace[287083365] transaction","detail":"{read_only:false; response_revision:11163; number_of_response:1; }","duration":"113.69869ms","start":"2026-05-25T06:19:45.477862Z","end":"2026-05-25T06:19:45.591561Z","steps":["trace[287083365] 'process raft request' (duration: 81.642294ms)","trace[287083365] 'compare' (duration: 31.935244ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:19:45.591583Z","caller":"traceutil/trace.go:171","msg":"trace[502554640] linearizableReadLoop","detail":"{readStateIndex:11544; appliedIndex:11543; }","duration":"110.936637ms","start":"2026-05-25T06:19:45.480618Z","end":"2026-05-25T06:19:45.591554Z","steps":["trace[502554640] 'read index received' (duration: 78.83144ms)","trace[502554640] 'applied index is now lower than readState.Index' (duration: 32.104227ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:19:45.592126Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.490808ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/\" range_end:\"/registry/deployments/openstack0\" ","response":"range_response_count:15 size:143760"} {"level":"info","ts":"2026-05-25T06:19:45.592255Z","caller":"traceutil/trace.go:171","msg":"trace[1130288562] range","detail":"{range_begin:/registry/deployments/openstack/; range_end:/registry/deployments/openstack0; response_count:15; response_revision:11163; }","duration":"111.619621ms","start":"2026-05-25T06:19:45.480572Z","end":"2026-05-25T06:19:45.592192Z","steps":["trace[1130288562] 'agreement among raft nodes before linearized reading' (duration: 111.066511ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:20:01.902906Z","caller":"traceutil/trace.go:171","msg":"trace[1066996692] transaction","detail":"{read_only:false; response_revision:11255; number_of_response:1; }","duration":"123.234ms","start":"2026-05-25T06:20:01.779642Z","end":"2026-05-25T06:20:01.902876Z","steps":["trace[1066996692] 'process raft request' (duration: 89.043033ms)","trace[1066996692] 'compare' (duration: 33.995173ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:20:02.216908Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.516591ms","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-05-25T06:20:02.216989Z","caller":"traceutil/trace.go:171","msg":"trace[892078602] range","detail":"{range_begin:/registry/jobs/openstack/cinder-ks-user; range_end:; response_count:0; response_revision:11257; }","duration":"173.663674ms","start":"2026-05-25T06:20:02.043307Z","end":"2026-05-25T06:20:02.21697Z","steps":["trace[892078602] 'range keys from in-memory index tree' (duration: 173.40534ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:20:02.217004Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.582163ms","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-05-25T06:20:02.217052Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.333758ms","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-05-25T06:20:02.217108Z","caller":"traceutil/trace.go:171","msg":"trace[874841834] range","detail":"{range_begin:/registry/jobs/openstack/cinder-storage-init; range_end:; response_count:0; response_revision:11257; }","duration":"173.726525ms","start":"2026-05-25T06:20:02.043354Z","end":"2026-05-25T06:20:02.21708Z","steps":["trace[874841834] 'range keys from in-memory index tree' (duration: 173.492851ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:20:02.217119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.739009ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-db-sync\" ","response":"range_response_count:1 size:5077"} {"level":"info","ts":"2026-05-25T06:20:02.217137Z","caller":"traceutil/trace.go:171","msg":"trace[169790833] range","detail":"{range_begin:/registry/jobs/openstack/cinder-ks-endpoints; range_end:; response_count:0; response_revision:11257; }","duration":"173.458341ms","start":"2026-05-25T06:20:02.043626Z","end":"2026-05-25T06:20:02.217116Z","steps":["trace[169790833] 'range keys from in-memory index tree' (duration: 173.244227ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:20:02.217101Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.45957ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12215"} {"level":"info","ts":"2026-05-25T06:20:02.217174Z","caller":"traceutil/trace.go:171","msg":"trace[1634310949] range","detail":"{range_begin:/registry/jobs/openstack/cinder-db-sync; range_end:; response_count:1; response_revision:11257; }","duration":"171.81394ms","start":"2026-05-25T06:20:02.045344Z","end":"2026-05-25T06:20:02.217157Z","steps":["trace[1634310949] 'range keys from in-memory index tree' (duration: 171.570345ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:20:02.2172Z","caller":"traceutil/trace.go:171","msg":"trace[1357577785] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:11257; }","duration":"182.588613ms","start":"2026-05-25T06:20:02.03459Z","end":"2026-05-25T06:20:02.217179Z","steps":["trace[1357577785] 'range keys from in-memory index tree' (duration: 182.224766ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:20:02.21731Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.958219ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/openstack/cinder-api\" ","response":"range_response_count:1 size:667"} {"level":"info","ts":"2026-05-25T06:20:02.21735Z","caller":"traceutil/trace.go:171","msg":"trace[73596210] range","detail":"{range_begin:/registry/services/endpoints/openstack/cinder-api; range_end:; response_count:1; response_revision:11257; }","duration":"174.037961ms","start":"2026-05-25T06:20:02.043302Z","end":"2026-05-25T06:20:02.21734Z","steps":["trace[73596210] 'range keys from in-memory index tree' (duration: 173.790007ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:20:02.217519Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.994368ms","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-05-25T06:20:02.217564Z","caller":"traceutil/trace.go:171","msg":"trace[1070546934] range","detail":"{range_begin:/registry/rabbitmq.com/schemareplications/; range_end:/registry/rabbitmq.com/schemareplications0; response_count:0; response_revision:11257; }","duration":"149.055439ms","start":"2026-05-25T06:20:02.068494Z","end":"2026-05-25T06:20:02.21755Z","steps":["trace[1070546934] 'count revisions from in-memory index tree' (duration: 148.956517ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:20:02.216882Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.37853ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/cinder-rabbit-init\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-25T06:20:02.217942Z","caller":"traceutil/trace.go:171","msg":"trace[539351581] range","detail":"{range_begin:/registry/jobs/openstack/cinder-rabbit-init; range_end:; response_count:0; response_revision:11257; }","duration":"173.473291ms","start":"2026-05-25T06:20:02.044435Z","end":"2026-05-25T06:20:02.217908Z","steps":["trace[539351581] 'range keys from in-memory index tree' (duration: 172.307578ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:24:12.587288Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":10787} {"level":"info","ts":"2026-05-25T06:24:12.666078Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":10787,"took":"76.301024ms","hash":1135755668,"current-db-size-bytes":57569280,"current-db-size":"58 MB","current-db-size-in-use-bytes":27639808,"current-db-size-in-use":"28 MB"} {"level":"info","ts":"2026-05-25T06:24:12.666136Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1135755668,"revision":10787,"compact-revision":8298} {"level":"info","ts":"2026-05-25T06:26:00.612775Z","caller":"traceutil/trace.go:171","msg":"trace[1648850814] transaction","detail":"{read_only:false; response_revision:13694; number_of_response:1; }","duration":"118.331027ms","start":"2026-05-25T06:26:00.494423Z","end":"2026-05-25T06:26:00.612754Z","steps":["trace[1648850814] 'process raft request' (duration: 118.217434ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:26:35.070182Z","caller":"traceutil/trace.go:171","msg":"trace[2144038085] linearizableReadLoop","detail":"{readStateIndex:14362; appliedIndex:14361; }","duration":"271.546802ms","start":"2026-05-25T06:26:34.798615Z","end":"2026-05-25T06:26:35.070162Z","steps":["trace[2144038085] 'read index received' (duration: 271.406959ms)","trace[2144038085] 'applied index is now lower than readState.Index' (duration: 139.103µs)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:26:35.070213Z","caller":"traceutil/trace.go:171","msg":"trace[702597268] transaction","detail":"{read_only:false; response_revision:13884; number_of_response:1; }","duration":"282.099482ms","start":"2026-05-25T06:26:34.788078Z","end":"2026-05-25T06:26:35.070177Z","steps":["trace[702597268] 'process raft request' (duration: 281.94884ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:26:35.070442Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.701898ms","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-05-25T06:26:35.070463Z","caller":"traceutil/trace.go:171","msg":"trace[895871388] range","detail":"{range_begin:/registry/roles/; range_end:/registry/roles0; response_count:0; response_revision:13884; }","duration":"179.782479ms","start":"2026-05-25T06:26:34.890672Z","end":"2026-05-25T06:26:35.070455Z","steps":["trace[895871388] 'agreement among raft nodes before linearized reading' (duration: 179.668867ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:26:35.070601Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"238.643411ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/openvswitch-qxtjk\" ","response":"range_response_count:1 size:12364"} {"level":"warn","ts":"2026-05-25T06:26:35.070659Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"272.029321ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-25T06:26:35.070692Z","caller":"traceutil/trace.go:171","msg":"trace[536666632] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:13884; }","duration":"272.125242ms","start":"2026-05-25T06:26:34.798559Z","end":"2026-05-25T06:26:35.070684Z","steps":["trace[536666632] 'agreement among raft nodes before linearized reading' (duration: 271.720485ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:26:35.070697Z","caller":"traceutil/trace.go:171","msg":"trace[970835267] range","detail":"{range_begin:/registry/pods/openstack/openvswitch-qxtjk; range_end:; response_count:1; response_revision:13884; }","duration":"238.796144ms","start":"2026-05-25T06:26:34.831878Z","end":"2026-05-25T06:26:35.070674Z","steps":["trace[970835267] 'agreement among raft nodes before linearized reading' (duration: 238.451898ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:26:43.943933Z","caller":"traceutil/trace.go:171","msg":"trace[1792482546] transaction","detail":"{read_only:false; response_revision:14053; number_of_response:1; }","duration":"131.321971ms","start":"2026-05-25T06:26:43.812586Z","end":"2026-05-25T06:26:43.943908Z","steps":["trace[1792482546] 'process raft request' (duration: 131.21811ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:26:44.242365Z","caller":"traceutil/trace.go:171","msg":"trace[1407553815] transaction","detail":"{read_only:false; response_revision:14054; number_of_response:1; }","duration":"267.040307ms","start":"2026-05-25T06:26:43.975284Z","end":"2026-05-25T06:26:44.242324Z","steps":["trace[1407553815] 'process raft request' (duration: 266.794032ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:27:49.515535Z","caller":"traceutil/trace.go:171","msg":"trace[86942818] transaction","detail":"{read_only:false; response_revision:14955; number_of_response:1; }","duration":"138.041409ms","start":"2026-05-25T06:27:49.377453Z","end":"2026-05-25T06:27:49.515494Z","steps":["trace[86942818] 'process raft request' (duration: 137.753224ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:28:17.836998Z","caller":"traceutil/trace.go:171","msg":"trace[419030752] linearizableReadLoop","detail":"{readStateIndex:15621; appliedIndex:15617; }","duration":"202.993116ms","start":"2026-05-25T06:28:17.633985Z","end":"2026-05-25T06:28:17.836978Z","steps":["trace[419030752] 'read index received' (duration: 28.554509ms)","trace[419030752] 'applied index is now lower than readState.Index' (duration: 174.437487ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:28:17.837244Z","caller":"traceutil/trace.go:171","msg":"trace[1649362701] transaction","detail":"{read_only:false; response_revision:15105; number_of_response:1; }","duration":"209.887447ms","start":"2026-05-25T06:28:17.627345Z","end":"2026-05-25T06:28:17.837232Z","steps":["trace[1649362701] 'process raft request' (duration: 157.504257ms)","trace[1649362701] 'compare' (duration: 51.934711ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:28:17.837483Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.522744ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"} {"level":"info","ts":"2026-05-25T06:28:17.837516Z","caller":"traceutil/trace.go:171","msg":"trace[619863055] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:15107; }","duration":"196.649997ms","start":"2026-05-25T06:28:17.640859Z","end":"2026-05-25T06:28:17.837509Z","steps":["trace[619863055] 'agreement among raft nodes before linearized reading' (duration: 196.535985ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:28:17.837635Z","caller":"traceutil/trace.go:171","msg":"trace[1919619386] transaction","detail":"{read_only:false; response_revision:15106; number_of_response:1; }","duration":"210.155502ms","start":"2026-05-25T06:28:17.627436Z","end":"2026-05-25T06:28:17.837592Z","steps":["trace[1919619386] 'process raft request' (duration: 209.483008ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:28:17.837755Z","caller":"traceutil/trace.go:171","msg":"trace[2013638459] transaction","detail":"{read_only:false; response_revision:15107; number_of_response:1; }","duration":"207.586113ms","start":"2026-05-25T06:28:17.630098Z","end":"2026-05-25T06:28:17.837684Z","steps":["trace[2013638459] 'process raft request' (duration: 206.85225ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:28:17.838012Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.813367ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-db-sync\" ","response":"range_response_count:1 size:5521"} {"level":"info","ts":"2026-05-25T06:28:17.838046Z","caller":"traceutil/trace.go:171","msg":"trace[1028883099] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:15107; }","duration":"153.869718ms","start":"2026-05-25T06:28:17.684169Z","end":"2026-05-25T06:28:17.838038Z","steps":["trace[1028883099] 'agreement among raft nodes before linearized reading' (duration: 153.797786ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:28:17.838204Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.614822ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-rabbit-init\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-25T06:28:17.838258Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.244319ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/\" range_end:\"/registry/pods/openstack0\" ","response":"range_response_count:79 size:769873"} {"level":"warn","ts":"2026-05-25T06:28:17.838362Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.065671ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-ks-user\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-25T06:28:17.838353Z","caller":"traceutil/trace.go:171","msg":"trace[97672665] range","detail":"{range_begin:/registry/pods/openstack/; range_end:/registry/pods/openstack0; response_count:79; response_revision:15107; }","duration":"204.388683ms","start":"2026-05-25T06:28:17.633944Z","end":"2026-05-25T06:28:17.838333Z","steps":["trace[97672665] 'agreement among raft nodes before linearized reading' (duration: 203.335123ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:28:17.838397Z","caller":"traceutil/trace.go:171","msg":"trace[79746833] range","detail":"{range_begin:/registry/jobs/openstack/nova-ks-user; range_end:; response_count:0; response_revision:15107; }","duration":"164.100502ms","start":"2026-05-25T06:28:17.674289Z","end":"2026-05-25T06:28:17.83839Z","steps":["trace[79746833] 'agreement among raft nodes before linearized reading' (duration: 164.052441ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:28:17.838304Z","caller":"traceutil/trace.go:171","msg":"trace[288067428] range","detail":"{range_begin:/registry/jobs/openstack/nova-rabbit-init; range_end:; response_count:0; response_revision:15107; }","duration":"163.773484ms","start":"2026-05-25T06:28:17.674516Z","end":"2026-05-25T06:28:17.83829Z","steps":["trace[288067428] 'agreement among raft nodes before linearized reading' (duration: 163.56147ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:28:17.838541Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.398478ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/nova-ks-endpoints\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-25T06:28:17.838622Z","caller":"traceutil/trace.go:171","msg":"trace[1601836780] range","detail":"{range_begin:/registry/jobs/openstack/nova-ks-endpoints; range_end:; response_count:0; response_revision:15107; }","duration":"164.552021ms","start":"2026-05-25T06:28:17.674053Z","end":"2026-05-25T06:28:17.838605Z","steps":["trace[1601836780] 'agreement among raft nodes before linearized reading' (duration: 164.379668ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:29:12.594191Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":12861} {"level":"info","ts":"2026-05-25T06:29:12.674929Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":12861,"took":"77.418746ms","hash":873161235,"current-db-size-bytes":57569280,"current-db-size":"58 MB","current-db-size-in-use-bytes":30797824,"current-db-size-in-use":"31 MB"} {"level":"info","ts":"2026-05-25T06:29:12.674992Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":873161235,"revision":12861,"compact-revision":10787} {"level":"info","ts":"2026-05-25T06:34:01.208194Z","caller":"traceutil/trace.go:171","msg":"trace[865027785] transaction","detail":"{read_only:false; response_revision:17631; number_of_response:1; }","duration":"177.044211ms","start":"2026-05-25T06:34:01.031119Z","end":"2026-05-25T06:34:01.208164Z","steps":["trace[865027785] 'process raft request' (duration: 176.819626ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:01.209052Z","caller":"traceutil/trace.go:171","msg":"trace[1127267879] transaction","detail":"{read_only:false; response_revision:17633; number_of_response:1; }","duration":"112.925987ms","start":"2026-05-25T06:34:01.096109Z","end":"2026-05-25T06:34:01.209035Z","steps":["trace[1127267879] 'process raft request' (duration: 112.841546ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:01.209049Z","caller":"traceutil/trace.go:171","msg":"trace[1286345919] transaction","detail":"{read_only:false; response_revision:17632; number_of_response:1; }","duration":"115.044497ms","start":"2026-05-25T06:34:01.093975Z","end":"2026-05-25T06:34:01.209019Z","steps":["trace[1286345919] 'process raft request' (duration: 114.833713ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:01.209303Z","caller":"traceutil/trace.go:171","msg":"trace[1544639583] transaction","detail":"{read_only:false; response_revision:17634; number_of_response:1; }","duration":"111.914228ms","start":"2026-05-25T06:34:01.097377Z","end":"2026-05-25T06:34:01.209291Z","steps":["trace[1544639583] 'process raft request' (duration: 111.612573ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:07.35451Z","caller":"traceutil/trace.go:171","msg":"trace[1909274917] transaction","detail":"{read_only:false; response_revision:17674; number_of_response:1; }","duration":"125.087137ms","start":"2026-05-25T06:34:07.229393Z","end":"2026-05-25T06:34:07.35448Z","steps":["trace[1909274917] 'process raft request' (duration: 125.046247ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:07.354886Z","caller":"traceutil/trace.go:171","msg":"trace[1960278602] transaction","detail":"{read_only:false; response_revision:17672; number_of_response:1; }","duration":"127.918301ms","start":"2026-05-25T06:34:07.226958Z","end":"2026-05-25T06:34:07.354877Z","steps":["trace[1960278602] 'process raft request' (duration: 114.079569ms)","trace[1960278602] 'compare' (duration: 12.854764ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:34:07.355002Z","caller":"traceutil/trace.go:171","msg":"trace[448522864] transaction","detail":"{read_only:false; response_revision:17673; number_of_response:1; }","duration":"125.614688ms","start":"2026-05-25T06:34:07.229378Z","end":"2026-05-25T06:34:07.354993Z","steps":["trace[448522864] 'process raft request' (duration: 125.016536ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:34:07.69387Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.015099ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:18"} {"level":"info","ts":"2026-05-25T06:34:07.693976Z","caller":"traceutil/trace.go:171","msg":"trace[219255124] linearizableReadLoop","detail":"{readStateIndex:18274; appliedIndex:18273; }","duration":"155.845911ms","start":"2026-05-25T06:34:07.538114Z","end":"2026-05-25T06:34:07.69396Z","steps":["trace[219255124] 'read index received' (duration: 14.580726ms)","trace[219255124] 'applied index is now lower than readState.Index' (duration: 141.263865ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:34:07.694209Z","caller":"traceutil/trace.go:171","msg":"trace[961199428] transaction","detail":"{read_only:false; response_revision:17675; number_of_response:1; }","duration":"305.83759ms","start":"2026-05-25T06:34:07.388358Z","end":"2026-05-25T06:34:07.694195Z","steps":["trace[961199428] 'process raft request' (duration: 164.428003ms)","trace[961199428] 'compare' (duration: 140.345896ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:34:07.694278Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-25T06:34:07.388311Z","time spent":"305.933761ms","remote":"127.0.0.1:57734","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":20966,"response count":0,"response size":41,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-25T06:34:07.695087Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.635126ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:6"} {"level":"warn","ts":"2026-05-25T06:34:07.695132Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"157.006262ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:481"} {"level":"warn","ts":"2026-05-25T06:34:07.695168Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.974159ms","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-05-25T06:34:07.695181Z","caller":"traceutil/trace.go:171","msg":"trace[856421168] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:17675; }","duration":"136.751108ms","start":"2026-05-25T06:34:07.558405Z","end":"2026-05-25T06:34:07.695156Z","steps":["trace[856421168] 'agreement among raft nodes before linearized reading' (duration: 136.591485ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:07.695189Z","caller":"traceutil/trace.go:171","msg":"trace[2080839305] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:17675; }","duration":"157.105964ms","start":"2026-05-25T06:34:07.538068Z","end":"2026-05-25T06:34:07.695174Z","steps":["trace[2080839305] 'agreement among raft nodes before linearized reading' (duration: 156.8816ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:34:07.695175Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.107252ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:494"} {"level":"info","ts":"2026-05-25T06:34:07.695214Z","caller":"traceutil/trace.go:171","msg":"trace[1205351900] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:17675; }","duration":"150.04227ms","start":"2026-05-25T06:34:07.545157Z","end":"2026-05-25T06:34:07.6952Z","steps":["trace[1205351900] 'agreement among raft nodes before linearized reading' (duration: 149.802496ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:07.695242Z","caller":"traceutil/trace.go:171","msg":"trace[1695430831] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:17675; }","duration":"149.207955ms","start":"2026-05-25T06:34:07.546017Z","end":"2026-05-25T06:34:07.695225Z","steps":["trace[1695430831] 'agreement among raft nodes before linearized reading' (duration: 148.99201ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:07.994186Z","caller":"traceutil/trace.go:171","msg":"trace[477421743] transaction","detail":"{read_only:false; response_revision:17676; number_of_response:1; }","duration":"282.658851ms","start":"2026-05-25T06:34:07.711494Z","end":"2026-05-25T06:34:07.994153Z","steps":["trace[477421743] 'process raft request' (duration: 247.813201ms)","trace[477421743] 'compare' (duration: 34.628206ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:34:07.994555Z","caller":"traceutil/trace.go:171","msg":"trace[142526990] transaction","detail":"{read_only:false; response_revision:17677; number_of_response:1; }","duration":"283.019467ms","start":"2026-05-25T06:34:07.711507Z","end":"2026-05-25T06:34:07.994527Z","steps":["trace[142526990] 'process raft request' (duration: 282.60069ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:07.994765Z","caller":"traceutil/trace.go:171","msg":"trace[839941427] transaction","detail":"{read_only:false; response_revision:17678; number_of_response:1; }","duration":"283.121799ms","start":"2026-05-25T06:34:07.711601Z","end":"2026-05-25T06:34:07.994723Z","steps":["trace[839941427] 'process raft request' (duration: 282.870574ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:07.995048Z","caller":"traceutil/trace.go:171","msg":"trace[882373189] transaction","detail":"{read_only:false; response_revision:17679; number_of_response:1; }","duration":"283.381455ms","start":"2026-05-25T06:34:07.711602Z","end":"2026-05-25T06:34:07.994983Z","steps":["trace[882373189] 'process raft request' (duration: 283.056918ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:07.995174Z","caller":"traceutil/trace.go:171","msg":"trace[1477170836] linearizableReadLoop","detail":"{readStateIndex:18279; appliedIndex:18274; }","duration":"246.011717ms","start":"2026-05-25T06:34:07.749146Z","end":"2026-05-25T06:34:07.995158Z","steps":["trace[1477170836] 'read index received' (duration: 210.135147ms)","trace[1477170836] 'applied index is now lower than readState.Index' (duration: 35.87505ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:34:07.995251Z","caller":"traceutil/trace.go:171","msg":"trace[2024554343] transaction","detail":"{read_only:false; response_revision:17680; number_of_response:1; }","duration":"283.600748ms","start":"2026-05-25T06:34:07.711638Z","end":"2026-05-25T06:34:07.995239Z","steps":["trace[2024554343] 'process raft request' (duration: 283.249372ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:34:07.995408Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"246.252402ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-cell-setup-gzhvv\" ","response":"range_response_count:1 size:9792"} {"level":"info","ts":"2026-05-25T06:34:07.995458Z","caller":"traceutil/trace.go:171","msg":"trace[1651215341] range","detail":"{range_begin:/registry/pods/openstack/nova-cell-setup-gzhvv; range_end:; response_count:1; response_revision:17680; }","duration":"246.364014ms","start":"2026-05-25T06:34:07.749079Z","end":"2026-05-25T06:34:07.995443Z","steps":["trace[1651215341] 'agreement among raft nodes before linearized reading' (duration: 246.16202ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:34:07.995493Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.142744ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-compute-default-ksmr8\" ","response":"range_response_count:1 size:22094"} {"level":"info","ts":"2026-05-25T06:34:07.995555Z","caller":"traceutil/trace.go:171","msg":"trace[114136491] range","detail":"{range_begin:/registry/pods/openstack/nova-compute-default-ksmr8; range_end:; response_count:1; response_revision:17680; }","duration":"232.273987ms","start":"2026-05-25T06:34:07.763266Z","end":"2026-05-25T06:34:07.99554Z","steps":["trace[114136491] 'agreement among raft nodes before linearized reading' (duration: 231.997172ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:08.206355Z","caller":"traceutil/trace.go:171","msg":"trace[1832155372] transaction","detail":"{read_only:false; response_revision:17681; number_of_response:1; }","duration":"126.900753ms","start":"2026-05-25T06:34:08.079407Z","end":"2026-05-25T06:34:08.206308Z","steps":["trace[1832155372] 'process raft request' (duration: 81.695136ms)","trace[1832155372] 'compare' (duration: 44.958401ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:34:12.60051Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":15457} {"level":"info","ts":"2026-05-25T06:34:12.69982Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":15457,"took":"94.005909ms","hash":3105025526,"current-db-size-bytes":57569280,"current-db-size":"58 MB","current-db-size-in-use-bytes":32178176,"current-db-size-in-use":"32 MB"} {"level":"info","ts":"2026-05-25T06:34:12.699897Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3105025526,"revision":15457,"compact-revision":12861} {"level":"info","ts":"2026-05-25T06:34:17.198105Z","caller":"traceutil/trace.go:171","msg":"trace[356619770] linearizableReadLoop","detail":"{readStateIndex:18396; appliedIndex:18395; }","duration":"107.062618ms","start":"2026-05-25T06:34:17.091012Z","end":"2026-05-25T06:34:17.198074Z","steps":["trace[356619770] 'read index received' (duration: 55.749196ms)","trace[356619770] 'applied index is now lower than readState.Index' (duration: 51.312182ms)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:34:17.198298Z","caller":"traceutil/trace.go:171","msg":"trace[663616941] transaction","detail":"{read_only:false; response_revision:17791; number_of_response:1; }","duration":"149.941478ms","start":"2026-05-25T06:34:17.048322Z","end":"2026-05-25T06:34:17.198263Z","steps":["trace[663616941] 'process raft request' (duration: 98.423973ms)","trace[663616941] 'compare' (duration: 51.177669ms)"],"step_count":2} {"level":"warn","ts":"2026-05-25T06:34:17.198489Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.846512ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-1\" ","response":"range_response_count:0 size:6"} {"level":"info","ts":"2026-05-25T06:34:17.198544Z","caller":"traceutil/trace.go:171","msg":"trace[1691825544] range","detail":"{range_begin:/registry/secrets/monitoring/alertmanager-kube-prometheus-stack-alertmanager-tls-assets-1; range_end:; response_count:0; response_revision:17791; }","duration":"154.939233ms","start":"2026-05-25T06:34:17.043586Z","end":"2026-05-25T06:34:17.198525Z","steps":["trace[1691825544] 'agreement among raft nodes before linearized reading' (duration: 154.828331ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:17.246878Z","caller":"traceutil/trace.go:171","msg":"trace[528492972] transaction","detail":"{read_only:false; response_revision:17792; number_of_response:1; }","duration":"145.958142ms","start":"2026-05-25T06:34:17.100887Z","end":"2026-05-25T06:34:17.246845Z","steps":["trace[528492972] 'process raft request' (duration: 145.368581ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:17.246904Z","caller":"traceutil/trace.go:171","msg":"trace[773763825] transaction","detail":"{read_only:false; number_of_response:1; response_revision:17792; }","duration":"141.345905ms","start":"2026-05-25T06:34:17.105538Z","end":"2026-05-25T06:34:17.246884Z","steps":["trace[773763825] 'process raft request' (duration: 140.857796ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:34:17.246947Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.623791ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus-tls-assets-0\" ","response":"range_response_count:1 size:1343"} {"level":"info","ts":"2026-05-25T06:34:17.247006Z","caller":"traceutil/trace.go:171","msg":"trace[484247780] range","detail":"{range_begin:/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus-tls-assets-0; range_end:; response_count:1; response_revision:17792; }","duration":"150.748253ms","start":"2026-05-25T06:34:17.096241Z","end":"2026-05-25T06:34:17.246989Z","steps":["trace[484247780] 'agreement among raft nodes before linearized reading' (duration: 150.523228ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:23.192828Z","caller":"traceutil/trace.go:171","msg":"trace[1123917384] transaction","detail":"{read_only:false; response_revision:17829; number_of_response:1; }","duration":"105.221462ms","start":"2026-05-25T06:34:23.087578Z","end":"2026-05-25T06:34:23.1928Z","steps":["trace[1123917384] 'process raft request' (duration: 105.053698ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:25.710182Z","caller":"traceutil/trace.go:171","msg":"trace[1639248254] transaction","detail":"{read_only:false; response_revision:17844; number_of_response:1; }","duration":"103.477369ms","start":"2026-05-25T06:34:25.606677Z","end":"2026-05-25T06:34:25.710155Z","steps":["trace[1639248254] 'process raft request' (duration: 103.328706ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:34:28.592796Z","caller":"traceutil/trace.go:171","msg":"trace[1491772075] linearizableReadLoop","detail":"{readStateIndex:18471; appliedIndex:18470; }","duration":"107.855212ms","start":"2026-05-25T06:34:28.484924Z","end":"2026-05-25T06:34:28.592779Z","steps":["trace[1491772075] 'read index received' (duration: 107.7793ms)","trace[1491772075] 'applied index is now lower than readState.Index' (duration: 75.052µs)"],"step_count":2} {"level":"info","ts":"2026-05-25T06:34:28.592882Z","caller":"traceutil/trace.go:171","msg":"trace[653168229] transaction","detail":"{read_only:false; response_revision:17863; number_of_response:1; }","duration":"120.693515ms","start":"2026-05-25T06:34:28.472156Z","end":"2026-05-25T06:34:28.592849Z","steps":["trace[653168229] 'process raft request' (duration: 120.529092ms)"],"step_count":1} {"level":"warn","ts":"2026-05-25T06:34:28.592954Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.026855ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:481"} {"level":"info","ts":"2026-05-25T06:34:28.59301Z","caller":"traceutil/trace.go:171","msg":"trace[229536207] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:17863; }","duration":"108.069875ms","start":"2026-05-25T06:34:28.484907Z","end":"2026-05-25T06:34:28.592977Z","steps":["trace[229536207] 'agreement among raft nodes before linearized reading' (duration: 107.974414ms)"],"step_count":1} {"level":"info","ts":"2026-05-25T06:39:10.726521Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"56c01ea8fdc90390","local-member-applied-index":20002,"local-member-snapshot-index":10001,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-05-25T06:39:10.733334Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":20002} {"level":"info","ts":"2026-05-25T06:39:10.73343Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":15002} {"level":"info","ts":"2026-05-25T06:39:12.606787Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":17719} {"level":"info","ts":"2026-05-25T06:39:12.70469Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":17719,"took":"94.613453ms","hash":2778581601,"current-db-size-bytes":57569280,"current-db-size":"58 MB","current-db-size-in-use-bytes":27246592,"current-db-size-in-use":"27 MB"} {"level":"info","ts":"2026-05-25T06:39:12.704748Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2778581601,"revision":17719,"compact-revision":15457}