{"level":"warn","ts":"2026-04-25T15:59:35.382165Z","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-25T15:59:35.382253Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.65: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.65:2380","--initial-cluster=instance=https://199.204.45.65:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.65:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.65: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-25T15:59:35.382318Z","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-25T15:59:35.382325Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.65:2380"]}
{"level":"info","ts":"2026-04-25T15:59:35.382342Z","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-25T15:59:35.382942Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.65:2379"]}
{"level":"info","ts":"2026-04-25T15:59:35.383021Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":16,"max-cpu-available":16,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.65:2380"],"listen-peer-urls":["https://199.204.45.65:2380"],"advertise-client-urls":["https://199.204.45.65:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.65:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.65: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-25T15:59:35.386762Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.547036ms"}
{"level":"info","ts":"2026-04-25T15:59:35.39408Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"cf8c3a138c9a77a2","cluster-id":"c278183e1f634dff"}
{"level":"info","ts":"2026-04-25T15:59:35.394161Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=()"}
{"level":"info","ts":"2026-04-25T15:59:35.394178Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became follower at term 0"}
{"level":"info","ts":"2026-04-25T15:59:35.394187Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft cf8c3a138c9a77a2 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-04-25T15:59:35.394193Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became follower at term 1"}
{"level":"info","ts":"2026-04-25T15:59:35.394221Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=(14955392318228297634)"}
{"level":"warn","ts":"2026-04-25T15:59:35.39961Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-04-25T15:59:35.400884Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-04-25T15:59:35.40204Z","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-25T15:59:35.403984Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"cf8c3a138c9a77a2","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-04-25T15:59:35.404389Z","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-25T15:59:35.404379Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"cf8c3a138c9a77a2","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-04-25T15:59:35.404453Z","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-25T15:59:35.404526Z","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-25T15:59:35.405757Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 switched to configuration voters=(14955392318228297634)"}
{"level":"info","ts":"2026-04-25T15:59:35.405866Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"c278183e1f634dff","local-member-id":"cf8c3a138c9a77a2","added-peer-id":"cf8c3a138c9a77a2","added-peer-peer-urls":["https://199.204.45.65:2380"]}
{"level":"info","ts":"2026-04-25T15:59:35.409544Z","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-25T15:59:35.409689Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.65:2380"}
{"level":"info","ts":"2026-04-25T15:59:35.409726Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.65:2380"}
{"level":"info","ts":"2026-04-25T15:59:35.410667Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"cf8c3a138c9a77a2","initial-advertise-peer-urls":["https://199.204.45.65:2380"],"listen-peer-urls":["https://199.204.45.65:2380"],"advertise-client-urls":["https://199.204.45.65:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.65:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-04-25T15:59:35.410719Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-04-25T15:59:35.99463Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 is starting a new election at term 1"}
{"level":"info","ts":"2026-04-25T15:59:35.994683Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became pre-candidate at term 1"}
{"level":"info","ts":"2026-04-25T15:59:35.9947Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 received MsgPreVoteResp from cf8c3a138c9a77a2 at term 1"}
{"level":"info","ts":"2026-04-25T15:59:35.994712Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became candidate at term 2"}
{"level":"info","ts":"2026-04-25T15:59:35.99472Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 received MsgVoteResp from cf8c3a138c9a77a2 at term 2"}
{"level":"info","ts":"2026-04-25T15:59:35.994743Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"cf8c3a138c9a77a2 became leader at term 2"}
{"level":"info","ts":"2026-04-25T15:59:35.99476Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: cf8c3a138c9a77a2 elected leader cf8c3a138c9a77a2 at term 2"}
{"level":"info","ts":"2026-04-25T15:59:35.995981Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"cf8c3a138c9a77a2","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.65:2379]}","request-path":"/0/members/cf8c3a138c9a77a2/attributes","cluster-id":"c278183e1f634dff","publish-timeout":"7s"}
{"level":"info","ts":"2026-04-25T15:59:35.995967Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-25T15:59:35.996012Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-04-25T15:59:35.996138Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-04-25T15:59:35.996239Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-04-25T15:59:35.996272Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-04-25T15:59:35.997412Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"c278183e1f634dff","local-member-id":"cf8c3a138c9a77a2","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-25T15:59:35.997602Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-25T15:59:35.997653Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-04-25T15:59:35.998554Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.65:2379"}
{"level":"info","ts":"2026-04-25T15:59:35.999171Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-04-25T16:00:06.967186Z","caller":"traceutil/trace.go:171","msg":"trace[488107518] transaction","detail":"{read_only:false; response_revision:602; number_of_response:1; }","duration":"148.544294ms","start":"2026-04-25T16:00:06.818617Z","end":"2026-04-25T16:00:06.967162Z","steps":["trace[488107518] 'process raft request'  (duration: 67.54404ms)","trace[488107518] 'compare'  (duration: 80.806498ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-25T16:00:07.596908Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"272.393305ms","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-04-25T16:00:07.597003Z","caller":"traceutil/trace.go:171","msg":"trace[1468089127] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:603; }","duration":"272.5321ms","start":"2026-04-25T16:00:07.324453Z","end":"2026-04-25T16:00:07.596985Z","steps":["trace[1468089127] 'range keys from in-memory index tree'  (duration: 272.22308ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:00:07.635236Z","caller":"traceutil/trace.go:171","msg":"trace[1868483783] transaction","detail":"{read_only:false; response_revision:604; number_of_response:1; }","duration":"245.59589ms","start":"2026-04-25T16:00:07.389608Z","end":"2026-04-25T16:00:07.635204Z","steps":["trace[1868483783] 'process raft request'  (duration: 244.853328ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:00:34.673225Z","caller":"traceutil/trace.go:171","msg":"trace[191944614] linearizableReadLoop","detail":"{readStateIndex:832; appliedIndex:831; }","duration":"112.261933ms","start":"2026-04-25T16:00:34.560936Z","end":"2026-04-25T16:00:34.673197Z","steps":["trace[191944614] 'read index received'  (duration: 100.631464ms)","trace[191944614] 'applied index is now lower than readState.Index'  (duration: 11.628859ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-25T16:00:34.673457Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.49696ms","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-25T16:00:34.673498Z","caller":"traceutil/trace.go:171","msg":"trace[421343165] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:802; }","duration":"112.601493ms","start":"2026-04-25T16:00:34.560886Z","end":"2026-04-25T16:00:34.673487Z","steps":["trace[421343165] 'agreement among raft nodes before linearized reading'  (duration: 112.425118ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:00:52.919201Z","caller":"traceutil/trace.go:171","msg":"trace[429492515] linearizableReadLoop","detail":"{readStateIndex:1468; appliedIndex:1467; }","duration":"144.497753ms","start":"2026-04-25T16:00:52.774674Z","end":"2026-04-25T16:00:52.919172Z","steps":["trace[429492515] 'read index received'  (duration: 144.40518ms)","trace[429492515] 'applied index is now lower than readState.Index'  (duration: 91.833µs)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:00:52.919236Z","caller":"traceutil/trace.go:171","msg":"trace[1019359267] transaction","detail":"{read_only:false; response_revision:1427; number_of_response:1; }","duration":"196.415452ms","start":"2026-04-25T16:00:52.722788Z","end":"2026-04-25T16:00:52.919204Z","steps":["trace[1019359267] 'process raft request'  (duration: 196.271277ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:00:52.919394Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.715239ms","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-25T16:00:52.919426Z","caller":"traceutil/trace.go:171","msg":"trace[337741248] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1427; }","duration":"144.800571ms","start":"2026-04-25T16:00:52.774618Z","end":"2026-04-25T16:00:52.919418Z","steps":["trace[337741248] 'agreement among raft nodes before linearized reading'  (duration: 144.647806ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:01:03.265199Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.237435ms","expected-duration":"100ms","prefix":"","request":"header:<ID:8620626107754343879 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" mod_revision:1517 > success:<request_put:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" value_size:459 >> failure:<request_range:<key:\"/registry/leases/envoy-gateway-system/5b9825d2.gateway.envoyproxy.io\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-25T16:01:03.265313Z","caller":"traceutil/trace.go:171","msg":"trace[293931104] linearizableReadLoop","detail":"{readStateIndex:1573; appliedIndex:1572; }","duration":"101.771938ms","start":"2026-04-25T16:01:03.163526Z","end":"2026-04-25T16:01:03.265298Z","steps":["trace[293931104] 'read index received'  (duration: 45.371µs)","trace[293931104] 'applied index is now lower than readState.Index'  (duration: 101.725187ms)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:01:03.265378Z","caller":"traceutil/trace.go:171","msg":"trace[1056090179] transaction","detail":"{read_only:false; response_revision:1529; number_of_response:1; }","duration":"279.799259ms","start":"2026-04-25T16:01:02.985544Z","end":"2026-04-25T16:01:03.265343Z","steps":["trace[1056090179] 'process raft request'  (duration: 134.78559ms)","trace[1056090179] 'compare'  (duration: 143.668499ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-25T16:01:03.265465Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.942183ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"}
{"level":"info","ts":"2026-04-25T16:01:03.265502Z","caller":"traceutil/trace.go:171","msg":"trace[854628411] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1529; }","duration":"102.013515ms","start":"2026-04-25T16:01:03.16348Z","end":"2026-04-25T16:01:03.265494Z","steps":["trace[854628411] 'agreement among raft nodes before linearized reading'  (duration: 101.86269ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:01:15.458037Z","caller":"traceutil/trace.go:171","msg":"trace[560314206] transaction","detail":"{read_only:false; response_revision:1690; number_of_response:1; }","duration":"110.397576ms","start":"2026-04-25T16:01:15.34759Z","end":"2026-04-25T16:01:15.457988Z","steps":["trace[560314206] 'process raft request'  (duration: 110.249702ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:01:33.509848Z","caller":"traceutil/trace.go:171","msg":"trace[1090742670] transaction","detail":"{read_only:false; response_revision:1837; number_of_response:1; }","duration":"147.589744ms","start":"2026-04-25T16:01:33.362234Z","end":"2026-04-25T16:01:33.509824Z","steps":["trace[1090742670] 'process raft request'  (duration: 147.395869ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:01:33.696977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.438159ms","expected-duration":"100ms","prefix":"","request":"header:<ID:8620626107754344567 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:1831 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:411 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-04-25T16:01:33.697121Z","caller":"traceutil/trace.go:171","msg":"trace[1176427146] transaction","detail":"{read_only:false; response_revision:1838; number_of_response:1; }","duration":"150.327247ms","start":"2026-04-25T16:01:33.546777Z","end":"2026-04-25T16:01:33.697104Z","steps":["trace[1176427146] 'process raft request'  (duration: 43.681403ms)","trace[1176427146] 'compare'  (duration: 106.214081ms)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:01:33.934002Z","caller":"traceutil/trace.go:171","msg":"trace[406307377] transaction","detail":"{read_only:false; response_revision:1839; number_of_response:1; }","duration":"150.677068ms","start":"2026-04-25T16:01:33.783297Z","end":"2026-04-25T16:01:33.933974Z","steps":["trace[406307377] 'process raft request'  (duration: 63.91602ms)","trace[406307377] 'compare'  (duration: 86.643104ms)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:01:34.463219Z","caller":"traceutil/trace.go:171","msg":"trace[357650604] linearizableReadLoop","detail":"{readStateIndex:1891; appliedIndex:1890; }","duration":"277.794628ms","start":"2026-04-25T16:01:34.1854Z","end":"2026-04-25T16:01:34.463195Z","steps":["trace[357650604] 'read index received'  (duration: 246.715954ms)","trace[357650604] 'applied index is now lower than readState.Index'  (duration: 31.077214ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-25T16:01:34.463429Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"270.922711ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/\" range_end:\"/registry/apiextensions.k8s.io/customresourcedefinitions0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-04-25T16:01:34.463472Z","caller":"traceutil/trace.go:171","msg":"trace[1685272129] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:1839; }","duration":"270.998484ms","start":"2026-04-25T16:01:34.192463Z","end":"2026-04-25T16:01:34.463461Z","steps":["trace[1685272129] 'agreement among raft nodes before linearized reading'  (duration: 270.88009ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:01:34.463533Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"278.097557ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:477"}
{"level":"info","ts":"2026-04-25T16:01:34.463669Z","caller":"traceutil/trace.go:171","msg":"trace[1409524620] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1839; }","duration":"278.287904ms","start":"2026-04-25T16:01:34.185364Z","end":"2026-04-25T16:01:34.463652Z","steps":["trace[1409524620] 'agreement among raft nodes before linearized reading'  (duration: 277.935513ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:01:52.823392Z","caller":"traceutil/trace.go:171","msg":"trace[522436634] linearizableReadLoop","detail":"{readStateIndex:2228; appliedIndex:2227; }","duration":"225.921039ms","start":"2026-04-25T16:01:52.597448Z","end":"2026-04-25T16:01:52.823369Z","steps":["trace[522436634] 'read index received'  (duration: 225.778375ms)","trace[522436634] 'applied index is now lower than readState.Index'  (duration: 141.554µs)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:01:52.823513Z","caller":"traceutil/trace.go:171","msg":"trace[1683603117] transaction","detail":"{read_only:false; response_revision:2147; number_of_response:1; }","duration":"231.308321ms","start":"2026-04-25T16:01:52.592169Z","end":"2026-04-25T16:01:52.823477Z","steps":["trace[1683603117] 'process raft request'  (duration: 231.032583ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:01:52.823724Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.238968ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/keepalived-d6m9r\" ","response":"range_response_count:1 size:6447"}
{"level":"info","ts":"2026-04-25T16:01:52.823807Z","caller":"traceutil/trace.go:171","msg":"trace[2033948807] range","detail":"{range_begin:/registry/pods/openstack/keepalived-d6m9r; range_end:; response_count:1; response_revision:2147; }","duration":"226.368613ms","start":"2026-04-25T16:01:52.59742Z","end":"2026-04-25T16:01:52.823789Z","steps":["trace[2033948807] 'agreement among raft nodes before linearized reading'  (duration: 226.075654ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:04:18.717465Z","caller":"traceutil/trace.go:171","msg":"trace[2041048639] transaction","detail":"{read_only:false; response_revision:3458; number_of_response:1; }","duration":"156.61372ms","start":"2026-04-25T16:04:18.560823Z","end":"2026-04-25T16:04:18.717437Z","steps":["trace[2041048639] 'process raft request'  (duration: 156.431475ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:04:26.385162Z","caller":"traceutil/trace.go:171","msg":"trace[700326824] transaction","detail":"{read_only:false; response_revision:3519; number_of_response:1; }","duration":"125.631561ms","start":"2026-04-25T16:04:26.259507Z","end":"2026-04-25T16:04:26.385139Z","steps":["trace[700326824] 'process raft request'  (duration: 125.474687ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:05:01.187996Z","caller":"traceutil/trace.go:171","msg":"trace[1978874734] linearizableReadLoop","detail":"{readStateIndex:3867; appliedIndex:3866; }","duration":"162.451086ms","start":"2026-04-25T16:05:01.025512Z","end":"2026-04-25T16:05:01.187964Z","steps":["trace[1978874734] 'read index received'  (duration: 142.78627ms)","trace[1978874734] 'applied index is now lower than readState.Index'  (duration: 19.663306ms)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:05:01.188084Z","caller":"traceutil/trace.go:171","msg":"trace[2037726267] transaction","detail":"{read_only:false; response_revision:3729; number_of_response:1; }","duration":"210.834042ms","start":"2026-04-25T16:05:00.977219Z","end":"2026-04-25T16:05:01.188053Z","steps":["trace[2037726267] 'process raft request'  (duration: 191.069333ms)","trace[2037726267] 'compare'  (duration: 18.884795ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-25T16:05:01.188399Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.334402ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-04-25T16:05:01.188515Z","caller":"traceutil/trace.go:171","msg":"trace[1383459263] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:3729; }","duration":"110.501136ms","start":"2026-04-25T16:05:01.07799Z","end":"2026-04-25T16:05:01.188491Z","steps":["trace[1383459263] 'agreement among raft nodes before linearized reading'  (duration: 110.292641ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:05:01.188896Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"163.34162ms","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-04-25T16:05:01.188992Z","caller":"traceutil/trace.go:171","msg":"trace[962008967] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:3729; }","duration":"163.489794ms","start":"2026-04-25T16:05:01.025485Z","end":"2026-04-25T16:05:01.188975Z","steps":["trace[962008967] 'agreement among raft nodes before linearized reading'  (duration: 162.604191ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:06:18.186019Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.295123ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-c3e3fe26-c306-435e-8f7f-76a8f09825d6\" ","response":"range_response_count:1 size:3645"}
{"level":"info","ts":"2026-04-25T16:06:18.186165Z","caller":"traceutil/trace.go:171","msg":"trace[1857899831] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-c3e3fe26-c306-435e-8f7f-76a8f09825d6; range_end:; response_count:1; response_revision:4261; }","duration":"107.477758ms","start":"2026-04-25T16:06:18.078654Z","end":"2026-04-25T16:06:18.186132Z","steps":["trace[1857899831] 'range keys from in-memory index tree'  (duration: 107.075838ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:07:16.227736Z","caller":"traceutil/trace.go:171","msg":"trace[601932113] transaction","detail":"{read_only:false; response_revision:4750; number_of_response:1; }","duration":"118.153527ms","start":"2026-04-25T16:07:16.109555Z","end":"2026-04-25T16:07:16.227708Z","steps":["trace[601932113] 'process raft request'  (duration: 117.992313ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:09:36.0254Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":3574}
{"level":"info","ts":"2026-04-25T16:09:36.11792Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":3574,"took":"90.871717ms","hash":2744341134,"current-db-size-bytes":46211072,"current-db-size":"46 MB","current-db-size-in-use-bytes":18112512,"current-db-size-in-use":"18 MB"}
{"level":"info","ts":"2026-04-25T16:09:36.118001Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2744341134,"revision":3574,"compact-revision":-1}
{"level":"info","ts":"2026-04-25T16:11:42.017018Z","caller":"traceutil/trace.go:171","msg":"trace[771933860] linearizableReadLoop","detail":"{readStateIndex:7757; appliedIndex:7756; }","duration":"118.819495ms","start":"2026-04-25T16:11:41.898178Z","end":"2026-04-25T16:11:42.016997Z","steps":["trace[771933860] 'read index received'  (duration: 118.679361ms)","trace[771933860] 'applied index is now lower than readState.Index'  (duration: 139.334µs)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:11:42.017034Z","caller":"traceutil/trace.go:171","msg":"trace[1061146860] transaction","detail":"{read_only:false; response_revision:7513; number_of_response:1; }","duration":"144.927976ms","start":"2026-04-25T16:11:41.872079Z","end":"2026-04-25T16:11:42.017007Z","steps":["trace[1061146860] 'process raft request'  (duration: 144.770222ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:11:42.017331Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.139263ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:435"}
{"level":"info","ts":"2026-04-25T16:11:42.017432Z","caller":"traceutil/trace.go:171","msg":"trace[886424924] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:7513; }","duration":"119.253866ms","start":"2026-04-25T16:11:41.898153Z","end":"2026-04-25T16:11:42.017407Z","steps":["trace[886424924] 'agreement among raft nodes before linearized reading'  (duration: 118.967809ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:11:42.017488Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.2494ms","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-25T16:11:42.017533Z","caller":"traceutil/trace.go:171","msg":"trace[85931297] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:7513; }","duration":"107.62275ms","start":"2026-04-25T16:11:41.909887Z","end":"2026-04-25T16:11:42.017509Z","steps":["trace[85931297] 'agreement among raft nodes before linearized reading'  (duration: 107.230719ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:11:45.398366Z","caller":"traceutil/trace.go:171","msg":"trace[1288989808] transaction","detail":"{read_only:false; response_revision:7636; number_of_response:1; }","duration":"115.680539ms","start":"2026-04-25T16:11:45.282652Z","end":"2026-04-25T16:11:45.398332Z","steps":["trace[1288989808] 'process raft request'  (duration: 24.391214ms)","trace[1288989808] 'compare'  (duration: 91.160022ms)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:11:45.419067Z","caller":"traceutil/trace.go:171","msg":"trace[799631287] linearizableReadLoop","detail":"{readStateIndex:7883; appliedIndex:7881; }","duration":"128.021255ms","start":"2026-04-25T16:11:45.291017Z","end":"2026-04-25T16:11:45.419038Z","steps":["trace[799631287] 'read index received'  (duration: 15.976325ms)","trace[799631287] 'applied index is now lower than readState.Index'  (duration: 112.04389ms)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:11:45.4192Z","caller":"traceutil/trace.go:171","msg":"trace[920507668] transaction","detail":"{read_only:false; response_revision:7637; number_of_response:1; }","duration":"129.825866ms","start":"2026-04-25T16:11:45.289335Z","end":"2026-04-25T16:11:45.419161Z","steps":["trace[920507668] 'process raft request'  (duration: 129.545977ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:11:45.419315Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.270623ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/libvirt-libvirt-default-gcdxz\" ","response":"range_response_count:1 size:20671"}
{"level":"info","ts":"2026-04-25T16:11:45.419359Z","caller":"traceutil/trace.go:171","msg":"trace[252559783] range","detail":"{range_begin:/registry/pods/openstack/libvirt-libvirt-default-gcdxz; range_end:; response_count:1; response_revision:7637; }","duration":"128.375336ms","start":"2026-04-25T16:11:45.290973Z","end":"2026-04-25T16:11:45.419348Z","steps":["trace[252559783] 'agreement among raft nodes before linearized reading'  (duration: 128.17521ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:11:49.664922Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.74089ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-25T16:11:49.665042Z","caller":"traceutil/trace.go:171","msg":"trace[101200975] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:7717; }","duration":"112.877663ms","start":"2026-04-25T16:11:49.552144Z","end":"2026-04-25T16:11:49.665022Z","steps":["trace[101200975] 'range keys from in-memory index tree'  (duration: 112.722599ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:11:49.665677Z","caller":"traceutil/trace.go:171","msg":"trace[1848441050] transaction","detail":"{read_only:false; response_revision:7718; number_of_response:1; }","duration":"195.524513ms","start":"2026-04-25T16:11:49.470108Z","end":"2026-04-25T16:11:49.665633Z","steps":["trace[1848441050] 'process raft request'  (duration: 179.786195ms)","trace[1848441050] 'compare'  (duration: 15.231644ms)"],"step_count":2}
{"level":"warn","ts":"2026-04-25T16:11:52.542053Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.814565ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/heat-rabbit-init\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-25T16:11:52.542142Z","caller":"traceutil/trace.go:171","msg":"trace[2046878837] range","detail":"{range_begin:/registry/jobs/openstack/heat-rabbit-init; range_end:; response_count:0; response_revision:7744; }","duration":"100.927328ms","start":"2026-04-25T16:11:52.441196Z","end":"2026-04-25T16:11:52.542123Z","steps":["trace[2046878837] 'range keys from in-memory index tree'  (duration: 100.726543ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:11:52.542342Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.208655ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/heat-bootstrap\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-25T16:11:52.542378Z","caller":"traceutil/trace.go:171","msg":"trace[231150825] range","detail":"{range_begin:/registry/jobs/openstack/heat-bootstrap; range_end:; response_count:0; response_revision:7744; }","duration":"101.283497ms","start":"2026-04-25T16:11:52.441086Z","end":"2026-04-25T16:11:52.542369Z","steps":["trace[231150825] 'range keys from in-memory index tree'  (duration: 101.02543ms)"],"step_count":1}
{"level":"warn","ts":"2026-04-25T16:11:52.542515Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.068312ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/heat-domain-ks-user\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-04-25T16:11:52.542555Z","caller":"traceutil/trace.go:171","msg":"trace[1592317168] range","detail":"{range_begin:/registry/jobs/openstack/heat-domain-ks-user; range_end:; response_count:0; response_revision:7744; }","duration":"101.107093ms","start":"2026-04-25T16:11:52.441439Z","end":"2026-04-25T16:11:52.542547Z","steps":["trace[1592317168] 'range keys from in-memory index tree'  (duration: 101.034841ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:12:02.136492Z","caller":"traceutil/trace.go:171","msg":"trace[2091581691] transaction","detail":"{read_only:false; response_revision:7870; number_of_response:1; }","duration":"102.880391ms","start":"2026-04-25T16:12:02.033586Z","end":"2026-04-25T16:12:02.136466Z","steps":["trace[2091581691] 'process raft request'  (duration: 79.489074ms)","trace[2091581691] 'compare'  (duration: 23.273884ms)"],"step_count":2}
{"level":"info","ts":"2026-04-25T16:12:04.356399Z","caller":"traceutil/trace.go:171","msg":"trace[2053762974] transaction","detail":"{read_only:false; response_revision:7886; number_of_response:1; }","duration":"110.969892ms","start":"2026-04-25T16:12:04.245391Z","end":"2026-04-25T16:12:04.356361Z","steps":["trace[2053762974] 'process raft request'  (duration: 110.746095ms)"],"step_count":1}
{"level":"info","ts":"2026-04-25T16:14:36.031936Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5639}
{"level":"info","ts":"2026-04-25T16:14:36.092877Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5639,"took":"58.552154ms","hash":1701795852,"current-db-size-bytes":46211072,"current-db-size":"46 MB","current-db-size-in-use-bytes":29908992,"current-db-size-in-use":"30 MB"}
{"level":"info","ts":"2026-04-25T16:14:36.092947Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1701795852,"revision":5639,"compact-revision":3574}
{"level":"info","ts":"2026-04-25T16:15:00.945954Z","caller":"etcdserver/server.go:1401","msg":"triggering snapshot","local-member-id":"cf8c3a138c9a77a2","local-member-applied-index":10001,"local-member-snapshot-index":0,"local-member-snapshot-count":10000}
{"level":"info","ts":"2026-04-25T16:15:00.950915Z","caller":"etcdserver/server.go:2420","msg":"saved snapshot","snapshot-index":10001}
{"level":"info","ts":"2026-04-25T16:15:00.951013Z","caller":"etcdserver/server.go:2450","msg":"compacted Raft logs","compact-index":5001}