{"level":"warn","ts":"2026-07-06T21:36:04.883114Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-07-06T21:36:04.88321Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.153: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.153:2380","--initial-cluster=instance=https://199.204.45.153:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.153:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.153: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-07-06T21:36:04.883285Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-07-06T21:36:04.883299Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.153:2380"]} {"level":"info","ts":"2026-07-06T21:36:04.883319Z","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-07-06T21:36:04.884146Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.153:2379"]} {"level":"info","ts":"2026-07-06T21:36:04.884239Z","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.153:2380"],"listen-peer-urls":["https://199.204.45.153:2380"],"advertise-client-urls":["https://199.204.45.153:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.153:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.153: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-07-06T21:36:04.889763Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.044767ms"} {"level":"info","ts":"2026-07-06T21:36:04.898886Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"355195d5aae85944","cluster-id":"e424441517bc0b32"} {"level":"info","ts":"2026-07-06T21:36:04.899031Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 switched to configuration voters=()"} {"level":"info","ts":"2026-07-06T21:36:04.899063Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 became follower at term 0"} {"level":"info","ts":"2026-07-06T21:36:04.899086Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 355195d5aae85944 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-07-06T21:36:04.899098Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 became follower at term 1"} {"level":"info","ts":"2026-07-06T21:36:04.899158Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 switched to configuration voters=(3842016702051670340)"} {"level":"warn","ts":"2026-07-06T21:36:04.911275Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-07-06T21:36:04.913002Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-07-06T21:36:04.91423Z","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-07-06T21:36:04.917734Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"355195d5aae85944","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-07-06T21:36:04.920904Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"355195d5aae85944","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-07-06T21:36:04.920877Z","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-07-06T21:36:04.921404Z","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-07-06T21:36:04.921587Z","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-07-06T21:36:04.92175Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 switched to configuration voters=(3842016702051670340)"} {"level":"info","ts":"2026-07-06T21:36:04.921959Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"e424441517bc0b32","local-member-id":"355195d5aae85944","added-peer-id":"355195d5aae85944","added-peer-peer-urls":["https://199.204.45.153:2380"]} {"level":"info","ts":"2026-07-06T21:36:04.924378Z","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-07-06T21:36:04.924462Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.153:2380"} {"level":"info","ts":"2026-07-06T21:36:04.924504Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.153:2380"} {"level":"info","ts":"2026-07-06T21:36:04.924674Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"355195d5aae85944","initial-advertise-peer-urls":["https://199.204.45.153:2380"],"listen-peer-urls":["https://199.204.45.153:2380"],"advertise-client-urls":["https://199.204.45.153:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.153:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-07-06T21:36:04.925277Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-07-06T21:36:05.304201Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 is starting a new election at term 1"} {"level":"info","ts":"2026-07-06T21:36:05.304268Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 became pre-candidate at term 1"} {"level":"info","ts":"2026-07-06T21:36:05.304307Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 received MsgPreVoteResp from 355195d5aae85944 at term 1"} {"level":"info","ts":"2026-07-06T21:36:05.304326Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 became candidate at term 2"} {"level":"info","ts":"2026-07-06T21:36:05.304334Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 received MsgVoteResp from 355195d5aae85944 at term 2"} {"level":"info","ts":"2026-07-06T21:36:05.304355Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"355195d5aae85944 became leader at term 2"} {"level":"info","ts":"2026-07-06T21:36:05.304371Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 355195d5aae85944 elected leader 355195d5aae85944 at term 2"} {"level":"info","ts":"2026-07-06T21:36:05.321545Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"355195d5aae85944","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.153:2379]}","request-path":"/0/members/355195d5aae85944/attributes","cluster-id":"e424441517bc0b32","publish-timeout":"7s"} {"level":"info","ts":"2026-07-06T21:36:05.321651Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-07-06T21:36:05.321907Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-06T21:36:05.322287Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-07-06T21:36:05.322325Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-07-06T21:36:05.322354Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-06T21:36:05.323167Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"e424441517bc0b32","local-member-id":"355195d5aae85944","cluster-version":"3.5"} {"level":"info","ts":"2026-07-06T21:36:05.32337Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-07-06T21:36:05.323454Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-07-06T21:36:05.327813Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-07-06T21:36:05.329205Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.153:2379"} {"level":"info","ts":"2026-07-06T21:36:14.621918Z","caller":"traceutil/trace.go:171","msg":"trace[1143574238] transaction","detail":"{read_only:false; response_revision:335; number_of_response:1; }","duration":"182.85173ms","start":"2026-07-06T21:36:14.439025Z","end":"2026-07-06T21:36:14.621877Z","steps":["trace[1143574238] 'process raft request' (duration: 182.612094ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:36:48.478078Z","caller":"traceutil/trace.go:171","msg":"trace[968357963] transaction","detail":"{read_only:false; response_revision:632; number_of_response:1; }","duration":"136.843232ms","start":"2026-07-06T21:36:48.341195Z","end":"2026-07-06T21:36:48.478039Z","steps":["trace[968357963] 'process raft request' (duration: 132.488196ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:36:48.706317Z","caller":"traceutil/trace.go:171","msg":"trace[603372296] linearizableReadLoop","detail":"{readStateIndex:654; appliedIndex:652; }","duration":"164.693294ms","start":"2026-07-06T21:36:48.541589Z","end":"2026-07-06T21:36:48.706283Z","steps":["trace[603372296] 'read index received' (duration: 73.971596ms)","trace[603372296] 'applied index is now lower than readState.Index' (duration: 90.720518ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:36:48.706396Z","caller":"traceutil/trace.go:171","msg":"trace[1147589350] transaction","detail":"{read_only:false; response_revision:633; number_of_response:1; }","duration":"176.374986ms","start":"2026-07-06T21:36:48.529986Z","end":"2026-07-06T21:36:48.706361Z","steps":["trace[1147589350] 'process raft request' (duration: 176.13334ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:36:48.706628Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.019711ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-07-06T21:36:48.70672Z","caller":"traceutil/trace.go:171","msg":"trace[1746063852] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:633; }","duration":"165.153135ms","start":"2026-07-06T21:36:48.541546Z","end":"2026-07-06T21:36:48.706699Z","steps":["trace[1746063852] 'agreement among raft nodes before linearized reading' (duration: 164.866748ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:36:49.176785Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.464302ms","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-07-06T21:36:49.176852Z","caller":"traceutil/trace.go:171","msg":"trace[907201804] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:635; }","duration":"109.577863ms","start":"2026-07-06T21:36:49.067259Z","end":"2026-07-06T21:36:49.176837Z","steps":["trace[907201804] 'range keys from in-memory index tree' (duration: 109.280407ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:36:50.541089Z","caller":"traceutil/trace.go:171","msg":"trace[515745017] transaction","detail":"{read_only:false; response_revision:667; number_of_response:1; }","duration":"106.664044ms","start":"2026-07-06T21:36:50.434399Z","end":"2026-07-06T21:36:50.541063Z","steps":["trace[515745017] 'process raft request' (duration: 103.249931ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:36:50.547251Z","caller":"traceutil/trace.go:171","msg":"trace[173678564] transaction","detail":"{read_only:false; response_revision:668; number_of_response:1; }","duration":"112.74759ms","start":"2026-07-06T21:36:50.434482Z","end":"2026-07-06T21:36:50.547229Z","steps":["trace[173678564] 'process raft request' (duration: 112.635667ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:37:03.659456Z","caller":"traceutil/trace.go:171","msg":"trace[1167918674] transaction","detail":"{read_only:false; response_revision:797; number_of_response:1; }","duration":"151.734681ms","start":"2026-07-06T21:37:03.507697Z","end":"2026-07-06T21:37:03.659432Z","steps":["trace[1167918674] 'process raft request' (duration: 151.543826ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:37:03.662775Z","caller":"traceutil/trace.go:171","msg":"trace[595701406] transaction","detail":"{read_only:false; response_revision:798; number_of_response:1; }","duration":"155.00243ms","start":"2026-07-06T21:37:03.507745Z","end":"2026-07-06T21:37:03.662747Z","steps":["trace[595701406] 'process raft request' (duration: 154.838206ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:38:22.280919Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"207.59523ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-06T21:38:22.281059Z","caller":"traceutil/trace.go:171","msg":"trace[1016650580] linearizableReadLoop","detail":"{readStateIndex:1949; appliedIndex:1948; }","duration":"123.014074ms","start":"2026-07-06T21:38:22.158024Z","end":"2026-07-06T21:38:22.281038Z","steps":["trace[1016650580] 'read index received' (duration: 46.581µs)","trace[1016650580] 'applied index is now lower than readState.Index' (duration: 122.965653ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:38:22.281114Z","caller":"traceutil/trace.go:171","msg":"trace[1971900404] transaction","detail":"{read_only:false; response_revision:1878; number_of_response:1; }","duration":"374.30584ms","start":"2026-07-06T21:38:21.906756Z","end":"2026-07-06T21:38:22.281062Z","steps":["trace[1971900404] 'process raft request' (duration: 165.742788ms)","trace[1971900404] 'compare' (duration: 207.471676ms)"],"step_count":2} {"level":"warn","ts":"2026-07-06T21:38:22.28131Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-06T21:38:21.906736Z","time spent":"374.483304ms","remote":"127.0.0.1:54060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":10967,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-06T21:38:22.281394Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.347903ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"warn","ts":"2026-07-06T21:38:22.281509Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.487938ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5412"} {"level":"info","ts":"2026-07-06T21:38:22.281522Z","caller":"traceutil/trace.go:171","msg":"trace[1764886283] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1878; }","duration":"123.524077ms","start":"2026-07-06T21:38:22.15797Z","end":"2026-07-06T21:38:22.281494Z","steps":["trace[1764886283] 'agreement among raft nodes before linearized reading' (duration: 123.176439ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:38:22.281592Z","caller":"traceutil/trace.go:171","msg":"trace[1528242150] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1878; }","duration":"114.622471ms","start":"2026-07-06T21:38:22.166955Z","end":"2026-07-06T21:38:22.281578Z","steps":["trace[1528242150] 'agreement among raft nodes before linearized reading' (duration: 114.275853ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:38:29.851019Z","caller":"traceutil/trace.go:171","msg":"trace[428038364] transaction","detail":"{read_only:false; response_revision:1955; number_of_response:1; }","duration":"119.98972ms","start":"2026-07-06T21:38:29.731004Z","end":"2026-07-06T21:38:29.850994Z","steps":["trace[428038364] 'process raft request' (duration: 119.847796ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:38:30.131231Z","caller":"traceutil/trace.go:171","msg":"trace[1937405638] transaction","detail":"{read_only:false; response_revision:1956; number_of_response:1; }","duration":"396.773975ms","start":"2026-07-06T21:38:29.734435Z","end":"2026-07-06T21:38:30.131209Z","steps":["trace[1937405638] 'process raft request' (duration: 396.646182ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:38:30.131399Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-06T21:38:29.734424Z","time spent":"396.896808ms","remote":"127.0.0.1:54156","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-06T21:38:33.753402Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.542306ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-07-06T21:39:06.631285Z","caller":"traceutil/trace.go:171","msg":"trace[1403374520] transaction","detail":"{read_only:false; response_revision:2172; number_of_response:1; }","duration":"100.812625ms","start":"2026-07-06T21:39:06.530446Z","end":"2026-07-06T21:39:06.631258Z","steps":["trace[1403374520] 'process raft request' (duration: 100.548359ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:39:07.323987Z","caller":"traceutil/trace.go:171","msg":"trace[1939508573] transaction","detail":"{read_only:false; response_revision:2175; number_of_response:1; }","duration":"107.836376ms","start":"2026-07-06T21:39:07.216116Z","end":"2026-07-06T21:39:07.323953Z","steps":["trace[1939508573] 'process raft request' (duration: 94.785379ms)","trace[1939508573] 'compare' (duration: 12.900273ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:40:43.813061Z","caller":"traceutil/trace.go:171","msg":"trace[865898428] transaction","detail":"{read_only:false; response_revision:2893; number_of_response:1; }","duration":"102.554251ms","start":"2026-07-06T21:40:43.710461Z","end":"2026-07-06T21:40:43.813016Z","steps":["trace[865898428] 'process raft request' (duration: 36.074253ms)","trace[865898428] 'compare' (duration: 66.166781ms)"],"step_count":2} {"level":"warn","ts":"2026-07-06T21:40:43.852125Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.322729ms","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-07-06T21:40:43.852192Z","caller":"traceutil/trace.go:171","msg":"trace[1400636057] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2893; }","duration":"136.421511ms","start":"2026-07-06T21:40:43.715752Z","end":"2026-07-06T21:40:43.852173Z","steps":["trace[1400636057] 'agreement among raft nodes before linearized reading' (duration: 97.286384ms)","trace[1400636057] 'range keys from in-memory index tree' (duration: 38.938951ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:44:30.72277Z","caller":"traceutil/trace.go:171","msg":"trace[1196856857] linearizableReadLoop","detail":"{readStateIndex:5198; appliedIndex:5196; }","duration":"178.59295ms","start":"2026-07-06T21:44:30.544152Z","end":"2026-07-06T21:44:30.722745Z","steps":["trace[1196856857] 'read index received' (duration: 86.142969ms)","trace[1196856857] 'applied index is now lower than readState.Index' (duration: 92.429221ms)"],"step_count":2} {"level":"warn","ts":"2026-07-06T21:44:30.723013Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"178.839686ms","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-07-06T21:44:30.723078Z","caller":"traceutil/trace.go:171","msg":"trace[1440553876] range","detail":"{range_begin:/registry/rabbitmq.com/schemareplications/; range_end:/registry/rabbitmq.com/schemareplications0; response_count:0; response_revision:5014; }","duration":"178.936119ms","start":"2026-07-06T21:44:30.544124Z","end":"2026-07-06T21:44:30.72306Z","steps":["trace[1440553876] 'agreement among raft nodes before linearized reading' (duration: 178.830696ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:44:30.722821Z","caller":"traceutil/trace.go:171","msg":"trace[681620258] transaction","detail":"{read_only:false; response_revision:5013; number_of_response:1; }","duration":"235.710345ms","start":"2026-07-06T21:44:30.487078Z","end":"2026-07-06T21:44:30.722789Z","steps":["trace[681620258] 'process raft request' (duration: 143.190282ms)","trace[681620258] 'compare' (duration: 92.131844ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:44:30.722929Z","caller":"traceutil/trace.go:171","msg":"trace[1545430397] transaction","detail":"{read_only:false; response_revision:5014; number_of_response:1; }","duration":"178.944999ms","start":"2026-07-06T21:44:30.543936Z","end":"2026-07-06T21:44:30.722881Z","steps":["trace[1545430397] 'process raft request' (duration: 178.713103ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:44:30.738307Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"185.044617ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-06T21:44:30.7384Z","caller":"traceutil/trace.go:171","msg":"trace[820235330] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:5015; }","duration":"185.16938ms","start":"2026-07-06T21:44:30.553209Z","end":"2026-07-06T21:44:30.738379Z","steps":["trace[820235330] 'agreement among raft nodes before linearized reading' (duration: 185.025806ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:44:30.739272Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.859504ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-3fbc5764-77d1-438d-962e-85832810f878\" ","response":"range_response_count:1 size:3601"} {"level":"info","ts":"2026-07-06T21:44:30.739351Z","caller":"traceutil/trace.go:171","msg":"trace[1976813213] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-3fbc5764-77d1-438d-962e-85832810f878; range_end:; response_count:1; response_revision:5015; }","duration":"149.961557ms","start":"2026-07-06T21:44:30.589373Z","end":"2026-07-06T21:44:30.739334Z","steps":["trace[1976813213] 'agreement among raft nodes before linearized reading' (duration: 149.806233ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:44:32.832648Z","caller":"traceutil/trace.go:171","msg":"trace[835642279] transaction","detail":"{read_only:false; response_revision:5053; number_of_response:1; }","duration":"105.724683ms","start":"2026-07-06T21:44:32.726898Z","end":"2026-07-06T21:44:32.832622Z","steps":["trace[835642279] 'process raft request' (duration: 105.483508ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:44:32.83861Z","caller":"traceutil/trace.go:171","msg":"trace[1652239027] transaction","detail":"{read_only:false; response_revision:5054; number_of_response:1; }","duration":"111.236048ms","start":"2026-07-06T21:44:32.727332Z","end":"2026-07-06T21:44:32.838568Z","steps":["trace[1652239027] 'process raft request' (duration: 110.966701ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:44:44.528433Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.022236ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/podtemplates/\" range_end:\"/registry/podtemplates0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-06T21:44:44.528527Z","caller":"traceutil/trace.go:171","msg":"trace[1330973314] range","detail":"{range_begin:/registry/podtemplates/; range_end:/registry/podtemplates0; response_count:0; response_revision:5282; }","duration":"166.170309ms","start":"2026-07-06T21:44:44.36234Z","end":"2026-07-06T21:44:44.528511Z","steps":["trace[1330973314] 'count revisions from in-memory index tree' (duration: 165.933203ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:46:05.349218Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":3010} {"level":"info","ts":"2026-07-06T21:46:05.438846Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":3010,"took":"87.846091ms","hash":1710353537,"current-db-size-bytes":58413056,"current-db-size":"58 MB","current-db-size-in-use-bytes":31920128,"current-db-size-in-use":"32 MB"} {"level":"info","ts":"2026-07-06T21:46:05.438952Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1710353537,"revision":3010,"compact-revision":-1} {"level":"info","ts":"2026-07-06T21:51:05.370952Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":6095} {"level":"info","ts":"2026-07-06T21:51:05.588456Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":6095,"took":"215.449046ms","hash":119572431,"current-db-size-bytes":58413056,"current-db-size":"58 MB","current-db-size-in-use-bytes":21987328,"current-db-size-in-use":"22 MB"} {"level":"info","ts":"2026-07-06T21:51:05.588531Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":119572431,"revision":6095,"compact-revision":3010} {"level":"info","ts":"2026-07-06T21:51:12.773639Z","caller":"traceutil/trace.go:171","msg":"trace[108656534] transaction","detail":"{read_only:false; response_revision:8351; number_of_response:1; }","duration":"423.201046ms","start":"2026-07-06T21:51:12.350412Z","end":"2026-07-06T21:51:12.773613Z","steps":["trace[108656534] 'process raft request' (duration: 423.032801ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:51:12.773983Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-06T21:51:12.350368Z","time spent":"423.536253ms","remote":"127.0.0.1:54156","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":555,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-06T21:51:12.774818Z","caller":"traceutil/trace.go:171","msg":"trace[369411031] linearizableReadLoop","detail":"{readStateIndex:8643; appliedIndex:8640; }","duration":"216.704447ms","start":"2026-07-06T21:51:12.558083Z","end":"2026-07-06T21:51:12.774787Z","steps":["trace[369411031] 'read index received' (duration: 215.425386ms)","trace[369411031] 'applied index is now lower than readState.Index' (duration: 1.277711ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:51:12.774842Z","caller":"traceutil/trace.go:171","msg":"trace[760986248] transaction","detail":"{read_only:false; response_revision:8352; number_of_response:1; }","duration":"415.153639ms","start":"2026-07-06T21:51:12.359655Z","end":"2026-07-06T21:51:12.774808Z","steps":["trace[760986248] 'process raft request' (duration: 414.900203ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:51:12.77489Z","caller":"traceutil/trace.go:171","msg":"trace[474693606] transaction","detail":"{read_only:false; response_revision:8353; number_of_response:1; }","duration":"413.683873ms","start":"2026-07-06T21:51:12.361137Z","end":"2026-07-06T21:51:12.774821Z","steps":["trace[474693606] 'process raft request' (duration: 413.591551ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:51:12.774988Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"216.888621ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-07-06T21:51:12.775008Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-06T21:51:12.359621Z","time spent":"415.300553ms","remote":"127.0.0.1:54156","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":509,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-06T21:51:12.775046Z","caller":"traceutil/trace.go:171","msg":"trace[1192867351] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:8353; }","duration":"216.997733ms","start":"2026-07-06T21:51:12.558031Z","end":"2026-07-06T21:51:12.775029Z","steps":["trace[1192867351] 'agreement among raft nodes before linearized reading' (duration: 216.87375ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:51:12.775035Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-06T21:51:12.361125Z","time spent":"413.823487ms","remote":"127.0.0.1:54156","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":540,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-06T21:51:23.738494Z","caller":"traceutil/trace.go:171","msg":"trace[858285366] transaction","detail":"{read_only:false; response_revision:8409; number_of_response:1; }","duration":"103.466914ms","start":"2026-07-06T21:51:23.634986Z","end":"2026-07-06T21:51:23.738453Z","steps":["trace[858285366] 'process raft request' (duration: 73.524309ms)","trace[858285366] 'compare' (duration: 29.76761ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:51:24.033986Z","caller":"traceutil/trace.go:171","msg":"trace[1892653039] transaction","detail":"{read_only:false; response_revision:8410; number_of_response:1; }","duration":"214.768986ms","start":"2026-07-06T21:51:23.819111Z","end":"2026-07-06T21:51:24.03388Z","steps":["trace[1892653039] 'process raft request' (duration: 205.766838ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:51:24.081156Z","caller":"traceutil/trace.go:171","msg":"trace[1189569192] linearizableReadLoop","detail":"{readStateIndex:8704; appliedIndex:8702; }","duration":"223.150038ms","start":"2026-07-06T21:51:23.857978Z","end":"2026-07-06T21:51:24.081128Z","steps":["trace[1189569192] 'read index received' (duration: 167.01421ms)","trace[1189569192] 'applied index is now lower than readState.Index' (duration: 56.134578ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:51:24.081207Z","caller":"traceutil/trace.go:171","msg":"trace[1604993934] transaction","detail":"{read_only:false; response_revision:8411; number_of_response:1; }","duration":"228.385985ms","start":"2026-07-06T21:51:23.852789Z","end":"2026-07-06T21:51:24.081175Z","steps":["trace[1604993934] 'process raft request' (duration: 228.107888ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:51:24.081439Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"223.429174ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-5qqnc\" ","response":"range_response_count:1 size:6524"} {"level":"info","ts":"2026-07-06T21:51:24.081506Z","caller":"traceutil/trace.go:171","msg":"trace[1586927807] range","detail":"{range_begin:/registry/pods/openstack/keepalived-5qqnc; range_end:; response_count:1; response_revision:8412; }","duration":"223.561277ms","start":"2026-07-06T21:51:23.857931Z","end":"2026-07-06T21:51:24.081493Z","steps":["trace[1586927807] 'agreement among raft nodes before linearized reading' (duration: 223.334372ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:51:24.10651Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"185.636151ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12216"} {"level":"info","ts":"2026-07-06T21:51:24.10659Z","caller":"traceutil/trace.go:171","msg":"trace[914888010] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:8413; }","duration":"185.788874ms","start":"2026-07-06T21:51:23.920784Z","end":"2026-07-06T21:51:24.106573Z","steps":["trace[914888010] 'agreement among raft nodes before linearized reading' (duration: 185.549118ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:51:24.984309Z","caller":"traceutil/trace.go:171","msg":"trace[497424846] transaction","detail":"{read_only:false; response_revision:8415; number_of_response:1; }","duration":"160.74313ms","start":"2026-07-06T21:51:24.823544Z","end":"2026-07-06T21:51:24.984287Z","steps":["trace[497424846] 'process raft request' (duration: 160.598616ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:51:25.015214Z","caller":"traceutil/trace.go:171","msg":"trace[1358662215] transaction","detail":"{read_only:false; response_revision:8416; number_of_response:1; }","duration":"186.619235ms","start":"2026-07-06T21:51:24.828563Z","end":"2026-07-06T21:51:25.015183Z","steps":["trace[1358662215] 'process raft request' (duration: 186.437131ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:51:25.015501Z","caller":"traceutil/trace.go:171","msg":"trace[2030570164] transaction","detail":"{read_only:false; response_revision:8417; number_of_response:1; }","duration":"185.409195ms","start":"2026-07-06T21:51:24.830017Z","end":"2026-07-06T21:51:25.015426Z","steps":["trace[2030570164] 'process raft request' (duration: 185.117458ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:51:34.194498Z","caller":"wal/wal.go:785","msg":"created a new WAL segment","path":"/var/lib/etcd/member/wal/0000000000000001-000000000000223e.wal"} {"level":"info","ts":"2026-07-06T21:52:05.289449Z","caller":"traceutil/trace.go:171","msg":"trace[1392695358] transaction","detail":"{read_only:false; response_revision:8722; number_of_response:1; }","duration":"100.174573ms","start":"2026-07-06T21:52:05.189246Z","end":"2026-07-06T21:52:05.289421Z","steps":["trace[1392695358] 'process raft request' (duration: 99.985428ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:52:05.459348Z","caller":"traceutil/trace.go:171","msg":"trace[1358301512] linearizableReadLoop","detail":"{readStateIndex:9033; appliedIndex:9032; }","duration":"133.441268ms","start":"2026-07-06T21:52:05.325889Z","end":"2026-07-06T21:52:05.45933Z","steps":["trace[1358301512] 'read index received' (duration: 133.312625ms)","trace[1358301512] 'applied index is now lower than readState.Index' (duration: 127.723µs)"],"step_count":2} {"level":"warn","ts":"2026-07-06T21:52:05.459522Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.618683ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"} {"level":"info","ts":"2026-07-06T21:52:05.45955Z","caller":"traceutil/trace.go:171","msg":"trace[1806492129] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:8726; }","duration":"133.658553ms","start":"2026-07-06T21:52:05.325884Z","end":"2026-07-06T21:52:05.459542Z","steps":["trace[1806492129] 'agreement among raft nodes before linearized reading' (duration: 133.547881ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T21:52:05.459561Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.654489ms","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-07-06T21:52:05.459614Z","caller":"traceutil/trace.go:171","msg":"trace[47546251] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:8726; }","duration":"132.734031ms","start":"2026-07-06T21:52:05.326865Z","end":"2026-07-06T21:52:05.459599Z","steps":["trace[47546251] 'agreement among raft nodes before linearized reading' (duration: 132.595598ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:52:05.459461Z","caller":"traceutil/trace.go:171","msg":"trace[1930279091] transaction","detail":"{read_only:false; response_revision:8726; number_of_response:1; }","duration":"143.793168ms","start":"2026-07-06T21:52:05.315639Z","end":"2026-07-06T21:52:05.459432Z","steps":["trace[1930279091] 'process raft request' (duration: 143.571163ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:52:06.102552Z","caller":"traceutil/trace.go:171","msg":"trace[487629458] linearizableReadLoop","detail":"{readStateIndex:9037; appliedIndex:9036; }","duration":"163.528667ms","start":"2026-07-06T21:52:05.939003Z","end":"2026-07-06T21:52:06.102532Z","steps":["trace[487629458] 'read index received' (duration: 138.308717ms)","trace[487629458] 'applied index is now lower than readState.Index' (duration: 25.2191ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:52:06.102612Z","caller":"traceutil/trace.go:171","msg":"trace[1472279138] transaction","detail":"{read_only:false; response_revision:8730; number_of_response:1; }","duration":"168.700702ms","start":"2026-07-06T21:52:05.933881Z","end":"2026-07-06T21:52:06.102582Z","steps":["trace[1472279138] 'process raft request' (duration: 143.417051ms)","trace[1472279138] 'compare' (duration: 25.142707ms)"],"step_count":2} {"level":"warn","ts":"2026-07-06T21:52:06.102661Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.642449ms","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:7"} {"level":"info","ts":"2026-07-06T21:52:06.102692Z","caller":"traceutil/trace.go:171","msg":"trace[12642754] range","detail":"{range_begin:/registry/cert-manager.io/clusterissuers/; range_end:/registry/cert-manager.io/clusterissuers0; response_count:0; response_revision:8730; }","duration":"163.726801ms","start":"2026-07-06T21:52:05.938955Z","end":"2026-07-06T21:52:06.102681Z","steps":["trace[12642754] 'agreement among raft nodes before linearized reading' (duration: 163.65527ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:52:06.137207Z","caller":"traceutil/trace.go:171","msg":"trace[1336878573] transaction","detail":"{read_only:false; response_revision:8731; number_of_response:1; }","duration":"130.144719ms","start":"2026-07-06T21:52:06.007041Z","end":"2026-07-06T21:52:06.137186Z","steps":["trace[1336878573] 'process raft request' (duration: 130.028006ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:53:24.566416Z","caller":"traceutil/trace.go:171","msg":"trace[95181720] transaction","detail":"{read_only:false; response_revision:9490; number_of_response:1; }","duration":"214.219233ms","start":"2026-07-06T21:53:24.352179Z","end":"2026-07-06T21:53:24.566398Z","steps":["trace[95181720] 'process raft request' (duration: 213.756641ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:53:47.642477Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"355195d5aae85944","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-07-06T21:53:47.647565Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001} {"level":"info","ts":"2026-07-06T21:53:47.647659Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001} {"level":"info","ts":"2026-07-06T21:56:05.378711Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":8183} {"level":"info","ts":"2026-07-06T21:56:05.439477Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":8183,"took":"58.084239ms","hash":1027826172,"current-db-size-bytes":58413056,"current-db-size":"58 MB","current-db-size-in-use-bytes":28327936,"current-db-size-in-use":"28 MB"} {"level":"info","ts":"2026-07-06T21:56:05.439531Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1027826172,"revision":8183,"compact-revision":6095} {"level":"info","ts":"2026-07-06T21:58:58.056184Z","caller":"traceutil/trace.go:171","msg":"trace[944091886] transaction","detail":"{read_only:false; response_revision:11889; number_of_response:1; }","duration":"121.358586ms","start":"2026-07-06T21:58:57.934797Z","end":"2026-07-06T21:58:58.056156Z","steps":["trace[944091886] 'process raft request' (duration: 121.206622ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T21:58:58.43812Z","caller":"traceutil/trace.go:171","msg":"trace[1198264676] linearizableReadLoop","detail":"{readStateIndex:12297; appliedIndex:12296; }","duration":"166.276943ms","start":"2026-07-06T21:58:58.271813Z","end":"2026-07-06T21:58:58.43809Z","steps":["trace[1198264676] 'read index received' (duration: 146.947265ms)","trace[1198264676] 'applied index is now lower than readState.Index' (duration: 19.328587ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T21:58:58.438163Z","caller":"traceutil/trace.go:171","msg":"trace[1483252053] transaction","detail":"{read_only:false; response_revision:11892; number_of_response:1; }","duration":"280.237348ms","start":"2026-07-06T21:58:58.157889Z","end":"2026-07-06T21:58:58.438126Z","steps":["trace[1483252053] 'process raft request' (duration: 260.941182ms)","trace[1483252053] 'compare' (duration: 19.129362ms)"],"step_count":2} {"level":"warn","ts":"2026-07-06T21:58:58.438442Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.60996ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-07-06T21:58:58.438512Z","caller":"traceutil/trace.go:171","msg":"trace[660868531] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:11892; }","duration":"166.740394ms","start":"2026-07-06T21:58:58.271752Z","end":"2026-07-06T21:58:58.438492Z","steps":["trace[660868531] 'agreement among raft nodes before linearized reading' (duration: 166.460887ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:01:05.385369Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":10534} {"level":"info","ts":"2026-07-06T22:01:05.468857Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":10534,"took":"80.981599ms","hash":97941292,"current-db-size-bytes":58413056,"current-db-size":"58 MB","current-db-size-in-use-bytes":26275840,"current-db-size-in-use":"26 MB"} {"level":"info","ts":"2026-07-06T22:01:05.469021Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":97941292,"revision":10534,"compact-revision":8183} {"level":"info","ts":"2026-07-06T22:05:40.176224Z","caller":"traceutil/trace.go:171","msg":"trace[1968843755] linearizableReadLoop","detail":"{readStateIndex:15092; appliedIndex:15091; }","duration":"167.001505ms","start":"2026-07-06T22:05:40.009193Z","end":"2026-07-06T22:05:40.176195Z","steps":["trace[1968843755] 'read index received' (duration: 166.772849ms)","trace[1968843755] 'applied index is now lower than readState.Index' (duration: 227.336µs)"],"step_count":2} {"level":"info","ts":"2026-07-06T22:05:40.176536Z","caller":"traceutil/trace.go:171","msg":"trace[1250531356] transaction","detail":"{read_only:false; response_revision:14592; number_of_response:1; }","duration":"210.804406ms","start":"2026-07-06T22:05:39.965719Z","end":"2026-07-06T22:05:40.176523Z","steps":["trace[1250531356] 'process raft request' (duration: 210.266493ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:05:40.176806Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.605149ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/openstack/\" range_end:\"/registry/limitranges/openstack0\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-06T22:05:40.176854Z","caller":"traceutil/trace.go:171","msg":"trace[985536379] range","detail":"{range_begin:/registry/limitranges/openstack/; range_end:/registry/limitranges/openstack0; response_count:0; response_revision:14592; }","duration":"167.717571ms","start":"2026-07-06T22:05:40.009123Z","end":"2026-07-06T22:05:40.17684Z","steps":["trace[985536379] 'agreement among raft nodes before linearized reading' (duration: 167.631179ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:05:40.339107Z","caller":"traceutil/trace.go:171","msg":"trace[673585324] transaction","detail":"{read_only:false; response_revision:14593; number_of_response:1; }","duration":"290.119966ms","start":"2026-07-06T22:05:40.048952Z","end":"2026-07-06T22:05:40.339072Z","steps":["trace[673585324] 'process raft request' (duration: 288.459457ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:05:40.339117Z","caller":"traceutil/trace.go:171","msg":"trace[1269356235] transaction","detail":"{read_only:false; response_revision:14594; number_of_response:1; }","duration":"202.562416ms","start":"2026-07-06T22:05:40.136531Z","end":"2026-07-06T22:05:40.339093Z","steps":["trace[1269356235] 'process raft request' (duration: 202.463123ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:05:40.339342Z","caller":"traceutil/trace.go:171","msg":"trace[1451747463] linearizableReadLoop","detail":"{readStateIndex:15096; appliedIndex:15092; }","duration":"163.025738ms","start":"2026-07-06T22:05:40.176304Z","end":"2026-07-06T22:05:40.33933Z","steps":["trace[1451747463] 'read index received' (duration: 161.122923ms)","trace[1451747463] 'applied index is now lower than readState.Index' (duration: 1.901685ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T22:05:40.339428Z","caller":"traceutil/trace.go:171","msg":"trace[1666267965] transaction","detail":"{read_only:false; response_revision:14595; number_of_response:1; }","duration":"202.834413ms","start":"2026-07-06T22:05:40.136542Z","end":"2026-07-06T22:05:40.339376Z","steps":["trace[1666267965] 'process raft request' (duration: 202.519025ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:05:40.339475Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"325.481133ms","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-07-06T22:05:40.339516Z","caller":"traceutil/trace.go:171","msg":"trace[1643589645] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:14596; }","duration":"325.574295ms","start":"2026-07-06T22:05:40.013932Z","end":"2026-07-06T22:05:40.339506Z","steps":["trace[1643589645] 'agreement among raft nodes before linearized reading' (duration: 325.468652ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:05:40.33955Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-06T22:05:40.013909Z","time spent":"325.632608ms","remote":"127.0.0.1:54392","response type":"/etcdserverpb.KV/Range","request count":0,"request size":53,"response count":0,"response size":28,"request content":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" "} {"level":"info","ts":"2026-07-06T22:05:40.339426Z","caller":"traceutil/trace.go:171","msg":"trace[468701588] transaction","detail":"{read_only:false; response_revision:14596; number_of_response:1; }","duration":"202.805802ms","start":"2026-07-06T22:05:40.136583Z","end":"2026-07-06T22:05:40.339389Z","steps":["trace[468701588] 'process raft request' (duration: 202.699229ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:05:40.343648Z","caller":"traceutil/trace.go:171","msg":"trace[1450216848] transaction","detail":"{read_only:false; response_revision:14597; number_of_response:1; }","duration":"161.516332ms","start":"2026-07-06T22:05:40.18211Z","end":"2026-07-06T22:05:40.343626Z","steps":["trace[1450216848] 'process raft request' (duration: 161.320137ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:05:40.343725Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.353789ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-5qqnc\" ","response":"range_response_count:1 size:6524"} {"level":"info","ts":"2026-07-06T22:05:40.343797Z","caller":"traceutil/trace.go:171","msg":"trace[1325736571] range","detail":"{range_begin:/registry/pods/openstack/keepalived-5qqnc; range_end:; response_count:1; response_revision:14597; }","duration":"102.478403ms","start":"2026-07-06T22:05:40.2413Z","end":"2026-07-06T22:05:40.343779Z","steps":["trace[1325736571] 'agreement among raft nodes before linearized reading' (duration: 102.255417ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:05:51.174472Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"238.510716ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-07-06T22:05:51.174618Z","caller":"traceutil/trace.go:171","msg":"trace[1619598560] linearizableReadLoop","detail":"{readStateIndex:15281; appliedIndex:15280; }","duration":"195.35512ms","start":"2026-07-06T22:05:50.979245Z","end":"2026-07-06T22:05:51.1746Z","steps":["trace[1619598560] 'read index received' (duration: 30.25µs)","trace[1619598560] 'applied index is now lower than readState.Index' (duration: 195.32198ms)"],"step_count":2} {"level":"warn","ts":"2026-07-06T22:05:51.174843Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.589807ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/ovn-northd-fc978744-mc56t\" ","response":"range_response_count:1 size:7032"} {"level":"info","ts":"2026-07-06T22:05:51.174894Z","caller":"traceutil/trace.go:171","msg":"trace[894952233] range","detail":"{range_begin:/registry/pods/openstack/ovn-northd-fc978744-mc56t; range_end:; response_count:1; response_revision:14777; }","duration":"195.682408ms","start":"2026-07-06T22:05:50.979198Z","end":"2026-07-06T22:05:51.17488Z","steps":["trace[894952233] 'agreement among raft nodes before linearized reading' (duration: 195.448913ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:05:51.174957Z","caller":"traceutil/trace.go:171","msg":"trace[1575527243] transaction","detail":"{read_only:false; response_revision:14777; number_of_response:1; }","duration":"272.307665ms","start":"2026-07-06T22:05:50.902486Z","end":"2026-07-06T22:05:51.174793Z","steps":["trace[1575527243] 'process raft request' (duration: 33.354808ms)","trace[1575527243] 'compare' (duration: 238.151158ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T22:05:51.327291Z","caller":"traceutil/trace.go:171","msg":"trace[1795371171] transaction","detail":"{read_only:false; response_revision:14778; number_of_response:1; }","duration":"142.043821ms","start":"2026-07-06T22:05:51.185191Z","end":"2026-07-06T22:05:51.327235Z","steps":["trace[1795371171] 'process raft request' (duration: 141.812805ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:06:05.392126Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":12756} {"level":"info","ts":"2026-07-06T22:06:05.47731Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":12756,"took":"82.626451ms","hash":1042444684,"current-db-size-bytes":58413056,"current-db-size":"58 MB","current-db-size-in-use-bytes":28774400,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-07-06T22:06:05.477386Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1042444684,"revision":12756,"compact-revision":10534} {"level":"info","ts":"2026-07-06T22:07:30.481478Z","caller":"traceutil/trace.go:171","msg":"trace[1145243966] linearizableReadLoop","detail":"{readStateIndex:16399; appliedIndex:16398; }","duration":"237.00266ms","start":"2026-07-06T22:07:30.244453Z","end":"2026-07-06T22:07:30.481456Z","steps":["trace[1145243966] 'read index received' (duration: 236.790374ms)","trace[1145243966] 'applied index is now lower than readState.Index' (duration: 211.506µs)"],"step_count":2} {"level":"info","ts":"2026-07-06T22:07:30.481526Z","caller":"traceutil/trace.go:171","msg":"trace[471088028] transaction","detail":"{read_only:false; response_revision:15860; number_of_response:1; }","duration":"283.708342ms","start":"2026-07-06T22:07:30.197788Z","end":"2026-07-06T22:07:30.481497Z","steps":["trace[471088028] 'process raft request' (duration: 283.530598ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:07:30.481635Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.160234ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/\" range_end:\"/registry/pxc.percona.com/perconaxtradbclusters0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-07-06T22:07:30.4817Z","caller":"traceutil/trace.go:171","msg":"trace[845141612] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/; range_end:/registry/pxc.percona.com/perconaxtradbclusters0; response_count:0; response_revision:15860; }","duration":"237.284457ms","start":"2026-07-06T22:07:30.244406Z","end":"2026-07-06T22:07:30.48169Z","steps":["trace[845141612] 'agreement among raft nodes before linearized reading' (duration: 237.168394ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:07:30.697559Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.779784ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-compute-default-5nhwg\" ","response":"range_response_count:1 size:22093"} {"level":"info","ts":"2026-07-06T22:07:30.697625Z","caller":"traceutil/trace.go:171","msg":"trace[772708774] range","detail":"{range_begin:/registry/pods/openstack/nova-compute-default-5nhwg; range_end:; response_count:1; response_revision:15861; }","duration":"148.899487ms","start":"2026-07-06T22:07:30.548709Z","end":"2026-07-06T22:07:30.697608Z","steps":["trace[772708774] 'range keys from in-memory index tree' (duration: 148.627989ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:07:30.697701Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.08359ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-compute-default-5nhwg\" ","response":"range_response_count:1 size:22093"} {"level":"info","ts":"2026-07-06T22:07:30.697774Z","caller":"traceutil/trace.go:171","msg":"trace[1454545645] range","detail":"{range_begin:/registry/pods/openstack/nova-compute-default-5nhwg; range_end:; response_count:1; response_revision:15861; }","duration":"151.224403ms","start":"2026-07-06T22:07:30.546531Z","end":"2026-07-06T22:07:30.697755Z","steps":["trace[1454545645] 'range keys from in-memory index tree' (duration: 150.847534ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:07:30.697928Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.533103ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-06T22:07:30.69797Z","caller":"traceutil/trace.go:171","msg":"trace[989290954] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:15861; }","duration":"142.592144ms","start":"2026-07-06T22:07:30.555368Z","end":"2026-07-06T22:07:30.69796Z","steps":["trace[989290954] 'range keys from in-memory index tree' (duration: 142.475231ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:07:30.923568Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.201953ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-06T22:07:30.923694Z","caller":"traceutil/trace.go:171","msg":"trace[65326045] linearizableReadLoop","detail":"{readStateIndex:16404; appliedIndex:16403; }","duration":"140.119684ms","start":"2026-07-06T22:07:30.783558Z","end":"2026-07-06T22:07:30.923678Z","steps":["trace[65326045] 'read index received' (duration: 28.655545ms)","trace[65326045] 'applied index is now lower than readState.Index' (duration: 111.462379ms)"],"step_count":2} {"level":"info","ts":"2026-07-06T22:07:30.92391Z","caller":"traceutil/trace.go:171","msg":"trace[1920985145] transaction","detail":"{read_only:false; response_revision:15865; number_of_response:1; }","duration":"197.110214ms","start":"2026-07-06T22:07:30.726788Z","end":"2026-07-06T22:07:30.923898Z","steps":["trace[1920985145] 'process raft request' (duration: 85.483201ms)","trace[1920985145] 'compare' (duration: 110.887535ms)"],"step_count":2} {"level":"warn","ts":"2026-07-06T22:07:30.924141Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.577426ms","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-07-06T22:07:30.924199Z","caller":"traceutil/trace.go:171","msg":"trace[239822413] range","detail":"{range_begin:/registry/jobs/openstack/nova-rabbit-init; range_end:; response_count:0; response_revision:15865; }","duration":"140.647877ms","start":"2026-07-06T22:07:30.783521Z","end":"2026-07-06T22:07:30.924168Z","steps":["trace[239822413] 'agreement among raft nodes before linearized reading' (duration: 140.551964ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:07:30.924455Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.77318ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/openstack/nova-api\" ","response":"range_response_count:1 size:667"} {"level":"info","ts":"2026-07-06T22:07:30.924491Z","caller":"traceutil/trace.go:171","msg":"trace[1307422222] range","detail":"{range_begin:/registry/services/endpoints/openstack/nova-api; range_end:; response_count:1; response_revision:15865; }","duration":"140.821381ms","start":"2026-07-06T22:07:30.783662Z","end":"2026-07-06T22:07:30.924483Z","steps":["trace[1307422222] 'agreement among raft nodes before linearized reading' (duration: 140.696158ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:07:30.925055Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.117063ms","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-07-06T22:07:30.925131Z","caller":"traceutil/trace.go:171","msg":"trace[1048753747] range","detail":"{range_begin:/registry/jobs/openstack/nova-db-sync; range_end:; response_count:1; response_revision:15865; }","duration":"140.214725ms","start":"2026-07-06T22:07:30.7849Z","end":"2026-07-06T22:07:30.925114Z","steps":["trace[1048753747] 'agreement among raft nodes before linearized reading' (duration: 140.017311ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:11:05.398313Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":15055} {"level":"info","ts":"2026-07-06T22:11:05.495366Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":15055,"took":"94.287138ms","hash":748753296,"current-db-size-bytes":58413056,"current-db-size":"58 MB","current-db-size-in-use-bytes":30908416,"current-db-size-in-use":"31 MB"} {"level":"info","ts":"2026-07-06T22:11:05.495424Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":748753296,"revision":15055,"compact-revision":12756} {"level":"info","ts":"2026-07-06T22:13:08.315278Z","caller":"traceutil/trace.go:171","msg":"trace[461289187] transaction","detail":"{read_only:false; response_revision:18357; number_of_response:1; }","duration":"175.910957ms","start":"2026-07-06T22:13:08.139348Z","end":"2026-07-06T22:13:08.315259Z","steps":["trace[461289187] 'process raft request' (duration: 175.791134ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:13:08.341335Z","caller":"traceutil/trace.go:171","msg":"trace[1565179642] transaction","detail":"{read_only:false; response_revision:18358; number_of_response:1; }","duration":"199.645822ms","start":"2026-07-06T22:13:08.141661Z","end":"2026-07-06T22:13:08.341307Z","steps":["trace[1565179642] 'process raft request' (duration: 199.424907ms)"],"step_count":1} {"level":"warn","ts":"2026-07-06T22:13:15.116592Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.041715ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/nova-cell-setup-6wqng\" ","response":"range_response_count:1 size:9789"} {"level":"info","ts":"2026-07-06T22:13:15.116698Z","caller":"traceutil/trace.go:171","msg":"trace[160573880] range","detail":"{range_begin:/registry/pods/openstack/nova-cell-setup-6wqng; range_end:; response_count:1; response_revision:18402; }","duration":"123.196249ms","start":"2026-07-06T22:13:14.993483Z","end":"2026-07-06T22:13:15.116679Z","steps":["trace[160573880] 'range keys from in-memory index tree' (duration: 122.859941ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:13:15.614565Z","caller":"traceutil/trace.go:171","msg":"trace[250428620] transaction","detail":"{read_only:false; response_revision:18403; number_of_response:1; }","duration":"134.049432ms","start":"2026-07-06T22:13:15.480479Z","end":"2026-07-06T22:13:15.614528Z","steps":["trace[250428620] 'process raft request' (duration: 133.815927ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:13:16.151235Z","caller":"traceutil/trace.go:171","msg":"trace[1190447759] transaction","detail":"{read_only:false; response_revision:18406; number_of_response:1; }","duration":"247.965334ms","start":"2026-07-06T22:13:15.903238Z","end":"2026-07-06T22:13:16.151203Z","steps":["trace[1190447759] 'process raft request' (duration: 247.876872ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:13:16.151511Z","caller":"traceutil/trace.go:171","msg":"trace[1902390248] transaction","detail":"{read_only:false; response_revision:18405; number_of_response:1; }","duration":"248.747393ms","start":"2026-07-06T22:13:15.902737Z","end":"2026-07-06T22:13:16.151484Z","steps":["trace[1902390248] 'process raft request' (duration: 248.1858ms)"],"step_count":1} {"level":"info","ts":"2026-07-06T22:15:55.923778Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"355195d5aae85944","local-member-applied-index":20002,"local-member-snapshot-index":10001,"local-member-snapshot-count":10000} {"level":"info","ts":"2026-07-06T22:15:55.929017Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":20002} {"level":"info","ts":"2026-07-06T22:15:55.929176Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":15002} {"level":"info","ts":"2026-07-06T22:16:05.404543Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":17500} {"level":"info","ts":"2026-07-06T22:16:05.496749Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":17500,"took":"88.749962ms","hash":3735184153,"current-db-size-bytes":58413056,"current-db-size":"58 MB","current-db-size-in-use-bytes":30150656,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-07-06T22:16:05.496903Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3735184153,"revision":17500,"compact-revision":15055} {"level":"info","ts":"2026-07-06T22:21:05.409516Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":19388} {"level":"info","ts":"2026-07-06T22:21:05.503115Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":19388,"took":"90.224139ms","hash":2168378249,"current-db-size-bytes":58413056,"current-db-size":"58 MB","current-db-size-in-use-bytes":24657920,"current-db-size-in-use":"25 MB"} {"level":"info","ts":"2026-07-06T22:21:05.503172Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2168378249,"revision":19388,"compact-revision":17500}