{"level":"warn","ts":"2026-04-21T21:11:09.29568Z","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-21T21:11:09.295875Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.240: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.240:2380","--initial-cluster=instance=https://199.204.45.240:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.240:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.240: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-21T21:11:09.295994Z","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-21T21:11:09.29604Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.240:2380"]} {"level":"info","ts":"2026-04-21T21:11:09.296083Z","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-21T21:11:09.296832Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.240:2379"]} {"level":"info","ts":"2026-04-21T21:11:09.296945Z","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.240:2380"],"listen-peer-urls":["https://199.204.45.240:2380"],"advertise-client-urls":["https://199.204.45.240:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.240:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.240: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-21T21:11:09.301217Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.033931ms"} {"level":"info","ts":"2026-04-21T21:11:09.311018Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"4e46287fb5aa4785","cluster-id":"cae704afa9813e87"} {"level":"info","ts":"2026-04-21T21:11:09.311168Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 switched to configuration voters=()"} {"level":"info","ts":"2026-04-21T21:11:09.31121Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 became follower at term 0"} {"level":"info","ts":"2026-04-21T21:11:09.311247Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 4e46287fb5aa4785 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-21T21:11:09.311272Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 became follower at term 1"} {"level":"info","ts":"2026-04-21T21:11:09.311335Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 switched to configuration voters=(5640240112301918085)"} {"level":"warn","ts":"2026-04-21T21:11:09.319306Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-21T21:11:09.323484Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-21T21:11:09.325217Z","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-21T21:11:09.328739Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"4e46287fb5aa4785","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-21T21:11:09.328898Z","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-21T21:11:09.32902Z","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-21T21:11:09.329031Z","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-21T21:11:09.329126Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"4e46287fb5aa4785","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-21T21:11:09.329725Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 switched to configuration voters=(5640240112301918085)"} {"level":"info","ts":"2026-04-21T21:11:09.329838Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"cae704afa9813e87","local-member-id":"4e46287fb5aa4785","added-peer-id":"4e46287fb5aa4785","added-peer-peer-urls":["https://199.204.45.240:2380"]} {"level":"info","ts":"2026-04-21T21:11:09.335354Z","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-21T21:11:09.335616Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"4e46287fb5aa4785","initial-advertise-peer-urls":["https://199.204.45.240:2380"],"listen-peer-urls":["https://199.204.45.240:2380"],"advertise-client-urls":["https://199.204.45.240:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.240:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-21T21:11:09.335667Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-21T21:11:09.336093Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.240:2380"} {"level":"info","ts":"2026-04-21T21:11:09.33613Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.240:2380"} {"level":"info","ts":"2026-04-21T21:11:10.311581Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 is starting a new election at term 1"} {"level":"info","ts":"2026-04-21T21:11:10.311627Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 became pre-candidate at term 1"} {"level":"info","ts":"2026-04-21T21:11:10.311645Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 received MsgPreVoteResp from 4e46287fb5aa4785 at term 1"} {"level":"info","ts":"2026-04-21T21:11:10.311659Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 became candidate at term 2"} {"level":"info","ts":"2026-04-21T21:11:10.311667Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 received MsgVoteResp from 4e46287fb5aa4785 at term 2"} {"level":"info","ts":"2026-04-21T21:11:10.311679Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e46287fb5aa4785 became leader at term 2"} {"level":"info","ts":"2026-04-21T21:11:10.311688Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 4e46287fb5aa4785 elected leader 4e46287fb5aa4785 at term 2"} {"level":"info","ts":"2026-04-21T21:11:10.313061Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-21T21:11:10.313988Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-21T21:11:10.313986Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"4e46287fb5aa4785","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.240:2379]}","request-path":"/0/members/4e46287fb5aa4785/attributes","cluster-id":"cae704afa9813e87","publish-timeout":"7s"} {"level":"info","ts":"2026-04-21T21:11:10.314255Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-21T21:11:10.314438Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-21T21:11:10.314471Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-21T21:11:10.314624Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"cae704afa9813e87","local-member-id":"4e46287fb5aa4785","cluster-version":"3.5"} {"level":"info","ts":"2026-04-21T21:11:10.314744Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-21T21:11:10.314782Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-21T21:11:10.31709Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.240:2379"} {"level":"info","ts":"2026-04-21T21:11:10.318206Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-21T21:11:45.423423Z","caller":"traceutil/trace.go:171","msg":"trace[1603699831] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"105.980238ms","start":"2026-04-21T21:11:45.317414Z","end":"2026-04-21T21:11:45.423395Z","steps":["trace[1603699831] 'process raft request' (duration: 104.557171ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:11:45.641364Z","caller":"traceutil/trace.go:171","msg":"trace[1568297608] transaction","detail":"{read_only:false; response_revision:620; number_of_response:1; }","duration":"157.807832ms","start":"2026-04-21T21:11:45.483515Z","end":"2026-04-21T21:11:45.641323Z","steps":["trace[1568297608] 'process raft request' (duration: 104.360171ms)","trace[1568297608] 'compare' (duration: 53.21028ms)"],"step_count":2} {"level":"warn","ts":"2026-04-21T21:11:46.054822Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"220.726401ms","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-04-21T21:11:46.054918Z","caller":"traceutil/trace.go:171","msg":"trace[1320791226] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:620; }","duration":"220.877721ms","start":"2026-04-21T21:11:45.834023Z","end":"2026-04-21T21:11:46.0549Z","steps":["trace[1320791226] 'range keys from in-memory index tree' (duration: 220.567211ms)"],"step_count":1} {"level":"warn","ts":"2026-04-21T21:11:46.054933Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"212.54951ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-04-21T21:11:46.054969Z","caller":"traceutil/trace.go:171","msg":"trace[189420778] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:620; }","duration":"212.60467ms","start":"2026-04-21T21:11:45.842351Z","end":"2026-04-21T21:11:46.054955Z","steps":["trace[189420778] 'range keys from in-memory index tree' (duration: 212.462629ms)"],"step_count":1} {"level":"warn","ts":"2026-04-21T21:11:46.054822Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"215.048842ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-04-21T21:11:46.05507Z","caller":"traceutil/trace.go:171","msg":"trace[1221374094] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:620; }","duration":"215.319253ms","start":"2026-04-21T21:11:45.839742Z","end":"2026-04-21T21:11:46.055061Z","steps":["trace[1221374094] 'range keys from in-memory index tree' (duration: 214.889432ms)"],"step_count":1} {"level":"warn","ts":"2026-04-21T21:11:46.055201Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.326699ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-2dkn8\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-04-21T21:11:46.055275Z","caller":"traceutil/trace.go:171","msg":"trace[262645073] range","detail":"{range_begin:/registry/pods/kube-system/cilium-2dkn8; range_end:; response_count:1; response_revision:620; }","duration":"104.434999ms","start":"2026-04-21T21:11:45.950818Z","end":"2026-04-21T21:11:46.055253Z","steps":["trace[262645073] 'range keys from in-memory index tree' (duration: 103.807737ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:22.673885Z","caller":"traceutil/trace.go:171","msg":"trace[2118128324] transaction","detail":"{read_only:false; response_revision:1865; number_of_response:1; }","duration":"283.760529ms","start":"2026-04-21T21:13:22.390068Z","end":"2026-04-21T21:13:22.673828Z","steps":["trace[2118128324] 'process raft request' (duration: 283.498418ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:22.882032Z","caller":"traceutil/trace.go:171","msg":"trace[1953532832] transaction","detail":"{read_only:false; response_revision:1866; number_of_response:1; }","duration":"199.439124ms","start":"2026-04-21T21:13:22.682563Z","end":"2026-04-21T21:13:22.882002Z","steps":["trace[1953532832] 'process raft request' (duration: 199.214973ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:22.983893Z","caller":"traceutil/trace.go:171","msg":"trace[453213627] transaction","detail":"{read_only:false; response_revision:1867; number_of_response:1; }","duration":"301.236118ms","start":"2026-04-21T21:13:22.682631Z","end":"2026-04-21T21:13:22.983867Z","steps":["trace[453213627] 'process raft request' (duration: 293.022156ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:22.984177Z","caller":"traceutil/trace.go:171","msg":"trace[991971480] transaction","detail":"{read_only:false; response_revision:1868; number_of_response:1; }","duration":"301.286687ms","start":"2026-04-21T21:13:22.682859Z","end":"2026-04-21T21:13:22.984146Z","steps":["trace[991971480] 'process raft request' (duration: 300.964286ms)"],"step_count":1} {"level":"warn","ts":"2026-04-21T21:13:22.984861Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-21T21:13:22.682607Z","time spent":"301.371019ms","remote":"127.0.0.1:52534","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-21T21:13:22.984908Z","caller":"traceutil/trace.go:171","msg":"trace[736919761] transaction","detail":"{read_only:false; response_revision:1869; number_of_response:1; }","duration":"300.665495ms","start":"2026-04-21T21:13:22.684213Z","end":"2026-04-21T21:13:22.984879Z","steps":["trace[736919761] 'process raft request' (duration: 299.827442ms)"],"step_count":1} {"level":"warn","ts":"2026-04-21T21:13:22.984973Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-21T21:13:22.682854Z","time spent":"301.402428ms","remote":"127.0.0.1:52534","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-21T21:13:22.985017Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-21T21:13:22.684187Z","time spent":"300.770025ms","remote":"127.0.0.1:52534","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-21T21:13:22.985132Z","caller":"traceutil/trace.go:171","msg":"trace[1131753351] transaction","detail":"{read_only:false; response_revision:1870; number_of_response:1; }","duration":"297.997735ms","start":"2026-04-21T21:13:22.687118Z","end":"2026-04-21T21:13:22.985116Z","steps":["trace[1131753351] 'process raft request' (duration: 297.626523ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:23.189349Z","caller":"traceutil/trace.go:171","msg":"trace[189152490] linearizableReadLoop","detail":"{readStateIndex:1944; appliedIndex:1940; }","duration":"136.723029ms","start":"2026-04-21T21:13:23.052605Z","end":"2026-04-21T21:13:23.189328Z","steps":["trace[189152490] 'read index received' (duration: 136.376548ms)","trace[189152490] 'applied index is now lower than readState.Index' (duration: 345.741µs)"],"step_count":2} {"level":"warn","ts":"2026-04-21T21:13:23.189793Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.177831ms","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-04-21T21:13:23.18977Z","caller":"traceutil/trace.go:171","msg":"trace[1032550343] transaction","detail":"{read_only:false; response_revision:1872; number_of_response:1; }","duration":"197.311385ms","start":"2026-04-21T21:13:22.992436Z","end":"2026-04-21T21:13:23.189748Z","steps":["trace[1032550343] 'process raft request' (duration: 196.633252ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:23.189836Z","caller":"traceutil/trace.go:171","msg":"trace[577146666] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1875; }","duration":"137.279432ms","start":"2026-04-21T21:13:23.052547Z","end":"2026-04-21T21:13:23.189826Z","steps":["trace[577146666] 'agreement among raft nodes before linearized reading' (duration: 137.10373ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:23.189794Z","caller":"traceutil/trace.go:171","msg":"trace[1837854654] transaction","detail":"{read_only:false; response_revision:1873; number_of_response:1; }","duration":"197.215964ms","start":"2026-04-21T21:13:22.992537Z","end":"2026-04-21T21:13:23.189753Z","steps":["trace[1837854654] 'process raft request' (duration: 196.671232ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:23.190025Z","caller":"traceutil/trace.go:171","msg":"trace[717684699] transaction","detail":"{read_only:false; response_revision:1874; number_of_response:1; }","duration":"197.177054ms","start":"2026-04-21T21:13:22.992795Z","end":"2026-04-21T21:13:23.189972Z","steps":["trace[717684699] 'process raft request' (duration: 196.450001ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:23.191373Z","caller":"traceutil/trace.go:171","msg":"trace[219736216] transaction","detail":"{read_only:false; response_revision:1875; number_of_response:1; }","duration":"194.135432ms","start":"2026-04-21T21:13:22.995553Z","end":"2026-04-21T21:13:23.189689Z","steps":["trace[219736216] 'process raft request' (duration: 193.735691ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:55.800932Z","caller":"traceutil/trace.go:171","msg":"trace[193114686] transaction","detail":"{read_only:false; response_revision:2102; number_of_response:1; }","duration":"121.425466ms","start":"2026-04-21T21:13:55.679481Z","end":"2026-04-21T21:13:55.800907Z","steps":["trace[193114686] 'process raft request' (duration: 121.236935ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:13:56.839789Z","caller":"traceutil/trace.go:171","msg":"trace[1263210159] transaction","detail":"{read_only:false; response_revision:2107; number_of_response:1; }","duration":"166.942861ms","start":"2026-04-21T21:13:56.672792Z","end":"2026-04-21T21:13:56.839735Z","steps":["trace[1263210159] 'process raft request' (duration: 166.61191ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:15:04.862194Z","caller":"traceutil/trace.go:171","msg":"trace[1060699422] transaction","detail":"{read_only:false; response_revision:2570; number_of_response:1; }","duration":"100.494584ms","start":"2026-04-21T21:15:04.761662Z","end":"2026-04-21T21:15:04.862157Z","steps":["trace[1060699422] 'process raft request' (duration: 100.313644ms)"],"step_count":1} {"level":"warn","ts":"2026-04-21T21:15:35.175851Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.792935ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-21T21:15:35.176117Z","caller":"traceutil/trace.go:171","msg":"trace[1630842335] transaction","detail":"{read_only:false; response_revision:2738; number_of_response:1; }","duration":"194.268251ms","start":"2026-04-21T21:15:34.981795Z","end":"2026-04-21T21:15:35.176063Z","steps":["trace[1630842335] 'process raft request' (duration: 50.892124ms)","trace[1630842335] 'compare' (duration: 142.628415ms)"],"step_count":2} {"level":"info","ts":"2026-04-21T21:19:35.98335Z","caller":"traceutil/trace.go:171","msg":"trace[1152248472] transaction","detail":"{read_only:false; response_revision:4605; number_of_response:1; }","duration":"114.332005ms","start":"2026-04-21T21:19:35.868988Z","end":"2026-04-21T21:19:35.98332Z","steps":["trace[1152248472] 'process raft request' (duration: 113.843525ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:35.994667Z","caller":"traceutil/trace.go:171","msg":"trace[1181148123] transaction","detail":"{read_only:false; response_revision:4606; number_of_response:1; }","duration":"125.335256ms","start":"2026-04-21T21:19:35.869285Z","end":"2026-04-21T21:19:35.99462Z","steps":["trace[1181148123] 'process raft request' (duration: 125.06212ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:35.995476Z","caller":"traceutil/trace.go:171","msg":"trace[1685919377] transaction","detail":"{read_only:false; response_revision:4607; number_of_response:1; }","duration":"126.130193ms","start":"2026-04-21T21:19:35.869327Z","end":"2026-04-21T21:19:35.995457Z","steps":["trace[1685919377] 'process raft request' (duration: 125.186703ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:35.995804Z","caller":"traceutil/trace.go:171","msg":"trace[349497703] linearizableReadLoop","detail":"{readStateIndex:4780; appliedIndex:4777; }","duration":"124.705584ms","start":"2026-04-21T21:19:35.871088Z","end":"2026-04-21T21:19:35.995794Z","steps":["trace[349497703] 'read index received' (duration: 111.768911ms)","trace[349497703] 'applied index is now lower than readState.Index' (duration: 12.935613ms)"],"step_count":2} {"level":"warn","ts":"2026-04-21T21:19:35.996038Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.926978ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/storageclasses/general\" ","response":"range_response_count:1 size:1124"} {"level":"info","ts":"2026-04-21T21:19:35.996107Z","caller":"traceutil/trace.go:171","msg":"trace[1861939171] range","detail":"{range_begin:/registry/storageclasses/general; range_end:; response_count:1; response_revision:4607; }","duration":"125.03101ms","start":"2026-04-21T21:19:35.87106Z","end":"2026-04-21T21:19:35.996091Z","steps":["trace[1861939171] 'agreement among raft nodes before linearized reading' (duration: 124.824136ms)"],"step_count":1} {"level":"warn","ts":"2026-04-21T21:19:35.998773Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.141735ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/monitoring/\" range_end:\"/registry/pods/monitoring0\" ","response":"range_response_count:6 size:56697"} {"level":"info","ts":"2026-04-21T21:19:35.998805Z","caller":"traceutil/trace.go:171","msg":"trace[675238462] range","detail":"{range_begin:/registry/pods/monitoring/; range_end:/registry/pods/monitoring0; response_count:6; response_revision:4609; }","duration":"127.175996ms","start":"2026-04-21T21:19:35.87162Z","end":"2026-04-21T21:19:35.998796Z","steps":["trace[675238462] 'agreement among raft nodes before linearized reading' (duration: 127.033603ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:44.815513Z","caller":"traceutil/trace.go:171","msg":"trace[1880710893] transaction","detail":"{read_only:false; response_revision:4775; number_of_response:1; }","duration":"117.675577ms","start":"2026-04-21T21:19:44.697804Z","end":"2026-04-21T21:19:44.81548Z","steps":["trace[1880710893] 'process raft request' (duration: 117.492853ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:45.330677Z","caller":"traceutil/trace.go:171","msg":"trace[534823952] transaction","detail":"{read_only:false; response_revision:4781; number_of_response:1; }","duration":"118.472822ms","start":"2026-04-21T21:19:45.212164Z","end":"2026-04-21T21:19:45.330637Z","steps":["trace[534823952] 'process raft request' (duration: 118.228427ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:45.331327Z","caller":"traceutil/trace.go:171","msg":"trace[686820573] transaction","detail":"{read_only:false; response_revision:4782; number_of_response:1; }","duration":"119.022483ms","start":"2026-04-21T21:19:45.212268Z","end":"2026-04-21T21:19:45.331291Z","steps":["trace[686820573] 'process raft request' (duration: 118.244147ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:45.331508Z","caller":"traceutil/trace.go:171","msg":"trace[299318957] transaction","detail":"{read_only:false; response_revision:4780; number_of_response:1; }","duration":"119.396501ms","start":"2026-04-21T21:19:45.212088Z","end":"2026-04-21T21:19:45.331484Z","steps":["trace[299318957] 'process raft request' (duration: 117.959092ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:57.756877Z","caller":"traceutil/trace.go:171","msg":"trace[680571210] transaction","detail":"{read_only:false; response_revision:4976; number_of_response:1; }","duration":"239.453264ms","start":"2026-04-21T21:19:57.517408Z","end":"2026-04-21T21:19:57.756861Z","steps":["trace[680571210] 'process raft request' (duration: 230.661464ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:19:57.75703Z","caller":"traceutil/trace.go:171","msg":"trace[1141848850] linearizableReadLoop","detail":"{readStateIndex:5159; appliedIndex:5158; }","duration":"222.457927ms","start":"2026-04-21T21:19:57.534342Z","end":"2026-04-21T21:19:57.7568Z","steps":["trace[1141848850] 'read index received' (duration: 213.766409ms)","trace[1141848850] 'applied index is now lower than readState.Index' (duration: 8.690458ms)"],"step_count":2} {"level":"warn","ts":"2026-04-21T21:19:57.757442Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"223.088309ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:1865"} {"level":"info","ts":"2026-04-21T21:19:57.757475Z","caller":"traceutil/trace.go:171","msg":"trace[1252033994] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:4976; }","duration":"223.193711ms","start":"2026-04-21T21:19:57.534269Z","end":"2026-04-21T21:19:57.757463Z","steps":["trace[1252033994] 'agreement among raft nodes before linearized reading' (duration: 222.801224ms)"],"step_count":1} {"level":"warn","ts":"2026-04-21T21:19:57.763841Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.493585ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-21T21:19:57.763972Z","caller":"traceutil/trace.go:171","msg":"trace[1280272983] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:4977; }","duration":"184.673509ms","start":"2026-04-21T21:19:57.579284Z","end":"2026-04-21T21:19:57.763957Z","steps":["trace[1280272983] 'agreement among raft nodes before linearized reading' (duration: 184.430184ms)"],"step_count":1} {"level":"info","ts":"2026-04-21T21:21:10.344848Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2924} {"level":"info","ts":"2026-04-21T21:21:10.420524Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2924,"took":"72.888286ms","hash":2344146951,"current-db-size-bytes":53661696,"current-db-size":"54 MB","current-db-size-in-use-bytes":29564928,"current-db-size-in-use":"30 MB"} {"level":"info","ts":"2026-04-21T21:21:10.420867Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2344146951,"revision":2924,"compact-revision":-1} {"level":"info","ts":"2026-04-21T21:26:10.351514Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5590} {"level":"info","ts":"2026-04-21T21:26:10.428737Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5590,"took":"75.15936ms","hash":1961198558,"current-db-size-bytes":53661696,"current-db-size":"54 MB","current-db-size-in-use-bytes":18563072,"current-db-size-in-use":"19 MB"} {"level":"info","ts":"2026-04-21T21:26:10.428837Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1961198558,"revision":5590,"compact-revision":2924}