{"level":"warn","ts":"2026-04-17T00:27:42.373007Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-17T00:27:42.373132Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.244: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.244:2380","--initial-cluster=instance=https://199.204.45.244:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.244:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.244:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-04-17T00:27:42.373242Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-17T00:27:42.373255Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.244:2380"]} {"level":"info","ts":"2026-04-17T00:27:42.373297Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-04-17T00:27:42.37403Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.244:2379"]} {"level":"info","ts":"2026-04-17T00:27:42.374126Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.244:2380"],"listen-peer-urls":["https://199.204.45.244:2380"],"advertise-client-urls":["https://199.204.45.244:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.244:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.244:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-04-17T00:27:42.378709Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.32943ms"} {"level":"info","ts":"2026-04-17T00:27:42.38738Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"1686e9b1ea717edf","cluster-id":"71c60fe001ca5b3c"} {"level":"info","ts":"2026-04-17T00:27:42.387508Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf switched to configuration voters=()"} {"level":"info","ts":"2026-04-17T00:27:42.387572Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf became follower at term 0"} {"level":"info","ts":"2026-04-17T00:27:42.387601Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 1686e9b1ea717edf [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-17T00:27:42.387647Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf became follower at term 1"} {"level":"info","ts":"2026-04-17T00:27:42.387724Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf switched to configuration voters=(1623241666065432287)"} {"level":"warn","ts":"2026-04-17T00:27:42.393779Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-17T00:27:42.395169Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-17T00:27:42.396395Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-04-17T00:27:42.399515Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"1686e9b1ea717edf","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-17T00:27:42.400137Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"1686e9b1ea717edf","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-17T00:27:42.401875Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf switched to configuration voters=(1623241666065432287)"} {"level":"info","ts":"2026-04-17T00:27:42.402031Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"71c60fe001ca5b3c","local-member-id":"1686e9b1ea717edf","added-peer-id":"1686e9b1ea717edf","added-peer-peer-urls":["https://199.204.45.244:2380"]} {"level":"info","ts":"2026-04-17T00:27:42.402899Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-17T00:27:42.403326Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-17T00:27:42.403354Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-17T00:27:42.406953Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-04-17T00:27:42.407012Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.244:2380"} {"level":"info","ts":"2026-04-17T00:27:42.407162Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.244:2380"} {"level":"info","ts":"2026-04-17T00:27:42.409012Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-17T00:27:42.408957Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"1686e9b1ea717edf","initial-advertise-peer-urls":["https://199.204.45.244:2380"],"listen-peer-urls":["https://199.204.45.244:2380"],"advertise-client-urls":["https://199.204.45.244:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.244:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-17T00:27:42.98859Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf is starting a new election at term 1"} {"level":"info","ts":"2026-04-17T00:27:42.988667Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf became pre-candidate at term 1"} {"level":"info","ts":"2026-04-17T00:27:42.988691Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf received MsgPreVoteResp from 1686e9b1ea717edf at term 1"} {"level":"info","ts":"2026-04-17T00:27:42.988712Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf became candidate at term 2"} {"level":"info","ts":"2026-04-17T00:27:42.988723Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf received MsgVoteResp from 1686e9b1ea717edf at term 2"} {"level":"info","ts":"2026-04-17T00:27:42.988739Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1686e9b1ea717edf became leader at term 2"} {"level":"info","ts":"2026-04-17T00:27:42.988754Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 1686e9b1ea717edf elected leader 1686e9b1ea717edf at term 2"} {"level":"info","ts":"2026-04-17T00:27:42.991018Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-17T00:27:42.991877Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"1686e9b1ea717edf","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.244:2379]}","request-path":"/0/members/1686e9b1ea717edf/attributes","cluster-id":"71c60fe001ca5b3c","publish-timeout":"7s"} {"level":"info","ts":"2026-04-17T00:27:42.991937Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-17T00:27:42.991922Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-17T00:27:42.992155Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-17T00:27:42.992252Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-17T00:27:42.995413Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.244:2379"} {"level":"info","ts":"2026-04-17T00:27:42.995462Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-17T00:27:42.995993Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"71c60fe001ca5b3c","local-member-id":"1686e9b1ea717edf","cluster-version":"3.5"} {"level":"info","ts":"2026-04-17T00:27:43.003207Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-17T00:27:43.003288Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"warn","ts":"2026-04-17T00:27:46.877891Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.34583ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-17T00:27:46.878059Z","caller":"traceutil/trace.go:171","msg":"trace[2048821708] transaction","detail":"{read_only:false; response_revision:221; number_of_response:1; }","duration":"280.811945ms","start":"2026-04-17T00:27:46.597222Z","end":"2026-04-17T00:27:46.878034Z","steps":["trace[2048821708] 'process raft request' (duration: 142.445269ms)","trace[2048821708] 'compare' (duration: 137.185476ms)"],"step_count":2} {"level":"warn","ts":"2026-04-17T00:27:47.197878Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.502856ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-17T00:27:47.198006Z","caller":"traceutil/trace.go:171","msg":"trace[364773832] linearizableReadLoop","detail":"{readStateIndex:228; appliedIndex:227; }","duration":"259.733235ms","start":"2026-04-17T00:27:46.938252Z","end":"2026-04-17T00:27:47.197986Z","steps":["trace[364773832] 'read index received' (duration: 65.915361ms)","trace[364773832] 'applied index is now lower than readState.Index' (duration: 193.816134ms)"],"step_count":2} {"level":"warn","ts":"2026-04-17T00:27:47.198239Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"259.976131ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:3492"} {"level":"info","ts":"2026-04-17T00:27:47.19828Z","caller":"traceutil/trace.go:171","msg":"trace[447664463] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:222; }","duration":"260.043723ms","start":"2026-04-17T00:27:46.938224Z","end":"2026-04-17T00:27:47.198268Z","steps":["trace[447664463] 'agreement among raft nodes before linearized reading' (duration: 259.887749ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:27:47.198254Z","caller":"traceutil/trace.go:171","msg":"trace[743722667] transaction","detail":"{read_only:false; response_revision:222; number_of_response:1; }","duration":"313.148111ms","start":"2026-04-17T00:27:46.884884Z","end":"2026-04-17T00:27:47.198033Z","steps":["trace[743722667] 'process raft request' (duration: 119.382628ms)","trace[743722667] 'compare' (duration: 193.296482ms)"],"step_count":2} {"level":"warn","ts":"2026-04-17T00:27:47.198868Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-17T00:27:46.884858Z","time spent":"313.634033ms","remote":"127.0.0.1:45182","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":638,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-17T00:28:16.888186Z","caller":"traceutil/trace.go:171","msg":"trace[421854435] transaction","detail":"{read_only:false; response_revision:603; number_of_response:1; }","duration":"153.818594ms","start":"2026-04-17T00:28:16.734297Z","end":"2026-04-17T00:28:16.888115Z","steps":["trace[421854435] 'process raft request' (duration: 153.083806ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:18.300945Z","caller":"traceutil/trace.go:171","msg":"trace[1169099790] transaction","detail":"{read_only:false; response_revision:613; number_of_response:1; }","duration":"377.57821ms","start":"2026-04-17T00:28:17.923309Z","end":"2026-04-17T00:28:18.300887Z","steps":["trace[1169099790] 'process raft request' (duration: 377.007406ms)"],"step_count":1} {"level":"warn","ts":"2026-04-17T00:28:18.301224Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-17T00:28:17.923279Z","time spent":"377.809125ms","remote":"127.0.0.1:45206","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036293,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-17T00:28:34.232157Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.414335ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-17T00:28:34.232276Z","caller":"traceutil/trace.go:171","msg":"trace[973997259] transaction","detail":"{read_only:false; response_revision:780; number_of_response:1; }","duration":"239.335281ms","start":"2026-04-17T00:28:33.992918Z","end":"2026-04-17T00:28:34.232253Z","steps":["trace[973997259] 'process raft request' (duration: 103.723311ms)","trace[973997259] 'compare' (duration: 135.314483ms)"],"step_count":2} {"level":"info","ts":"2026-04-17T00:28:51.241426Z","caller":"traceutil/trace.go:171","msg":"trace[1646357513] transaction","detail":"{read_only:false; response_revision:1046; number_of_response:1; }","duration":"118.803129ms","start":"2026-04-17T00:28:51.122603Z","end":"2026-04-17T00:28:51.241406Z","steps":["trace[1646357513] 'process raft request' (duration: 72.291218ms)","trace[1646357513] 'compare' (duration: 46.326894ms)"],"step_count":2} {"level":"info","ts":"2026-04-17T00:28:51.241673Z","caller":"traceutil/trace.go:171","msg":"trace[1951900562] transaction","detail":"{read_only:false; response_revision:1047; number_of_response:1; }","duration":"118.430386ms","start":"2026-04-17T00:28:51.123236Z","end":"2026-04-17T00:28:51.241666Z","steps":["trace[1951900562] 'process raft request' (duration: 118.111476ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.2417Z","caller":"traceutil/trace.go:171","msg":"trace[1118569448] transaction","detail":"{read_only:false; response_revision:1049; number_of_response:1; }","duration":"114.214999ms","start":"2026-04-17T00:28:51.127428Z","end":"2026-04-17T00:28:51.241643Z","steps":["trace[1118569448] 'process raft request' (duration: 114.023183ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.241901Z","caller":"traceutil/trace.go:171","msg":"trace[424819942] transaction","detail":"{read_only:false; response_revision:1055; number_of_response:1; }","duration":"114.055564ms","start":"2026-04-17T00:28:51.127822Z","end":"2026-04-17T00:28:51.241878Z","steps":["trace[424819942] 'process raft request' (duration: 113.93389ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.242037Z","caller":"traceutil/trace.go:171","msg":"trace[642005826] transaction","detail":"{read_only:false; response_revision:1048; number_of_response:1; }","duration":"118.681245ms","start":"2026-04-17T00:28:51.123321Z","end":"2026-04-17T00:28:51.242003Z","steps":["trace[642005826] 'process raft request' (duration: 118.093046ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.242096Z","caller":"traceutil/trace.go:171","msg":"trace[1450457433] transaction","detail":"{read_only:false; response_revision:1056; number_of_response:1; }","duration":"113.826166ms","start":"2026-04-17T00:28:51.128262Z","end":"2026-04-17T00:28:51.242088Z","steps":["trace[1450457433] 'process raft request' (duration: 113.575048ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.242167Z","caller":"traceutil/trace.go:171","msg":"trace[1992813131] transaction","detail":"{read_only:false; response_revision:1051; number_of_response:1; }","duration":"114.667563ms","start":"2026-04-17T00:28:51.127483Z","end":"2026-04-17T00:28:51.24215Z","steps":["trace[1992813131] 'process raft request' (duration: 114.043223ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.242191Z","caller":"traceutil/trace.go:171","msg":"trace[262421668] transaction","detail":"{read_only:false; response_revision:1050; number_of_response:1; }","duration":"114.702385ms","start":"2026-04-17T00:28:51.127468Z","end":"2026-04-17T00:28:51.24217Z","steps":["trace[262421668] 'process raft request' (duration: 114.015163ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.24233Z","caller":"traceutil/trace.go:171","msg":"trace[882080559] transaction","detail":"{read_only:false; response_revision:1053; number_of_response:1; }","duration":"114.746936ms","start":"2026-04-17T00:28:51.127576Z","end":"2026-04-17T00:28:51.242323Z","steps":["trace[882080559] 'process raft request' (duration: 114.078605ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.242386Z","caller":"traceutil/trace.go:171","msg":"trace[848058665] transaction","detail":"{read_only:false; response_revision:1054; number_of_response:1; }","duration":"114.810978ms","start":"2026-04-17T00:28:51.12757Z","end":"2026-04-17T00:28:51.242381Z","steps":["trace[848058665] 'process raft request' (duration: 114.122626ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:28:51.241924Z","caller":"traceutil/trace.go:171","msg":"trace[1970757703] transaction","detail":"{read_only:false; response_revision:1052; number_of_response:1; }","duration":"114.359284ms","start":"2026-04-17T00:28:51.127531Z","end":"2026-04-17T00:28:51.24189Z","steps":["trace[1970757703] 'process raft request' (duration: 114.087575ms)"],"step_count":1} {"level":"warn","ts":"2026-04-17T00:29:49.321623Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.427663ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-96aef168-720c-4232-ac39-3d083b407700\" ","response":"range_response_count:1 size:3627"} {"level":"info","ts":"2026-04-17T00:29:49.321741Z","caller":"traceutil/trace.go:171","msg":"trace[1975171665] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-96aef168-720c-4232-ac39-3d083b407700; range_end:; response_count:1; response_revision:1840; }","duration":"168.572987ms","start":"2026-04-17T00:29:49.153124Z","end":"2026-04-17T00:29:49.321697Z","steps":["trace[1975171665] 'range keys from in-memory index tree' (duration: 168.244548ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:30:02.272147Z","caller":"traceutil/trace.go:171","msg":"trace[341065023] transaction","detail":"{read_only:false; response_revision:1944; number_of_response:1; }","duration":"188.822822ms","start":"2026-04-17T00:30:02.083302Z","end":"2026-04-17T00:30:02.272125Z","steps":["trace[341065023] 'process raft request' (duration: 188.687579ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:30:02.274394Z","caller":"traceutil/trace.go:171","msg":"trace[2004346769] transaction","detail":"{read_only:false; response_revision:1945; number_of_response:1; }","duration":"189.905993ms","start":"2026-04-17T00:30:02.084477Z","end":"2026-04-17T00:30:02.274383Z","steps":["trace[2004346769] 'process raft request' (duration: 189.748899ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:30:02.274656Z","caller":"traceutil/trace.go:171","msg":"trace[996825704] transaction","detail":"{read_only:false; response_revision:1946; number_of_response:1; }","duration":"174.80915ms","start":"2026-04-17T00:30:02.099816Z","end":"2026-04-17T00:30:02.274625Z","steps":["trace[996825704] 'process raft request' (duration: 174.484511ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:30:24.677789Z","caller":"traceutil/trace.go:171","msg":"trace[927504562] transaction","detail":"{read_only:false; response_revision:2080; number_of_response:1; }","duration":"225.309251ms","start":"2026-04-17T00:30:24.452454Z","end":"2026-04-17T00:30:24.677763Z","steps":["trace[927504562] 'process raft request' (duration: 225.115826ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:30:24.740836Z","caller":"traceutil/trace.go:171","msg":"trace[297667815] transaction","detail":"{read_only:false; response_revision:2081; number_of_response:1; }","duration":"287.713039ms","start":"2026-04-17T00:30:24.453098Z","end":"2026-04-17T00:30:24.740811Z","steps":["trace[297667815] 'process raft request' (duration: 287.533544ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:30:24.741043Z","caller":"traceutil/trace.go:171","msg":"trace[1449706505] linearizableReadLoop","detail":"{readStateIndex:2159; appliedIndex:2157; }","duration":"285.855269ms","start":"2026-04-17T00:30:24.455152Z","end":"2026-04-17T00:30:24.741008Z","steps":["trace[1449706505] 'read index received' (duration: 222.498987ms)","trace[1449706505] 'applied index is now lower than readState.Index' (duration: 63.352912ms)"],"step_count":2} {"level":"info","ts":"2026-04-17T00:30:24.741148Z","caller":"traceutil/trace.go:171","msg":"trace[1869008526] transaction","detail":"{read_only:false; response_revision:2082; number_of_response:1; }","duration":"144.090816ms","start":"2026-04-17T00:30:24.59702Z","end":"2026-04-17T00:30:24.741111Z","steps":["trace[1869008526] 'process raft request' (duration: 143.738827ms)"],"step_count":1} {"level":"warn","ts":"2026-04-17T00:30:24.741378Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"286.203539ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-17T00:30:24.741986Z","caller":"traceutil/trace.go:171","msg":"trace[168299851] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2082; }","duration":"286.864846ms","start":"2026-04-17T00:30:24.455107Z","end":"2026-04-17T00:30:24.741972Z","steps":["trace[168299851] 'agreement among raft nodes before linearized reading' (duration: 286.104087ms)"],"step_count":1} {"level":"warn","ts":"2026-04-17T00:30:24.742216Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.477558ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-17T00:30:24.742482Z","caller":"traceutil/trace.go:171","msg":"trace[1273188482] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2082; }","duration":"149.789947ms","start":"2026-04-17T00:30:24.59266Z","end":"2026-04-17T00:30:24.74245Z","steps":["trace[1273188482] 'agreement among raft nodes before linearized reading' (duration: 149.493279ms)"],"step_count":1} {"level":"warn","ts":"2026-04-17T00:30:24.742285Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.917017ms","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":"warn","ts":"2026-04-17T00:30:24.742485Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.263541ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:554"} {"level":"info","ts":"2026-04-17T00:30:24.742839Z","caller":"traceutil/trace.go:171","msg":"trace[241463143] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:2082; }","duration":"151.486262ms","start":"2026-04-17T00:30:24.591334Z","end":"2026-04-17T00:30:24.74282Z","steps":["trace[241463143] 'agreement among raft nodes before linearized reading' (duration: 150.865135ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:30:24.743014Z","caller":"traceutil/trace.go:171","msg":"trace[1227515442] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2082; }","duration":"199.775644ms","start":"2026-04-17T00:30:24.543129Z","end":"2026-04-17T00:30:24.742904Z","steps":["trace[1227515442] 'agreement among raft nodes before linearized reading' (duration: 198.49911ms)"],"step_count":1} {"level":"warn","ts":"2026-04-17T00:30:24.880628Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.388319ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-17T00:30:24.881419Z","caller":"traceutil/trace.go:171","msg":"trace[1344263679] transaction","detail":"{read_only:false; response_revision:2083; number_of_response:1; }","duration":"133.002902ms","start":"2026-04-17T00:30:24.748379Z","end":"2026-04-17T00:30:24.881381Z","steps":["trace[1344263679] 'process raft request' (duration: 12.733549ms)","trace[1344263679] 'compare' (duration: 118.811134ms)"],"step_count":2} {"level":"info","ts":"2026-04-17T00:30:24.881777Z","caller":"traceutil/trace.go:171","msg":"trace[1164696435] transaction","detail":"{read_only:false; response_revision:2084; number_of_response:1; }","duration":"133.223748ms","start":"2026-04-17T00:30:24.748488Z","end":"2026-04-17T00:30:24.881711Z","steps":["trace[1164696435] 'process raft request' (duration: 132.820667ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:31:35.098241Z","caller":"traceutil/trace.go:171","msg":"trace[1570811280] transaction","detail":"{read_only:false; response_revision:2558; number_of_response:1; }","duration":"106.149652ms","start":"2026-04-17T00:31:34.992072Z","end":"2026-04-17T00:31:35.098222Z","steps":["trace[1570811280] 'process raft request' (duration: 105.841154ms)"],"step_count":1} {"level":"warn","ts":"2026-04-17T00:35:48.220366Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.180851ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-17T00:35:48.220859Z","caller":"traceutil/trace.go:171","msg":"trace[836828570] transaction","detail":"{read_only:false; response_revision:4560; number_of_response:1; }","duration":"193.393715ms","start":"2026-04-17T00:35:48.027447Z","end":"2026-04-17T00:35:48.220841Z","steps":["trace[836828570] 'process raft request' (duration: 193.293933ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:35:48.220857Z","caller":"traceutil/trace.go:171","msg":"trace[394793741] transaction","detail":"{read_only:false; response_revision:4559; number_of_response:1; }","duration":"196.515054ms","start":"2026-04-17T00:35:48.024308Z","end":"2026-04-17T00:35:48.220823Z","steps":["trace[394793741] 'process raft request' (duration: 94.790389ms)","trace[394793741] 'compare' (duration: 101.070649ms)"],"step_count":2} {"level":"warn","ts":"2026-04-17T00:35:49.702399Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.13818ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-17T00:35:49.702478Z","caller":"traceutil/trace.go:171","msg":"trace[2079262843] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4579; }","duration":"112.225642ms","start":"2026-04-17T00:35:49.590234Z","end":"2026-04-17T00:35:49.702459Z","steps":["trace[2079262843] 'range keys from in-memory index tree' (duration: 111.782321ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:36:05.435171Z","caller":"traceutil/trace.go:171","msg":"trace[1554985364] transaction","detail":"{read_only:false; response_revision:4856; number_of_response:1; }","duration":"143.402607ms","start":"2026-04-17T00:36:05.291743Z","end":"2026-04-17T00:36:05.435146Z","steps":["trace[1554985364] 'process raft request' (duration: 143.228193ms)"],"step_count":1} {"level":"info","ts":"2026-04-17T00:37:43.021636Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2924} {"level":"info","ts":"2026-04-17T00:37:43.153174Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2924,"took":"129.874336ms","hash":2940994551,"current-db-size-bytes":53653504,"current-db-size":"54 MB","current-db-size-in-use-bytes":29437952,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-04-17T00:37:43.153309Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2940994551,"revision":2924,"compact-revision":-1} {"level":"info","ts":"2026-04-17T00:42:43.032045Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5645} {"level":"info","ts":"2026-04-17T00:42:43.122352Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5645,"took":"89.077873ms","hash":3046579784,"current-db-size-bytes":53653504,"current-db-size":"54 MB","current-db-size-in-use-bytes":18362368,"current-db-size-in-use":"18 MB"} {"level":"info","ts":"2026-04-17T00:42:43.122436Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3046579784,"revision":5645,"compact-revision":2924}