{"level":"warn","ts":"2026-06-18T03:13:52.843922Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-18T03:13:52.84403Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.140:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.140:2380","--initial-cluster=instance=https://199.204.45.140:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.140:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.140: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-06-18T03:13:52.84413Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-18T03:13:52.844164Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.140:2380"]} {"level":"info","ts":"2026-06-18T03:13:52.844198Z","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-06-18T03:13:52.845049Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.140:2379"]} {"level":"info","ts":"2026-06-18T03:13:52.84515Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.140:2380"],"listen-peer-urls":["https://199.204.45.140:2380"],"advertise-client-urls":["https://199.204.45.140:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.140:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.140: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-06-18T03:13:52.84961Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.175249ms"} {"level":"info","ts":"2026-06-18T03:13:52.859742Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"35b2766da46a76bb","cluster-id":"f5fd3aeb8d9f53dc"} {"level":"info","ts":"2026-06-18T03:13:52.859819Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb switched to configuration voters=()"} {"level":"info","ts":"2026-06-18T03:13:52.859842Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb became follower at term 0"} {"level":"info","ts":"2026-06-18T03:13:52.859859Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 35b2766da46a76bb [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-06-18T03:13:52.859873Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb became follower at term 1"} {"level":"info","ts":"2026-06-18T03:13:52.859962Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb switched to configuration voters=(3869285243146630843)"} {"level":"warn","ts":"2026-06-18T03:13:52.869196Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-06-18T03:13:52.870691Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-06-18T03:13:52.871949Z","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-06-18T03:13:52.876117Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"35b2766da46a76bb","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-06-18T03:13:52.87674Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"35b2766da46a76bb","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-06-18T03:13:52.876776Z","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-06-18T03:13:52.883444Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb switched to configuration voters=(3869285243146630843)"} {"level":"info","ts":"2026-06-18T03:13:52.883525Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"f5fd3aeb8d9f53dc","local-member-id":"35b2766da46a76bb","added-peer-id":"35b2766da46a76bb","added-peer-peer-urls":["https://199.204.45.140:2380"]} {"level":"info","ts":"2026-06-18T03:13:52.883551Z","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-06-18T03:13:52.883566Z","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-06-18T03:13:52.883724Z","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-06-18T03:13:52.883806Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.140:2380"} {"level":"info","ts":"2026-06-18T03:13:52.883821Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.140:2380"} {"level":"info","ts":"2026-06-18T03:13:52.885124Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"35b2766da46a76bb","initial-advertise-peer-urls":["https://199.204.45.140:2380"],"listen-peer-urls":["https://199.204.45.140:2380"],"advertise-client-urls":["https://199.204.45.140:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.140:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-06-18T03:13:52.885167Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-06-18T03:13:53.461273Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb is starting a new election at term 1"} {"level":"info","ts":"2026-06-18T03:13:53.461376Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb became pre-candidate at term 1"} {"level":"info","ts":"2026-06-18T03:13:53.46141Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb received MsgPreVoteResp from 35b2766da46a76bb at term 1"} {"level":"info","ts":"2026-06-18T03:13:53.461425Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb became candidate at term 2"} {"level":"info","ts":"2026-06-18T03:13:53.461433Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb received MsgVoteResp from 35b2766da46a76bb at term 2"} {"level":"info","ts":"2026-06-18T03:13:53.461443Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"35b2766da46a76bb became leader at term 2"} {"level":"info","ts":"2026-06-18T03:13:53.461453Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 35b2766da46a76bb elected leader 35b2766da46a76bb at term 2"} {"level":"info","ts":"2026-06-18T03:13:53.462364Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-06-18T03:13:53.463181Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"35b2766da46a76bb","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.140:2379]}","request-path":"/0/members/35b2766da46a76bb/attributes","cluster-id":"f5fd3aeb8d9f53dc","publish-timeout":"7s"} {"level":"info","ts":"2026-06-18T03:13:53.463232Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-18T03:13:53.463528Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-18T03:13:53.464727Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-06-18T03:13:53.464775Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-06-18T03:13:53.46577Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"f5fd3aeb8d9f53dc","local-member-id":"35b2766da46a76bb","cluster-version":"3.5"} {"level":"info","ts":"2026-06-18T03:13:53.465858Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-06-18T03:13:53.465886Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-06-18T03:13:53.466282Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-06-18T03:13:53.480353Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.140:2379"} {"level":"info","ts":"2026-06-18T03:14:01.964723Z","caller":"traceutil/trace.go:171","msg":"trace[131051295] transaction","detail":"{read_only:false; response_revision:339; number_of_response:1; }","duration":"378.459585ms","start":"2026-06-18T03:14:01.586233Z","end":"2026-06-18T03:14:01.964693Z","steps":["trace[131051295] 'process raft request' (duration: 378.267489ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:01.965415Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:01.586174Z","time spent":"378.679572ms","remote":"127.0.0.1:46672","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":192,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-18T03:14:02.309941Z","caller":"traceutil/trace.go:171","msg":"trace[1578008907] linearizableReadLoop","detail":"{readStateIndex:361; appliedIndex:359; }","duration":"124.854674ms","start":"2026-06-18T03:14:02.185066Z","end":"2026-06-18T03:14:02.309921Z","steps":["trace[1578008907] 'read index received' (duration: 27.835697ms)","trace[1578008907] 'applied index is now lower than readState.Index' (duration: 97.018137ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:02.310222Z","caller":"traceutil/trace.go:171","msg":"trace[856203031] transaction","detail":"{read_only:false; response_revision:352; number_of_response:1; }","duration":"162.317371ms","start":"2026-06-18T03:14:02.147891Z","end":"2026-06-18T03:14:02.310208Z","steps":["trace[856203031] 'process raft request' (duration: 65.030344ms)","trace[856203031] 'compare' (duration: 96.759898ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:02.310399Z","caller":"traceutil/trace.go:171","msg":"trace[1000142074] transaction","detail":"{read_only:false; response_revision:353; number_of_response:1; }","duration":"162.239648ms","start":"2026-06-18T03:14:02.148104Z","end":"2026-06-18T03:14:02.310344Z","steps":["trace[1000142074] 'process raft request' (duration: 161.73989ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:02.310584Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.498317ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/bootstrap-signer\" ","response":"range_response_count:1 size:197"} {"level":"info","ts":"2026-06-18T03:14:02.310747Z","caller":"traceutil/trace.go:171","msg":"trace[1288542822] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/bootstrap-signer; range_end:; response_count:1; response_revision:353; }","duration":"125.666862ms","start":"2026-06-18T03:14:02.18506Z","end":"2026-06-18T03:14:02.310727Z","steps":["trace[1288542822] 'agreement among raft nodes before linearized reading' (duration: 125.151755ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:07.509028Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"311.220397ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:477"} {"level":"info","ts":"2026-06-18T03:14:07.509134Z","caller":"traceutil/trace.go:171","msg":"trace[636211011] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:401; }","duration":"311.34927ms","start":"2026-06-18T03:14:07.197751Z","end":"2026-06-18T03:14:07.5091Z","steps":["trace[636211011] 'range keys from in-memory index tree' (duration: 311.152294ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:07.509176Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:07.197736Z","time spent":"311.426724ms","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":500,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-06-18T03:14:07.509225Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.295494ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:14:07.509338Z","caller":"traceutil/trace.go:171","msg":"trace[2123698967] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:401; }","duration":"167.446949ms","start":"2026-06-18T03:14:07.341873Z","end":"2026-06-18T03:14:07.50932Z","steps":["trace[2123698967] 'range keys from in-memory index tree' (duration: 167.216371ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:13.092927Z","caller":"traceutil/trace.go:171","msg":"trace[661500591] transaction","detail":"{read_only:false; response_revision:420; number_of_response:1; }","duration":"187.624951ms","start":"2026-06-18T03:14:12.905275Z","end":"2026-06-18T03:14:13.0929Z","steps":["trace[661500591] 'process raft request' (duration: 187.485315ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:15.632802Z","caller":"traceutil/trace.go:171","msg":"trace[582090519] linearizableReadLoop","detail":"{readStateIndex:435; appliedIndex:434; }","duration":"445.702788ms","start":"2026-06-18T03:14:15.187076Z","end":"2026-06-18T03:14:15.632779Z","steps":["trace[582090519] 'read index received' (duration: 445.667626ms)","trace[582090519] 'applied index is now lower than readState.Index' (duration: 34.132µs)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:15.632898Z","caller":"traceutil/trace.go:171","msg":"trace[818811275] transaction","detail":"{read_only:false; response_revision:424; number_of_response:1; }","duration":"530.194943ms","start":"2026-06-18T03:14:15.102683Z","end":"2026-06-18T03:14:15.632878Z","steps":["trace[818811275] 'process raft request' (duration: 529.976295ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:15.633006Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"445.921364ms","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-06-18T03:14:15.633044Z","caller":"traceutil/trace.go:171","msg":"trace[1197229768] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:424; }","duration":"446.028629ms","start":"2026-06-18T03:14:15.187003Z","end":"2026-06-18T03:14:15.633032Z","steps":["trace[1197229768] 'agreement among raft nodes before linearized reading' (duration: 445.940826ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:15.633074Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:15.186972Z","time spent":"446.09551ms","remote":"127.0.0.1:46740","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-06-18T03:14:15.633233Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:15.102644Z","time spent":"530.347606ms","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T03:14:15.76638Z","caller":"traceutil/trace.go:171","msg":"trace[1755410190] transaction","detail":"{read_only:false; response_revision:425; number_of_response:1; }","duration":"207.720572ms","start":"2026-06-18T03:14:15.558636Z","end":"2026-06-18T03:14:15.766357Z","steps":["trace[1755410190] 'process raft request' (duration: 165.680502ms)","trace[1755410190] 'compare' (duration: 41.808633ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:15.766408Z","caller":"traceutil/trace.go:171","msg":"trace[199464707] transaction","detail":"{read_only:false; response_revision:426; number_of_response:1; }","duration":"129.673904ms","start":"2026-06-18T03:14:15.636707Z","end":"2026-06-18T03:14:15.766381Z","steps":["trace[199464707] 'process raft request' (duration: 129.55828ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:15.766594Z","caller":"traceutil/trace.go:171","msg":"trace[140738391] linearizableReadLoop","detail":"{readStateIndex:436; appliedIndex:435; }","duration":"133.61983ms","start":"2026-06-18T03:14:15.632959Z","end":"2026-06-18T03:14:15.766579Z","steps":["trace[140738391] 'read index received' (duration: 91.385094ms)","trace[140738391] 'applied index is now lower than readState.Index' (duration: 42.233376ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T03:14:15.766652Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.96993ms","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-06-18T03:14:15.766705Z","caller":"traceutil/trace.go:171","msg":"trace[536431991] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:426; }","duration":"182.048833ms","start":"2026-06-18T03:14:15.584626Z","end":"2026-06-18T03:14:15.766675Z","steps":["trace[536431991] 'agreement among raft nodes before linearized reading' (duration: 181.965781ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:15.766707Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"296.802452ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T03:14:15.766698Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.185062ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-18T03:14:15.766747Z","caller":"traceutil/trace.go:171","msg":"trace[2006940085] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:426; }","duration":"296.877754ms","start":"2026-06-18T03:14:15.469854Z","end":"2026-06-18T03:14:15.766732Z","steps":["trace[2006940085] 'agreement among raft nodes before linearized reading' (duration: 296.817462ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:15.766756Z","caller":"traceutil/trace.go:171","msg":"trace[358184362] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:426; }","duration":"195.323026ms","start":"2026-06-18T03:14:15.571418Z","end":"2026-06-18T03:14:15.766741Z","steps":["trace[358184362] 'agreement among raft nodes before linearized reading' (duration: 195.224634ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:17.790674Z","caller":"traceutil/trace.go:171","msg":"trace[1867167672] transaction","detail":"{read_only:false; response_revision:431; number_of_response:1; }","duration":"150.229283ms","start":"2026-06-18T03:14:17.640406Z","end":"2026-06-18T03:14:17.790635Z","steps":["trace[1867167672] 'process raft request' (duration: 149.994796ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:19.027164Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"558.939675ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:14:19.027247Z","caller":"traceutil/trace.go:171","msg":"trace[1453392964] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:434; }","duration":"559.116041ms","start":"2026-06-18T03:14:18.468112Z","end":"2026-06-18T03:14:19.027228Z","steps":["trace[1453392964] 'range keys from in-memory index tree' (duration: 558.831682ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:19.02729Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:18.468094Z","time spent":"559.187833ms","remote":"127.0.0.1:46446","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-06-18T03:14:19.161577Z","caller":"traceutil/trace.go:171","msg":"trace[1735494545] linearizableReadLoop","detail":"{readStateIndex:447; appliedIndex:446; }","duration":"440.581101ms","start":"2026-06-18T03:14:18.720973Z","end":"2026-06-18T03:14:19.161554Z","steps":["trace[1735494545] 'read index received' (duration: 440.412996ms)","trace[1735494545] 'applied index is now lower than readState.Index' (duration: 167.065µs)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:19.161634Z","caller":"traceutil/trace.go:171","msg":"trace[2040549102] transaction","detail":"{read_only:false; response_revision:435; number_of_response:1; }","duration":"550.658498ms","start":"2026-06-18T03:14:18.610947Z","end":"2026-06-18T03:14:19.161606Z","steps":["trace[2040549102] 'process raft request' (duration: 550.462263ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:19.161745Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"440.751226ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/kube-system/coredns\" ","response":"range_response_count:1 size:4056"} {"level":"info","ts":"2026-06-18T03:14:19.161782Z","caller":"traceutil/trace.go:171","msg":"trace[1394029381] range","detail":"{range_begin:/registry/deployments/kube-system/coredns; range_end:; response_count:1; response_revision:435; }","duration":"440.838409ms","start":"2026-06-18T03:14:18.720933Z","end":"2026-06-18T03:14:19.161771Z","steps":["trace[1394029381] 'agreement among raft nodes before linearized reading' (duration: 440.750676ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:19.161786Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:18.61092Z","time spent":"550.780802ms","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-18T03:14:19.161816Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:18.720915Z","time spent":"440.892032ms","remote":"127.0.0.1:46946","response type":"/etcdserverpb.KV/Range","request count":0,"request size":43,"response count":1,"response size":4079,"request content":"key:\"/registry/deployments/kube-system/coredns\" "} {"level":"warn","ts":"2026-06-18T03:14:19.161788Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.554641ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:14:19.161914Z","caller":"traceutil/trace.go:171","msg":"trace[834535433] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:435; }","duration":"133.693886ms","start":"2026-06-18T03:14:19.028165Z","end":"2026-06-18T03:14:19.161859Z","steps":["trace[834535433] 'agreement among raft nodes before linearized reading' (duration: 133.540171ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:19.352131Z","caller":"traceutil/trace.go:171","msg":"trace[65043556] transaction","detail":"{read_only:false; response_revision:436; number_of_response:1; }","duration":"177.966227ms","start":"2026-06-18T03:14:19.174141Z","end":"2026-06-18T03:14:19.352107Z","steps":["trace[65043556] 'process raft request' (duration: 177.816023ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:19.855573Z","caller":"traceutil/trace.go:171","msg":"trace[384165141] transaction","detail":"{read_only:false; response_revision:453; number_of_response:1; }","duration":"170.962541ms","start":"2026-06-18T03:14:19.68459Z","end":"2026-06-18T03:14:19.855553Z","steps":["trace[384165141] 'process raft request' (duration: 170.849527ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:19.855597Z","caller":"traceutil/trace.go:171","msg":"trace[450976561] transaction","detail":"{read_only:false; response_revision:452; number_of_response:1; }","duration":"171.100876ms","start":"2026-06-18T03:14:19.684457Z","end":"2026-06-18T03:14:19.855558Z","steps":["trace[450976561] 'process raft request' (duration: 147.940577ms)","trace[450976561] 'compare' (duration: 22.827909ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:19.878806Z","caller":"traceutil/trace.go:171","msg":"trace[1825774426] transaction","detail":"{read_only:false; response_revision:454; number_of_response:1; }","duration":"141.540788ms","start":"2026-06-18T03:14:19.737214Z","end":"2026-06-18T03:14:19.878755Z","steps":["trace[1825774426] 'process raft request' (duration: 141.367394ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:19.879219Z","caller":"traceutil/trace.go:171","msg":"trace[308381158] transaction","detail":"{read_only:false; response_revision:455; number_of_response:1; }","duration":"136.804861ms","start":"2026-06-18T03:14:19.742384Z","end":"2026-06-18T03:14:19.879189Z","steps":["trace[308381158] 'process raft request' (duration: 136.289106ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:19.879489Z","caller":"traceutil/trace.go:171","msg":"trace[921750208] transaction","detail":"{read_only:false; response_revision:456; number_of_response:1; }","duration":"136.896835ms","start":"2026-06-18T03:14:19.742566Z","end":"2026-06-18T03:14:19.879463Z","steps":["trace[921750208] 'process raft request' (duration: 136.159862ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:19.947304Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.371177ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-06-18T03:14:19.947322Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.499346ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-18T03:14:19.947423Z","caller":"traceutil/trace.go:171","msg":"trace[32024793] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:457; }","duration":"119.63927ms","start":"2026-06-18T03:14:19.827763Z","end":"2026-06-18T03:14:19.947402Z","steps":["trace[32024793] 'agreement among raft nodes before linearized reading' (duration: 119.422683ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:19.94741Z","caller":"traceutil/trace.go:171","msg":"trace[1128511836] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:457; }","duration":"143.52651ms","start":"2026-06-18T03:14:19.803858Z","end":"2026-06-18T03:14:19.947384Z","steps":["trace[1128511836] 'agreement among raft nodes before linearized reading' (duration: 143.293623ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:19.947476Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.693655ms","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-06-18T03:14:19.947576Z","caller":"traceutil/trace.go:171","msg":"trace[565848478] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:457; }","duration":"123.84034ms","start":"2026-06-18T03:14:19.823714Z","end":"2026-06-18T03:14:19.947554Z","steps":["trace[565848478] 'agreement among raft nodes before linearized reading' (duration: 123.681386ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:20.02062Z","caller":"traceutil/trace.go:171","msg":"trace[1396422536] transaction","detail":"{read_only:false; response_revision:460; number_of_response:1; }","duration":"136.467718ms","start":"2026-06-18T03:14:19.884122Z","end":"2026-06-18T03:14:20.02059Z","steps":["trace[1396422536] 'process raft request' (duration: 136.365864ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:20.020747Z","caller":"traceutil/trace.go:171","msg":"trace[587500221] transaction","detail":"{read_only:false; response_revision:458; number_of_response:1; }","duration":"136.734877ms","start":"2026-06-18T03:14:19.883914Z","end":"2026-06-18T03:14:20.020649Z","steps":["trace[587500221] 'process raft request' (duration: 110.546599ms)","trace[587500221] 'compare' (duration: 25.840587ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:20.020686Z","caller":"traceutil/trace.go:171","msg":"trace[1186950596] transaction","detail":"{read_only:false; response_revision:459; number_of_response:1; }","duration":"136.561911ms","start":"2026-06-18T03:14:19.884092Z","end":"2026-06-18T03:14:20.020653Z","steps":["trace[1186950596] 'process raft request' (duration: 136.329414ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:20.020988Z","caller":"traceutil/trace.go:171","msg":"trace[100102943] transaction","detail":"{read_only:false; response_revision:462; number_of_response:1; }","duration":"135.094756ms","start":"2026-06-18T03:14:19.885869Z","end":"2026-06-18T03:14:20.020964Z","steps":["trace[100102943] 'process raft request' (duration: 134.700173ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:20.0233Z","caller":"traceutil/trace.go:171","msg":"trace[1297559619] transaction","detail":"{read_only:false; response_revision:461; number_of_response:1; }","duration":"138.49645ms","start":"2026-06-18T03:14:19.884762Z","end":"2026-06-18T03:14:20.023259Z","steps":["trace[1297559619] 'process raft request' (duration: 135.762056ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:20.024113Z","caller":"traceutil/trace.go:171","msg":"trace[1657669950] transaction","detail":"{read_only:false; response_revision:463; number_of_response:1; }","duration":"134.696142ms","start":"2026-06-18T03:14:19.889331Z","end":"2026-06-18T03:14:20.024027Z","steps":["trace[1657669950] 'process raft request' (duration: 131.503634ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:32.987492Z","caller":"traceutil/trace.go:171","msg":"trace[1228939660] transaction","detail":"{read_only:false; response_revision:532; number_of_response:1; }","duration":"193.075718ms","start":"2026-06-18T03:14:32.794375Z","end":"2026-06-18T03:14:32.987451Z","steps":["trace[1228939660] 'process raft request' (duration: 192.873412ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:32.99795Z","caller":"traceutil/trace.go:171","msg":"trace[1138387072] transaction","detail":"{read_only:false; response_revision:535; number_of_response:1; }","duration":"194.670533ms","start":"2026-06-18T03:14:32.803263Z","end":"2026-06-18T03:14:32.997934Z","steps":["trace[1138387072] 'process raft request' (duration: 194.363404ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:32.999377Z","caller":"traceutil/trace.go:171","msg":"trace[1213002449] transaction","detail":"{read_only:false; response_revision:534; number_of_response:1; }","duration":"204.035451ms","start":"2026-06-18T03:14:32.795332Z","end":"2026-06-18T03:14:32.999367Z","steps":["trace[1213002449] 'process raft request' (duration: 202.199449ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:32.999821Z","caller":"traceutil/trace.go:171","msg":"trace[1659538847] transaction","detail":"{read_only:false; response_revision:533; number_of_response:1; }","duration":"204.584087ms","start":"2026-06-18T03:14:32.795224Z","end":"2026-06-18T03:14:32.999808Z","steps":["trace[1659538847] 'process raft request' (duration: 201.659814ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:32.999907Z","caller":"traceutil/trace.go:171","msg":"trace[404984633] transaction","detail":"{read_only:false; response_revision:539; number_of_response:1; }","duration":"191.008009ms","start":"2026-06-18T03:14:32.808893Z","end":"2026-06-18T03:14:32.999901Z","steps":["trace[404984633] 'process raft request' (duration: 188.906669ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:33.000014Z","caller":"traceutil/trace.go:171","msg":"trace[1931632888] transaction","detail":"{read_only:false; response_revision:536; number_of_response:1; }","duration":"193.927563ms","start":"2026-06-18T03:14:32.80608Z","end":"2026-06-18T03:14:33.000007Z","steps":["trace[1931632888] 'process raft request' (duration: 191.585196ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:32.999982Z","caller":"traceutil/trace.go:171","msg":"trace[873586478] transaction","detail":"{read_only:false; response_revision:540; number_of_response:1; }","duration":"175.558788ms","start":"2026-06-18T03:14:32.824398Z","end":"2026-06-18T03:14:32.999957Z","steps":["trace[873586478] 'process raft request' (duration: 173.453998ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:33.000102Z","caller":"traceutil/trace.go:171","msg":"trace[189444694] transaction","detail":"{read_only:false; response_revision:537; number_of_response:1; }","duration":"193.923101ms","start":"2026-06-18T03:14:32.806173Z","end":"2026-06-18T03:14:33.000096Z","steps":["trace[189444694] 'process raft request' (duration: 191.526503ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:33.00017Z","caller":"traceutil/trace.go:171","msg":"trace[1373375714] transaction","detail":"{read_only:false; response_revision:542; number_of_response:1; }","duration":"138.07479ms","start":"2026-06-18T03:14:32.862042Z","end":"2026-06-18T03:14:33.000117Z","steps":["trace[1373375714] 'process raft request' (duration: 135.915877ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:33.000201Z","caller":"traceutil/trace.go:171","msg":"trace[1193167692] transaction","detail":"{read_only:false; response_revision:541; number_of_response:1; }","duration":"167.613782ms","start":"2026-06-18T03:14:32.832555Z","end":"2026-06-18T03:14:33.000168Z","steps":["trace[1193167692] 'process raft request' (duration: 165.348397ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:33.000225Z","caller":"traceutil/trace.go:171","msg":"trace[1711206376] transaction","detail":"{read_only:false; response_revision:538; number_of_response:1; }","duration":"193.113639ms","start":"2026-06-18T03:14:32.807105Z","end":"2026-06-18T03:14:33.000218Z","steps":["trace[1711206376] 'process raft request' (duration: 190.625488ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:39.333902Z","caller":"traceutil/trace.go:171","msg":"trace[1171964936] transaction","detail":"{read_only:false; response_revision:638; number_of_response:1; }","duration":"273.619405ms","start":"2026-06-18T03:14:39.060256Z","end":"2026-06-18T03:14:39.333875Z","steps":["trace[1171964936] 'process raft request' (duration: 273.007258ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:39.779262Z","caller":"traceutil/trace.go:171","msg":"trace[1601166720] linearizableReadLoop","detail":"{readStateIndex:661; appliedIndex:660; }","duration":"363.409673ms","start":"2026-06-18T03:14:39.415831Z","end":"2026-06-18T03:14:39.779241Z","steps":["trace[1601166720] 'read index received' (duration: 323.096209ms)","trace[1601166720] 'applied index is now lower than readState.Index' (duration: 40.310174ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:39.779377Z","caller":"traceutil/trace.go:171","msg":"trace[1023282730] transaction","detail":"{read_only:false; response_revision:639; number_of_response:1; }","duration":"388.396328ms","start":"2026-06-18T03:14:39.390944Z","end":"2026-06-18T03:14:39.77934Z","steps":["trace[1023282730] 'process raft request' (duration: 347.990361ms)","trace[1023282730] 'compare' (duration: 39.826881ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T03:14:39.779468Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"363.620709ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-t4slk\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-06-18T03:14:39.779495Z","caller":"traceutil/trace.go:171","msg":"trace[1371471242] range","detail":"{range_begin:/registry/pods/kube-system/cilium-t4slk; range_end:; response_count:1; response_revision:639; }","duration":"363.691701ms","start":"2026-06-18T03:14:39.415795Z","end":"2026-06-18T03:14:39.779486Z","steps":["trace[1371471242] 'agreement among raft nodes before linearized reading' (duration: 363.542078ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:39.779516Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:39.415778Z","time spent":"363.732863ms","remote":"127.0.0.1:46648","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16988,"request content":"key:\"/registry/pods/kube-system/cilium-t4slk\" "} {"level":"warn","ts":"2026-06-18T03:14:39.779507Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:39.390923Z","time spent":"388.521201ms","remote":"127.0.0.1:46976","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1627,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-06-18T03:14:39.814219Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"344.914338ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:14:39.814303Z","caller":"traceutil/trace.go:171","msg":"trace[235176252] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:640; }","duration":"345.04928ms","start":"2026-06-18T03:14:39.469236Z","end":"2026-06-18T03:14:39.814285Z","steps":["trace[235176252] 'agreement among raft nodes before linearized reading' (duration: 344.871696ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:39.814346Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:39.469219Z","time spent":"345.118753ms","remote":"127.0.0.1:46446","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-06-18T03:14:40.194146Z","caller":"traceutil/trace.go:171","msg":"trace[1410031915] linearizableReadLoop","detail":"{readStateIndex:663; appliedIndex:662; }","duration":"380.188484ms","start":"2026-06-18T03:14:39.813935Z","end":"2026-06-18T03:14:40.194123Z","steps":["trace[1410031915] 'read index received' (duration: 368.738563ms)","trace[1410031915] 'applied index is now lower than readState.Index' (duration: 11.449081ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:14:40.194447Z","caller":"traceutil/trace.go:171","msg":"trace[278034940] transaction","detail":"{read_only:false; response_revision:641; number_of_response:1; }","duration":"398.31329ms","start":"2026-06-18T03:14:39.796121Z","end":"2026-06-18T03:14:40.194434Z","steps":["trace[278034940] 'process raft request' (duration: 386.508749ms)","trace[278034940] 'compare' (duration: 11.05808ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T03:14:40.194546Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:39.796092Z","time spent":"398.390293ms","remote":"127.0.0.1:46648","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-18T03:14:40.194574Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"379.201547ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:14:40.194655Z","caller":"traceutil/trace.go:171","msg":"trace[1886083021] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:641; }","duration":"379.30089ms","start":"2026-06-18T03:14:39.815331Z","end":"2026-06-18T03:14:40.194632Z","steps":["trace[1886083021] 'agreement among raft nodes before linearized reading' (duration: 379.183197ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:40.19471Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:39.815316Z","time spent":"379.381553ms","remote":"127.0.0.1:46450","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-18T03:14:40.195585Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"405.625401ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:14:40.195637Z","caller":"traceutil/trace.go:171","msg":"trace[1536886695] range","detail":"{range_begin:/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:641; }","duration":"405.706493ms","start":"2026-06-18T03:14:39.789918Z","end":"2026-06-18T03:14:40.195624Z","steps":["trace[1536886695] 'agreement among raft nodes before linearized reading' (duration: 404.980954ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:40.195692Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:39.789902Z","time spent":"405.781625ms","remote":"127.0.0.1:46708","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":0,"response size":28,"request content":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" "} {"level":"warn","ts":"2026-06-18T03:14:41.530374Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"567.036986ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-18T03:14:41.530542Z","caller":"traceutil/trace.go:171","msg":"trace[2001822263] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"1.329656667s","start":"2026-06-18T03:14:40.200866Z","end":"2026-06-18T03:14:41.530523Z","steps":["trace[2001822263] 'process raft request' (duration: 762.245231ms)","trace[2001822263] 'compare' (duration: 566.939313ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T03:14:41.530612Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:40.200849Z","time spent":"1.329731349s","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T03:14:41.530931Z","caller":"traceutil/trace.go:171","msg":"trace[14168621] transaction","detail":"{read_only:false; response_revision:645; number_of_response:1; }","duration":"1.329849141s","start":"2026-06-18T03:14:40.201068Z","end":"2026-06-18T03:14:41.530917Z","steps":["trace[14168621] 'process raft request' (duration: 1.32978181s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:41.531013Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:40.201059Z","time spent":"1.329911883s","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T03:14:41.530974Z","caller":"traceutil/trace.go:171","msg":"trace[1370615935] transaction","detail":"{read_only:false; response_revision:644; number_of_response:1; }","duration":"1.329989535s","start":"2026-06-18T03:14:40.200952Z","end":"2026-06-18T03:14:41.530941Z","steps":["trace[1370615935] 'process raft request' (duration: 1.329520693s)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:41.531384Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:40.200913Z","time spent":"1.330380077s","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":462,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T03:14:41.535536Z","caller":"traceutil/trace.go:171","msg":"trace[1035332459] transaction","detail":"{read_only:false; response_revision:646; number_of_response:1; }","duration":"957.152571ms","start":"2026-06-18T03:14:40.578346Z","end":"2026-06-18T03:14:41.535498Z","steps":["trace[1035332459] 'process raft request' (duration: 956.576205ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:41.535704Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:40.578313Z","time spent":"957.299784ms","remote":"127.0.0.1:46560","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036309,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T03:14:57.396907Z","caller":"traceutil/trace.go:171","msg":"trace[2038337643] transaction","detail":"{read_only:false; response_revision:805; number_of_response:1; }","duration":"310.168257ms","start":"2026-06-18T03:14:57.086714Z","end":"2026-06-18T03:14:57.396882Z","steps":["trace[2038337643] 'process raft request' (duration: 310.021183ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:57.397065Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:57.086696Z","time spent":"310.29127ms","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-18T03:14:57.789046Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.020784ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-06-18T03:14:57.789146Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"264.873707ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-95phk\" ","response":"range_response_count:1 size:3965"} {"level":"info","ts":"2026-06-18T03:14:57.789178Z","caller":"traceutil/trace.go:171","msg":"trace[557458140] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:805; }","duration":"109.202237ms","start":"2026-06-18T03:14:57.679946Z","end":"2026-06-18T03:14:57.789148Z","steps":["trace[557458140] 'count revisions from in-memory index tree' (duration: 108.949751ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:14:57.789221Z","caller":"traceutil/trace.go:171","msg":"trace[1503532049] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-95phk; range_end:; response_count:1; response_revision:805; }","duration":"264.994419ms","start":"2026-06-18T03:14:57.524207Z","end":"2026-06-18T03:14:57.789201Z","steps":["trace[1503532049] 'range keys from in-memory index tree' (duration: 264.64916ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:57.789065Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.656873ms","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-06-18T03:14:57.78937Z","caller":"traceutil/trace.go:171","msg":"trace[1230578801] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:805; }","duration":"127.014772ms","start":"2026-06-18T03:14:57.662333Z","end":"2026-06-18T03:14:57.789348Z","steps":["trace[1230578801] 'range keys from in-memory index tree' (duration: 126.434338ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:57.789079Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"318.526036ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:14:57.789519Z","caller":"traceutil/trace.go:171","msg":"trace[1017698599] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:805; }","duration":"318.993537ms","start":"2026-06-18T03:14:57.47049Z","end":"2026-06-18T03:14:57.789484Z","steps":["trace[1017698599] 'range keys from in-memory index tree' (duration: 318.429604ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:14:57.789588Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:14:57.470473Z","time spent":"319.094941ms","remote":"127.0.0.1:46446","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-18T03:14:57.790187Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"177.74146ms","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-06-18T03:14:57.790233Z","caller":"traceutil/trace.go:171","msg":"trace[1836794560] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:805; }","duration":"177.831181ms","start":"2026-06-18T03:14:57.612392Z","end":"2026-06-18T03:14:57.790223Z","steps":["trace[1836794560] 'range keys from in-memory index tree' (duration: 176.330724ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.3078Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":8555606570766492323,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-18T03:15:02.64417Z","caller":"traceutil/trace.go:171","msg":"trace[1963375839] transaction","detail":"{read_only:false; response_revision:832; number_of_response:1; }","duration":"845.194842ms","start":"2026-06-18T03:15:01.798924Z","end":"2026-06-18T03:15:02.644119Z","steps":["trace[1963375839] 'process raft request' (duration: 845.051408ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.644428Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:01.798906Z","time spent":"845.423588ms","remote":"127.0.0.1:46830","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1131,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-18T03:15:02.66221Z","caller":"traceutil/trace.go:171","msg":"trace[1693533130] transaction","detail":"{read_only:false; response_revision:833; number_of_response:1; }","duration":"863.026208ms","start":"2026-06-18T03:15:01.799163Z","end":"2026-06-18T03:15:02.66219Z","steps":["trace[1693533130] 'process raft request' (duration: 862.773972ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.662353Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:01.799134Z","time spent":"863.13632ms","remote":"127.0.0.1:46830","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1096,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-06-18T03:15:02.680613Z","caller":"traceutil/trace.go:171","msg":"trace[88320525] linearizableReadLoop","detail":"{readStateIndex:862; appliedIndex:859; }","duration":"872.857187ms","start":"2026-06-18T03:15:01.807738Z","end":"2026-06-18T03:15:02.680595Z","steps":["trace[88320525] 'read index received' (duration: 836.271053ms)","trace[88320525] 'applied index is now lower than readState.Index' (duration: 36.584804ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T03:15:02.680809Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"873.059562ms","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-06-18T03:15:02.680836Z","caller":"traceutil/trace.go:171","msg":"trace[444012971] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:833; }","duration":"873.131563ms","start":"2026-06-18T03:15:01.807698Z","end":"2026-06-18T03:15:02.68083Z","steps":["trace[444012971] 'agreement among raft nodes before linearized reading' (duration: 873.007591ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.680861Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:01.807686Z","time spent":"873.169185ms","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":529,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-06-18T03:15:02.681006Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.453407ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"warn","ts":"2026-06-18T03:15:02.681034Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"864.061142ms","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-06-18T03:15:02.681086Z","caller":"traceutil/trace.go:171","msg":"trace[21108786] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:833; }","duration":"864.153103ms","start":"2026-06-18T03:15:01.81692Z","end":"2026-06-18T03:15:02.681073Z","steps":["trace[21108786] 'agreement among raft nodes before linearized reading' (duration: 863.98148ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:15:02.681089Z","caller":"traceutil/trace.go:171","msg":"trace[1677727816] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:833; }","duration":"112.523289ms","start":"2026-06-18T03:15:02.568512Z","end":"2026-06-18T03:15:02.681035Z","steps":["trace[1677727816] 'agreement among raft nodes before linearized reading' (duration: 112.405216ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.681172Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"369.711829ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T03:15:02.681185Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"354.569449ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:02.68121Z","caller":"traceutil/trace.go:171","msg":"trace[1901977404] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:833; }","duration":"369.762219ms","start":"2026-06-18T03:15:02.311437Z","end":"2026-06-18T03:15:02.681199Z","steps":["trace[1901977404] 'agreement among raft nodes before linearized reading' (duration: 369.710258ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:15:02.681237Z","caller":"traceutil/trace.go:171","msg":"trace[1098040257] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:833; }","duration":"354.63579ms","start":"2026-06-18T03:15:02.326582Z","end":"2026-06-18T03:15:02.681218Z","steps":["trace[1098040257] 'agreement among raft nodes before linearized reading' (duration: 354.578718ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.681293Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:02.326572Z","time spent":"354.710521ms","remote":"127.0.0.1:37302","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:10000 "} {"level":"warn","ts":"2026-06-18T03:15:02.681318Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"860.233108ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-18T03:15:02.681345Z","caller":"traceutil/trace.go:171","msg":"trace[1354574248] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:833; }","duration":"860.283718ms","start":"2026-06-18T03:15:01.821053Z","end":"2026-06-18T03:15:02.681337Z","steps":["trace[1354574248] 'agreement among raft nodes before linearized reading' (duration: 860.208496ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.681374Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:01.821039Z","time spent":"860.32939ms","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-06-18T03:15:02.681245Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:02.311431Z","time spent":"369.804142ms","remote":"127.0.0.1:37292","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" count_only:true "} {"level":"warn","ts":"2026-06-18T03:15:02.68139Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"370.011056ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T03:15:02.681127Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:01.81688Z","time spent":"864.239476ms","remote":"127.0.0.1:46740","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-06-18T03:15:02.681574Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"353.695178ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:02.681605Z","caller":"traceutil/trace.go:171","msg":"trace[156502950] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:833; }","duration":"353.743629ms","start":"2026-06-18T03:15:02.327854Z","end":"2026-06-18T03:15:02.681597Z","steps":["trace[156502950] 'agreement among raft nodes before linearized reading' (duration: 353.695618ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.681631Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:02.327848Z","time spent":"353.777269ms","remote":"127.0.0.1:37302","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:500 "} {"level":"info","ts":"2026-06-18T03:15:02.681679Z","caller":"traceutil/trace.go:171","msg":"trace[1997641847] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:833; }","duration":"370.314424ms","start":"2026-06-18T03:15:02.311269Z","end":"2026-06-18T03:15:02.681584Z","steps":["trace[1997641847] 'agreement among raft nodes before linearized reading' (duration: 369.907674ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.68173Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.892408ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoypatchpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoypatchpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:02.681765Z","caller":"traceutil/trace.go:171","msg":"trace[788249698] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:833; }","duration":"101.947219ms","start":"2026-06-18T03:15:02.579808Z","end":"2026-06-18T03:15:02.681755Z","steps":["trace[788249698] 'agreement among raft nodes before linearized reading' (duration: 101.897418ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.68177Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.050702ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoypatchpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoypatchpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:02.681845Z","caller":"traceutil/trace.go:171","msg":"trace[8736255] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:833; }","duration":"102.114363ms","start":"2026-06-18T03:15:02.579685Z","end":"2026-06-18T03:15:02.681799Z","steps":["trace[8736255] 'agreement among raft nodes before linearized reading' (duration: 102.054221ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.681918Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:02.311253Z","time spent":"370.493068ms","remote":"127.0.0.1:37292","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:10000 "} {"level":"warn","ts":"2026-06-18T03:15:02.681945Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"355.115303ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:02.682134Z","caller":"traceutil/trace.go:171","msg":"trace[379180750] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:833; }","duration":"355.304137ms","start":"2026-06-18T03:15:02.326728Z","end":"2026-06-18T03:15:02.682033Z","steps":["trace[379180750] 'agreement among raft nodes before linearized reading' (duration: 355.096011ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.681686Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.58592ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-18T03:15:02.682205Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:02.326714Z","time spent":"355.470731ms","remote":"127.0.0.1:37302","response type":"/etcdserverpb.KV/Range","request count":0,"request size":110,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" count_only:true "} {"level":"info","ts":"2026-06-18T03:15:02.682213Z","caller":"traceutil/trace.go:171","msg":"trace[1264818195] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:833; }","duration":"111.131954ms","start":"2026-06-18T03:15:02.57107Z","end":"2026-06-18T03:15:02.682202Z","steps":["trace[1264818195] 'agreement among raft nodes before linearized reading' (duration: 110.593841ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.681098Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"369.009641ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:02.682274Z","caller":"traceutil/trace.go:171","msg":"trace[441464906] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:833; }","duration":"370.270762ms","start":"2026-06-18T03:15:02.311991Z","end":"2026-06-18T03:15:02.682262Z","steps":["trace[441464906] 'agreement among raft nodes before linearized reading' (duration: 369.009122ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:02.682351Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:02.311971Z","time spent":"370.369604ms","remote":"127.0.0.1:37292","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:500 "} {"level":"warn","ts":"2026-06-18T03:15:02.681127Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.387412ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoypatchpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoypatchpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:02.682402Z","caller":"traceutil/trace.go:171","msg":"trace[598865870] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:833; }","duration":"101.667933ms","start":"2026-06-18T03:15:02.580728Z","end":"2026-06-18T03:15:02.682396Z","steps":["trace[598865870] 'agreement among raft nodes before linearized reading' (duration: 100.373222ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:15:06.834182Z","caller":"traceutil/trace.go:171","msg":"trace[489236504] transaction","detail":"{read_only:false; response_revision:878; number_of_response:1; }","duration":"128.520496ms","start":"2026-06-18T03:15:06.705632Z","end":"2026-06-18T03:15:06.834153Z","steps":["trace[489236504] 'process raft request' (duration: 128.110176ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:15:06.84406Z","caller":"traceutil/trace.go:171","msg":"trace[41281698] transaction","detail":"{read_only:false; response_revision:879; number_of_response:1; }","duration":"137.928691ms","start":"2026-06-18T03:15:06.706109Z","end":"2026-06-18T03:15:06.844037Z","steps":["trace[41281698] 'process raft request' (duration: 137.766407ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:15:06.844261Z","caller":"traceutil/trace.go:171","msg":"trace[1153028579] linearizableReadLoop","detail":"{readStateIndex:909; appliedIndex:907; }","duration":"136.941257ms","start":"2026-06-18T03:15:06.707273Z","end":"2026-06-18T03:15:06.844214Z","steps":["trace[1153028579] 'read index received' (duration: 126.485486ms)","trace[1153028579] 'applied index is now lower than readState.Index' (duration: 10.453731ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:15:06.844283Z","caller":"traceutil/trace.go:171","msg":"trace[738618166] transaction","detail":"{read_only:false; response_revision:880; number_of_response:1; }","duration":"136.883585ms","start":"2026-06-18T03:15:06.70737Z","end":"2026-06-18T03:15:06.844253Z","steps":["trace[738618166] 'process raft request' (duration: 136.628619ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:06.844485Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.189163ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-18T03:15:06.844632Z","caller":"traceutil/trace.go:171","msg":"trace[1130225323] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:880; }","duration":"137.376468ms","start":"2026-06-18T03:15:06.707247Z","end":"2026-06-18T03:15:06.844623Z","steps":["trace[1130225323] 'agreement among raft nodes before linearized reading' (duration: 137.064ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:15:10.243828Z","caller":"traceutil/trace.go:171","msg":"trace[1805870348] linearizableReadLoop","detail":"{readStateIndex:958; appliedIndex:957; }","duration":"119.332318ms","start":"2026-06-18T03:15:10.124471Z","end":"2026-06-18T03:15:10.243803Z","steps":["trace[1805870348] 'read index received' (duration: 119.100573ms)","trace[1805870348] 'applied index is now lower than readState.Index' (duration: 230.585µs)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:15:10.243948Z","caller":"traceutil/trace.go:171","msg":"trace[780747754] transaction","detail":"{read_only:false; response_revision:928; number_of_response:1; }","duration":"394.866641ms","start":"2026-06-18T03:15:09.849011Z","end":"2026-06-18T03:15:10.243878Z","steps":["trace[780747754] 'process raft request' (duration: 394.641235ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:10.243991Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.491613ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/local-path-storage/\" range_end:\"/registry/secrets/local-path-storage0\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:10.24421Z","caller":"traceutil/trace.go:171","msg":"trace[1491188217] range","detail":"{range_begin:/registry/secrets/local-path-storage/; range_end:/registry/secrets/local-path-storage0; response_count:0; response_revision:928; }","duration":"119.759628ms","start":"2026-06-18T03:15:10.12443Z","end":"2026-06-18T03:15:10.244189Z","steps":["trace[1491188217] 'agreement among raft nodes before linearized reading' (duration: 119.492491ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:10.244191Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-18T03:15:09.848994Z","time spent":"395.054075ms","remote":"127.0.0.1:46740","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-18T03:15:20.708875Z","caller":"traceutil/trace.go:171","msg":"trace[1860234584] transaction","detail":"{read_only:false; response_revision:1005; number_of_response:1; }","duration":"119.725613ms","start":"2026-06-18T03:15:20.589133Z","end":"2026-06-18T03:15:20.708859Z","steps":["trace[1860234584] 'process raft request' (duration: 119.630861ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:15:26.403469Z","caller":"traceutil/trace.go:171","msg":"trace[762944252] transaction","detail":"{read_only:false; response_revision:1023; number_of_response:1; }","duration":"102.485543ms","start":"2026-06-18T03:15:26.300955Z","end":"2026-06-18T03:15:26.40344Z","steps":["trace[762944252] 'process raft request' (duration: 102.30663ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:15:29.067689Z","caller":"traceutil/trace.go:171","msg":"trace[32335819] linearizableReadLoop","detail":"{readStateIndex:1068; appliedIndex:1066; }","duration":"111.534626ms","start":"2026-06-18T03:15:28.956127Z","end":"2026-06-18T03:15:29.067661Z","steps":["trace[32335819] 'read index received' (duration: 50.481998ms)","trace[32335819] 'applied index is now lower than readState.Index' (duration: 60.988626ms)"],"step_count":2} {"level":"info","ts":"2026-06-18T03:15:29.067803Z","caller":"traceutil/trace.go:171","msg":"trace[1301996008] transaction","detail":"{read_only:false; response_revision:1034; number_of_response:1; }","duration":"113.5671ms","start":"2026-06-18T03:15:28.954203Z","end":"2026-06-18T03:15:29.06777Z","steps":["trace[1301996008] 'process raft request' (duration: 109.361017ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:29.0679Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.74604ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-18T03:15:29.06793Z","caller":"traceutil/trace.go:171","msg":"trace[416124631] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1034; }","duration":"111.819461ms","start":"2026-06-18T03:15:28.956102Z","end":"2026-06-18T03:15:29.067922Z","steps":["trace[416124631] 'agreement among raft nodes before linearized reading' (duration: 111.659598ms)"],"step_count":1} {"level":"warn","ts":"2026-06-18T03:15:39.49917Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.039397ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/\" range_end:\"/registry/resourcequotas0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:15:39.499248Z","caller":"traceutil/trace.go:171","msg":"trace[75652889] range","detail":"{range_begin:/registry/resourcequotas/; range_end:/registry/resourcequotas0; response_count:0; response_revision:1073; }","duration":"153.181281ms","start":"2026-06-18T03:15:39.34605Z","end":"2026-06-18T03:15:39.499231Z","steps":["trace[75652889] 'count revisions from in-memory index tree' (duration: 152.883505ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:05.561894Z","caller":"traceutil/trace.go:171","msg":"trace[1283847850] transaction","detail":"{read_only:false; response_revision:1158; number_of_response:1; }","duration":"119.62708ms","start":"2026-06-18T03:16:05.442247Z","end":"2026-06-18T03:16:05.561874Z","steps":["trace[1283847850] 'process raft request' (duration: 110.253641ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:06.780511Z","caller":"traceutil/trace.go:171","msg":"trace[1569060962] linearizableReadLoop","detail":"{readStateIndex:1202; appliedIndex:1201; }","duration":"142.223789ms","start":"2026-06-18T03:16:06.638265Z","end":"2026-06-18T03:16:06.780489Z","steps":["trace[1569060962] 'read index received' (duration: 142.015115ms)","trace[1569060962] 'applied index is now lower than readState.Index' (duration: 207.494µs)"],"step_count":2} {"level":"warn","ts":"2026-06-18T03:16:06.780643Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.360951ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumloadbalancerippools/\" range_end:\"/registry/cilium.io/ciliumloadbalancerippools0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:16:06.780679Z","caller":"traceutil/trace.go:171","msg":"trace[1295878638] range","detail":"{range_begin:/registry/cilium.io/ciliumloadbalancerippools/; range_end:/registry/cilium.io/ciliumloadbalancerippools0; response_count:0; response_revision:1159; }","duration":"142.458133ms","start":"2026-06-18T03:16:06.638208Z","end":"2026-06-18T03:16:06.780666Z","steps":["trace[1295878638] 'agreement among raft nodes before linearized reading' (duration: 142.375921ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:07.601994Z","caller":"traceutil/trace.go:171","msg":"trace[667452474] transaction","detail":"{read_only:false; response_revision:1163; number_of_response:1; }","duration":"101.879324ms","start":"2026-06-18T03:16:07.500091Z","end":"2026-06-18T03:16:07.60197Z","steps":["trace[667452474] 'process raft request' (duration: 101.277713ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:07.729829Z","caller":"traceutil/trace.go:171","msg":"trace[1393695206] transaction","detail":"{read_only:false; response_revision:1164; number_of_response:1; }","duration":"124.530588ms","start":"2026-06-18T03:16:07.605272Z","end":"2026-06-18T03:16:07.729802Z","steps":["trace[1393695206] 'process raft request' (duration: 121.976937ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:07.730863Z","caller":"traceutil/trace.go:171","msg":"trace[1592378955] transaction","detail":"{read_only:false; response_revision:1165; number_of_response:1; }","duration":"124.781604ms","start":"2026-06-18T03:16:07.606061Z","end":"2026-06-18T03:16:07.730843Z","steps":["trace[1592378955] 'process raft request' (duration: 124.672142ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:31.987977Z","caller":"traceutil/trace.go:171","msg":"trace[1651450145] linearizableReadLoop","detail":"{readStateIndex:1290; appliedIndex:1289; }","duration":"121.658088ms","start":"2026-06-18T03:16:31.866293Z","end":"2026-06-18T03:16:31.987951Z","steps":["trace[1651450145] 'read index received' (duration: 86.152542ms)","trace[1651450145] 'applied index is now lower than readState.Index' (duration: 35.504546ms)"],"step_count":2} {"level":"warn","ts":"2026-06-18T03:16:31.988389Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.067476ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-18T03:16:31.988513Z","caller":"traceutil/trace.go:171","msg":"trace[112594827] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1242; }","duration":"122.245088ms","start":"2026-06-18T03:16:31.866246Z","end":"2026-06-18T03:16:31.988491Z","steps":["trace[112594827] 'agreement among raft nodes before linearized reading' (duration: 121.967174ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:53.287245Z","caller":"traceutil/trace.go:171","msg":"trace[610482582] transaction","detail":"{read_only:false; response_revision:1350; number_of_response:1; }","duration":"153.158279ms","start":"2026-06-18T03:16:53.134063Z","end":"2026-06-18T03:16:53.287221Z","steps":["trace[610482582] 'process raft request' (duration: 152.976616ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:53.801276Z","caller":"traceutil/trace.go:171","msg":"trace[933395132] linearizableReadLoop","detail":"{readStateIndex:1405; appliedIndex:1404; }","duration":"149.392437ms","start":"2026-06-18T03:16:53.651862Z","end":"2026-06-18T03:16:53.801254Z","steps":["trace[933395132] 'read index received' (duration: 149.246165ms)","trace[933395132] 'applied index is now lower than readState.Index' (duration: 145.332µs)"],"step_count":2} {"level":"warn","ts":"2026-06-18T03:16:53.801412Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"149.52572ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-18T03:16:53.801406Z","caller":"traceutil/trace.go:171","msg":"trace[1730254796] transaction","detail":"{read_only:false; response_revision:1351; number_of_response:1; }","duration":"210.867593ms","start":"2026-06-18T03:16:53.590501Z","end":"2026-06-18T03:16:53.801368Z","steps":["trace[1730254796] 'process raft request' (duration: 210.626169ms)"],"step_count":1} {"level":"info","ts":"2026-06-18T03:16:53.801451Z","caller":"traceutil/trace.go:171","msg":"trace[554865134] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:1351; }","duration":"149.615932ms","start":"2026-06-18T03:16:53.651825Z","end":"2026-06-18T03:16:53.801441Z","steps":["trace[554865134] 'agreement among raft nodes before linearized reading' (duration: 149.5176ms)"],"step_count":1}