{"level":"warn","ts":"2026-09-10T10:59:38.112659Z","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-10T10:59:38.112747Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.32: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.32:2380","--initial-cluster=instance=https://162.253.55.32:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.32:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.32: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-10T10:59:38.112814Z","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-10T10:59:38.112825Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.32:2380"]} {"level":"info","ts":"2026-09-10T10:59:38.112843Z","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-10T10:59:38.113444Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.32:2379"]} {"level":"info","ts":"2026-09-10T10:59:38.113519Z","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.32:2380"],"listen-peer-urls":["https://162.253.55.32:2380"],"advertise-client-urls":["https://162.253.55.32:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.32:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.32: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-10T10:59:38.117701Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.971378ms"} {"level":"info","ts":"2026-09-10T10:59:38.124514Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"c665390cd9eacc14","cluster-id":"d19b610fbe64baae"} {"level":"info","ts":"2026-09-10T10:59:38.124576Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 switched to configuration voters=()"} {"level":"info","ts":"2026-09-10T10:59:38.124595Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 became follower at term 0"} {"level":"info","ts":"2026-09-10T10:59:38.124607Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft c665390cd9eacc14 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-09-10T10:59:38.124617Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 became follower at term 1"} {"level":"info","ts":"2026-09-10T10:59:38.124648Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 switched to configuration voters=(14295895319515941908)"} {"level":"warn","ts":"2026-09-10T10:59:38.131759Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-09-10T10:59:38.133259Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-09-10T10:59:38.134452Z","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-10T10:59:38.136594Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"c665390cd9eacc14","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-09-10T10:59:38.136751Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"c665390cd9eacc14","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-09-10T10:59:38.136834Z","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-10T10:59:38.136922Z","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-10T10:59:38.136932Z","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-10T10:59:38.139026Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 switched to configuration voters=(14295895319515941908)"} {"level":"info","ts":"2026-09-10T10:59:38.139845Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"d19b610fbe64baae","local-member-id":"c665390cd9eacc14","added-peer-id":"c665390cd9eacc14","added-peer-peer-urls":["https://162.253.55.32:2380"]} {"level":"info","ts":"2026-09-10T10:59:38.14091Z","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-10T10:59:38.140985Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.32:2380"} {"level":"info","ts":"2026-09-10T10:59:38.141006Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.32:2380"} {"level":"info","ts":"2026-09-10T10:59:38.14106Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"c665390cd9eacc14","initial-advertise-peer-urls":["https://162.253.55.32:2380"],"listen-peer-urls":["https://162.253.55.32:2380"],"advertise-client-urls":["https://162.253.55.32:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.32:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-09-10T10:59:38.141086Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-09-10T10:59:38.925386Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 is starting a new election at term 1"} {"level":"info","ts":"2026-09-10T10:59:38.925461Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 became pre-candidate at term 1"} {"level":"info","ts":"2026-09-10T10:59:38.925486Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 received MsgPreVoteResp from c665390cd9eacc14 at term 1"} {"level":"info","ts":"2026-09-10T10:59:38.9255Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 became candidate at term 2"} {"level":"info","ts":"2026-09-10T10:59:38.925507Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 received MsgVoteResp from c665390cd9eacc14 at term 2"} {"level":"info","ts":"2026-09-10T10:59:38.925517Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"c665390cd9eacc14 became leader at term 2"} {"level":"info","ts":"2026-09-10T10:59:38.925529Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: c665390cd9eacc14 elected leader c665390cd9eacc14 at term 2"} {"level":"info","ts":"2026-09-10T10:59:38.927158Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"c665390cd9eacc14","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.32:2379]}","request-path":"/0/members/c665390cd9eacc14/attributes","cluster-id":"d19b610fbe64baae","publish-timeout":"7s"} {"level":"info","ts":"2026-09-10T10:59:38.928427Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-09-10T10:59:38.928475Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-09-10T10:59:38.928741Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-09-10T10:59:38.931341Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-09-10T10:59:38.931384Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-09-10T10:59:38.932268Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.32:2379"} {"level":"info","ts":"2026-09-10T10:59:38.933836Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-09-10T10:59:38.943345Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"d19b610fbe64baae","local-member-id":"c665390cd9eacc14","cluster-version":"3.5"} {"level":"info","ts":"2026-09-10T10:59:38.943495Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-09-10T10:59:38.944252Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"warn","ts":"2026-09-10T10:59:42.73043Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"361.12514ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-09-10T10:59:42.730567Z","caller":"traceutil/trace.go:171","msg":"trace[2124848870] transaction","detail":"{read_only:false; response_revision:205; number_of_response:1; }","duration":"563.064469ms","start":"2026-09-10T10:59:42.167485Z","end":"2026-09-10T10:59:42.73055Z","steps":["trace[2124848870] 'process raft request' (duration: 201.066831ms)","trace[2124848870] 'compare' (duration: 360.975087ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T10:59:42.730563Z","caller":"traceutil/trace.go:171","msg":"trace[1405830520] linearizableReadLoop","detail":"{readStateIndex:210; appliedIndex:209; }","duration":"318.727395ms","start":"2026-09-10T10:59:42.411812Z","end":"2026-09-10T10:59:42.730539Z","steps":["trace[1405830520] 'read index received' (duration: 27.521µs)","trace[1405830520] 'applied index is now lower than readState.Index' (duration: 318.698614ms)"],"step_count":2} {"level":"warn","ts":"2026-09-10T10:59:42.730628Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T10:59:42.167471Z","time spent":"563.133721ms","remote":"127.0.0.1:59652","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":330,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-09-10T10:59:42.730825Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.782254ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/kube-system/\" range_end:\"/registry/limitranges/kube-system0\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-09-10T10:59:42.73089Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"318.422449ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-09-10T10:59:42.73093Z","caller":"traceutil/trace.go:171","msg":"trace[1656101895] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:205; }","duration":"318.48461ms","start":"2026-09-10T10:59:42.412434Z","end":"2026-09-10T10:59:42.730918Z","steps":["trace[1656101895] 'agreement among raft nodes before linearized reading' (duration: 318.272666ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T10:59:42.730973Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T10:59:42.412389Z","time spent":"318.574872ms","remote":"127.0.0.1:59584","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-09-10T10:59:42.730905Z","caller":"traceutil/trace.go:171","msg":"trace[662194054] range","detail":"{range_begin:/registry/limitranges/kube-system/; range_end:/registry/limitranges/kube-system0; response_count:0; response_revision:205; }","duration":"244.886166ms","start":"2026-09-10T10:59:42.486011Z","end":"2026-09-10T10:59:42.730897Z","steps":["trace[662194054] 'agreement among raft nodes before linearized reading' (duration: 244.795495ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T10:59:42.730816Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"318.96093ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:431"} {"level":"info","ts":"2026-09-10T10:59:42.731105Z","caller":"traceutil/trace.go:171","msg":"trace[524835335] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:205; }","duration":"319.304656ms","start":"2026-09-10T10:59:42.411773Z","end":"2026-09-10T10:59:42.731078Z","steps":["trace[524835335] 'agreement among raft nodes before linearized reading' (duration: 318.884898ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T10:59:42.731146Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T10:59:42.411756Z","time spent":"319.378758ms","remote":"127.0.0.1:59584","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":455,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-09-10T10:59:42.730816Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"203.148684ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-09-10T10:59:42.731197Z","caller":"traceutil/trace.go:171","msg":"trace[1115721928] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:0; response_revision:205; }","duration":"203.569253ms","start":"2026-09-10T10:59:42.52762Z","end":"2026-09-10T10:59:42.731189Z","steps":["trace[1115721928] 'agreement among raft nodes before linearized reading' (duration: 203.148745ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T10:59:42.938915Z","caller":"traceutil/trace.go:171","msg":"trace[733184686] transaction","detail":"{read_only:false; response_revision:206; number_of_response:1; }","duration":"204.980681ms","start":"2026-09-10T10:59:42.733916Z","end":"2026-09-10T10:59:42.938897Z","steps":["trace[733184686] 'process raft request' (duration: 204.866759ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T10:59:43.055675Z","caller":"traceutil/trace.go:171","msg":"trace[331071576] transaction","detail":"{read_only:false; response_revision:209; number_of_response:1; }","duration":"319.829014ms","start":"2026-09-10T10:59:42.735818Z","end":"2026-09-10T10:59:43.055647Z","steps":["trace[331071576] 'process raft request' (duration: 319.765313ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T10:59:43.055866Z","caller":"traceutil/trace.go:171","msg":"trace[1789409635] transaction","detail":"{read_only:false; response_revision:210; number_of_response:1; }","duration":"319.450306ms","start":"2026-09-10T10:59:42.736223Z","end":"2026-09-10T10:59:43.055674Z","steps":["trace[1789409635] 'process raft request' (duration: 319.393135ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T10:59:43.056016Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T10:59:42.735808Z","time spent":"319.956707ms","remote":"127.0.0.1:59666","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":523,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-09-10T10:59:43.056134Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T10:59:42.736212Z","time spent":"319.67925ms","remote":"127.0.0.1:59584","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-09-10T10:59:43.0563Z","caller":"traceutil/trace.go:171","msg":"trace[413437038] transaction","detail":"{read_only:false; response_revision:207; number_of_response:1; }","duration":"320.772183ms","start":"2026-09-10T10:59:42.73552Z","end":"2026-09-10T10:59:43.056292Z","steps":["trace[413437038] 'process raft request' (duration: 316.606238ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T10:59:43.056361Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T10:59:42.735494Z","time spent":"320.823003ms","remote":"127.0.0.1:59584","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T10:59:43.056596Z","caller":"traceutil/trace.go:171","msg":"trace[398881265] transaction","detail":"{read_only:false; response_revision:208; number_of_response:1; }","duration":"320.61186ms","start":"2026-09-10T10:59:42.73566Z","end":"2026-09-10T10:59:43.056272Z","steps":["trace[398881265] 'process raft request' (duration: 319.878465ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T10:59:43.056678Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T10:59:42.735651Z","time spent":"320.974257ms","remote":"127.0.0.1:59584","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-09-10T11:00:15.121572Z","caller":"traceutil/trace.go:171","msg":"trace[1025770969] transaction","detail":"{read_only:false; response_revision:481; number_of_response:1; }","duration":"512.728208ms","start":"2026-09-10T11:00:14.608819Z","end":"2026-09-10T11:00:15.121547Z","steps":["trace[1025770969] 'process raft request' (duration: 512.523093ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.121716Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.608801Z","time spent":"512.84426ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":8162,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.12898Z","caller":"traceutil/trace.go:171","msg":"trace[674635648] transaction","detail":"{read_only:false; response_revision:482; number_of_response:1; }","duration":"516.388973ms","start":"2026-09-10T11:00:14.612554Z","end":"2026-09-10T11:00:15.128943Z","steps":["trace[674635648] 'process raft request' (duration: 516.161898ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.129119Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.612528Z","time spent":"516.521806ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9490,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129262Z","caller":"traceutil/trace.go:171","msg":"trace[1932641274] transaction","detail":"{read_only:false; response_revision:485; number_of_response:1; }","duration":"512.193775ms","start":"2026-09-10T11:00:14.617053Z","end":"2026-09-10T11:00:15.129247Z","steps":["trace[1932641274] 'process raft request' (duration: 511.923319ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.12933Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.617048Z","time spent":"512.246137ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28462,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129382Z","caller":"traceutil/trace.go:171","msg":"trace[1118359936] transaction","detail":"{read_only:false; response_revision:483; number_of_response:1; }","duration":"516.715461ms","start":"2026-09-10T11:00:14.612657Z","end":"2026-09-10T11:00:15.129373Z","steps":["trace[1118359936] 'process raft request' (duration: 516.21349ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.129427Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.612648Z","time spent":"516.755041ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":6315,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129454Z","caller":"traceutil/trace.go:171","msg":"trace[1286850888] transaction","detail":"{read_only:false; response_revision:484; number_of_response:1; }","duration":"512.492303ms","start":"2026-09-10T11:00:14.616954Z","end":"2026-09-10T11:00:15.129447Z","steps":["trace[1286850888] 'process raft request' (duration: 511.965712ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.129485Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.616938Z","time spent":"512.531504ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":22019,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129503Z","caller":"traceutil/trace.go:171","msg":"trace[2017787788] linearizableReadLoop","detail":"{readStateIndex:507; appliedIndex:501; }","duration":"499.995445ms","start":"2026-09-10T11:00:14.629477Z","end":"2026-09-10T11:00:15.129472Z","steps":["trace[2017787788] 'read index received' (duration: 491.843908ms)","trace[2017787788] 'applied index is now lower than readState.Index' (duration: 8.150767ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:00:15.129572Z","caller":"traceutil/trace.go:171","msg":"trace[1518306155] transaction","detail":"{read_only:false; response_revision:486; number_of_response:1; }","duration":"508.832349ms","start":"2026-09-10T11:00:14.620732Z","end":"2026-09-10T11:00:15.129564Z","steps":["trace[1518306155] 'process raft request' (duration: 508.286256ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.129601Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.62072Z","time spent":"508.86794ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29820,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129617Z","caller":"traceutil/trace.go:171","msg":"trace[574093720] transaction","detail":"{read_only:false; response_revision:490; number_of_response:1; }","duration":"485.479342ms","start":"2026-09-10T11:00:14.644129Z","end":"2026-09-10T11:00:15.129608Z","steps":["trace[574093720] 'process raft request' (duration: 485.081782ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:00:15.129659Z","caller":"traceutil/trace.go:171","msg":"trace[493579430] transaction","detail":"{read_only:false; response_revision:492; number_of_response:1; }","duration":"351.18617ms","start":"2026-09-10T11:00:14.778465Z","end":"2026-09-10T11:00:15.129651Z","steps":["trace[493579430] 'process raft request' (duration: 350.906053ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:00:15.129692Z","caller":"traceutil/trace.go:171","msg":"trace[797000744] transaction","detail":"{read_only:false; response_revision:487; number_of_response:1; }","duration":"498.141033ms","start":"2026-09-10T11:00:14.63154Z","end":"2026-09-10T11:00:15.129681Z","steps":["trace[797000744] 'process raft request' (duration: 497.522128ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.129698Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.778448Z","time spent":"351.234401ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":149907,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-09-10T11:00:15.129715Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.644116Z","time spent":"485.524613ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":58271,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-09-10T11:00:15.129728Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.631528Z","time spent":"498.183973ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28166,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129781Z","caller":"traceutil/trace.go:171","msg":"trace[2021533025] transaction","detail":"{read_only:false; response_revision:491; number_of_response:1; }","duration":"459.584416ms","start":"2026-09-10T11:00:14.670189Z","end":"2026-09-10T11:00:15.129774Z","steps":["trace[2021533025] 'process raft request' (duration: 459.112644ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.12981Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.670168Z","time spent":"459.630157ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":79374,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129822Z","caller":"traceutil/trace.go:171","msg":"trace[775098502] transaction","detail":"{read_only:false; response_revision:488; number_of_response:1; }","duration":"498.205905ms","start":"2026-09-10T11:00:14.631607Z","end":"2026-09-10T11:00:15.129813Z","steps":["trace[775098502] 'process raft request' (duration: 497.487398ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.12985Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.631603Z","time spent":"498.234575ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29801,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129547Z","caller":"traceutil/trace.go:171","msg":"trace[1567523304] transaction","detail":"{read_only:false; response_revision:489; number_of_response:1; }","duration":"493.574978ms","start":"2026-09-10T11:00:14.635965Z","end":"2026-09-10T11:00:15.12954Z","steps":["trace[1567523304] 'process raft request' (duration: 493.191259ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.129943Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"500.460836ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"warn","ts":"2026-09-10T11:00:15.129961Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.635939Z","time spent":"494.003727ms","remote":"127.0.0.1:59382","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":63889,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-09-10T11:00:15.129968Z","caller":"traceutil/trace.go:171","msg":"trace[32955376] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:492; }","duration":"500.504698ms","start":"2026-09-10T11:00:14.629454Z","end":"2026-09-10T11:00:15.129959Z","steps":["trace[32955376] 'agreement among raft nodes before linearized reading' (duration: 500.403516ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.129993Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.629438Z","time spent":"500.549898ms","remote":"127.0.0.1:59584","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-09-10T11:00:15.130329Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"491.649623ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-09-10T11:00:15.130359Z","caller":"traceutil/trace.go:171","msg":"trace[1182475393] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:493; }","duration":"491.704695ms","start":"2026-09-10T11:00:14.638645Z","end":"2026-09-10T11:00:15.13035Z","steps":["trace[1182475393] 'agreement among raft nodes before linearized reading' (duration: 491.613103ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:15.130378Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:14.638637Z","time spent":"491.736795ms","remote":"127.0.0.1:59328","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-09-10T11:00:21.393511Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.78134ms","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-09-10T11:00:21.394003Z","caller":"traceutil/trace.go:171","msg":"trace[1828242755] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:589; }","duration":"115.341333ms","start":"2026-09-10T11:00:21.278642Z","end":"2026-09-10T11:00:21.393983Z","steps":["trace[1828242755] 'range keys from in-memory index tree' (duration: 114.565955ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:00:21.493964Z","caller":"traceutil/trace.go:171","msg":"trace[866038482] linearizableReadLoop","detail":"{readStateIndex:616; appliedIndex:615; }","duration":"209.08829ms","start":"2026-09-10T11:00:21.284851Z","end":"2026-09-10T11:00:21.493939Z","steps":["trace[866038482] 'read index received' (duration: 208.215139ms)","trace[866038482] 'applied index is now lower than readState.Index' (duration: 872.091µs)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:00:21.494003Z","caller":"traceutil/trace.go:171","msg":"trace[211367265] transaction","detail":"{read_only:false; response_revision:590; number_of_response:1; }","duration":"212.039419ms","start":"2026-09-10T11:00:21.281944Z","end":"2026-09-10T11:00:21.493983Z","steps":["trace[211367265] 'process raft request' (duration: 211.302862ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:21.658889Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"374.01054ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-09-10T11:00:21.658998Z","caller":"traceutil/trace.go:171","msg":"trace[687401836] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:590; }","duration":"374.161024ms","start":"2026-09-10T11:00:21.284813Z","end":"2026-09-10T11:00:21.658974Z","steps":["trace[687401836] 'agreement among raft nodes before linearized reading' (duration: 209.249774ms)","trace[687401836] 'range keys from in-memory index tree' (duration: 164.46397ms)"],"step_count":2} {"level":"warn","ts":"2026-09-10T11:00:21.659065Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:21.284802Z","time spent":"374.248495ms","remote":"127.0.0.1:59584","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-09-10T11:00:21.65969Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.915172ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-09-10T11:00:21.659946Z","caller":"traceutil/trace.go:171","msg":"trace[1153246263] linearizableReadLoop","detail":"{readStateIndex:617; appliedIndex:616; }","duration":"165.873963ms","start":"2026-09-10T11:00:21.494039Z","end":"2026-09-10T11:00:21.659912Z","steps":["trace[1153246263] 'read index received' (duration: 14.492829ms)","trace[1153246263] 'applied index is now lower than readState.Index' (duration: 151.378854ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:00:21.659985Z","caller":"traceutil/trace.go:171","msg":"trace[63171779] transaction","detail":"{read_only:false; response_revision:591; number_of_response:1; }","duration":"260.86897ms","start":"2026-09-10T11:00:21.399065Z","end":"2026-09-10T11:00:21.659934Z","steps":["trace[63171779] 'process raft request' (duration: 109.542618ms)","trace[63171779] 'compare' (duration: 150.101554ms)"],"step_count":2} {"level":"warn","ts":"2026-09-10T11:00:21.660341Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"369.596637ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-09-10T11:00:21.660464Z","caller":"traceutil/trace.go:171","msg":"trace[1689583031] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:591; }","duration":"369.71815ms","start":"2026-09-10T11:00:21.290729Z","end":"2026-09-10T11:00:21.660448Z","steps":["trace[1689583031] 'agreement among raft nodes before linearized reading' (duration: 369.353132ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:21.660542Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:21.290708Z","time spent":"369.820263ms","remote":"127.0.0.1:59584","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-09-10T11:00:21.718806Z","caller":"traceutil/trace.go:171","msg":"trace[2073098051] transaction","detail":"{read_only:false; response_revision:592; number_of_response:1; }","duration":"132.461793ms","start":"2026-09-10T11:00:21.586313Z","end":"2026-09-10T11:00:21.718775Z","steps":["trace[2073098051] 'process raft request' (duration: 132.259238ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:22.437048Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.094142ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-09-10T11:00:22.43715Z","caller":"traceutil/trace.go:171","msg":"trace[308041753] linearizableReadLoop","detail":"{readStateIndex:622; appliedIndex:621; }","duration":"560.552504ms","start":"2026-09-10T11:00:21.876581Z","end":"2026-09-10T11:00:22.437133Z","steps":["trace[308041753] 'read index received' (duration: 356.644925ms)","trace[308041753] 'applied index is now lower than readState.Index' (duration: 203.906079ms)"],"step_count":2} {"level":"warn","ts":"2026-09-10T11:00:22.437271Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"560.690547ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.32\" ","response":"range_response_count:1 size:133"} {"level":"info","ts":"2026-09-10T11:00:22.437305Z","caller":"traceutil/trace.go:171","msg":"trace[966948971] range","detail":"{range_begin:/registry/masterleases/162.253.55.32; range_end:; response_count:1; response_revision:596; }","duration":"560.771718ms","start":"2026-09-10T11:00:21.876522Z","end":"2026-09-10T11:00:22.437294Z","steps":["trace[966948971] 'agreement among raft nodes before linearized reading' (duration: 560.659816ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:00:22.43735Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:21.876498Z","time spent":"560.841269ms","remote":"127.0.0.1:59362","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/162.253.55.32\" "} {"level":"info","ts":"2026-09-10T11:00:22.437647Z","caller":"traceutil/trace.go:171","msg":"trace[1495448347] transaction","detail":"{read_only:false; response_revision:596; number_of_response:1; }","duration":"613.334094ms","start":"2026-09-10T11:00:21.824049Z","end":"2026-09-10T11:00:22.437383Z","steps":["trace[1495448347] 'process raft request' (duration: 408.770161ms)","trace[1495448347] 'compare' (duration: 203.754264ms)"],"step_count":2} {"level":"warn","ts":"2026-09-10T11:00:22.437936Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-09-10T11:00:21.824022Z","time spent":"613.786835ms","remote":"127.0.0.1:59524","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2735,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-09-10T11:01:54.954564Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.959258ms","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-09-10T11:01:54.954865Z","caller":"traceutil/trace.go:171","msg":"trace[1580391302] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:1827; }","duration":"108.289249ms","start":"2026-09-10T11:01:54.84655Z","end":"2026-09-10T11:01:54.95484Z","steps":["trace[1580391302] 'range keys from in-memory index tree' (duration: 107.919046ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:01:54.954663Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.369028ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-ebfa4e2c-f7f9-4bd9-9f21-6023b000dae9\" ","response":"range_response_count:1 size:3626"} {"level":"info","ts":"2026-09-10T11:01:54.955261Z","caller":"traceutil/trace.go:171","msg":"trace[1231010673] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-ebfa4e2c-f7f9-4bd9-9f21-6023b000dae9; range_end:; response_count:1; response_revision:1827; }","duration":"111.987567ms","start":"2026-09-10T11:01:54.843233Z","end":"2026-09-10T11:01:54.955221Z","steps":["trace[1231010673] 'range keys from in-memory index tree' (duration: 111.181323ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:01:55.297099Z","caller":"traceutil/trace.go:171","msg":"trace[1440562712] transaction","detail":"{read_only:false; response_revision:1828; number_of_response:1; }","duration":"123.259552ms","start":"2026-09-10T11:01:55.173814Z","end":"2026-09-10T11:01:55.297073Z","steps":["trace[1440562712] 'process raft request' (duration: 123.084857ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:02:08.397858Z","caller":"traceutil/trace.go:171","msg":"trace[1664689852] transaction","detail":"{read_only:false; response_revision:1935; number_of_response:1; }","duration":"144.635475ms","start":"2026-09-10T11:02:08.253196Z","end":"2026-09-10T11:02:08.397832Z","steps":["trace[1664689852] 'process raft request' (duration: 144.441109ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:02:08.420219Z","caller":"traceutil/trace.go:171","msg":"trace[767984171] transaction","detail":"{read_only:false; response_revision:1937; number_of_response:1; }","duration":"126.093792ms","start":"2026-09-10T11:02:08.294096Z","end":"2026-09-10T11:02:08.420189Z","steps":["trace[767984171] 'process raft request' (duration: 126.008049ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:02:08.420236Z","caller":"traceutil/trace.go:171","msg":"trace[1995127754] transaction","detail":"{read_only:false; response_revision:1936; number_of_response:1; }","duration":"126.880385ms","start":"2026-09-10T11:02:08.293317Z","end":"2026-09-10T11:02:08.420197Z","steps":["trace[1995127754] 'process raft request' (duration: 126.617437ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:02:34.425229Z","caller":"traceutil/trace.go:171","msg":"trace[1217057352] transaction","detail":"{read_only:false; response_revision:2091; number_of_response:1; }","duration":"109.522413ms","start":"2026-09-10T11:02:34.315679Z","end":"2026-09-10T11:02:34.425202Z","steps":["trace[1217057352] 'process raft request' (duration: 109.354818ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:02:34.619661Z","caller":"traceutil/trace.go:171","msg":"trace[2127060514] linearizableReadLoop","detail":"{readStateIndex:2176; appliedIndex:2175; }","duration":"103.073394ms","start":"2026-09-10T11:02:34.51656Z","end":"2026-09-10T11:02:34.619633Z","steps":["trace[2127060514] 'read index received' (duration: 79.61632ms)","trace[2127060514] 'applied index is now lower than readState.Index' (duration: 23.453244ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:02:34.619822Z","caller":"traceutil/trace.go:171","msg":"trace[2013972688] transaction","detail":"{read_only:false; response_revision:2092; number_of_response:1; }","duration":"117.930607ms","start":"2026-09-10T11:02:34.501836Z","end":"2026-09-10T11:02:34.619767Z","steps":["trace[2013972688] 'process raft request' (duration: 94.381631ms)","trace[2013972688] 'compare' (duration: 23.280659ms)"],"step_count":2} {"level":"warn","ts":"2026-09-10T11:02:34.62029Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.367541ms","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-09-10T11:02:34.620346Z","caller":"traceutil/trace.go:171","msg":"trace[1303755729] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2092; }","duration":"103.824794ms","start":"2026-09-10T11:02:34.516507Z","end":"2026-09-10T11:02:34.620331Z","steps":["trace[1303755729] 'agreement among raft nodes before linearized reading' (duration: 103.231127ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:02:34.771819Z","caller":"traceutil/trace.go:171","msg":"trace[317534239] transaction","detail":"{read_only:false; response_revision:2093; number_of_response:1; }","duration":"243.341092ms","start":"2026-09-10T11:02:34.528444Z","end":"2026-09-10T11:02:34.771785Z","steps":["trace[317534239] 'process raft request' (duration: 225.793624ms)","trace[317534239] 'compare' (duration: 17.408484ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:02:34.803184Z","caller":"traceutil/trace.go:171","msg":"trace[1653645895] linearizableReadLoop","detail":"{readStateIndex:2178; appliedIndex:2176; }","duration":"161.412971ms","start":"2026-09-10T11:02:34.641756Z","end":"2026-09-10T11:02:34.803169Z","steps":["trace[1653645895] 'read index received' (duration: 112.501247ms)","trace[1653645895] 'applied index is now lower than readState.Index' (duration: 48.910574ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:02:34.803256Z","caller":"traceutil/trace.go:171","msg":"trace[1713149745] transaction","detail":"{read_only:false; response_revision:2094; number_of_response:1; }","duration":"178.305341ms","start":"2026-09-10T11:02:34.624944Z","end":"2026-09-10T11:02:34.80325Z","steps":["trace[1713149745] 'process raft request' (duration: 178.135336ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:02:34.803468Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.699048ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-09-10T11:02:34.803496Z","caller":"traceutil/trace.go:171","msg":"trace[1190190571] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:2094; }","duration":"161.78538ms","start":"2026-09-10T11:02:34.641703Z","end":"2026-09-10T11:02:34.803488Z","steps":["trace[1190190571] 'agreement among raft nodes before linearized reading' (duration: 161.726739ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:02:34.803644Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.593839ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-09-10T11:02:34.803703Z","caller":"traceutil/trace.go:171","msg":"trace[1074958724] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2094; }","duration":"154.672771ms","start":"2026-09-10T11:02:34.649013Z","end":"2026-09-10T11:02:34.803686Z","steps":["trace[1074958724] 'agreement among raft nodes before linearized reading' (duration: 154.425964ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:02:34.803846Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.095281ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-09-10T11:02:34.803906Z","caller":"traceutil/trace.go:171","msg":"trace[2120036165] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:2094; }","duration":"156.158243ms","start":"2026-09-10T11:02:34.647715Z","end":"2026-09-10T11:02:34.803873Z","steps":["trace[2120036165] 'agreement among raft nodes before linearized reading' (duration: 155.613278ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:04:03.367172Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"249.920669ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ingressclasses/\" range_end:\"/registry/ingressclasses0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-09-10T11:04:03.367266Z","caller":"traceutil/trace.go:171","msg":"trace[1715704382] range","detail":"{range_begin:/registry/ingressclasses/; range_end:/registry/ingressclasses0; response_count:0; response_revision:2678; }","duration":"250.096384ms","start":"2026-09-10T11:04:03.117151Z","end":"2026-09-10T11:04:03.367247Z","steps":["trace[1715704382] 'count revisions from in-memory index tree' (duration: 249.856698ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:04:03.367523Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.500169ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-09-10T11:04:03.367778Z","caller":"traceutil/trace.go:171","msg":"trace[432497520] linearizableReadLoop","detail":"{readStateIndex:2784; appliedIndex:2783; }","duration":"108.581659ms","start":"2026-09-10T11:04:03.259176Z","end":"2026-09-10T11:04:03.367757Z","steps":["trace[432497520] 'read index received' (duration: 55.231µs)","trace[432497520] 'applied index is now lower than readState.Index' (duration: 108.393545ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:04:03.367794Z","caller":"traceutil/trace.go:171","msg":"trace[500799265] transaction","detail":"{read_only:false; response_revision:2679; number_of_response:1; }","duration":"250.256009ms","start":"2026-09-10T11:04:03.117521Z","end":"2026-09-10T11:04:03.367777Z","steps":["trace[500799265] 'process raft request' (duration: 112.371269ms)","trace[500799265] 'compare' (duration: 137.118879ms)"],"step_count":2} {"level":"warn","ts":"2026-09-10T11:04:03.367984Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.808806ms","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-09-10T11:04:03.368025Z","caller":"traceutil/trace.go:171","msg":"trace[683975902] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2679; }","duration":"108.889388ms","start":"2026-09-10T11:04:03.259122Z","end":"2026-09-10T11:04:03.368012Z","steps":["trace[683975902] 'agreement among raft nodes before linearized reading' (duration: 108.745334ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:08:13.070992Z","caller":"traceutil/trace.go:171","msg":"trace[1206508583] linearizableReadLoop","detail":"{readStateIndex:4705; appliedIndex:4703; }","duration":"121.682704ms","start":"2026-09-10T11:08:12.949292Z","end":"2026-09-10T11:08:13.070974Z","steps":["trace[1206508583] 'read index received' (duration: 120.953232ms)","trace[1206508583] 'applied index is now lower than readState.Index' (duration: 728.822µs)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:08:13.071065Z","caller":"traceutil/trace.go:171","msg":"trace[1979927029] transaction","detail":"{read_only:false; response_revision:4522; number_of_response:1; }","duration":"170.018002ms","start":"2026-09-10T11:08:12.901029Z","end":"2026-09-10T11:08:13.071047Z","steps":["trace[1979927029] 'process raft request' (duration: 169.204997ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:08:13.071228Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.715618ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/statefulsets/\" range_end:\"/registry/statefulsets0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-09-10T11:08:13.07126Z","caller":"traceutil/trace.go:171","msg":"trace[1449019324] range","detail":"{range_begin:/registry/statefulsets/; range_end:/registry/statefulsets0; response_count:0; response_revision:4523; }","duration":"114.758399ms","start":"2026-09-10T11:08:12.956494Z","end":"2026-09-10T11:08:13.071252Z","steps":["trace[1449019324] 'agreement among raft nodes before linearized reading' (duration: 114.696157ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:08:13.071482Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.88551ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"} {"level":"info","ts":"2026-09-10T11:08:13.071501Z","caller":"traceutil/trace.go:171","msg":"trace[954428502] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4523; }","duration":"122.262251ms","start":"2026-09-10T11:08:12.949232Z","end":"2026-09-10T11:08:13.071495Z","steps":["trace[954428502] 'agreement among raft nodes before linearized reading' (duration: 121.835508ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:08:13.071082Z","caller":"traceutil/trace.go:171","msg":"trace[937823064] transaction","detail":"{read_only:false; response_revision:4523; number_of_response:1; }","duration":"169.435114ms","start":"2026-09-10T11:08:12.901616Z","end":"2026-09-10T11:08:13.071051Z","steps":["trace[937823064] 'process raft request' (duration: 169.327811ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:08:17.126365Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.453556ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-a731af1b-e7e2-493b-9af3-d0c067c4df7e\" ","response":"range_response_count:1 size:4065"} {"level":"info","ts":"2026-09-10T11:08:17.126437Z","caller":"traceutil/trace.go:171","msg":"trace[881439274] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-a731af1b-e7e2-493b-9af3-d0c067c4df7e; range_end:; response_count:1; response_revision:4642; }","duration":"145.566199ms","start":"2026-09-10T11:08:16.980851Z","end":"2026-09-10T11:08:17.126418Z","steps":["trace[881439274] 'range keys from in-memory index tree' (duration: 145.298372ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:08:17.126576Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.302271ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-09-10T11:08:17.126597Z","caller":"traceutil/trace.go:171","msg":"trace[469154999] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:4642; }","duration":"125.325821ms","start":"2026-09-10T11:08:17.001266Z","end":"2026-09-10T11:08:17.126592Z","steps":["trace[469154999] 'count revisions from in-memory index tree' (duration: 125.23601ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:08:19.023015Z","caller":"traceutil/trace.go:171","msg":"trace[1145932986] transaction","detail":"{read_only:false; response_revision:4706; number_of_response:1; }","duration":"118.958692ms","start":"2026-09-10T11:08:18.904041Z","end":"2026-09-10T11:08:19.023Z","steps":["trace[1145932986] 'process raft request' (duration: 118.740935ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:08:25.365877Z","caller":"traceutil/trace.go:171","msg":"trace[135920964] linearizableReadLoop","detail":"{readStateIndex:4960; appliedIndex:4959; }","duration":"167.102423ms","start":"2026-09-10T11:08:25.19876Z","end":"2026-09-10T11:08:25.365863Z","steps":["trace[135920964] 'read index received' (duration: 111.907044ms)","trace[135920964] 'applied index is now lower than readState.Index' (duration: 55.194729ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:08:25.365932Z","caller":"traceutil/trace.go:171","msg":"trace[2053101393] transaction","detail":"{read_only:false; response_revision:4771; number_of_response:1; }","duration":"174.82677ms","start":"2026-09-10T11:08:25.191067Z","end":"2026-09-10T11:08:25.365894Z","steps":["trace[2053101393] 'process raft request' (duration: 119.6029ms)","trace[2053101393] 'compare' (duration: 55.089336ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:08:25.36609Z","caller":"traceutil/trace.go:171","msg":"trace[639946592] transaction","detail":"{read_only:false; response_revision:4772; number_of_response:1; }","duration":"149.062373ms","start":"2026-09-10T11:08:25.21701Z","end":"2026-09-10T11:08:25.366072Z","steps":["trace[639946592] 'process raft request' (duration: 148.830096ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:08:25.366151Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.377561ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-09-10T11:08:25.366191Z","caller":"traceutil/trace.go:171","msg":"trace[1411812442] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4772; }","duration":"167.467343ms","start":"2026-09-10T11:08:25.198713Z","end":"2026-09-10T11:08:25.366181Z","steps":["trace[1411812442] 'agreement among raft nodes before linearized reading' (duration: 167.246397ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:08:25.366341Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.37379ms","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-09-10T11:08:25.366373Z","caller":"traceutil/trace.go:171","msg":"trace[1025154205] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4773; }","duration":"167.414531ms","start":"2026-09-10T11:08:25.19895Z","end":"2026-09-10T11:08:25.366365Z","steps":["trace[1025154205] 'agreement among raft nodes before linearized reading' (duration: 167.323769ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:08:26.776203Z","caller":"traceutil/trace.go:171","msg":"trace[500412299] linearizableReadLoop","detail":"{readStateIndex:5035; appliedIndex:5034; }","duration":"164.929207ms","start":"2026-09-10T11:08:26.611245Z","end":"2026-09-10T11:08:26.776175Z","steps":["trace[500412299] 'read index received' (duration: 164.68621ms)","trace[500412299] 'applied index is now lower than readState.Index' (duration: 241.727µs)"],"step_count":2} {"level":"warn","ts":"2026-09-10T11:08:26.776505Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.229375ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus\" ","response":"range_response_count:1 size:3506"} {"level":"info","ts":"2026-09-10T11:08:26.776298Z","caller":"traceutil/trace.go:171","msg":"trace[431265857] transaction","detail":"{read_only:false; response_revision:4846; number_of_response:1; }","duration":"167.412989ms","start":"2026-09-10T11:08:26.608846Z","end":"2026-09-10T11:08:26.776259Z","steps":["trace[431265857] 'process raft request' (duration: 167.137621ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:08:26.776561Z","caller":"traceutil/trace.go:171","msg":"trace[1714006748] range","detail":"{range_begin:/registry/secrets/monitoring/prometheus-kube-prometheus-stack-prometheus; range_end:; response_count:1; response_revision:4846; }","duration":"165.323238ms","start":"2026-09-10T11:08:26.61122Z","end":"2026-09-10T11:08:26.776544Z","steps":["trace[1714006748] 'agreement among raft nodes before linearized reading' (duration: 165.094262ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:08:37.607951Z","caller":"traceutil/trace.go:171","msg":"trace[873310789] linearizableReadLoop","detail":"{readStateIndex:5198; appliedIndex:5197; }","duration":"150.50907ms","start":"2026-09-10T11:08:37.457419Z","end":"2026-09-10T11:08:37.607928Z","steps":["trace[873310789] 'read index received' (duration: 141.318953ms)","trace[873310789] 'applied index is now lower than readState.Index' (duration: 9.189047ms)"],"step_count":2} {"level":"info","ts":"2026-09-10T11:08:37.608009Z","caller":"traceutil/trace.go:171","msg":"trace[195374130] transaction","detail":"{read_only:false; response_revision:5002; number_of_response:1; }","duration":"162.750129ms","start":"2026-09-10T11:08:37.445223Z","end":"2026-09-10T11:08:37.607973Z","steps":["trace[195374130] 'process raft request' (duration: 153.636053ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:08:37.608249Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.807351ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"} {"level":"warn","ts":"2026-09-10T11:08:37.608249Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.484275ms","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-09-10T11:08:37.608352Z","caller":"traceutil/trace.go:171","msg":"trace[1003238927] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:5002; }","duration":"145.626139ms","start":"2026-09-10T11:08:37.46271Z","end":"2026-09-10T11:08:37.608336Z","steps":["trace[1003238927] 'agreement among raft nodes before linearized reading' (duration: 145.369601ms)"],"step_count":1} {"level":"warn","ts":"2026-09-10T11:08:37.60854Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.73287ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-09-10T11:08:37.608352Z","caller":"traceutil/trace.go:171","msg":"trace[373232686] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:5002; }","duration":"150.941074ms","start":"2026-09-10T11:08:37.457384Z","end":"2026-09-10T11:08:37.608325Z","steps":["trace[373232686] 'agreement among raft nodes before linearized reading' (duration: 150.650994ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:08:37.608597Z","caller":"traceutil/trace.go:171","msg":"trace[1187090339] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:5002; }","duration":"135.802322ms","start":"2026-09-10T11:08:37.472782Z","end":"2026-09-10T11:08:37.608584Z","steps":["trace[1187090339] 'agreement among raft nodes before linearized reading' (duration: 135.668058ms)"],"step_count":1} {"level":"info","ts":"2026-09-10T11:09:38.956973Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2865} {"level":"info","ts":"2026-09-10T11:09:39.075772Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2865,"took":"117.812642ms","hash":819187872,"current-db-size-bytes":53936128,"current-db-size":"54 MB","current-db-size-in-use-bytes":28872704,"current-db-size-in-use":"29 MB"} {"level":"info","ts":"2026-09-10T11:09:39.075842Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":819187872,"revision":2865,"compact-revision":-1} {"level":"info","ts":"2026-09-10T11:14:38.969012Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5509} {"level":"info","ts":"2026-09-10T11:14:39.038633Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5509,"took":"68.165355ms","hash":1814909906,"current-db-size-bytes":53936128,"current-db-size":"54 MB","current-db-size-in-use-bytes":18321408,"current-db-size-in-use":"18 MB"} {"level":"info","ts":"2026-09-10T11:14:39.038675Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1814909906,"revision":5509,"compact-revision":2865}