{"level":"warn","ts":"2026-09-18T01:16:13.96435Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-09-18T01:16:13.964488Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.105: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://162.253.55.105:2380","--initial-cluster=instance=https://162.253.55.105:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.105:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.105: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-09-18T01:16:13.96463Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-09-18T01:16:13.96465Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.105:2380"]}
{"level":"info","ts":"2026-09-18T01:16:13.964689Z","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-09-18T01:16:13.965838Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.105:2379"]}
{"level":"info","ts":"2026-09-18T01:16:13.965971Z","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://162.253.55.105:2380"],"listen-peer-urls":["https://162.253.55.105:2380"],"advertise-client-urls":["https://162.253.55.105:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.105:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.105: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-09-18T01:16:13.974101Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"5.45466ms"}
{"level":"info","ts":"2026-09-18T01:16:13.981216Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"15a19459cc268924","cluster-id":"9aaad1c0fc15509e"}
{"level":"info","ts":"2026-09-18T01:16:13.981322Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 switched to configuration voters=()"}
{"level":"info","ts":"2026-09-18T01:16:13.981349Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 became follower at term 0"}
{"level":"info","ts":"2026-09-18T01:16:13.981364Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 15a19459cc268924 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-09-18T01:16:13.981375Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 became follower at term 1"}
{"level":"info","ts":"2026-09-18T01:16:13.981422Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 switched to configuration voters=(1558690059444980004)"}
{"level":"warn","ts":"2026-09-18T01:16:13.992023Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-09-18T01:16:13.994617Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-09-18T01:16:13.996025Z","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-09-18T01:16:13.998182Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"15a19459cc268924","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-09-18T01:16:13.998354Z","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-09-18T01:16:13.99845Z","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-09-18T01:16:13.998463Z","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-09-18T01:16:13.998614Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"15a19459cc268924","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-09-18T01:16:14.002416Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 switched to configuration voters=(1558690059444980004)"}
{"level":"info","ts":"2026-09-18T01:16:14.002785Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"9aaad1c0fc15509e","local-member-id":"15a19459cc268924","added-peer-id":"15a19459cc268924","added-peer-peer-urls":["https://162.253.55.105:2380"]}
{"level":"info","ts":"2026-09-18T01:16:14.011621Z","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-09-18T01:16:14.011748Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.105:2380"}
{"level":"info","ts":"2026-09-18T01:16:14.011804Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.105:2380"}
{"level":"info","ts":"2026-09-18T01:16:14.011908Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"15a19459cc268924","initial-advertise-peer-urls":["https://162.253.55.105:2380"],"listen-peer-urls":["https://162.253.55.105:2380"],"advertise-client-urls":["https://162.253.55.105:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.105:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-09-18T01:16:14.011965Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-09-18T01:16:14.182008Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 is starting a new election at term 1"}
{"level":"info","ts":"2026-09-18T01:16:14.182128Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 became pre-candidate at term 1"}
{"level":"info","ts":"2026-09-18T01:16:14.18216Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 received MsgPreVoteResp from 15a19459cc268924 at term 1"}
{"level":"info","ts":"2026-09-18T01:16:14.182185Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 became candidate at term 2"}
{"level":"info","ts":"2026-09-18T01:16:14.182201Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 received MsgVoteResp from 15a19459cc268924 at term 2"}
{"level":"info","ts":"2026-09-18T01:16:14.182221Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"15a19459cc268924 became leader at term 2"}
{"level":"info","ts":"2026-09-18T01:16:14.182241Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 15a19459cc268924 elected leader 15a19459cc268924 at term 2"}
{"level":"info","ts":"2026-09-18T01:16:14.183367Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"15a19459cc268924","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.105:2379]}","request-path":"/0/members/15a19459cc268924/attributes","cluster-id":"9aaad1c0fc15509e","publish-timeout":"7s"}
{"level":"info","ts":"2026-09-18T01:16:14.183379Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-09-18T01:16:14.183898Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-18T01:16:14.18409Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-09-18T01:16:14.186379Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-09-18T01:16:14.186426Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-09-18T01:16:14.186478Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.105:2379"}
{"level":"info","ts":"2026-09-18T01:16:14.186713Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"9aaad1c0fc15509e","local-member-id":"15a19459cc268924","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-18T01:16:14.186794Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-18T01:16:14.186825Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-09-18T01:16:14.187854Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-09-18T01:16:16.85596Z","caller":"traceutil/trace.go:171","msg":"trace[324969708] transaction","detail":"{read_only:false; response_revision:2; number_of_response:1; }","duration":"208.365232ms","start":"2026-09-18T01:16:16.647567Z","end":"2026-09-18T01:16:16.855933Z","steps":["trace[324969708] 'process raft request'  (duration: 207.947929ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.149624Z","caller":"traceutil/trace.go:171","msg":"trace[820054892] transaction","detail":"{read_only:false; response_revision:3; number_of_response:1; }","duration":"501.584808ms","start":"2026-09-18T01:16:16.64799Z","end":"2026-09-18T01:16:17.149574Z","steps":["trace[820054892] 'process raft request'  (duration: 501.29879ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.149804Z","caller":"traceutil/trace.go:171","msg":"trace[2068834251] linearizableReadLoop","detail":"{readStateIndex:6; appliedIndex:4; }","duration":"490.645475ms","start":"2026-09-18T01:16:16.659143Z","end":"2026-09-18T01:16:17.149788Z","steps":["trace[2068834251] 'read index received'  (duration: 196.351118ms)","trace[2068834251] 'applied index is now lower than readState.Index'  (duration: 294.293547ms)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:16:17.149894Z","caller":"traceutil/trace.go:171","msg":"trace[1197166663] transaction","detail":"{read_only:false; response_revision:8; number_of_response:1; }","duration":"438.759786ms","start":"2026-09-18T01:16:16.711115Z","end":"2026-09-18T01:16:17.149875Z","steps":["trace[1197166663] 'process raft request'  (duration: 438.481078ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.149871Z","caller":"traceutil/trace.go:171","msg":"trace[942988688] transaction","detail":"{read_only:false; response_revision:7; number_of_response:1; }","duration":"438.749316ms","start":"2026-09-18T01:16:16.711085Z","end":"2026-09-18T01:16:17.149835Z","steps":["trace[942988688] 'process raft request'  (duration: 438.484768ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.149944Z","caller":"traceutil/trace.go:171","msg":"trace[1012374594] transaction","detail":"{read_only:false; response_revision:10; number_of_response:1; }","duration":"418.53243ms","start":"2026-09-18T01:16:16.731399Z","end":"2026-09-18T01:16:17.149932Z","steps":["trace[1012374594] 'process raft request'  (duration: 418.270652ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.149989Z","caller":"traceutil/trace.go:171","msg":"trace[1427223980] transaction","detail":"{read_only:false; response_revision:5; number_of_response:1; }","duration":"438.969452ms","start":"2026-09-18T01:16:16.711008Z","end":"2026-09-18T01:16:17.149978Z","steps":["trace[1427223980] 'process raft request'  (duration: 438.498148ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.150044Z","caller":"traceutil/trace.go:171","msg":"trace[746437488] transaction","detail":"{read_only:false; response_revision:6; number_of_response:1; }","duration":"438.941411ms","start":"2026-09-18T01:16:16.711077Z","end":"2026-09-18T01:16:17.150018Z","steps":["trace[746437488] 'process raft request'  (duration: 438.454417ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.150038Z","caller":"traceutil/trace.go:171","msg":"trace[1044587163] transaction","detail":"{read_only:false; response_revision:9; number_of_response:1; }","duration":"438.731535ms","start":"2026-09-18T01:16:16.711248Z","end":"2026-09-18T01:16:17.14998Z","steps":["trace[1044587163] 'process raft request'  (duration: 438.396035ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.150131Z","caller":"traceutil/trace.go:171","msg":"trace[64212522] transaction","detail":"{read_only:false; response_revision:4; number_of_response:1; }","duration":"439.134217ms","start":"2026-09-18T01:16:16.710986Z","end":"2026-09-18T01:16:17.15012Z","steps":["trace[64212522] 'process raft request'  (duration: 438.427816ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.150255Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"437.648633ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/kube-system/\" range_end:\"/registry/resourcequotas/kube-system0\" ","response":"range_response_count:0 size:4"}
{"level":"warn","ts":"2026-09-18T01:16:17.150257Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"444.620349ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.105\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-09-18T01:16:17.15034Z","caller":"traceutil/trace.go:171","msg":"trace[25746647] range","detail":"{range_begin:/registry/resourcequotas/kube-system/; range_end:/registry/resourcequotas/kube-system0; response_count:0; response_revision:11; }","duration":"437.770076ms","start":"2026-09-18T01:16:16.712559Z","end":"2026-09-18T01:16:17.150329Z","steps":["trace[25746647] 'agreement among raft nodes before linearized reading'  (duration: 437.622852ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.150349Z","caller":"traceutil/trace.go:171","msg":"trace[60907360] range","detail":"{range_begin:/registry/masterleases/162.253.55.105; range_end:; response_count:0; response_revision:11; }","duration":"444.768784ms","start":"2026-09-18T01:16:16.70557Z","end":"2026-09-18T01:16:17.150338Z","steps":["trace[60907360] 'agreement among raft nodes before linearized reading'  (duration: 444.615389ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.150355Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"452.764299ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-09-18T01:16:17.150392Z","caller":"traceutil/trace.go:171","msg":"trace[1125838040] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"452.807821ms","start":"2026-09-18T01:16:16.697565Z","end":"2026-09-18T01:16:17.150373Z","steps":["trace[1125838040] 'agreement among raft nodes before linearized reading'  (duration: 452.77143ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.150373Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.712545Z","time spent":"437.818507ms","remote":"127.0.0.1:55420","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":0,"response size":27,"request content":"key:\"/registry/resourcequotas/kube-system/\" range_end:\"/registry/resourcequotas/kube-system0\" "}
{"level":"warn","ts":"2026-09-18T01:16:17.15042Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.697532Z","time spent":"452.882553ms","remote":"127.0.0.1:55446","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":27,"request content":"key:\"/registry/namespaces/kube-system\" "}
{"level":"warn","ts":"2026-09-18T01:16:17.150435Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"440.62588ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-09-18T01:16:17.15046Z","caller":"traceutil/trace.go:171","msg":"trace[1700895650] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"440.668822ms","start":"2026-09-18T01:16:16.709784Z","end":"2026-09-18T01:16:17.150453Z","steps":["trace[1700895650] 'agreement among raft nodes before linearized reading'  (duration: 440.633931ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.15048Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.709771Z","time spent":"440.704863ms","remote":"127.0.0.1:55446","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":27,"request content":"key:\"/registry/namespaces/kube-system\" "}
{"level":"warn","ts":"2026-09-18T01:16:17.150565Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"371.237615ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/default\" ","response":"range_response_count:0 size:4"}
{"level":"warn","ts":"2026-09-18T01:16:17.150573Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"393.10494ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-09-18T01:16:17.15059Z","caller":"traceutil/trace.go:171","msg":"trace[1123472332] range","detail":"{range_begin:/registry/namespaces/default; range_end:; response_count:0; response_revision:11; }","duration":"371.277647ms","start":"2026-09-18T01:16:16.779305Z","end":"2026-09-18T01:16:17.150582Z","steps":["trace[1123472332] 'agreement among raft nodes before linearized reading'  (duration: 371.240406ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.150564Z","caller":"traceutil/trace.go:171","msg":"trace[1004391482] transaction","detail":"{read_only:false; response_revision:11; number_of_response:1; }","duration":"409.750931ms","start":"2026-09-18T01:16:16.740801Z","end":"2026-09-18T01:16:17.150552Z","steps":["trace[1004391482] 'process raft request'  (duration: 408.912646ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.150642Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.779295Z","time spent":"371.341409ms","remote":"127.0.0.1:55446","response type":"/etcdserverpb.KV/Range","request count":0,"request size":30,"response count":0,"response size":27,"request content":"key:\"/registry/namespaces/default\" "}
{"level":"warn","ts":"2026-09-18T01:16:17.150378Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.705551Z","time spent":"444.820695ms","remote":"127.0.0.1:55374","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":0,"response size":27,"request content":"key:\"/registry/masterleases/162.253.55.105\" "}
{"level":"warn","ts":"2026-09-18T01:16:17.150678Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"455.591893ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-09-18T01:16:17.150706Z","caller":"traceutil/trace.go:171","msg":"trace[1979276760] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"455.645494ms","start":"2026-09-18T01:16:16.695051Z","end":"2026-09-18T01:16:17.150697Z","steps":["trace[1979276760] 'agreement among raft nodes before linearized reading'  (duration: 455.602573ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.150628Z","caller":"traceutil/trace.go:171","msg":"trace[971538157] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"393.158872ms","start":"2026-09-18T01:16:16.757435Z","end":"2026-09-18T01:16:17.150594Z","steps":["trace[971538157] 'agreement among raft nodes before linearized reading'  (duration: 393.114801ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.15074Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.69504Z","time spent":"455.683435ms","remote":"127.0.0.1:55446","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":27,"request content":"key:\"/registry/namespaces/kube-system\" "}
{"level":"warn","ts":"2026-09-18T01:16:17.150767Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.757426Z","time spent":"393.330767ms","remote":"127.0.0.1:55446","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":27,"request content":"key:\"/registry/namespaces/kube-system\" "}
{"level":"warn","ts":"2026-09-18T01:16:17.150793Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"491.651995ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/instance\" ","response":"range_response_count:0 size:4"}
{"level":"warn","ts":"2026-09-18T01:16:17.150289Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"458.609271ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-09-18T01:16:17.150847Z","caller":"traceutil/trace.go:171","msg":"trace[220275983] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:11; }","duration":"459.249841ms","start":"2026-09-18T01:16:16.691588Z","end":"2026-09-18T01:16:17.150838Z","steps":["trace[220275983] 'agreement among raft nodes before linearized reading'  (duration: 458.511859ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.150877Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.691576Z","time spent":"459.288141ms","remote":"127.0.0.1:55446","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":27,"request content":"key:\"/registry/namespaces/kube-system\" "}
{"level":"info","ts":"2026-09-18T01:16:17.15082Z","caller":"traceutil/trace.go:171","msg":"trace[1954208189] range","detail":"{range_begin:/registry/csinodes/instance; range_end:; response_count:0; response_revision:11; }","duration":"491.699497ms","start":"2026-09-18T01:16:16.659112Z","end":"2026-09-18T01:16:17.150811Z","steps":["trace[1954208189] 'agreement among raft nodes before linearized reading'  (duration: 491.651215ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.15094Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.659104Z","time spent":"491.83065ms","remote":"127.0.0.1:55754","response type":"/etcdserverpb.KV/Range","request count":0,"request size":29,"response count":0,"response size":27,"request content":"key:\"/registry/csinodes/instance\" "}
{"level":"warn","ts":"2026-09-18T01:16:17.151013Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.647969Z","time spent":"501.728152ms","remote":"127.0.0.1:55414","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":105,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/ranges/servicenodeports\" mod_revision:0 > success:<request_put:<key:\"/registry/ranges/servicenodeports\" value_size:66 >> failure:<request_range:<key:\"/registry/ranges/servicenodeports\" > >"}
{"level":"warn","ts":"2026-09-18T01:16:17.15118Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.711075Z","time spent":"438.850668ms","remote":"127.0.0.1:55882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":883,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.\" value_size:827 >> failure:<>"}
{"level":"warn","ts":"2026-09-18T01:16:17.151333Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.711055Z","time spent":"438.89511ms","remote":"127.0.0.1:55882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":971,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.authentication.k8s.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.authentication.k8s.io\" value_size:894 >> failure:<>"}
{"level":"warn","ts":"2026-09-18T01:16:17.151412Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.731386Z","time spent":"418.590721ms","remote":"127.0.0.1:55514","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3159,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:0 > success:<request_put:<key:\"/registry/minions/instance\" value_size:3125 >> failure:<>"}
{"level":"warn","ts":"2026-09-18T01:16:17.151537Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.710995Z","time spent":"439.014434ms","remote":"127.0.0.1:55882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":968,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.apiextensions.k8s.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.apiextensions.k8s.io\" value_size:892 >> failure:<>"}
{"level":"warn","ts":"2026-09-18T01:16:17.15169Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.711068Z","time spent":"439.000224ms","remote":"127.0.0.1:55882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":920,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.apps\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.apps\" value_size:860 >> failure:<>"}
{"level":"warn","ts":"2026-09-18T01:16:17.151818Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.711241Z","time spent":"438.87776ms","remote":"127.0.0.1:55882","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":992,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/apiregistration.k8s.io/apiservices/v1.admissionregistration.k8s.io\" mod_revision:0 > success:<request_put:<key:\"/registry/apiregistration.k8s.io/apiservices/v1.admissionregistration.k8s.io\" value_size:908 >> failure:<>"}
{"level":"warn","ts":"2026-09-18T01:16:17.152024Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.710956Z","time spent":"439.20878ms","remote":"127.0.0.1:55806","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":698,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/prioritylevelconfigurations/system\" mod_revision:0 > success:<request_put:<key:\"/registry/prioritylevelconfigurations/system\" value_size:646 >> failure:<>"}
{"level":"warn","ts":"2026-09-18T01:16:17.152213Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:16:16.740788Z","time spent":"409.864375ms","remote":"127.0.0.1:55610","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":849,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/certificatesigningrequests/csr-zlngc\" mod_revision:0 > success:<request_put:<key:\"/registry/certificatesigningrequests/csr-zlngc\" value_size:795 >> failure:<>"}
{"level":"info","ts":"2026-09-18T01:16:17.39124Z","caller":"traceutil/trace.go:171","msg":"trace[1756556228] transaction","detail":"{read_only:false; number_of_response:0; response_revision:12; }","duration":"233.658681ms","start":"2026-09-18T01:16:17.157556Z","end":"2026-09-18T01:16:17.391215Z","steps":["trace[1756556228] 'process raft request'  (duration: 229.748705ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.391542Z","caller":"traceutil/trace.go:171","msg":"trace[556281582] transaction","detail":"{read_only:false; response_revision:15; number_of_response:1; }","duration":"232.955621ms","start":"2026-09-18T01:16:17.158538Z","end":"2026-09-18T01:16:17.391494Z","steps":["trace[556281582] 'process raft request'  (duration: 232.787746ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.391658Z","caller":"traceutil/trace.go:171","msg":"trace[560619829] transaction","detail":"{read_only:false; response_revision:17; number_of_response:1; }","duration":"232.479477ms","start":"2026-09-18T01:16:17.159169Z","end":"2026-09-18T01:16:17.391649Z","steps":["trace[560619829] 'process raft request'  (duration: 232.24873ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.391546Z","caller":"traceutil/trace.go:171","msg":"trace[168384187] transaction","detail":"{read_only:false; response_revision:14; number_of_response:1; }","duration":"233.800865ms","start":"2026-09-18T01:16:17.157712Z","end":"2026-09-18T01:16:17.391512Z","steps":["trace[168384187] 'process raft request'  (duration: 233.532777ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.391761Z","caller":"traceutil/trace.go:171","msg":"trace[243117046] transaction","detail":"{read_only:false; response_revision:21; number_of_response:1; }","duration":"178.570956ms","start":"2026-09-18T01:16:17.213172Z","end":"2026-09-18T01:16:17.391743Z","steps":["trace[243117046] 'process raft request'  (duration: 178.510765ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.391851Z","caller":"traceutil/trace.go:171","msg":"trace[1803820202] transaction","detail":"{read_only:false; response_revision:16; number_of_response:1; }","duration":"232.979941ms","start":"2026-09-18T01:16:17.158861Z","end":"2026-09-18T01:16:17.391841Z","steps":["trace[1803820202] 'process raft request'  (duration: 232.526948ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.391774Z","caller":"traceutil/trace.go:171","msg":"trace[984387516] transaction","detail":"{read_only:false; response_revision:13; number_of_response:1; }","duration":"234.035542ms","start":"2026-09-18T01:16:17.157715Z","end":"2026-09-18T01:16:17.391751Z","steps":["trace[984387516] 'process raft request'  (duration: 233.431074ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.392042Z","caller":"traceutil/trace.go:171","msg":"trace[1802673373] transaction","detail":"{read_only:false; response_revision:18; number_of_response:1; }","duration":"232.338662ms","start":"2026-09-18T01:16:17.159692Z","end":"2026-09-18T01:16:17.392031Z","steps":["trace[1802673373] 'process raft request'  (duration: 231.791166ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.392074Z","caller":"traceutil/trace.go:171","msg":"trace[798688855] transaction","detail":"{read_only:false; response_revision:20; number_of_response:1; }","duration":"227.959774ms","start":"2026-09-18T01:16:17.164104Z","end":"2026-09-18T01:16:17.392064Z","steps":["trace[798688855] 'process raft request'  (duration: 227.465949ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:16:17.392158Z","caller":"traceutil/trace.go:171","msg":"trace[2142232436] linearizableReadLoop","detail":"{readStateIndex:24; appliedIndex:15; }","duration":"184.395668ms","start":"2026-09-18T01:16:17.207752Z","end":"2026-09-18T01:16:17.392148Z","steps":["trace[2142232436] 'read index received'  (duration: 179.597516ms)","trace[2142232436] 'applied index is now lower than readState.Index'  (duration: 4.797272ms)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:16:17.392226Z","caller":"traceutil/trace.go:171","msg":"trace[1857563651] transaction","detail":"{read_only:false; response_revision:19; number_of_response:1; }","duration":"232.352752ms","start":"2026-09-18T01:16:17.159861Z","end":"2026-09-18T01:16:17.392213Z","steps":["trace[1857563651] 'process raft request'  (duration: 231.653392ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.392404Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.640205ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/kube-public/\" range_end:\"/registry/resourcequotas/kube-public0\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-09-18T01:16:17.392487Z","caller":"traceutil/trace.go:171","msg":"trace[299162399] range","detail":"{range_begin:/registry/resourcequotas/kube-public/; range_end:/registry/resourcequotas/kube-public0; response_count:0; response_revision:21; }","duration":"184.729538ms","start":"2026-09-18T01:16:17.207704Z","end":"2026-09-18T01:16:17.392434Z","steps":["trace[299162399] 'agreement among raft nodes before linearized reading'  (duration: 184.554503ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:16:17.392504Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.439381ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/default\" ","response":"range_response_count:0 size:4"}
{"level":"info","ts":"2026-09-18T01:16:17.392657Z","caller":"traceutil/trace.go:171","msg":"trace[2127259512] range","detail":"{range_begin:/registry/namespaces/default; range_end:; response_count:0; response_revision:21; }","duration":"182.623966ms","start":"2026-09-18T01:16:17.21002Z","end":"2026-09-18T01:16:17.392644Z","steps":["trace[2127259512] 'agreement among raft nodes before linearized reading'  (duration: 182.389229ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:17:01.680699Z","caller":"traceutil/trace.go:171","msg":"trace[730245976] transaction","detail":"{read_only:false; response_revision:544; number_of_response:1; }","duration":"109.794797ms","start":"2026-09-18T01:17:01.570879Z","end":"2026-09-18T01:17:01.680673Z","steps":["trace[730245976] 'process raft request'  (duration: 109.634952ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:17:01.700972Z","caller":"traceutil/trace.go:171","msg":"trace[968614288] linearizableReadLoop","detail":"{readStateIndex:565; appliedIndex:563; }","duration":"111.599891ms","start":"2026-09-18T01:17:01.58934Z","end":"2026-09-18T01:17:01.70094Z","steps":["trace[968614288] 'read index received'  (duration: 91.152108ms)","trace[968614288] 'applied index is now lower than readState.Index'  (duration: 20.446453ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-18T01:17:01.701072Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.713444ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/envoy-gateway-system/\" range_end:\"/registry/secrets/envoy-gateway-system0\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-18T01:17:01.70111Z","caller":"traceutil/trace.go:171","msg":"trace[2018859365] range","detail":"{range_begin:/registry/secrets/envoy-gateway-system/; range_end:/registry/secrets/envoy-gateway-system0; response_count:0; response_revision:545; }","duration":"111.805756ms","start":"2026-09-18T01:17:01.589291Z","end":"2026-09-18T01:17:01.701097Z","steps":["trace[2018859365] 'agreement among raft nodes before linearized reading'  (duration: 111.726164ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:17:01.701192Z","caller":"traceutil/trace.go:171","msg":"trace[896150864] transaction","detail":"{read_only:false; response_revision:545; number_of_response:1; }","duration":"127.481887ms","start":"2026-09-18T01:17:01.573669Z","end":"2026-09-18T01:17:01.701151Z","steps":["trace[896150864] 'process raft request'  (duration: 127.191078ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:17:08.358127Z","caller":"traceutil/trace.go:171","msg":"trace[801920228] transaction","detail":"{read_only:false; response_revision:649; number_of_response:1; }","duration":"177.808963ms","start":"2026-09-18T01:17:08.180282Z","end":"2026-09-18T01:17:08.35809Z","steps":["trace[801920228] 'process raft request'  (duration: 121.497864ms)","trace[801920228] 'compare'  (duration: 56.165945ms)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:17:08.742766Z","caller":"traceutil/trace.go:171","msg":"trace[746544906] linearizableReadLoop","detail":"{readStateIndex:677; appliedIndex:676; }","duration":"178.024061ms","start":"2026-09-18T01:17:08.564502Z","end":"2026-09-18T01:17:08.742527Z","steps":["trace[746544906] 'read index received'  (duration: 167.954808ms)","trace[746544906] 'applied index is now lower than readState.Index'  (duration: 10.067223ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-18T01:17:08.743068Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"178.536255ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.105\" ","response":"range_response_count:1 size:135"}
{"level":"info","ts":"2026-09-18T01:17:08.74319Z","caller":"traceutil/trace.go:171","msg":"trace[1965545518] range","detail":"{range_begin:/registry/masterleases/162.253.55.105; range_end:; response_count:1; response_revision:650; }","duration":"178.679979ms","start":"2026-09-18T01:17:08.564452Z","end":"2026-09-18T01:17:08.743132Z","steps":["trace[1965545518] 'agreement among raft nodes before linearized reading'  (duration: 178.486843ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:17:08.742885Z","caller":"traceutil/trace.go:171","msg":"trace[201346346] transaction","detail":"{read_only:false; response_revision:650; number_of_response:1; }","duration":"268.221505ms","start":"2026-09-18T01:17:08.474625Z","end":"2026-09-18T01:17:08.742846Z","steps":["trace[201346346] 'process raft request'  (duration: 257.924127ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:17:09.20385Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"226.383862ms","expected-duration":"100ms","prefix":"","request":"header:<ID:9882200169089540716 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/pods/kube-system/cilium-n9v4d\" mod_revision:536 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-n9v4d\" value_size:17085 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-n9v4d\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-18T01:17:09.203984Z","caller":"traceutil/trace.go:171","msg":"trace[485340950] transaction","detail":"{read_only:false; response_revision:651; number_of_response:1; }","duration":"450.591196ms","start":"2026-09-18T01:17:08.75337Z","end":"2026-09-18T01:17:09.203961Z","steps":["trace[485340950] 'process raft request'  (duration: 223.781822ms)","trace[485340950] 'compare'  (duration: 226.032121ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-18T01:17:09.204223Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:17:08.753345Z","time spent":"450.832364ms","remote":"127.0.0.1:55530","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/kube-system/cilium-n9v4d\" mod_revision:536 > success:<request_put:<key:\"/registry/pods/kube-system/cilium-n9v4d\" value_size:17085 >> failure:<request_range:<key:\"/registry/pods/kube-system/cilium-n9v4d\" > >"}
{"level":"info","ts":"2026-09-18T01:17:09.517847Z","caller":"traceutil/trace.go:171","msg":"trace[2040118163] transaction","detail":"{read_only:false; response_revision:652; number_of_response:1; }","duration":"762.414872ms","start":"2026-09-18T01:17:08.755395Z","end":"2026-09-18T01:17:09.51781Z","steps":["trace[2040118163] 'process raft request'  (duration: 752.808694ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:17:09.518024Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:17:08.755379Z","time spent":"762.547736ms","remote":"127.0.0.1:55374","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/masterleases/162.253.55.105\" mod_revision:501 > success:<request_put:<key:\"/registry/masterleases/162.253.55.105\" value_size:67 lease:658828132234764906 >> failure:<request_range:<key:\"/registry/masterleases/162.253.55.105\" > >"}
{"level":"info","ts":"2026-09-18T01:17:09.519022Z","caller":"traceutil/trace.go:171","msg":"trace[2019989009] linearizableReadLoop","detail":"{readStateIndex:681; appliedIndex:678; }","duration":"552.739812ms","start":"2026-09-18T01:17:08.966245Z","end":"2026-09-18T01:17:09.518984Z","steps":["trace[2019989009] 'read index received'  (duration: 10.975839ms)","trace[2019989009] 'applied index is now lower than readState.Index'  (duration: 541.762563ms)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:17:09.519127Z","caller":"traceutil/trace.go:171","msg":"trace[905340400] transaction","detail":"{read_only:false; response_revision:653; number_of_response:1; }","duration":"717.655049ms","start":"2026-09-18T01:17:08.801441Z","end":"2026-09-18T01:17:09.519096Z","steps":["trace[905340400] 'process raft request'  (duration: 716.576778ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:17:09.519314Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"553.055012ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-09-18T01:17:09.519386Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"512.354172ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"}
{"level":"warn","ts":"2026-09-18T01:17:09.519389Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:17:08.801411Z","time spent":"717.813534ms","remote":"127.0.0.1:55426","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036285,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" mod_revision:648 > success:<request_put:<key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" value_size:1036201 >> failure:<request_range:<key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" > >"}
{"level":"info","ts":"2026-09-18T01:17:09.519374Z","caller":"traceutil/trace.go:171","msg":"trace[915142386] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:653; }","duration":"553.162855ms","start":"2026-09-18T01:17:08.966196Z","end":"2026-09-18T01:17:09.519359Z","steps":["trace[915142386] 'agreement among raft nodes before linearized reading'  (duration: 552.953369ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:17:09.51944Z","caller":"traceutil/trace.go:171","msg":"trace[1648626760] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:653; }","duration":"512.493546ms","start":"2026-09-18T01:17:09.006928Z","end":"2026-09-18T01:17:09.519422Z","steps":["trace[1648626760] 'agreement among raft nodes before linearized reading'  (duration: 512.27456ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:17:09.519488Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:17:09.006917Z","time spent":"512.562178ms","remote":"127.0.0.1:55626","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "}
{"level":"warn","ts":"2026-09-18T01:17:09.519524Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:17:08.966174Z","time spent":"553.336751ms","remote":"127.0.0.1:55348","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "}
{"level":"info","ts":"2026-09-18T01:17:11.082869Z","caller":"traceutil/trace.go:171","msg":"trace[831103254] linearizableReadLoop","detail":"{readStateIndex:710; appliedIndex:709; }","duration":"120.799317ms","start":"2026-09-18T01:17:10.962038Z","end":"2026-09-18T01:17:11.082837Z","steps":["trace[831103254] 'read index received'  (duration: 120.522008ms)","trace[831103254] 'applied index is now lower than readState.Index'  (duration: 275.658µs)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:17:11.082943Z","caller":"traceutil/trace.go:171","msg":"trace[966484906] transaction","detail":"{read_only:false; response_revision:682; number_of_response:1; }","duration":"197.265791ms","start":"2026-09-18T01:17:10.885612Z","end":"2026-09-18T01:17:11.082878Z","steps":["trace[966484906] 'process raft request'  (duration: 197.000613ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:17:11.083048Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.976131ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-09-18T01:17:11.083092Z","caller":"traceutil/trace.go:171","msg":"trace[289013461] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:682; }","duration":"121.071473ms","start":"2026-09-18T01:17:10.962008Z","end":"2026-09-18T01:17:11.083079Z","steps":["trace[289013461] 'agreement among raft nodes before linearized reading'  (duration: 120.972081ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:17:25.724091Z","caller":"traceutil/trace.go:171","msg":"trace[902663657] transaction","detail":"{read_only:false; response_revision:821; number_of_response:1; }","duration":"100.471987ms","start":"2026-09-18T01:17:25.62358Z","end":"2026-09-18T01:17:25.724052Z","steps":["trace[902663657] 'process raft request'  (duration: 100.348713ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:18:34.028016Z","caller":"traceutil/trace.go:171","msg":"trace[1326863799] transaction","detail":"{read_only:false; response_revision:1754; number_of_response:1; }","duration":"118.991018ms","start":"2026-09-18T01:18:33.908999Z","end":"2026-09-18T01:18:34.02799Z","steps":["trace[1326863799] 'process raft request'  (duration: 118.885605ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:18:34.028069Z","caller":"traceutil/trace.go:171","msg":"trace[631888904] transaction","detail":"{read_only:false; response_revision:1753; number_of_response:1; }","duration":"127.746685ms","start":"2026-09-18T01:18:33.900278Z","end":"2026-09-18T01:18:34.028025Z","steps":["trace[631888904] 'process raft request'  (duration: 105.068064ms)","trace[631888904] 'compare'  (duration: 22.377962ms)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:18:43.391661Z","caller":"traceutil/trace.go:171","msg":"trace[156436413] linearizableReadLoop","detail":"{readStateIndex:1960; appliedIndex:1959; }","duration":"184.059219ms","start":"2026-09-18T01:18:43.207572Z","end":"2026-09-18T01:18:43.391631Z","steps":["trace[156436413] 'read index received'  (duration: 183.802771ms)","trace[156436413] 'applied index is now lower than readState.Index'  (duration: 255.108µs)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:18:43.391746Z","caller":"traceutil/trace.go:171","msg":"trace[462053653] transaction","detail":"{read_only:false; response_revision:1887; number_of_response:1; }","duration":"191.291331ms","start":"2026-09-18T01:18:43.200425Z","end":"2026-09-18T01:18:43.391716Z","steps":["trace[462053653] 'process raft request'  (duration: 191.039613ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:18:43.391871Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.275125ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-b54221ad-c6b6-4c48-9677-6ef377e4e1fc\" ","response":"range_response_count:1 size:3747"}
{"level":"warn","ts":"2026-09-18T01:18:43.391958Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.482255ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:554"}
{"level":"info","ts":"2026-09-18T01:18:43.391968Z","caller":"traceutil/trace.go:171","msg":"trace[1900377011] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-b54221ad-c6b6-4c48-9677-6ef377e4e1fc; range_end:; response_count:1; response_revision:1887; }","duration":"184.434871ms","start":"2026-09-18T01:18:43.207507Z","end":"2026-09-18T01:18:43.391942Z","steps":["trace[1900377011] 'agreement among raft nodes before linearized reading'  (duration: 184.235755ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:18:43.392018Z","caller":"traceutil/trace.go:171","msg":"trace[452562712] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:1887; }","duration":"133.593238ms","start":"2026-09-18T01:18:43.258408Z","end":"2026-09-18T01:18:43.392001Z","steps":["trace[452562712] 'agreement among raft nodes before linearized reading'  (duration: 133.402463ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:19:17.74399Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.480172ms","expected-duration":"100ms","prefix":"","request":"header:<ID:9882200169089543762 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" mod_revision:2120 > success:<request_put:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" value_size:464 >> failure:<request_range:<key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-18T01:19:17.744105Z","caller":"traceutil/trace.go:171","msg":"trace[1733668131] transaction","detail":"{read_only:false; response_revision:2132; number_of_response:1; }","duration":"129.831067ms","start":"2026-09-18T01:19:17.614254Z","end":"2026-09-18T01:19:17.744085Z","steps":["trace[1733668131] 'compare'  (duration: 121.353939ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:19:18.575335Z","caller":"traceutil/trace.go:171","msg":"trace[906172303] linearizableReadLoop","detail":"{readStateIndex:2215; appliedIndex:2214; }","duration":"173.379155ms","start":"2026-09-18T01:19:18.401926Z","end":"2026-09-18T01:19:18.575305Z","steps":["trace[906172303] 'read index received'  (duration: 173.088996ms)","trace[906172303] 'applied index is now lower than readState.Index'  (duration: 287.899µs)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:19:18.575395Z","caller":"traceutil/trace.go:171","msg":"trace[1562346156] transaction","detail":"{read_only:false; response_revision:2135; number_of_response:1; }","duration":"205.807067ms","start":"2026-09-18T01:19:18.369554Z","end":"2026-09-18T01:19:18.575361Z","steps":["trace[1562346156] 'process raft request'  (duration: 205.491338ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:19:18.575646Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.666062ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:571"}
{"level":"info","ts":"2026-09-18T01:19:18.575733Z","caller":"traceutil/trace.go:171","msg":"trace[2033401312] range","detail":"{range_begin:/registry/leases/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:2135; }","duration":"173.864269ms","start":"2026-09-18T01:19:18.401832Z","end":"2026-09-18T01:19:18.575696Z","steps":["trace[2033401312] 'agreement among raft nodes before linearized reading'  (duration: 173.621722ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:20:29.224286Z","caller":"traceutil/trace.go:171","msg":"trace[1207719341] linearizableReadLoop","detail":"{readStateIndex:2715; appliedIndex:2714; }","duration":"202.620322ms","start":"2026-09-18T01:20:29.021638Z","end":"2026-09-18T01:20:29.224259Z","steps":["trace[1207719341] 'read index received'  (duration: 202.429666ms)","trace[1207719341] 'applied index is now lower than readState.Index'  (duration: 189.216µs)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:20:29.224337Z","caller":"traceutil/trace.go:171","msg":"trace[1581310977] transaction","detail":"{read_only:false; response_revision:2617; number_of_response:1; }","duration":"250.686533ms","start":"2026-09-18T01:20:28.973597Z","end":"2026-09-18T01:20:29.224283Z","steps":["trace[1581310977] 'process raft request'  (duration: 250.485066ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:20:29.224634Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.970573ms","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-09-18T01:20:29.224692Z","caller":"traceutil/trace.go:171","msg":"trace[59651717] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2617; }","duration":"203.043495ms","start":"2026-09-18T01:20:29.021634Z","end":"2026-09-18T01:20:29.224678Z","steps":["trace[59651717] 'agreement among raft nodes before linearized reading'  (duration: 202.801787ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:20:29.224876Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.243847ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/\" range_end:\"/registry/csinodes0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-09-18T01:20:29.22492Z","caller":"traceutil/trace.go:171","msg":"trace[1264232817] range","detail":"{range_begin:/registry/csinodes/; range_end:/registry/csinodes0; response_count:0; response_revision:2617; }","duration":"110.327579ms","start":"2026-09-18T01:20:29.114581Z","end":"2026-09-18T01:20:29.224909Z","steps":["trace[1264232817] 'agreement among raft nodes before linearized reading'  (duration: 110.256597ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:21:05.688014Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.026322ms","expected-duration":"100ms","prefix":"","request":"header:<ID:9882200169089545539 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:2807 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:478 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-09-18T01:21:05.68818Z","caller":"traceutil/trace.go:171","msg":"trace[1817405312] transaction","detail":"{read_only:false; response_revision:2817; number_of_response:1; }","duration":"193.488675ms","start":"2026-09-18T01:21:05.49467Z","end":"2026-09-18T01:21:05.688158Z","steps":["trace[1817405312] 'process raft request'  (duration: 11.791729ms)","trace[1817405312] 'compare'  (duration: 180.741826ms)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:25:51.614277Z","caller":"traceutil/trace.go:171","msg":"trace[2019795090] transaction","detail":"{read_only:false; response_revision:5017; number_of_response:1; }","duration":"124.507472ms","start":"2026-09-18T01:25:51.489746Z","end":"2026-09-18T01:25:51.614253Z","steps":["trace[2019795090] 'process raft request'  (duration: 123.794163ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:25:52.833701Z","caller":"traceutil/trace.go:171","msg":"trace[947343096] transaction","detail":"{read_only:false; response_revision:5026; number_of_response:1; }","duration":"147.483956ms","start":"2026-09-18T01:25:52.686189Z","end":"2026-09-18T01:25:52.833673Z","steps":["trace[947343096] 'process raft request'  (duration: 146.984494ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:25:58.234288Z","caller":"traceutil/trace.go:171","msg":"trace[266257768] transaction","detail":"{read_only:false; response_revision:5116; number_of_response:1; }","duration":"272.069931ms","start":"2026-09-18T01:25:57.962194Z","end":"2026-09-18T01:25:58.234264Z","steps":["trace[266257768] 'process raft request'  (duration: 271.244879ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:25:58.249262Z","caller":"traceutil/trace.go:171","msg":"trace[921304255] transaction","detail":"{read_only:false; response_revision:5117; number_of_response:1; }","duration":"287.041981ms","start":"2026-09-18T01:25:57.962194Z","end":"2026-09-18T01:25:58.249236Z","steps":["trace[921304255] 'process raft request'  (duration: 286.878787ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:25:58.249925Z","caller":"traceutil/trace.go:171","msg":"trace[1318660906] transaction","detail":"{read_only:false; response_revision:5119; number_of_response:1; }","duration":"111.843766ms","start":"2026-09-18T01:25:58.138044Z","end":"2026-09-18T01:25:58.249888Z","steps":["trace[1318660906] 'process raft request'  (duration: 111.572818ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:25:58.24989Z","caller":"traceutil/trace.go:171","msg":"trace[1409124989] transaction","detail":"{read_only:false; response_revision:5118; number_of_response:1; }","duration":"133.545625ms","start":"2026-09-18T01:25:58.116268Z","end":"2026-09-18T01:25:58.249813Z","steps":["trace[1409124989] 'process raft request'  (duration: 132.912857ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:25:58.975754Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.301491ms","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-09-18T01:25:58.975842Z","caller":"traceutil/trace.go:171","msg":"trace[238249485] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:5125; }","duration":"108.462105ms","start":"2026-09-18T01:25:58.867359Z","end":"2026-09-18T01:25:58.975821Z","steps":["trace[238249485] 'range keys from in-memory index tree'  (duration: 108.109656ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:02.233664Z","caller":"traceutil/trace.go:171","msg":"trace[906003472] linearizableReadLoop","detail":"{readStateIndex:5364; appliedIndex:5362; }","duration":"268.596161ms","start":"2026-09-18T01:26:01.965009Z","end":"2026-09-18T01:26:02.233606Z","steps":["trace[906003472] 'read index received'  (duration: 7.86785ms)","trace[906003472] 'applied index is now lower than readState.Index'  (duration: 260.727111ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-18T01:26:02.233943Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.902899ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-09-18T01:26:02.233965Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.052158ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/cert-manager/cert-manager-cainjector-leader-election\" ","response":"range_response_count:1 size:558"}
{"level":"info","ts":"2026-09-18T01:26:02.234031Z","caller":"traceutil/trace.go:171","msg":"trace[575281631] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:5169; }","duration":"269.041663ms","start":"2026-09-18T01:26:01.964967Z","end":"2026-09-18T01:26:02.234009Z","steps":["trace[575281631] 'agreement among raft nodes before linearized reading'  (duration: 268.842038ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:02.23404Z","caller":"traceutil/trace.go:171","msg":"trace[2111340524] range","detail":"{range_begin:/registry/leases/cert-manager/cert-manager-cainjector-leader-election; range_end:; response_count:1; response_revision:5169; }","duration":"136.160831ms","start":"2026-09-18T01:26:02.097857Z","end":"2026-09-18T01:26:02.234018Z","steps":["trace[2111340524] 'agreement among raft nodes before linearized reading'  (duration: 135.953936ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:02.234029Z","caller":"traceutil/trace.go:171","msg":"trace[2056266369] transaction","detail":"{read_only:false; response_revision:5169; number_of_response:1; }","duration":"306.766362ms","start":"2026-09-18T01:26:01.927209Z","end":"2026-09-18T01:26:02.233976Z","steps":["trace[2056266369] 'process raft request'  (duration: 306.176536ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:26:02.234204Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:26:01.927194Z","time spent":"306.912376ms","remote":"127.0.0.1:55530","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4926,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/pods/monitoring/kube-prometheus-stack-kube-state-metrics-c7bd54d7-rhkh4\" mod_revision:4957 > success:<request_put:<key:\"/registry/pods/monitoring/kube-prometheus-stack-kube-state-metrics-c7bd54d7-rhkh4\" value_size:4837 >> failure:<request_range:<key:\"/registry/pods/monitoring/kube-prometheus-stack-kube-state-metrics-c7bd54d7-rhkh4\" > >"}
{"level":"info","ts":"2026-09-18T01:26:02.415648Z","caller":"traceutil/trace.go:171","msg":"trace[232477426] transaction","detail":"{read_only:false; response_revision:5170; number_of_response:1; }","duration":"175.735778ms","start":"2026-09-18T01:26:02.239885Z","end":"2026-09-18T01:26:02.415621Z","steps":["trace[232477426] 'process raft request'  (duration: 123.791639ms)","trace[232477426] 'compare'  (duration: 51.535818ms)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:26:02.415762Z","caller":"traceutil/trace.go:171","msg":"trace[1626334109] linearizableReadLoop","detail":"{readStateIndex:5368; appliedIndex:5364; }","duration":"159.720751ms","start":"2026-09-18T01:26:02.255996Z","end":"2026-09-18T01:26:02.415717Z","steps":["trace[1626334109] 'read index received'  (duration: 107.775221ms)","trace[1626334109] 'applied index is now lower than readState.Index'  (duration: 51.94444ms)"],"step_count":2}
{"level":"info","ts":"2026-09-18T01:26:02.415909Z","caller":"traceutil/trace.go:171","msg":"trace[702956205] transaction","detail":"{read_only:false; response_revision:5173; number_of_response:1; }","duration":"172.251737ms","start":"2026-09-18T01:26:02.243642Z","end":"2026-09-18T01:26:02.415894Z","steps":["trace[702956205] 'process raft request'  (duration: 171.922408ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:02.416116Z","caller":"traceutil/trace.go:171","msg":"trace[991273965] transaction","detail":"{read_only:false; response_revision:5175; number_of_response:1; }","duration":"103.382914ms","start":"2026-09-18T01:26:02.312721Z","end":"2026-09-18T01:26:02.416104Z","steps":["trace[991273965] 'process raft request'  (duration: 102.945882ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:26:02.41627Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.258025ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"}
{"level":"info","ts":"2026-09-18T01:26:02.416337Z","caller":"traceutil/trace.go:171","msg":"trace[5329415] transaction","detail":"{read_only:false; response_revision:5174; number_of_response:1; }","duration":"147.286699ms","start":"2026-09-18T01:26:02.26904Z","end":"2026-09-18T01:26:02.416327Z","steps":["trace[5329415] 'process raft request'  (duration: 146.58119ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:26:02.416369Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.017558ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-854a6f21-a539-4433-abe0-b7d11d02bb4c\" ","response":"range_response_count:1 size:3954"}
{"level":"info","ts":"2026-09-18T01:26:02.41644Z","caller":"traceutil/trace.go:171","msg":"trace[1645938344] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-854a6f21-a539-4433-abe0-b7d11d02bb4c; range_end:; response_count:1; response_revision:5175; }","duration":"102.113491ms","start":"2026-09-18T01:26:02.314279Z","end":"2026-09-18T01:26:02.416393Z","steps":["trace[1645938344] 'agreement among raft nodes before linearized reading'  (duration: 102.031679ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:02.416337Z","caller":"traceutil/trace.go:171","msg":"trace[2029009321] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:5175; }","duration":"160.369518ms","start":"2026-09-18T01:26:02.255952Z","end":"2026-09-18T01:26:02.416322Z","steps":["trace[2029009321] 'agreement among raft nodes before linearized reading'  (duration: 160.183543ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:26:02.416283Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.642236ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:555"}
{"level":"info","ts":"2026-09-18T01:26:02.416608Z","caller":"traceutil/trace.go:171","msg":"trace[1787948878] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:5175; }","duration":"106.014765ms","start":"2026-09-18T01:26:02.310581Z","end":"2026-09-18T01:26:02.416596Z","steps":["trace[1787948878] 'agreement among raft nodes before linearized reading'  (duration: 105.589944ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:02.41607Z","caller":"traceutil/trace.go:171","msg":"trace[542474263] transaction","detail":"{read_only:false; response_revision:5171; number_of_response:1; }","duration":"174.982009ms","start":"2026-09-18T01:26:02.241052Z","end":"2026-09-18T01:26:02.416034Z","steps":["trace[542474263] 'process raft request'  (duration: 174.395943ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:02.41609Z","caller":"traceutil/trace.go:171","msg":"trace[1561507785] transaction","detail":"{read_only:false; response_revision:5172; number_of_response:1; }","duration":"173.672433ms","start":"2026-09-18T01:26:02.242396Z","end":"2026-09-18T01:26:02.416069Z","steps":["trace[1561507785] 'process raft request'  (duration: 173.110638ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:12.893235Z","caller":"traceutil/trace.go:171","msg":"trace[895483738] linearizableReadLoop","detail":"{readStateIndex:5508; appliedIndex:5507; }","duration":"384.34378ms","start":"2026-09-18T01:26:12.508861Z","end":"2026-09-18T01:26:12.893205Z","steps":["trace[895483738] 'read index received'  (duration: 335.658383ms)","trace[895483738] 'applied index is now lower than readState.Index'  (duration: 48.684177ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-18T01:26:12.893888Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"384.220627ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:493"}
{"level":"info","ts":"2026-09-18T01:26:12.893945Z","caller":"traceutil/trace.go:171","msg":"trace[308955030] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:5307; }","duration":"384.339331ms","start":"2026-09-18T01:26:12.509594Z","end":"2026-09-18T01:26:12.893934Z","steps":["trace[308955030] 'agreement among raft nodes before linearized reading'  (duration: 384.144775ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:26:12.893962Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"385.09211ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/rabbitmq-keystone-server-0\" ","response":"range_response_count:1 size:10392"}
{"level":"warn","ts":"2026-09-18T01:26:12.893982Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:26:12.509585Z","time spent":"384.386232ms","remote":"127.0.0.1:55626","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":516,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "}
{"level":"warn","ts":"2026-09-18T01:26:12.893962Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"361.152078ms","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":"warn","ts":"2026-09-18T01:26:12.893988Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"377.702352ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:556"}
{"level":"info","ts":"2026-09-18T01:26:12.894025Z","caller":"traceutil/trace.go:171","msg":"trace[1562161703] range","detail":"{range_begin:/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:5307; }","duration":"361.269371ms","start":"2026-09-18T01:26:12.532743Z","end":"2026-09-18T01:26:12.894012Z","steps":["trace[1562161703] 'agreement among raft nodes before linearized reading'  (duration: 361.108436ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:12.894057Z","caller":"traceutil/trace.go:171","msg":"trace[897147139] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:5307; }","duration":"377.830096ms","start":"2026-09-18T01:26:12.516213Z","end":"2026-09-18T01:26:12.894043Z","steps":["trace[897147139] 'agreement among raft nodes before linearized reading'  (duration: 377.668541ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:26:12.894062Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:26:12.532725Z","time spent":"361.328843ms","remote":"127.0.0.1:55494","response type":"/etcdserverpb.KV/Range","request count":0,"request size":83,"response count":1,"response size":1888,"request content":"key:\"/registry/persistentvolumeclaims/openstack/persistence-rabbitmq-keystone-server-0\" "}
{"level":"warn","ts":"2026-09-18T01:26:12.894094Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:26:12.51618Z","time spent":"377.906468ms","remote":"127.0.0.1:55626","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":1,"response size":579,"request content":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" "}
{"level":"info","ts":"2026-09-18T01:26:12.894009Z","caller":"traceutil/trace.go:171","msg":"trace[1577229521] range","detail":"{range_begin:/registry/pods/openstack/rabbitmq-keystone-server-0; range_end:; response_count:1; response_revision:5307; }","duration":"385.179482ms","start":"2026-09-18T01:26:12.508819Z","end":"2026-09-18T01:26:12.893998Z","steps":["trace[1577229521] 'agreement among raft nodes before linearized reading'  (duration: 385.023758ms)"],"step_count":1}
{"level":"warn","ts":"2026-09-18T01:26:12.894278Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:26:12.508797Z","time spent":"385.464751ms","remote":"127.0.0.1:55530","response type":"/etcdserverpb.KV/Range","request count":0,"request size":53,"response count":1,"response size":10415,"request content":"key:\"/registry/pods/openstack/rabbitmq-keystone-server-0\" "}
{"level":"warn","ts":"2026-09-18T01:26:12.893994Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"212.773914ms","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-09-18T01:26:12.894431Z","caller":"traceutil/trace.go:171","msg":"trace[433181522] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:5307; }","duration":"213.202905ms","start":"2026-09-18T01:26:12.681188Z","end":"2026-09-18T01:26:12.894391Z","steps":["trace[433181522] 'agreement among raft nodes before linearized reading'  (duration: 212.64601ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:12.893573Z","caller":"traceutil/trace.go:171","msg":"trace[1260867499] transaction","detail":"{read_only:false; response_revision:5307; number_of_response:1; }","duration":"442.225094ms","start":"2026-09-18T01:26:12.451329Z","end":"2026-09-18T01:26:12.893555Z","steps":["trace[1260867499] 'process raft request'  (duration: 393.27634ms)","trace[1260867499] 'compare'  (duration: 48.486092ms)"],"step_count":2}
{"level":"warn","ts":"2026-09-18T01:26:12.894841Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-18T01:26:12.451306Z","time spent":"443.468649ms","remote":"127.0.0.1:55626","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":39,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:5284 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"info","ts":"2026-09-18T01:26:15.112806Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2865}
{"level":"info","ts":"2026-09-18T01:26:15.189521Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2865,"took":"75.353296ms","hash":573507150,"current-db-size-bytes":51748864,"current-db-size":"52 MB","current-db-size-in-use-bytes":27906048,"current-db-size-in-use":"28 MB"}
{"level":"info","ts":"2026-09-18T01:26:15.189586Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":573507150,"revision":2865,"compact-revision":-1}
{"level":"info","ts":"2026-09-18T01:26:48.745499Z","caller":"traceutil/trace.go:171","msg":"trace[1503068917] transaction","detail":"{read_only:false; response_revision:5629; number_of_response:1; }","duration":"123.834211ms","start":"2026-09-18T01:26:48.621631Z","end":"2026-09-18T01:26:48.745465Z","steps":["trace[1503068917] 'process raft request'  (duration: 123.188643ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:26:48.746348Z","caller":"traceutil/trace.go:171","msg":"trace[1087935316] transaction","detail":"{read_only:false; response_revision:5630; number_of_response:1; }","duration":"113.717176ms","start":"2026-09-18T01:26:48.63256Z","end":"2026-09-18T01:26:48.746277Z","steps":["trace[1087935316] 'process raft request'  (duration: 113.521761ms)"],"step_count":1}
{"level":"info","ts":"2026-09-18T01:31:15.119872Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5334}
{"level":"info","ts":"2026-09-18T01:31:15.207242Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5334,"took":"85.258837ms","hash":346773615,"current-db-size-bytes":51748864,"current-db-size":"52 MB","current-db-size-in-use-bytes":18956288,"current-db-size-in-use":"19 MB"}
{"level":"info","ts":"2026-09-18T01:31:15.207308Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":346773615,"revision":5334,"compact-revision":2865}