{"level":"warn","ts":"2026-07-11T03:22:17.713058Z","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-11T03:22:17.713177Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.116: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.116:2380","--initial-cluster=instance=https://199.204.45.116:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.116:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.116: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-11T03:22:17.713382Z","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-11T03:22:17.7134Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.116:2380"]} {"level":"info","ts":"2026-07-11T03:22:17.713419Z","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-11T03:22:17.714422Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.116:2379"]} {"level":"info","ts":"2026-07-11T03:22:17.714765Z","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.116:2380"],"listen-peer-urls":["https://199.204.45.116:2380"],"advertise-client-urls":["https://199.204.45.116:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.116:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.116: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-11T03:22:17.719018Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.982542ms"} {"level":"info","ts":"2026-07-11T03:22:17.726835Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"5caa70ef1dd6dc04","cluster-id":"45afccab143d2c82"} {"level":"info","ts":"2026-07-11T03:22:17.726925Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=()"} {"level":"info","ts":"2026-07-11T03:22:17.727051Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became follower at term 0"} {"level":"info","ts":"2026-07-11T03:22:17.727126Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 5caa70ef1dd6dc04 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-07-11T03:22:17.72715Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became follower at term 1"} {"level":"info","ts":"2026-07-11T03:22:17.7272Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=(6677273569830296580)"} {"level":"warn","ts":"2026-07-11T03:22:17.733835Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-07-11T03:22:17.73658Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-07-11T03:22:17.73852Z","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-11T03:22:17.744432Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"5caa70ef1dd6dc04","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-07-11T03:22:17.744784Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"5caa70ef1dd6dc04","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-07-11T03:22:17.745174Z","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-11T03:22:17.74527Z","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-11T03:22:17.745405Z","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-11T03:22:17.74576Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=(6677273569830296580)"} {"level":"info","ts":"2026-07-11T03:22:17.745995Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"45afccab143d2c82","local-member-id":"5caa70ef1dd6dc04","added-peer-id":"5caa70ef1dd6dc04","added-peer-peer-urls":["https://199.204.45.116:2380"]} {"level":"info","ts":"2026-07-11T03:22:17.747338Z","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-11T03:22:17.747538Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.116:2380"} {"level":"info","ts":"2026-07-11T03:22:17.747632Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.116:2380"} {"level":"info","ts":"2026-07-11T03:22:17.747653Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"5caa70ef1dd6dc04","initial-advertise-peer-urls":["https://199.204.45.116:2380"],"listen-peer-urls":["https://199.204.45.116:2380"],"advertise-client-urls":["https://199.204.45.116:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.116:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-07-11T03:22:17.747703Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-07-11T03:22:18.328113Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 is starting a new election at term 1"} {"level":"info","ts":"2026-07-11T03:22:18.328169Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became pre-candidate at term 1"} {"level":"info","ts":"2026-07-11T03:22:18.328205Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 received MsgPreVoteResp from 5caa70ef1dd6dc04 at term 1"} {"level":"info","ts":"2026-07-11T03:22:18.328233Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became candidate at term 2"} {"level":"info","ts":"2026-07-11T03:22:18.328249Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 received MsgVoteResp from 5caa70ef1dd6dc04 at term 2"} {"level":"info","ts":"2026-07-11T03:22:18.328272Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became leader at term 2"} {"level":"info","ts":"2026-07-11T03:22:18.328292Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 5caa70ef1dd6dc04 elected leader 5caa70ef1dd6dc04 at term 2"} {"level":"info","ts":"2026-07-11T03:22:18.329333Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-07-11T03:22:18.330346Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"5caa70ef1dd6dc04","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.116:2379]}","request-path":"/0/members/5caa70ef1dd6dc04/attributes","cluster-id":"45afccab143d2c82","publish-timeout":"7s"} {"level":"info","ts":"2026-07-11T03:22:18.330515Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-11T03:22:18.333829Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.116:2379"} {"level":"info","ts":"2026-07-11T03:22:18.333967Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-07-11T03:22:18.334043Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-07-11T03:22:18.334643Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-11T03:22:18.338563Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"45afccab143d2c82","local-member-id":"5caa70ef1dd6dc04","cluster-version":"3.5"} {"level":"info","ts":"2026-07-11T03:22:18.338659Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-07-11T03:22:18.338683Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-07-11T03:22:18.339979Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-07-11T03:22:20.180363Z","caller":"traceutil/trace.go:171","msg":"trace[991657475] transaction","detail":"{read_only:false; response_revision:105; number_of_response:1; }","duration":"121.348164ms","start":"2026-07-11T03:22:20.058949Z","end":"2026-07-11T03:22:20.180297Z","steps":["trace[991657475] 'process raft request' (duration: 62.128743ms)","trace[991657475] 'compare' (duration: 58.997448ms)"],"step_count":2} {"level":"warn","ts":"2026-07-11T03:22:25.382505Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"131.817028ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/horizontal-pod-autoscaler\" ","response":"range_response_count:1 size:216"} {"level":"info","ts":"2026-07-11T03:22:25.382617Z","caller":"traceutil/trace.go:171","msg":"trace[1338044217] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/horizontal-pod-autoscaler; range_end:; response_count:1; response_revision:329; }","duration":"132.002486ms","start":"2026-07-11T03:22:25.250595Z","end":"2026-07-11T03:22:25.382598Z","steps":["trace[1338044217] 'range keys from in-memory index tree' (duration: 131.738594ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:22:25.878556Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"278.270086ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/attachdetach-controller\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-11T03:22:25.87867Z","caller":"traceutil/trace.go:171","msg":"trace[1778474337] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/attachdetach-controller; range_end:; response_count:0; response_revision:330; }","duration":"278.457614ms","start":"2026-07-11T03:22:25.60018Z","end":"2026-07-11T03:22:25.878638Z","steps":["trace[1778474337] 'range keys from in-memory index tree' (duration: 278.175173ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:22:56.035098Z","caller":"traceutil/trace.go:171","msg":"trace[229308099] transaction","detail":"{read_only:false; response_revision:630; number_of_response:1; }","duration":"256.763828ms","start":"2026-07-11T03:22:55.778317Z","end":"2026-07-11T03:22:56.035081Z","steps":["trace[229308099] 'process raft request' (duration: 256.659124ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:22:56.03539Z","caller":"traceutil/trace.go:171","msg":"trace[1565985927] linearizableReadLoop","detail":"{readStateIndex:649; appliedIndex:649; }","duration":"164.382156ms","start":"2026-07-11T03:22:55.87098Z","end":"2026-07-11T03:22:56.035362Z","steps":["trace[1565985927] 'read index received' (duration: 164.373116ms)","trace[1565985927] 'applied index is now lower than readState.Index' (duration: 7.22µs)"],"step_count":2} {"level":"warn","ts":"2026-07-11T03:22:56.035561Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.568494ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-11T03:22:56.035588Z","caller":"traceutil/trace.go:171","msg":"trace[1990434465] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:630; }","duration":"164.647436ms","start":"2026-07-11T03:22:55.870932Z","end":"2026-07-11T03:22:56.035579Z","steps":["trace[1990434465] 'agreement among raft nodes before linearized reading' (duration: 164.517292ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:22:56.248151Z","caller":"traceutil/trace.go:171","msg":"trace[285944158] linearizableReadLoop","detail":"{readStateIndex:650; appliedIndex:649; }","duration":"211.854171ms","start":"2026-07-11T03:22:56.036276Z","end":"2026-07-11T03:22:56.248131Z","steps":["trace[285944158] 'read index received' (duration: 211.609103ms)","trace[285944158] 'applied index is now lower than readState.Index' (duration: 244.348µs)"],"step_count":2} {"level":"info","ts":"2026-07-11T03:22:56.248288Z","caller":"traceutil/trace.go:171","msg":"trace[1988090596] transaction","detail":"{read_only:false; response_revision:631; number_of_response:1; }","duration":"267.84274ms","start":"2026-07-11T03:22:55.980437Z","end":"2026-07-11T03:22:56.24828Z","steps":["trace[1988090596] 'process raft request' (duration: 267.49508ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:22:56.248514Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"212.213884ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-11T03:22:56.248621Z","caller":"traceutil/trace.go:171","msg":"trace[1898873131] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:631; }","duration":"212.348387ms","start":"2026-07-11T03:22:56.036247Z","end":"2026-07-11T03:22:56.248596Z","steps":["trace[1898873131] 'agreement among raft nodes before linearized reading' (duration: 212.150061ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:22:56.264911Z","caller":"traceutil/trace.go:171","msg":"trace[980133470] transaction","detail":"{read_only:false; response_revision:632; number_of_response:1; }","duration":"223.344011ms","start":"2026-07-11T03:22:56.041529Z","end":"2026-07-11T03:22:56.264873Z","steps":["trace[980133470] 'process raft request' (duration: 223.039531ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:22:56.265098Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"217.209959ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-07-11T03:22:56.265222Z","caller":"traceutil/trace.go:171","msg":"trace[1517431752] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:633; }","duration":"217.347624ms","start":"2026-07-11T03:22:56.047841Z","end":"2026-07-11T03:22:56.265188Z","steps":["trace[1517431752] 'agreement among raft nodes before linearized reading' (duration: 217.004152ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:22:56.265259Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"210.995306ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-07-11T03:22:56.265293Z","caller":"traceutil/trace.go:171","msg":"trace[1156153142] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:633; }","duration":"211.055797ms","start":"2026-07-11T03:22:56.054228Z","end":"2026-07-11T03:22:56.265284Z","steps":["trace[1156153142] 'agreement among raft nodes before linearized reading' (duration: 210.934144ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:23:02.936369Z","caller":"traceutil/trace.go:171","msg":"trace[337153081] transaction","detail":"{read_only:false; response_revision:697; number_of_response:1; }","duration":"104.811142ms","start":"2026-07-11T03:23:02.831534Z","end":"2026-07-11T03:23:02.936345Z","steps":["trace[337153081] 'process raft request' (duration: 104.344079ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:24:35.663377Z","caller":"traceutil/trace.go:171","msg":"trace[384288813] transaction","detail":"{read_only:false; response_revision:1889; number_of_response:1; }","duration":"180.313606ms","start":"2026-07-11T03:24:35.483048Z","end":"2026-07-11T03:24:35.663361Z","steps":["trace[384288813] 'process raft request' (duration: 180.104932ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:24:35.663664Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.850908ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-ff3a64df-ef25-4f6c-9963-9af84ad01646\" ","response":"range_response_count:1 size:3627"} {"level":"info","ts":"2026-07-11T03:24:35.663731Z","caller":"traceutil/trace.go:171","msg":"trace[745906403] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-ff3a64df-ef25-4f6c-9963-9af84ad01646; range_end:; response_count:1; response_revision:1889; }","duration":"148.951949ms","start":"2026-07-11T03:24:35.514762Z","end":"2026-07-11T03:24:35.663714Z","steps":["trace[745906403] 'agreement among raft nodes before linearized reading' (duration: 148.737706ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:24:35.663312Z","caller":"traceutil/trace.go:171","msg":"trace[481597012] linearizableReadLoop","detail":"{readStateIndex:1959; appliedIndex:1958; }","duration":"148.493712ms","start":"2026-07-11T03:24:35.514794Z","end":"2026-07-11T03:24:35.663288Z","steps":["trace[481597012] 'read index received' (duration: 148.287388ms)","trace[481597012] 'applied index is now lower than readState.Index' (duration: 205.414µs)"],"step_count":2} {"level":"info","ts":"2026-07-11T03:24:35.801785Z","caller":"traceutil/trace.go:171","msg":"trace[855409672] transaction","detail":"{read_only:false; response_revision:1890; number_of_response:1; }","duration":"129.319154ms","start":"2026-07-11T03:24:35.672439Z","end":"2026-07-11T03:24:35.801758Z","steps":["trace[855409672] 'process raft request' (duration: 123.366832ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:24:36.047141Z","caller":"traceutil/trace.go:171","msg":"trace[1717779371] linearizableReadLoop","detail":"{readStateIndex:1961; appliedIndex:1960; }","duration":"176.033756ms","start":"2026-07-11T03:24:35.871079Z","end":"2026-07-11T03:24:36.047113Z","steps":["trace[1717779371] 'read index received' (duration: 171.523786ms)","trace[1717779371] 'applied index is now lower than readState.Index' (duration: 4.508929ms)"],"step_count":2} {"level":"warn","ts":"2026-07-11T03:24:36.047283Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.187008ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-11T03:24:36.047337Z","caller":"traceutil/trace.go:171","msg":"trace[849284930] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1891; }","duration":"176.273849ms","start":"2026-07-11T03:24:35.871031Z","end":"2026-07-11T03:24:36.047305Z","steps":["trace[849284930] 'agreement among raft nodes before linearized reading' (duration: 176.178818ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:24:36.047605Z","caller":"traceutil/trace.go:171","msg":"trace[53050264] transaction","detail":"{read_only:false; response_revision:1891; number_of_response:1; }","duration":"230.413719ms","start":"2026-07-11T03:24:35.817163Z","end":"2026-07-11T03:24:36.047577Z","steps":["trace[53050264] 'process raft request' (duration: 225.601714ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:24:41.766435Z","caller":"traceutil/trace.go:171","msg":"trace[401475950] transaction","detail":"{read_only:false; response_revision:1954; number_of_response:1; }","duration":"128.896989ms","start":"2026-07-11T03:24:41.637506Z","end":"2026-07-11T03:24:41.766403Z","steps":["trace[401475950] 'process raft request' (duration: 128.741347ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:24:41.771578Z","caller":"traceutil/trace.go:171","msg":"trace[734918862] transaction","detail":"{read_only:false; response_revision:1955; number_of_response:1; }","duration":"133.946255ms","start":"2026-07-11T03:24:41.637609Z","end":"2026-07-11T03:24:41.771555Z","steps":["trace[734918862] 'process raft request' (duration: 133.800703ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:24:41.771877Z","caller":"traceutil/trace.go:171","msg":"trace[987999831] transaction","detail":"{read_only:false; response_revision:1956; number_of_response:1; }","duration":"133.986106ms","start":"2026-07-11T03:24:41.637883Z","end":"2026-07-11T03:24:41.771869Z","steps":["trace[987999831] 'process raft request' (duration: 133.612061ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:24:41.772143Z","caller":"traceutil/trace.go:171","msg":"trace[1150226865] transaction","detail":"{read_only:false; response_revision:1957; number_of_response:1; }","duration":"134.017667ms","start":"2026-07-11T03:24:41.638118Z","end":"2026-07-11T03:24:41.772135Z","steps":["trace[1150226865] 'process raft request' (duration: 133.401198ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:25:09.045092Z","caller":"traceutil/trace.go:171","msg":"trace[1927291075] linearizableReadLoop","detail":"{readStateIndex:2202; appliedIndex:2200; }","duration":"174.467535ms","start":"2026-07-11T03:25:08.870601Z","end":"2026-07-11T03:25:09.045069Z","steps":["trace[1927291075] 'read index received' (duration: 135.392217ms)","trace[1927291075] 'applied index is now lower than readState.Index' (duration: 39.074408ms)"],"step_count":2} {"level":"info","ts":"2026-07-11T03:25:09.04539Z","caller":"traceutil/trace.go:171","msg":"trace[1070772469] transaction","detail":"{read_only:false; response_revision:2124; number_of_response:1; }","duration":"209.494288ms","start":"2026-07-11T03:25:08.835882Z","end":"2026-07-11T03:25:09.045376Z","steps":["trace[1070772469] 'process raft request' (duration: 170.133367ms)","trace[1070772469] 'compare' (duration: 38.679832ms)"],"step_count":2} {"level":"info","ts":"2026-07-11T03:25:09.045595Z","caller":"traceutil/trace.go:171","msg":"trace[731725317] transaction","detail":"{read_only:false; response_revision:2125; number_of_response:1; }","duration":"207.811235ms","start":"2026-07-11T03:25:08.837774Z","end":"2026-07-11T03:25:09.045585Z","steps":["trace[731725317] 'process raft request' (duration: 207.215237ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:25:09.045742Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.142014ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-11T03:25:09.045824Z","caller":"traceutil/trace.go:171","msg":"trace[758810965] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2125; }","duration":"175.392669ms","start":"2026-07-11T03:25:08.870414Z","end":"2026-07-11T03:25:09.045807Z","steps":["trace[758810965] 'agreement among raft nodes before linearized reading' (duration: 175.247087ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:25:10.134572Z","caller":"traceutil/trace.go:171","msg":"trace[675637130] transaction","detail":"{read_only:false; response_revision:2131; number_of_response:1; }","duration":"225.268644ms","start":"2026-07-11T03:25:09.909279Z","end":"2026-07-11T03:25:10.134548Z","steps":["trace[675637130] 'process raft request' (duration: 224.618904ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:30:54.361251Z","caller":"traceutil/trace.go:171","msg":"trace[1162682283] transaction","detail":"{read_only:false; response_revision:4837; number_of_response:1; }","duration":"205.063619ms","start":"2026-07-11T03:30:54.156166Z","end":"2026-07-11T03:30:54.361229Z","steps":["trace[1162682283] 'process raft request' (duration: 204.942477ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:31:42.782375Z","caller":"traceutil/trace.go:171","msg":"trace[1713222300] transaction","detail":"{read_only:false; response_revision:5228; number_of_response:1; }","duration":"116.364508ms","start":"2026-07-11T03:31:42.665978Z","end":"2026-07-11T03:31:42.782343Z","steps":["trace[1713222300] 'process raft request' (duration: 111.709115ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:31:44.223998Z","caller":"traceutil/trace.go:171","msg":"trace[888558613] transaction","detail":"{read_only:false; response_revision:5316; number_of_response:1; }","duration":"123.290753ms","start":"2026-07-11T03:31:44.10068Z","end":"2026-07-11T03:31:44.223971Z","steps":["trace[888558613] 'process raft request' (duration: 122.602483ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:31:44.349753Z","caller":"traceutil/trace.go:171","msg":"trace[772006985] transaction","detail":"{read_only:false; response_revision:5318; number_of_response:1; }","duration":"115.067625ms","start":"2026-07-11T03:31:44.234663Z","end":"2026-07-11T03:31:44.349731Z","steps":["trace[772006985] 'process raft request' (duration: 115.017044ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:31:44.349807Z","caller":"traceutil/trace.go:171","msg":"trace[608444046] linearizableReadLoop","detail":"{readStateIndex:5509; appliedIndex:5508; }","duration":"117.832687ms","start":"2026-07-11T03:31:44.231943Z","end":"2026-07-11T03:31:44.349776Z","steps":["trace[608444046] 'read index received' (duration: 110.701387ms)","trace[608444046] 'applied index is now lower than readState.Index' (duration: 7.12706ms)"],"step_count":2} {"level":"info","ts":"2026-07-11T03:31:44.350702Z","caller":"traceutil/trace.go:171","msg":"trace[1919223] transaction","detail":"{read_only:false; response_revision:5317; number_of_response:1; }","duration":"121.476345ms","start":"2026-07-11T03:31:44.229207Z","end":"2026-07-11T03:31:44.350684Z","steps":["trace[1919223] 'process raft request' (duration: 113.48041ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:31:44.353555Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.582937ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus\" ","response":"range_response_count:1 size:3506"} {"level":"info","ts":"2026-07-11T03:31:44.353624Z","caller":"traceutil/trace.go:171","msg":"trace[2087986401] range","detail":"{range_begin:/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus; range_end:; response_count:1; response_revision:5318; }","duration":"121.699229ms","start":"2026-07-11T03:31:44.23191Z","end":"2026-07-11T03:31:44.353609Z","steps":["trace[2087986401] 'agreement among raft nodes before linearized reading' (duration: 117.97112ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:32:08.718836Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.499769ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/keystone-fernet-setup\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-11T03:32:08.718979Z","caller":"traceutil/trace.go:171","msg":"trace[2047951396] range","detail":"{range_begin:/registry/jobs/openstack/keystone-fernet-setup; range_end:; response_count:0; response_revision:5487; }","duration":"114.679573ms","start":"2026-07-11T03:32:08.60427Z","end":"2026-07-11T03:32:08.71895Z","steps":["trace[2047951396] 'range keys from in-memory index tree' (duration: 114.405488ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:32:08.719003Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.388093ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/keystone-db-sync\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-11T03:32:08.719092Z","caller":"traceutil/trace.go:171","msg":"trace[1333363067] range","detail":"{range_begin:/registry/jobs/openstack/keystone-db-sync; range_end:; response_count:0; response_revision:5487; }","duration":"115.523015ms","start":"2026-07-11T03:32:08.603547Z","end":"2026-07-11T03:32:08.71907Z","steps":["trace[1333363067] 'range keys from in-memory index tree' (duration: 115.301002ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:32:08.719553Z","caller":"traceutil/trace.go:171","msg":"trace[1787579482] transaction","detail":"{read_only:false; response_revision:5488; number_of_response:1; }","duration":"110.730892ms","start":"2026-07-11T03:32:08.608805Z","end":"2026-07-11T03:32:08.719536Z","steps":["trace[1787579482] 'process raft request' (duration: 42.914925ms)","trace[1787579482] 'compare' (duration: 67.537413ms)"],"step_count":2} {"level":"info","ts":"2026-07-11T03:32:08.775129Z","caller":"traceutil/trace.go:171","msg":"trace[27341284] transaction","detail":"{read_only:false; response_revision:5491; number_of_response:1; }","duration":"105.645044ms","start":"2026-07-11T03:32:08.669459Z","end":"2026-07-11T03:32:08.775104Z","steps":["trace[27341284] 'process raft request' (duration: 105.594893ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:32:08.775203Z","caller":"traceutil/trace.go:171","msg":"trace[131985965] transaction","detail":"{read_only:false; response_revision:5490; number_of_response:1; }","duration":"107.704336ms","start":"2026-07-11T03:32:08.667448Z","end":"2026-07-11T03:32:08.775153Z","steps":["trace[131985965] 'process raft request' (duration: 107.464462ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:32:18.37511Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2928} {"level":"info","ts":"2026-07-11T03:32:18.454125Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2928,"took":"77.858402ms","hash":613463334,"current-db-size-bytes":54386688,"current-db-size":"54 MB","current-db-size-in-use-bytes":29097984,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-07-11T03:32:18.454196Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":613463334,"revision":2928,"compact-revision":-1} {"level":"info","ts":"2026-07-11T03:34:50.055957Z","caller":"traceutil/trace.go:171","msg":"trace[2141438514] linearizableReadLoop","detail":"{readStateIndex:6849; appliedIndex:6848; }","duration":"186.266653ms","start":"2026-07-11T03:34:49.86967Z","end":"2026-07-11T03:34:50.055937Z","steps":["trace[2141438514] 'read index received' (duration: 186.084341ms)","trace[2141438514] 'applied index is now lower than readState.Index' (duration: 181.402µs)"],"step_count":2} {"level":"info","ts":"2026-07-11T03:34:50.056011Z","caller":"traceutil/trace.go:171","msg":"trace[1887985727] transaction","detail":"{read_only:false; response_revision:6613; number_of_response:1; }","duration":"214.433205ms","start":"2026-07-11T03:34:49.841547Z","end":"2026-07-11T03:34:50.05598Z","steps":["trace[1887985727] 'process raft request' (duration: 214.247802ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:34:50.056103Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.420046ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-11T03:34:50.056137Z","caller":"traceutil/trace.go:171","msg":"trace[596896507] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:6613; }","duration":"186.491467ms","start":"2026-07-11T03:34:49.869634Z","end":"2026-07-11T03:34:50.056126Z","steps":["trace[596896507] 'agreement among raft nodes before linearized reading' (duration: 186.423876ms)"],"step_count":1} {"level":"warn","ts":"2026-07-11T03:34:50.056277Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.056471ms","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-07-11T03:34:50.056395Z","caller":"traceutil/trace.go:171","msg":"trace[72562651] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:6613; }","duration":"110.211544ms","start":"2026-07-11T03:34:49.946165Z","end":"2026-07-11T03:34:50.056376Z","steps":["trace[72562651] 'agreement among raft nodes before linearized reading' (duration: 109.949371ms)"],"step_count":1} {"level":"info","ts":"2026-07-11T03:37:18.381145Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5569} {"level":"info","ts":"2026-07-11T03:37:18.45011Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5569,"took":"67.634065ms","hash":3492215924,"current-db-size-bytes":54386688,"current-db-size":"54 MB","current-db-size-in-use-bytes":18661376,"current-db-size-in-use":"19 MB"} {"level":"info","ts":"2026-07-11T03:37:18.450159Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3492215924,"revision":5569,"compact-revision":2928}