{"level":"warn","ts":"2026-04-14T05:41:53.013859Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-14T05:41:53.013943Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.248: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.248:2380","--initial-cluster=instance=https://199.204.45.248:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.248:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.248:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-04-14T05:41:53.014005Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-14T05:41:53.014018Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.248:2380"]} {"level":"info","ts":"2026-04-14T05:41:53.014036Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-04-14T05:41:53.014916Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.248:2379"]} {"level":"info","ts":"2026-04-14T05:41:53.014997Z","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.248:2380"],"listen-peer-urls":["https://199.204.45.248:2380"],"advertise-client-urls":["https://199.204.45.248:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.248:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.248:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-04-14T05:41:53.05927Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"39.753176ms"} {"level":"info","ts":"2026-04-14T05:41:53.197057Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"39582465ceaa2f67","cluster-id":"87fd8ddedde3be45"} {"level":"info","ts":"2026-04-14T05:41:53.197452Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 switched to configuration voters=()"} {"level":"info","ts":"2026-04-14T05:41:53.197527Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became follower at term 0"} {"level":"info","ts":"2026-04-14T05:41:53.197823Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 39582465ceaa2f67 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-14T05:41:53.197908Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became follower at term 1"} {"level":"info","ts":"2026-04-14T05:41:53.19805Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 switched to configuration voters=(4132092677789986663)"} {"level":"warn","ts":"2026-04-14T05:41:53.375309Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-14T05:41:53.444087Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-14T05:41:53.4598Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-04-14T05:41:53.4966Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"39582465ceaa2f67","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-14T05:41:53.496965Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"39582465ceaa2f67","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-14T05:41:53.497137Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-14T05:41:53.497309Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-14T05:41:53.497356Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-04-14T05:41:53.498971Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-04-14T05:41:53.499128Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.248:2380"} {"level":"info","ts":"2026-04-14T05:41:53.499216Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.248:2380"} {"level":"info","ts":"2026-04-14T05:41:53.499724Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"39582465ceaa2f67","initial-advertise-peer-urls":["https://199.204.45.248:2380"],"listen-peer-urls":["https://199.204.45.248:2380"],"advertise-client-urls":["https://199.204.45.248:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.248:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-14T05:41:53.499777Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-14T05:41:53.502305Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 switched to configuration voters=(4132092677789986663)"} {"level":"info","ts":"2026-04-14T05:41:53.50252Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"87fd8ddedde3be45","local-member-id":"39582465ceaa2f67","added-peer-id":"39582465ceaa2f67","added-peer-peer-urls":["https://199.204.45.248:2380"]} {"level":"info","ts":"2026-04-14T05:41:54.20642Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 is starting a new election at term 1"} {"level":"info","ts":"2026-04-14T05:41:54.2065Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became pre-candidate at term 1"} {"level":"info","ts":"2026-04-14T05:41:54.206546Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 received MsgPreVoteResp from 39582465ceaa2f67 at term 1"} {"level":"info","ts":"2026-04-14T05:41:54.206568Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became candidate at term 2"} {"level":"info","ts":"2026-04-14T05:41:54.20658Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 received MsgVoteResp from 39582465ceaa2f67 at term 2"} {"level":"info","ts":"2026-04-14T05:41:54.206609Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"39582465ceaa2f67 became leader at term 2"} {"level":"info","ts":"2026-04-14T05:41:54.206625Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 39582465ceaa2f67 elected leader 39582465ceaa2f67 at term 2"} {"level":"info","ts":"2026-04-14T05:41:54.20748Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T05:41:54.208793Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"87fd8ddedde3be45","local-member-id":"39582465ceaa2f67","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T05:41:54.208876Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"39582465ceaa2f67","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.248:2379]}","request-path":"/0/members/39582465ceaa2f67/attributes","cluster-id":"87fd8ddedde3be45","publish-timeout":"7s"} {"level":"info","ts":"2026-04-14T05:41:54.208907Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-14T05:41:54.208897Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T05:41:54.208943Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-14T05:41:54.208962Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-14T05:41:54.209405Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-14T05:41:54.209429Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-14T05:41:54.211799Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-14T05:41:54.212822Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.248:2379"} {"level":"info","ts":"2026-04-14T05:42:16.112757Z","caller":"traceutil/trace.go:171","msg":"trace[625482010] transaction","detail":"{read_only:false; response_revision:417; number_of_response:1; }","duration":"100.537213ms","start":"2026-04-14T05:42:16.011505Z","end":"2026-04-14T05:42:16.112042Z","steps":["trace[625482010] 'process raft request' (duration: 100.258226ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:21.740548Z","caller":"traceutil/trace.go:171","msg":"trace[1916711184] linearizableReadLoop","detail":"{readStateIndex:446; appliedIndex:445; }","duration":"265.436576ms","start":"2026-04-14T05:42:21.475085Z","end":"2026-04-14T05:42:21.740522Z","steps":["trace[1916711184] 'read index received' (duration: 265.267802ms)","trace[1916711184] 'applied index is now lower than readState.Index' (duration: 167.474µs)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:42:21.74076Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"265.673023ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:21.74083Z","caller":"traceutil/trace.go:171","msg":"trace[1304642231] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:431; }","duration":"265.768855ms","start":"2026-04-14T05:42:21.47505Z","end":"2026-04-14T05:42:21.740819Z","steps":["trace[1304642231] 'agreement among raft nodes before linearized reading' (duration: 265.58709ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:21.740882Z","caller":"traceutil/trace.go:171","msg":"trace[1805012459] transaction","detail":"{read_only:false; response_revision:431; number_of_response:1; }","duration":"450.768777ms","start":"2026-04-14T05:42:21.290081Z","end":"2026-04-14T05:42:21.740849Z","steps":["trace[1805012459] 'process raft request' (duration: 450.283294ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:21.741763Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:21.290056Z","time spent":"450.90696ms","remote":"127.0.0.1:34010","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-04-14T05:42:23.581246Z","caller":"traceutil/trace.go:171","msg":"trace[599758504] linearizableReadLoop","detail":"{readStateIndex:451; appliedIndex:450; }","duration":"108.242833ms","start":"2026-04-14T05:42:23.472986Z","end":"2026-04-14T05:42:23.581229Z","steps":["trace[599758504] 'read index received' (duration: 107.846943ms)","trace[599758504] 'applied index is now lower than readState.Index' (duration: 395.21µs)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:42:23.581362Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.353675ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:23.581386Z","caller":"traceutil/trace.go:171","msg":"trace[139572373] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:435; }","duration":"108.444688ms","start":"2026-04-14T05:42:23.472936Z","end":"2026-04-14T05:42:23.581381Z","steps":["trace[139572373] 'agreement among raft nodes before linearized reading' (duration: 108.364446ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:23.582139Z","caller":"traceutil/trace.go:171","msg":"trace[81485929] transaction","detail":"{read_only:false; response_revision:435; number_of_response:1; }","duration":"111.394374ms","start":"2026-04-14T05:42:23.470003Z","end":"2026-04-14T05:42:23.581397Z","steps":["trace[81485929] 'process raft request' (duration: 110.953103ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:23.873884Z","caller":"traceutil/trace.go:171","msg":"trace[1297438313] linearizableReadLoop","detail":"{readStateIndex:454; appliedIndex:453; }","duration":"127.287504ms","start":"2026-04-14T05:42:23.746571Z","end":"2026-04-14T05:42:23.873859Z","steps":["trace[1297438313] 'read index received' (duration: 31.703378ms)","trace[1297438313] 'applied index is now lower than readState.Index' (duration: 95.582616ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:23.874034Z","caller":"traceutil/trace.go:171","msg":"trace[1207066325] transaction","detail":"{read_only:false; response_revision:438; number_of_response:1; }","duration":"213.299062ms","start":"2026-04-14T05:42:23.660691Z","end":"2026-04-14T05:42:23.87399Z","steps":["trace[1207066325] 'process raft request' (duration: 117.619483ms)","trace[1207066325] 'compare' (duration: 95.253617ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:42:23.874268Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"127.672593ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-14T05:42:23.87464Z","caller":"traceutil/trace.go:171","msg":"trace[1844383504] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:438; }","duration":"127.789646ms","start":"2026-04-14T05:42:23.746516Z","end":"2026-04-14T05:42:23.874305Z","steps":["trace[1844383504] 'agreement among raft nodes before linearized reading' (duration: 127.521509ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.927559Z","caller":"traceutil/trace.go:171","msg":"trace[1485227078] transaction","detail":"{read_only:false; response_revision:473; number_of_response:1; }","duration":"258.993891ms","start":"2026-04-14T05:42:25.668531Z","end":"2026-04-14T05:42:25.927525Z","steps":["trace[1485227078] 'process raft request' (duration: 258.834717ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.93771Z","caller":"traceutil/trace.go:171","msg":"trace[180417283] transaction","detail":"{read_only:false; response_revision:477; number_of_response:1; }","duration":"257.111891ms","start":"2026-04-14T05:42:25.680553Z","end":"2026-04-14T05:42:25.937665Z","steps":["trace[180417283] 'process raft request' (duration: 256.588988ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.937759Z","caller":"traceutil/trace.go:171","msg":"trace[2136769751] transaction","detail":"{read_only:false; response_revision:474; number_of_response:1; }","duration":"265.075536ms","start":"2026-04-14T05:42:25.67266Z","end":"2026-04-14T05:42:25.937736Z","steps":["trace[2136769751] 'process raft request' (duration: 264.287716ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.937781Z","caller":"traceutil/trace.go:171","msg":"trace[1367039546] transaction","detail":"{read_only:false; response_revision:475; number_of_response:1; }","duration":"260.798777ms","start":"2026-04-14T05:42:25.676958Z","end":"2026-04-14T05:42:25.937757Z","steps":["trace[1367039546] 'process raft request' (duration: 260.089919ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.937796Z","caller":"traceutil/trace.go:171","msg":"trace[435864721] transaction","detail":"{read_only:false; response_revision:476; number_of_response:1; }","duration":"259.396289ms","start":"2026-04-14T05:42:25.678381Z","end":"2026-04-14T05:42:25.937778Z","steps":["trace[435864721] 'process raft request' (duration: 258.714832ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.937941Z","caller":"traceutil/trace.go:171","msg":"trace[1383039025] transaction","detail":"{read_only:false; response_revision:480; number_of_response:1; }","duration":"252.465861ms","start":"2026-04-14T05:42:25.685461Z","end":"2026-04-14T05:42:25.937927Z","steps":["trace[1383039025] 'process raft request' (duration: 251.889746ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.938029Z","caller":"traceutil/trace.go:171","msg":"trace[1442056916] transaction","detail":"{read_only:false; response_revision:479; number_of_response:1; }","duration":"252.954483ms","start":"2026-04-14T05:42:25.685067Z","end":"2026-04-14T05:42:25.938021Z","steps":["trace[1442056916] 'process raft request' (duration: 252.217955ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.938027Z","caller":"traceutil/trace.go:171","msg":"trace[428753037] transaction","detail":"{read_only:false; response_revision:481; number_of_response:1; }","duration":"245.349217ms","start":"2026-04-14T05:42:25.692668Z","end":"2026-04-14T05:42:25.938017Z","steps":["trace[428753037] 'process raft request' (duration: 244.753852ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.938029Z","caller":"traceutil/trace.go:171","msg":"trace[873261387] transaction","detail":"{read_only:false; response_revision:478; number_of_response:1; }","duration":"253.001445ms","start":"2026-04-14T05:42:25.685013Z","end":"2026-04-14T05:42:25.938014Z","steps":["trace[873261387] 'process raft request' (duration: 252.191385ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.938088Z","caller":"traceutil/trace.go:171","msg":"trace[614699077] transaction","detail":"{read_only:false; response_revision:482; number_of_response:1; }","duration":"196.871327ms","start":"2026-04-14T05:42:25.741209Z","end":"2026-04-14T05:42:25.938081Z","steps":["trace[614699077] 'process raft request' (duration: 196.263481ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:25.938199Z","caller":"traceutil/trace.go:171","msg":"trace[644835711] transaction","detail":"{read_only:false; response_revision:483; number_of_response:1; }","duration":"191.95476ms","start":"2026-04-14T05:42:25.746234Z","end":"2026-04-14T05:42:25.938189Z","steps":["trace[644835711] 'process raft request' (duration: 191.289723ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.302398Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"344.30581ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-14T05:42:26.302735Z","caller":"traceutil/trace.go:171","msg":"trace[1460632478] transaction","detail":"{read_only:false; response_revision:487; number_of_response:1; }","duration":"355.362436ms","start":"2026-04-14T05:42:25.947324Z","end":"2026-04-14T05:42:26.302686Z","steps":["trace[1460632478] 'process raft request' (duration: 10.221953ms)","trace[1460632478] 'compare' (duration: 343.982352ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:26.303088Z","caller":"traceutil/trace.go:171","msg":"trace[1803841146] transaction","detail":"{read_only:false; response_revision:489; number_of_response:1; }","duration":"353.848487ms","start":"2026-04-14T05:42:25.949205Z","end":"2026-04-14T05:42:26.303054Z","steps":["trace[1803841146] 'process raft request' (duration: 353.472528ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.304015Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.947313Z","time spent":"355.715905ms","remote":"127.0.0.1:33776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9125,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T05:42:26.305817Z","caller":"traceutil/trace.go:171","msg":"trace[241564515] transaction","detail":"{read_only:false; response_revision:491; number_of_response:1; }","duration":"351.367043ms","start":"2026-04-14T05:42:25.954401Z","end":"2026-04-14T05:42:26.305768Z","steps":["trace[241564515] 'process raft request' (duration: 350.441379ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:26.306044Z","caller":"traceutil/trace.go:171","msg":"trace[337982228] transaction","detail":"{read_only:false; response_revision:492; number_of_response:1; }","duration":"334.318613ms","start":"2026-04-14T05:42:25.971448Z","end":"2026-04-14T05:42:26.305766Z","steps":["trace[337982228] 'process raft request' (duration: 334.211341ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.306255Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.971427Z","time spent":"334.740174ms","remote":"127.0.0.1:34292","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":998,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-14T05:42:26.306139Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.954382Z","time spent":"351.66012ms","remote":"127.0.0.1:33776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":10063,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T05:42:26.307191Z","caller":"traceutil/trace.go:171","msg":"trace[1498880576] transaction","detail":"{read_only:false; response_revision:488; number_of_response:1; }","duration":"358.127156ms","start":"2026-04-14T05:42:25.948947Z","end":"2026-04-14T05:42:26.307074Z","steps":["trace[1498880576] 'process raft request' (duration: 353.642691ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.307244Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.949187Z","time spent":"354.013291ms","remote":"127.0.0.1:34292","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":995,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-14T05:42:26.307936Z","caller":"traceutil/trace.go:171","msg":"trace[412419332] transaction","detail":"{read_only:false; response_revision:490; number_of_response:1; }","duration":"356.844573ms","start":"2026-04-14T05:42:25.951047Z","end":"2026-04-14T05:42:26.307892Z","steps":["trace[412419332] 'process raft request' (duration: 351.674891ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.308453Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.951038Z","time spent":"356.977916ms","remote":"127.0.0.1:33776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":6888,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T05:42:26.307474Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.948939Z","time spent":"358.393654ms","remote":"127.0.0.1:34292","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":980,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-14T05:42:26.552186Z","caller":"traceutil/trace.go:171","msg":"trace[1319219385] linearizableReadLoop","detail":"{readStateIndex:513; appliedIndex:502; }","duration":"384.477768ms","start":"2026-04-14T05:42:26.167656Z","end":"2026-04-14T05:42:26.552134Z","steps":["trace[1319219385] 'read index received' (duration: 132.026895ms)","trace[1319219385] 'applied index is now lower than readState.Index' (duration: 252.449923ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:26.552229Z","caller":"traceutil/trace.go:171","msg":"trace[364547751] transaction","detail":"{read_only:false; response_revision:494; number_of_response:1; }","duration":"575.175986ms","start":"2026-04-14T05:42:25.977003Z","end":"2026-04-14T05:42:26.552179Z","steps":["trace[364547751] 'process raft request' (duration: 574.414806ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:26.552308Z","caller":"traceutil/trace.go:171","msg":"trace[844123748] transaction","detail":"{read_only:false; response_revision:495; number_of_response:1; }","duration":"573.520443ms","start":"2026-04-14T05:42:25.978774Z","end":"2026-04-14T05:42:26.552295Z","steps":["trace[844123748] 'process raft request' (duration: 573.106882ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:26.552337Z","caller":"traceutil/trace.go:171","msg":"trace[745121912] transaction","detail":"{read_only:false; response_revision:497; number_of_response:1; }","duration":"561.092372ms","start":"2026-04-14T05:42:25.991214Z","end":"2026-04-14T05:42:26.552307Z","steps":["trace[745121912] 'process raft request' (duration: 560.827026ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.552433Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.978765Z","time spent":"573.579034ms","remote":"127.0.0.1:33776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28739,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T05:42:26.552477Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.991197Z","time spent":"561.209816ms","remote":"127.0.0.1:33776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17062,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-14T05:42:26.552482Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.976992Z","time spent":"575.34937ms","remote":"127.0.0.1:33776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":30393,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T05:42:26.552539Z","caller":"traceutil/trace.go:171","msg":"trace[899161940] transaction","detail":"{read_only:false; response_revision:496; number_of_response:1; }","duration":"572.63663ms","start":"2026-04-14T05:42:25.979765Z","end":"2026-04-14T05:42:26.552402Z","steps":["trace[899161940] 'process raft request' (duration: 572.206699ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:26.552747Z","caller":"traceutil/trace.go:171","msg":"trace[392870083] transaction","detail":"{read_only:false; response_revision:493; number_of_response:1; }","duration":"581.001726ms","start":"2026-04-14T05:42:25.971732Z","end":"2026-04-14T05:42:26.552733Z","steps":["trace[392870083] 'process raft request' (duration: 577.546747ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.552715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"384.982571ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-04-14T05:42:26.552813Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.971722Z","time spent":"581.063207ms","remote":"127.0.0.1:34292","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":998,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-14T05:42:26.552829Z","caller":"traceutil/trace.go:171","msg":"trace[1459370503] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:497; }","duration":"385.193236ms","start":"2026-04-14T05:42:26.167606Z","end":"2026-04-14T05:42:26.552799Z","steps":["trace[1459370503] 'agreement among raft nodes before linearized reading' (duration: 384.833377ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.552882Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:26.167582Z","time spent":"385.290558ms","remote":"127.0.0.1:34010","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-04-14T05:42:26.552991Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:25.97976Z","time spent":"572.918098ms","remote":"127.0.0.1:33776","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":30374,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T05:42:26.55764Z","caller":"traceutil/trace.go:171","msg":"trace[669845116] transaction","detail":"{read_only:false; response_revision:498; number_of_response:1; }","duration":"236.607973ms","start":"2026-04-14T05:42:26.321001Z","end":"2026-04-14T05:42:26.557609Z","steps":["trace[669845116] 'process raft request' (duration: 236.355556ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:26.558527Z","caller":"traceutil/trace.go:171","msg":"trace[2124828192] transaction","detail":"{read_only:false; response_revision:499; number_of_response:1; }","duration":"225.100506ms","start":"2026-04-14T05:42:26.333402Z","end":"2026-04-14T05:42:26.558503Z","steps":["trace[2124828192] 'process raft request' (duration: 224.133341ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:26.559024Z","caller":"traceutil/trace.go:171","msg":"trace[1897017410] transaction","detail":"{read_only:false; response_revision:500; number_of_response:1; }","duration":"215.187761ms","start":"2026-04-14T05:42:26.343819Z","end":"2026-04-14T05:42:26.559006Z","steps":["trace[1897017410] 'process raft request' (duration: 214.503613ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.55928Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"309.790279ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-04-14T05:42:26.559322Z","caller":"traceutil/trace.go:171","msg":"trace[57879801] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:501; }","duration":"309.884642ms","start":"2026-04-14T05:42:26.249426Z","end":"2026-04-14T05:42:26.559311Z","steps":["trace[57879801] 'agreement among raft nodes before linearized reading' (duration: 309.78125ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:26.559346Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:26.249403Z","time spent":"309.936163ms","remote":"127.0.0.1:34010","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-04-14T05:42:26.559739Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"238.955433ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/referencegrants.gateway.networking.k8s.io\" ","response":"range_response_count:1 size:6903"} {"level":"info","ts":"2026-04-14T05:42:26.559767Z","caller":"traceutil/trace.go:171","msg":"trace[1941062286] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/referencegrants.gateway.networking.k8s.io; range_end:; response_count:1; response_revision:501; }","duration":"239.000305ms","start":"2026-04-14T05:42:26.320755Z","end":"2026-04-14T05:42:26.559755Z","steps":["trace[1941062286] 'agreement among raft nodes before linearized reading' (duration: 238.893042ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:26.55981Z","caller":"traceutil/trace.go:171","msg":"trace[688508111] transaction","detail":"{read_only:false; response_revision:501; number_of_response:1; }","duration":"162.81833ms","start":"2026-04-14T05:42:26.396975Z","end":"2026-04-14T05:42:26.559793Z","steps":["trace[688508111] 'process raft request' (duration: 161.840535ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:26.818618Z","caller":"traceutil/trace.go:171","msg":"trace[1416974663] transaction","detail":"{read_only:false; response_revision:514; number_of_response:1; }","duration":"177.485919ms","start":"2026-04-14T05:42:26.64108Z","end":"2026-04-14T05:42:26.818566Z","steps":["trace[1416974663] 'process raft request' (duration: 128.652899ms)","trace[1416974663] 'compare' (duration: 48.473711ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:26.818654Z","caller":"traceutil/trace.go:171","msg":"trace[1733433577] transaction","detail":"{read_only:false; response_revision:515; number_of_response:1; }","duration":"166.999168ms","start":"2026-04-14T05:42:26.651628Z","end":"2026-04-14T05:42:26.818627Z","steps":["trace[1733433577] 'process raft request' (duration: 166.878375ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:30.296004Z","caller":"traceutil/trace.go:171","msg":"trace[1271032445] transaction","detail":"{read_only:false; response_revision:564; number_of_response:1; }","duration":"103.092369ms","start":"2026-04-14T05:42:30.192875Z","end":"2026-04-14T05:42:30.295967Z","steps":["trace[1271032445] 'process raft request' (duration: 102.261618ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:30.784484Z","caller":"traceutil/trace.go:171","msg":"trace[752440607] transaction","detail":"{read_only:false; response_revision:568; number_of_response:1; }","duration":"147.281548ms","start":"2026-04-14T05:42:30.637177Z","end":"2026-04-14T05:42:30.784459Z","steps":["trace[752440607] 'process raft request' (duration: 147.226057ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:30.784781Z","caller":"traceutil/trace.go:171","msg":"trace[1755540184] transaction","detail":"{read_only:false; response_revision:567; number_of_response:1; }","duration":"149.112186ms","start":"2026-04-14T05:42:30.635637Z","end":"2026-04-14T05:42:30.784749Z","steps":["trace[1755540184] 'process raft request' (duration: 141.530661ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:33.627562Z","caller":"traceutil/trace.go:171","msg":"trace[1010270381] linearizableReadLoop","detail":"{readStateIndex:605; appliedIndex:604; }","duration":"187.064056ms","start":"2026-04-14T05:42:33.440444Z","end":"2026-04-14T05:42:33.627509Z","steps":["trace[1010270381] 'read index received' (duration: 186.135572ms)","trace[1010270381] 'applied index is now lower than readState.Index' (duration: 927.094µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:33.627638Z","caller":"traceutil/trace.go:171","msg":"trace[1774781502] transaction","detail":"{read_only:false; response_revision:587; number_of_response:1; }","duration":"188.326687ms","start":"2026-04-14T05:42:33.439292Z","end":"2026-04-14T05:42:33.627619Z","steps":["trace[1774781502] 'process raft request' (duration: 187.528137ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:33.627754Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"187.278161ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:33.629308Z","caller":"traceutil/trace.go:171","msg":"trace[997023126] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:587; }","duration":"188.884003ms","start":"2026-04-14T05:42:33.4404Z","end":"2026-04-14T05:42:33.629284Z","steps":["trace[997023126] 'agreement among raft nodes before linearized reading' (duration: 187.279731ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:33.630519Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.898807ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:33.631515Z","caller":"traceutil/trace.go:171","msg":"trace[698373960] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:587; }","duration":"190.162475ms","start":"2026-04-14T05:42:33.440486Z","end":"2026-04-14T05:42:33.630649Z","steps":["trace[698373960] 'agreement among raft nodes before linearized reading' (duration: 189.470498ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:33.632461Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.995019ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T05:42:33.632478Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.700388ms","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":"info","ts":"2026-04-14T05:42:33.632546Z","caller":"traceutil/trace.go:171","msg":"trace[661701783] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:587; }","duration":"157.085502ms","start":"2026-04-14T05:42:33.475423Z","end":"2026-04-14T05:42:33.632508Z","steps":["trace[661701783] 'agreement among raft nodes before linearized reading' (duration: 156.989349ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:33.632552Z","caller":"traceutil/trace.go:171","msg":"trace[1862824410] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:587; }","duration":"164.843822ms","start":"2026-04-14T05:42:33.467678Z","end":"2026-04-14T05:42:33.632521Z","steps":["trace[1862824410] 'agreement among raft nodes before linearized reading' (duration: 164.427521ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:33.633203Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.440127ms","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":"info","ts":"2026-04-14T05:42:33.633274Z","caller":"traceutil/trace.go:171","msg":"trace[708800876] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:587; }","duration":"165.52892ms","start":"2026-04-14T05:42:33.467723Z","end":"2026-04-14T05:42:33.633252Z","steps":["trace[708800876] 'agreement among raft nodes before linearized reading' (duration: 165.402546ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:33.633634Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.982566ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:33.633727Z","caller":"traceutil/trace.go:171","msg":"trace[1268014743] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:587; }","duration":"191.087689ms","start":"2026-04-14T05:42:33.442598Z","end":"2026-04-14T05:42:33.633685Z","steps":["trace[1268014743] 'agreement among raft nodes before linearized reading' (duration: 190.972616ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:33.630558Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.000927ms","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-04-14T05:42:33.63402Z","caller":"traceutil/trace.go:171","msg":"trace[1701348946] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:587; }","duration":"165.474478ms","start":"2026-04-14T05:42:33.468511Z","end":"2026-04-14T05:42:33.633985Z","steps":["trace[1701348946] 'agreement among raft nodes before linearized reading' (duration: 161.983518ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:34.096151Z","caller":"traceutil/trace.go:171","msg":"trace[277302113] linearizableReadLoop","detail":"{readStateIndex:606; appliedIndex:605; }","duration":"322.035526ms","start":"2026-04-14T05:42:33.774095Z","end":"2026-04-14T05:42:34.096131Z","steps":["trace[277302113] 'read index received' (duration: 321.814189ms)","trace[277302113] 'applied index is now lower than readState.Index' (duration: 219.577µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:34.09625Z","caller":"traceutil/trace.go:171","msg":"trace[626343608] transaction","detail":"{read_only:false; response_revision:588; number_of_response:1; }","duration":"403.767924ms","start":"2026-04-14T05:42:33.692455Z","end":"2026-04-14T05:42:34.096222Z","steps":["trace[626343608] 'process raft request' (duration: 403.491586ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.096403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"322.283102ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.097316Z","caller":"traceutil/trace.go:171","msg":"trace[1128330249] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:588; }","duration":"323.256097ms","start":"2026-04-14T05:42:33.774048Z","end":"2026-04-14T05:42:34.097304Z","steps":["trace[1128330249] 'agreement among raft nodes before linearized reading' (duration: 322.266302ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.09736Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:33.774003Z","time spent":"323.346699ms","remote":"127.0.0.1:55288","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 "} {"level":"warn","ts":"2026-04-14T05:42:34.096399Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:33.6924Z","time spent":"403.922589ms","remote":"127.0.0.1:33988","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-14T05:42:34.096573Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"322.360844ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.097512Z","caller":"traceutil/trace.go:171","msg":"trace[1465805645] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:588; }","duration":"323.33841ms","start":"2026-04-14T05:42:33.774158Z","end":"2026-04-14T05:42:34.097497Z","steps":["trace[1465805645] 'agreement among raft nodes before linearized reading' (duration: 322.330524ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.097568Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:33.774142Z","time spent":"323.410651ms","remote":"127.0.0.1:55288","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true "} {"level":"warn","ts":"2026-04-14T05:42:34.096639Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.697552ms","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":"warn","ts":"2026-04-14T05:42:34.096699Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.196834ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.097875Z","caller":"traceutil/trace.go:171","msg":"trace[802868219] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:588; }","duration":"201.374354ms","start":"2026-04-14T05:42:33.896486Z","end":"2026-04-14T05:42:34.09786Z","steps":["trace[802868219] 'agreement among raft nodes before linearized reading' (duration: 200.190824ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.096691Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.634781ms","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-04-14T05:42:34.097997Z","caller":"traceutil/trace.go:171","msg":"trace[2052369704] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:588; }","duration":"183.986605ms","start":"2026-04-14T05:42:33.913998Z","end":"2026-04-14T05:42:34.097984Z","steps":["trace[2052369704] 'agreement among raft nodes before linearized reading' (duration: 182.59181ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.096743Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.933352ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.098075Z","caller":"traceutil/trace.go:171","msg":"trace[419126900] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:588; }","duration":"202.270117ms","start":"2026-04-14T05:42:33.89579Z","end":"2026-04-14T05:42:34.09806Z","steps":["trace[419126900] 'agreement among raft nodes before linearized reading' (duration: 200.928853ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:34.097814Z","caller":"traceutil/trace.go:171","msg":"trace[1005727386] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:588; }","duration":"183.877323ms","start":"2026-04-14T05:42:33.91392Z","end":"2026-04-14T05:42:34.097797Z","steps":["trace[1005727386] 'agreement among raft nodes before linearized reading' (duration: 182.691513ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.096788Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.008134ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.098187Z","caller":"traceutil/trace.go:171","msg":"trace[1509509559] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:588; }","duration":"202.430121ms","start":"2026-04-14T05:42:33.895744Z","end":"2026-04-14T05:42:34.098174Z","steps":["trace[1509509559] 'agreement among raft nodes before linearized reading' (duration: 201.018585ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.096865Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.737409ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.098263Z","caller":"traceutil/trace.go:171","msg":"trace[1302507575] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:588; }","duration":"230.150126ms","start":"2026-04-14T05:42:33.868091Z","end":"2026-04-14T05:42:34.098241Z","steps":["trace[1302507575] 'agreement among raft nodes before linearized reading' (duration: 228.718359ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.096906Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.936044ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.098345Z","caller":"traceutil/trace.go:171","msg":"trace[1828260711] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:588; }","duration":"230.382382ms","start":"2026-04-14T05:42:33.867945Z","end":"2026-04-14T05:42:34.098328Z","steps":["trace[1828260711] 'agreement among raft nodes before linearized reading' (duration: 228.937745ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.096947Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"263.549327ms","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-04-14T05:42:34.098436Z","caller":"traceutil/trace.go:171","msg":"trace[590733700] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:588; }","duration":"265.061395ms","start":"2026-04-14T05:42:33.833364Z","end":"2026-04-14T05:42:34.098425Z","steps":["trace[590733700] 'agreement among raft nodes before linearized reading' (duration: 263.559787ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.09697Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"279.91838ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.098556Z","caller":"traceutil/trace.go:171","msg":"trace[1508704975] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:588; }","duration":"281.520791ms","start":"2026-04-14T05:42:33.817028Z","end":"2026-04-14T05:42:34.098549Z","steps":["trace[1508704975] 'agreement among raft nodes before linearized reading' (duration: 279.906699ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.096988Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"279.96008ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.09867Z","caller":"traceutil/trace.go:171","msg":"trace[628369844] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:588; }","duration":"281.653084ms","start":"2026-04-14T05:42:33.81701Z","end":"2026-04-14T05:42:34.098663Z","steps":["trace[628369844] 'agreement among raft nodes before linearized reading' (duration: 279.955441ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.097009Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.43627ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.098736Z","caller":"traceutil/trace.go:171","msg":"trace[671510555] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:588; }","duration":"126.176614ms","start":"2026-04-14T05:42:33.972553Z","end":"2026-04-14T05:42:34.098729Z","steps":["trace[671510555] 'agreement among raft nodes before linearized reading' (duration: 124.43363ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.097028Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"263.63083ms","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-04-14T05:42:34.098809Z","caller":"traceutil/trace.go:171","msg":"trace[457561719] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:588; }","duration":"265.448996ms","start":"2026-04-14T05:42:33.833349Z","end":"2026-04-14T05:42:34.098798Z","steps":["trace[457561719] 'agreement among raft nodes before linearized reading' (duration: 263.65326ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.097044Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.928252ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.098899Z","caller":"traceutil/trace.go:171","msg":"trace[1872677494] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:588; }","duration":"126.787701ms","start":"2026-04-14T05:42:33.972095Z","end":"2026-04-14T05:42:34.098882Z","steps":["trace[1872677494] 'agreement among raft nodes before linearized reading' (duration: 124.933163ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.097043Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"280.046813ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/udproutes/\" range_end:\"/registry/gateway.networking.k8s.io/udproutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.098997Z","caller":"traceutil/trace.go:171","msg":"trace[1115342545] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/udproutes/; range_end:/registry/gateway.networking.k8s.io/udproutes0; response_count:0; response_revision:588; }","duration":"282.032725ms","start":"2026-04-14T05:42:33.816954Z","end":"2026-04-14T05:42:34.098987Z","steps":["trace[1115342545] 'agreement among raft nodes before linearized reading' (duration: 280.058443ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.097076Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.998664ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:34.099118Z","caller":"traceutil/trace.go:171","msg":"trace[1454539619] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:588; }","duration":"127.032567ms","start":"2026-04-14T05:42:33.972069Z","end":"2026-04-14T05:42:34.099101Z","steps":["trace[1454539619] 'agreement among raft nodes before linearized reading' (duration: 124.989644ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.097075Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"264.39627ms","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-04-14T05:42:34.099208Z","caller":"traceutil/trace.go:171","msg":"trace[1284643520] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:588; }","duration":"266.555116ms","start":"2026-04-14T05:42:33.832635Z","end":"2026-04-14T05:42:34.09919Z","steps":["trace[1284643520] 'agreement among raft nodes before linearized reading' (duration: 264.41616ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:34.097111Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.907552ms","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-04-14T05:42:34.099296Z","caller":"traceutil/trace.go:171","msg":"trace[372205719] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoypatchpolicies/; range_end:/registry/gateway.envoyproxy.io/envoypatchpolicies0; response_count:0; response_revision:588; }","duration":"184.135369ms","start":"2026-04-14T05:42:33.91515Z","end":"2026-04-14T05:42:34.099285Z","steps":["trace[372205719] 'agreement among raft nodes before linearized reading' (duration: 181.940402ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:35.132819Z","caller":"traceutil/trace.go:171","msg":"trace[691348618] linearizableReadLoop","detail":"{readStateIndex:608; appliedIndex:607; }","duration":"452.805289ms","start":"2026-04-14T05:42:34.679983Z","end":"2026-04-14T05:42:35.132789Z","steps":["trace[691348618] 'read index received' (duration: 384.900377ms)","trace[691348618] 'applied index is now lower than readState.Index' (duration: 67.903452ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:35.132932Z","caller":"traceutil/trace.go:171","msg":"trace[928245466] transaction","detail":"{read_only:false; response_revision:590; number_of_response:1; }","duration":"992.49933ms","start":"2026-04-14T05:42:34.140397Z","end":"2026-04-14T05:42:35.132897Z","steps":["trace[928245466] 'process raft request' (duration: 924.536466ms)","trace[928245466] 'compare' (duration: 67.509031ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:42:35.133038Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"453.043935ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-14T05:42:35.133074Z","caller":"traceutil/trace.go:171","msg":"trace[1101837778] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:590; }","duration":"453.144108ms","start":"2026-04-14T05:42:34.679918Z","end":"2026-04-14T05:42:35.133063Z","steps":["trace[1101837778] 'agreement among raft nodes before linearized reading' (duration: 453.009044ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:35.133108Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:34.679892Z","time spent":"453.20737ms","remote":"127.0.0.1:34010","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-04-14T05:42:35.133142Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:34.140371Z","time spent":"992.690135ms","remote":"127.0.0.1:33942","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2735,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-14T05:42:35.133403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.462753ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"warn","ts":"2026-04-14T05:42:35.13359Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.183927ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T05:42:35.133619Z","caller":"traceutil/trace.go:171","msg":"trace[97595204] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:590; }","duration":"330.234548ms","start":"2026-04-14T05:42:34.803376Z","end":"2026-04-14T05:42:35.13361Z","steps":["trace[97595204] 'agreement among raft nodes before linearized reading' (duration: 330.080034ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:35.133642Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:34.803368Z","time spent":"330.269718ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-04-14T05:42:35.133727Z","caller":"traceutil/trace.go:171","msg":"trace[1243976743] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:590; }","duration":"330.749281ms","start":"2026-04-14T05:42:34.802849Z","end":"2026-04-14T05:42:35.133598Z","steps":["trace[1243976743] 'agreement among raft nodes before linearized reading' (duration: 330.376602ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:35.133834Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:34.802816Z","time spent":"331.001797ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-04-14T05:42:36.86103Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"160.084439ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:42:36.861145Z","caller":"traceutil/trace.go:171","msg":"trace[658855118] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumendpoints.cilium.io; range_end:; response_count:0; response_revision:629; }","duration":"160.223354ms","start":"2026-04-14T05:42:36.700896Z","end":"2026-04-14T05:42:36.86112Z","steps":["trace[658855118] 'range keys from in-memory index tree' (duration: 159.978656ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:39.450668Z","caller":"traceutil/trace.go:171","msg":"trace[1903808913] transaction","detail":"{read_only:false; response_revision:663; number_of_response:1; }","duration":"112.035279ms","start":"2026-04-14T05:42:39.338601Z","end":"2026-04-14T05:42:39.450636Z","steps":["trace[1903808913] 'process raft request' (duration: 111.67777ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:39.889685Z","caller":"traceutil/trace.go:171","msg":"trace[477834488] transaction","detail":"{read_only:false; response_revision:668; number_of_response:1; }","duration":"156.553478ms","start":"2026-04-14T05:42:39.733099Z","end":"2026-04-14T05:42:39.889653Z","steps":["trace[477834488] 'process raft request' (duration: 80.524006ms)","trace[477834488] 'compare' (duration: 75.843487ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:46.63636Z","caller":"traceutil/trace.go:171","msg":"trace[1178398118] transaction","detail":"{read_only:false; response_revision:723; number_of_response:1; }","duration":"120.840687ms","start":"2026-04-14T05:42:46.515494Z","end":"2026-04-14T05:42:46.636335Z","steps":["trace[1178398118] 'process raft request' (duration: 120.651462ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:46.810119Z","caller":"traceutil/trace.go:171","msg":"trace[336756287] transaction","detail":"{read_only:false; response_revision:726; number_of_response:1; }","duration":"164.049743ms","start":"2026-04-14T05:42:46.646042Z","end":"2026-04-14T05:42:46.810092Z","steps":["trace[336756287] 'process raft request' (duration: 163.95577ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:46.810126Z","caller":"traceutil/trace.go:171","msg":"trace[1017773437] transaction","detail":"{read_only:false; response_revision:725; number_of_response:1; }","duration":"166.28975ms","start":"2026-04-14T05:42:46.643816Z","end":"2026-04-14T05:42:46.810106Z","steps":["trace[1017773437] 'process raft request' (duration: 163.168729ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:50.684857Z","caller":"traceutil/trace.go:171","msg":"trace[235601852] linearizableReadLoop","detail":"{readStateIndex:768; appliedIndex:767; }","duration":"475.069743ms","start":"2026-04-14T05:42:50.209761Z","end":"2026-04-14T05:42:50.68483Z","steps":["trace[235601852] 'read index received' (duration: 474.854527ms)","trace[235601852] 'applied index is now lower than readState.Index' (duration: 213.726µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:50.684998Z","caller":"traceutil/trace.go:171","msg":"trace[505053575] transaction","detail":"{read_only:false; response_revision:746; number_of_response:1; }","duration":"538.093378ms","start":"2026-04-14T05:42:50.146893Z","end":"2026-04-14T05:42:50.684986Z","steps":["trace[505053575] 'process raft request' (duration: 537.704818ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:50.685327Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:50.146856Z","time spent":"538.375095ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":520,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T05:42:50.685424Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"274.664293ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-04-14T05:42:50.685528Z","caller":"traceutil/trace.go:171","msg":"trace[983557811] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:746; }","duration":"274.838537ms","start":"2026-04-14T05:42:50.410667Z","end":"2026-04-14T05:42:50.685506Z","steps":["trace[983557811] 'agreement among raft nodes before linearized reading' (duration: 274.57915ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:50.685732Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"475.979895ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-04-14T05:42:50.685767Z","caller":"traceutil/trace.go:171","msg":"trace[1390552049] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:746; }","duration":"476.052988ms","start":"2026-04-14T05:42:50.209702Z","end":"2026-04-14T05:42:50.685755Z","steps":["trace[1390552049] 'agreement among raft nodes before linearized reading' (duration: 475.961386ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:42:50.685796Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:42:50.209672Z","time spent":"476.114619ms","remote":"127.0.0.1:34010","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":"warn","ts":"2026-04-14T05:42:50.686053Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.727956ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-mx46m\" ","response":"range_response_count:1 size:3965"} {"level":"info","ts":"2026-04-14T05:42:50.686104Z","caller":"traceutil/trace.go:171","msg":"trace[1315855338] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-mx46m; range_end:; response_count:1; response_revision:746; }","duration":"190.776107ms","start":"2026-04-14T05:42:50.495311Z","end":"2026-04-14T05:42:50.686087Z","steps":["trace[1315855338] 'agreement among raft nodes before linearized reading' (duration: 190.604623ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:50.858543Z","caller":"traceutil/trace.go:171","msg":"trace[2064703714] transaction","detail":"{read_only:false; response_revision:747; number_of_response:1; }","duration":"166.742187ms","start":"2026-04-14T05:42:50.691258Z","end":"2026-04-14T05:42:50.858Z","steps":["trace[2064703714] 'process raft request' (duration: 155.88441ms)","trace[2064703714] 'compare' (duration: 10.685883ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:42:50.859585Z","caller":"traceutil/trace.go:171","msg":"trace[1298522846] transaction","detail":"{read_only:false; response_revision:749; number_of_response:1; }","duration":"164.690314ms","start":"2026-04-14T05:42:50.694884Z","end":"2026-04-14T05:42:50.859574Z","steps":["trace[1298522846] 'process raft request' (duration: 164.650043ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:42:50.859784Z","caller":"traceutil/trace.go:171","msg":"trace[900911648] transaction","detail":"{read_only:false; response_revision:748; number_of_response:1; }","duration":"168.43747ms","start":"2026-04-14T05:42:50.691296Z","end":"2026-04-14T05:42:50.859734Z","steps":["trace[900911648] 'process raft request' (duration: 168.170773ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:43:54.0943Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":3415872060607282946,"retry-timeout":"500ms"} {"level":"info","ts":"2026-04-14T05:43:54.112024Z","caller":"traceutil/trace.go:171","msg":"trace[2129372216] transaction","detail":"{read_only:false; response_revision:1056; number_of_response:1; }","duration":"549.649404ms","start":"2026-04-14T05:43:53.562341Z","end":"2026-04-14T05:43:54.111991Z","steps":["trace[2129372216] 'process raft request' (duration: 548.786681ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:43:54.112355Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:43:53.562316Z","time spent":"549.9016ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T05:43:54.250569Z","caller":"traceutil/trace.go:171","msg":"trace[259811410] linearizableReadLoop","detail":"{readStateIndex:1093; appliedIndex:1091; }","duration":"656.833731ms","start":"2026-04-14T05:43:53.593701Z","end":"2026-04-14T05:43:54.250534Z","steps":["trace[259811410] 'read index received' (duration: 517.455573ms)","trace[259811410] 'applied index is now lower than readState.Index' (duration: 139.376828ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:43:54.250726Z","caller":"traceutil/trace.go:171","msg":"trace[723206874] transaction","detail":"{read_only:false; response_revision:1057; number_of_response:1; }","duration":"283.471407ms","start":"2026-04-14T05:43:53.96724Z","end":"2026-04-14T05:43:54.250712Z","steps":["trace[723206874] 'process raft request' (duration: 270.948348ms)","trace[723206874] 'compare' (duration: 12.199551ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:43:54.250952Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"640.053625ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"warn","ts":"2026-04-14T05:43:54.251013Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"657.291483ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T05:43:54.251085Z","caller":"traceutil/trace.go:171","msg":"trace[238991448] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1057; }","duration":"640.250319ms","start":"2026-04-14T05:43:53.610804Z","end":"2026-04-14T05:43:54.251055Z","steps":["trace[238991448] 'agreement among raft nodes before linearized reading' (duration: 639.950722ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:43:54.251111Z","caller":"traceutil/trace.go:171","msg":"trace[1659581819] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1057; }","duration":"657.438317ms","start":"2026-04-14T05:43:53.593648Z","end":"2026-04-14T05:43:54.251086Z","steps":["trace[1659581819] 'agreement among raft nodes before linearized reading' (duration: 657.127739ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:43:54.251172Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:43:53.593631Z","time spent":"657.524569ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-04-14T05:43:54.251163Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:43:53.610776Z","time spent":"640.370603ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-04-14T05:43:55.46295Z","caller":"traceutil/trace.go:171","msg":"trace[1007468485] transaction","detail":"{read_only:false; response_revision:1061; number_of_response:1; }","duration":"165.648315ms","start":"2026-04-14T05:43:55.297267Z","end":"2026-04-14T05:43:55.462915Z","steps":["trace[1007468485] 'process raft request' (duration: 156.115205ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:43:56.694887Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.221719ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-14T05:43:56.695063Z","caller":"traceutil/trace.go:171","msg":"trace[1899563559] linearizableReadLoop","detail":"{readStateIndex:1099; appliedIndex:1098; }","duration":"418.500743ms","start":"2026-04-14T05:43:56.276538Z","end":"2026-04-14T05:43:56.695039Z","steps":["trace[1899563559] 'read index received' (duration: 119.988087ms)","trace[1899563559] 'applied index is now lower than readState.Index' (duration: 298.510986ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:43:56.695233Z","caller":"traceutil/trace.go:171","msg":"trace[1307944582] transaction","detail":"{read_only:false; response_revision:1063; number_of_response:1; }","duration":"433.86011ms","start":"2026-04-14T05:43:56.261313Z","end":"2026-04-14T05:43:56.695173Z","steps":["trace[1307944582] 'process raft request' (duration: 135.21946ms)","trace[1307944582] 'compare' (duration: 298.052254ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:43:56.69538Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"218.844593ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:43:56.695449Z","caller":"traceutil/trace.go:171","msg":"trace[1097122706] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1063; }","duration":"218.971676ms","start":"2026-04-14T05:43:56.476461Z","end":"2026-04-14T05:43:56.695432Z","steps":["trace[1097122706] 'agreement among raft nodes before linearized reading' (duration: 218.825692ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:43:56.695472Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"418.929544ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-04-14T05:43:56.695533Z","caller":"traceutil/trace.go:171","msg":"trace[2115745336] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1063; }","duration":"419.035707ms","start":"2026-04-14T05:43:56.27648Z","end":"2026-04-14T05:43:56.695516Z","steps":["trace[2115745336] 'agreement among raft nodes before linearized reading' (duration: 418.73743ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:43:56.695478Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"411.110117ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"warn","ts":"2026-04-14T05:43:56.695594Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:43:56.27645Z","time spent":"419.12987ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-04-14T05:43:56.695631Z","caller":"traceutil/trace.go:171","msg":"trace[890089952] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1063; }","duration":"411.301802ms","start":"2026-04-14T05:43:56.2843Z","end":"2026-04-14T05:43:56.695602Z","steps":["trace[890089952] 'agreement among raft nodes before linearized reading' (duration: 410.965254ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:43:56.695695Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:43:56.28429Z","time spent":"411.393964ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-04-14T05:43:56.695795Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:43:56.261281Z","time spent":"434.110616ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T05:43:56.904386Z","caller":"traceutil/trace.go:171","msg":"trace[1468867400] transaction","detail":"{read_only:false; response_revision:1065; number_of_response:1; }","duration":"203.62931ms","start":"2026-04-14T05:43:56.700704Z","end":"2026-04-14T05:43:56.904333Z","steps":["trace[1468867400] 'process raft request' (duration: 130.706566ms)","trace[1468867400] 'compare' (duration: 72.734079ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:43:58.743517Z","caller":"traceutil/trace.go:171","msg":"trace[1079313721] transaction","detail":"{read_only:false; response_revision:1070; number_of_response:1; }","duration":"120.8893ms","start":"2026-04-14T05:43:58.622599Z","end":"2026-04-14T05:43:58.743488Z","steps":["trace[1079313721] 'process raft request' (duration: 120.700845ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:11.149587Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"166.890306ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-14T05:44:11.15001Z","caller":"traceutil/trace.go:171","msg":"trace[1061052434] transaction","detail":"{read_only:false; response_revision:1162; number_of_response:1; }","duration":"242.079517ms","start":"2026-04-14T05:44:10.907898Z","end":"2026-04-14T05:44:11.149978Z","steps":["trace[1061052434] 'process raft request' (duration: 74.694228ms)","trace[1061052434] 'compare' (duration: 166.513436ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:44:12.73729Z","caller":"traceutil/trace.go:171","msg":"trace[835261213] transaction","detail":"{read_only:false; response_revision:1166; number_of_response:1; }","duration":"566.939565ms","start":"2026-04-14T05:44:12.170331Z","end":"2026-04-14T05:44:12.737271Z","steps":["trace[835261213] 'process raft request' (duration: 566.268168ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:12.73741Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:12.170309Z","time spent":"567.039318ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":520,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T05:44:12.738038Z","caller":"traceutil/trace.go:171","msg":"trace[1886309111] linearizableReadLoop","detail":"{readStateIndex:1207; appliedIndex:1207; }","duration":"420.111983ms","start":"2026-04-14T05:44:12.3179Z","end":"2026-04-14T05:44:12.738012Z","steps":["trace[1886309111] 'read index received' (duration: 420.098713ms)","trace[1886309111] 'applied index is now lower than readState.Index' (duration: 10.56µs)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:44:12.738238Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"420.331068ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"info","ts":"2026-04-14T05:44:12.738265Z","caller":"traceutil/trace.go:171","msg":"trace[401580895] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1166; }","duration":"420.375201ms","start":"2026-04-14T05:44:12.317882Z","end":"2026-04-14T05:44:12.738257Z","steps":["trace[401580895] 'agreement among raft nodes before linearized reading' (duration: 420.237707ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:12.738294Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:12.317816Z","time spent":"420.472983ms","remote":"127.0.0.1:34010","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-04-14T05:44:12.747304Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.91627ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-04-14T05:44:12.747361Z","caller":"traceutil/trace.go:171","msg":"trace[381272852] range","detail":"{range_begin:/registry/clusterrolebindings/; range_end:/registry/clusterrolebindings0; response_count:0; response_revision:1167; }","duration":"151.985862ms","start":"2026-04-14T05:44:12.595363Z","end":"2026-04-14T05:44:12.747348Z","steps":["trace[381272852] 'agreement among raft nodes before linearized reading' (duration: 151.850508ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:29.343347Z","caller":"traceutil/trace.go:171","msg":"trace[1580900051] transaction","detail":"{read_only:false; response_revision:1240; number_of_response:1; }","duration":"361.951371ms","start":"2026-04-14T05:44:28.981369Z","end":"2026-04-14T05:44:29.34332Z","steps":["trace[1580900051] 'process raft request' (duration: 361.754056ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:29.343506Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:28.98136Z","time spent":"362.060993ms","remote":"127.0.0.1:34248","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9375,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T05:44:29.799706Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"293.166732ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-04-14T05:44:29.799796Z","caller":"traceutil/trace.go:171","msg":"trace[268041395] linearizableReadLoop","detail":"{readStateIndex:1286; appliedIndex:1284; }","duration":"565.753465ms","start":"2026-04-14T05:44:29.234028Z","end":"2026-04-14T05:44:29.799781Z","steps":["trace[268041395] 'read index received' (duration: 109.038971ms)","trace[268041395] 'applied index is now lower than readState.Index' (duration: 456.713684ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:44:29.79986Z","caller":"traceutil/trace.go:171","msg":"trace[1340826606] transaction","detail":"{read_only:false; response_revision:1241; number_of_response:1; }","duration":"697.18319ms","start":"2026-04-14T05:44:29.102629Z","end":"2026-04-14T05:44:29.799813Z","steps":["trace[1340826606] 'process raft request' (duration: 403.845844ms)","trace[1340826606] 'compare' (duration: 292.883245ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:44:29.799921Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"565.899069ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-04-14T05:44:29.799942Z","caller":"traceutil/trace.go:171","msg":"trace[196230651] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1241; }","duration":"565.95908ms","start":"2026-04-14T05:44:29.233977Z","end":"2026-04-14T05:44:29.799936Z","steps":["trace[196230651] 'agreement among raft nodes before linearized reading' (duration: 565.865388ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:29.799959Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:29.233962Z","time spent":"565.993962ms","remote":"127.0.0.1:34010","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-04-14T05:44:29.800014Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:29.102596Z","time spent":"697.336354ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":672,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-14T05:44:29.800092Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"563.034987ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-04-14T05:44:29.800174Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"317.281458ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-14T05:44:29.800179Z","caller":"traceutil/trace.go:171","msg":"trace[745319648] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1241; }","duration":"563.1439ms","start":"2026-04-14T05:44:29.237012Z","end":"2026-04-14T05:44:29.800156Z","steps":["trace[745319648] 'agreement among raft nodes before linearized reading' (duration: 562.899024ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:29.800225Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:29.237005Z","time spent":"563.213161ms","remote":"127.0.0.1:34010","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":"info","ts":"2026-04-14T05:44:29.800194Z","caller":"traceutil/trace.go:171","msg":"trace[1304138424] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1241; }","duration":"317.331268ms","start":"2026-04-14T05:44:29.482858Z","end":"2026-04-14T05:44:29.800189Z","steps":["trace[1304138424] 'agreement among raft nodes before linearized reading' (duration: 317.279177ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:29.80033Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:29.48284Z","time spent":"317.486623ms","remote":"127.0.0.1:34010","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":"warn","ts":"2026-04-14T05:44:29.800331Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"324.471659ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:44:29.80037Z","caller":"traceutil/trace.go:171","msg":"trace[1989328030] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1241; }","duration":"324.549081ms","start":"2026-04-14T05:44:29.47581Z","end":"2026-04-14T05:44:29.800359Z","steps":["trace[1989328030] 'agreement among raft nodes before linearized reading' (duration: 324.479799ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:29.8004Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:29.475791Z","time spent":"324.602853ms","remote":"127.0.0.1:33724","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-04-14T05:44:29.948044Z","caller":"traceutil/trace.go:171","msg":"trace[254630488] transaction","detail":"{read_only:false; response_revision:1245; number_of_response:1; }","duration":"140.594125ms","start":"2026-04-14T05:44:29.807424Z","end":"2026-04-14T05:44:29.948018Z","steps":["trace[254630488] 'process raft request' (duration: 140.546934ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:29.948144Z","caller":"traceutil/trace.go:171","msg":"trace[433541336] transaction","detail":"{read_only:false; response_revision:1243; number_of_response:1; }","duration":"140.77801ms","start":"2026-04-14T05:44:29.807331Z","end":"2026-04-14T05:44:29.948109Z","steps":["trace[433541336] 'process raft request' (duration: 137.510478ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:29.948409Z","caller":"traceutil/trace.go:171","msg":"trace[237883704] transaction","detail":"{read_only:false; response_revision:1244; number_of_response:1; }","duration":"141.049636ms","start":"2026-04-14T05:44:29.807348Z","end":"2026-04-14T05:44:29.948398Z","steps":["trace[237883704] 'process raft request' (duration: 140.583285ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:30.524529Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"183.052114ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:44:30.52504Z","caller":"traceutil/trace.go:171","msg":"trace[1309932180] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:0; response_revision:1247; }","duration":"183.662439ms","start":"2026-04-14T05:44:30.34135Z","end":"2026-04-14T05:44:30.525012Z","steps":["trace[1309932180] 'range keys from in-memory index tree' (duration: 182.961652ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:31.017695Z","caller":"traceutil/trace.go:171","msg":"trace[632041046] transaction","detail":"{read_only:false; response_revision:1248; number_of_response:1; }","duration":"484.800121ms","start":"2026-04-14T05:44:30.532866Z","end":"2026-04-14T05:44:31.017667Z","steps":["trace[632041046] 'process raft request' (duration: 484.636127ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:31.01786Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:30.532836Z","time spent":"484.944493ms","remote":"127.0.0.1:33816","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":788,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-14T05:44:31.260286Z","caller":"traceutil/trace.go:171","msg":"trace[2089192944] linearizableReadLoop","detail":"{readStateIndex:1294; appliedIndex:1292; }","duration":"430.645528ms","start":"2026-04-14T05:44:30.829621Z","end":"2026-04-14T05:44:31.260266Z","steps":["trace[2089192944] 'read index received' (duration: 187.871154ms)","trace[2089192944] 'applied index is now lower than readState.Index' (duration: 242.773554ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:44:31.260327Z","caller":"traceutil/trace.go:171","msg":"trace[27953829] transaction","detail":"{read_only:false; response_revision:1249; number_of_response:1; }","duration":"726.62409ms","start":"2026-04-14T05:44:30.533651Z","end":"2026-04-14T05:44:31.260275Z","steps":["trace[27953829] 'process raft request' (duration: 705.1402ms)","trace[27953829] 'compare' (duration: 21.184033ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:44:31.260326Z","caller":"traceutil/trace.go:171","msg":"trace[46214559] transaction","detail":"{read_only:false; response_revision:1250; number_of_response:1; }","duration":"284.511084ms","start":"2026-04-14T05:44:30.975788Z","end":"2026-04-14T05:44:31.260299Z","steps":["trace[46214559] 'process raft request' (duration: 284.433682ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:31.26046Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"430.817402ms","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-04-14T05:44:31.260464Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:30.533627Z","time spent":"726.776664ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":459,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-14T05:44:31.260487Z","caller":"traceutil/trace.go:171","msg":"trace[1097324604] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1250; }","duration":"430.864963ms","start":"2026-04-14T05:44:30.829614Z","end":"2026-04-14T05:44:31.260479Z","steps":["trace[1097324604] 'agreement among raft nodes before linearized reading' (duration: 430.73696ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:31.260513Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:30.829593Z","time spent":"430.914364ms","remote":"127.0.0.1:34010","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":"info","ts":"2026-04-14T05:44:31.289042Z","caller":"traceutil/trace.go:171","msg":"trace[1524788128] transaction","detail":"{read_only:false; response_revision:1251; number_of_response:1; }","duration":"266.978813ms","start":"2026-04-14T05:44:31.022044Z","end":"2026-04-14T05:44:31.289023Z","steps":["trace[1524788128] 'process raft request' (duration: 266.8777ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:31.682418Z","caller":"traceutil/trace.go:171","msg":"trace[331428433] transaction","detail":"{read_only:false; response_revision:1254; number_of_response:1; }","duration":"317.130454ms","start":"2026-04-14T05:44:31.365264Z","end":"2026-04-14T05:44:31.682395Z","steps":["trace[331428433] 'process raft request' (duration: 225.858189ms)","trace[331428433] 'compare' (duration: 91.133812ms)"],"step_count":2} {"level":"warn","ts":"2026-04-14T05:44:31.682535Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.398579ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-04-14T05:44:31.682561Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:31.365235Z","time spent":"317.251637ms","remote":"127.0.0.1:34010","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":458,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-04-14T05:44:31.682399Z","caller":"traceutil/trace.go:171","msg":"trace[1598871359] linearizableReadLoop","detail":"{readStateIndex:1299; appliedIndex:1298; }","duration":"208.238506ms","start":"2026-04-14T05:44:31.474134Z","end":"2026-04-14T05:44:31.682372Z","steps":["trace[1598871359] 'read index received' (duration: 117.002651ms)","trace[1598871359] 'applied index is now lower than readState.Index' (duration: 91.234865ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:44:31.682575Z","caller":"traceutil/trace.go:171","msg":"trace[2146620967] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1254; }","duration":"208.44934ms","start":"2026-04-14T05:44:31.474116Z","end":"2026-04-14T05:44:31.682565Z","steps":["trace[2146620967] 'agreement among raft nodes before linearized reading' (duration: 208.356788ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:31.682764Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"162.129607ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:44:31.682837Z","caller":"traceutil/trace.go:171","msg":"trace[1061411374] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:1254; }","duration":"162.25786ms","start":"2026-04-14T05:44:31.520553Z","end":"2026-04-14T05:44:31.682811Z","steps":["trace[1061411374] 'agreement among raft nodes before linearized reading' (duration: 162.135207ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:32.05559Z","caller":"traceutil/trace.go:171","msg":"trace[1513505194] linearizableReadLoop","detail":"{readStateIndex:1300; appliedIndex:1299; }","duration":"101.922422ms","start":"2026-04-14T05:44:31.953641Z","end":"2026-04-14T05:44:32.055564Z","steps":["trace[1513505194] 'read index received' (duration: 101.767798ms)","trace[1513505194] 'applied index is now lower than readState.Index' (duration: 153.154µs)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:44:32.055661Z","caller":"traceutil/trace.go:171","msg":"trace[205956101] transaction","detail":"{read_only:false; response_revision:1255; number_of_response:1; }","duration":"189.256068ms","start":"2026-04-14T05:44:31.866373Z","end":"2026-04-14T05:44:32.055629Z","steps":["trace[205956101] 'process raft request' (duration: 189.043202ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:32.055845Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.186838ms","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-04-14T05:44:32.055889Z","caller":"traceutil/trace.go:171","msg":"trace[696022060] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1255; }","duration":"102.293972ms","start":"2026-04-14T05:44:31.953584Z","end":"2026-04-14T05:44:32.055878Z","steps":["trace[696022060] 'agreement among raft nodes before linearized reading' (duration: 102.128388ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:32.056076Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.391754ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-04-14T05:44:32.056116Z","caller":"traceutil/trace.go:171","msg":"trace[1451655618] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1255; }","duration":"102.479326ms","start":"2026-04-14T05:44:31.953628Z","end":"2026-04-14T05:44:32.056108Z","steps":["trace[1451655618] 'agreement among raft nodes before linearized reading' (duration: 102.377773ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:32.056081Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.330502ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-04-14T05:44:32.056229Z","caller":"traceutil/trace.go:171","msg":"trace[702931585] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1255; }","duration":"102.565628ms","start":"2026-04-14T05:44:31.953629Z","end":"2026-04-14T05:44:32.056195Z","steps":["trace[702931585] 'agreement among raft nodes before linearized reading' (duration: 102.2678ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:32.163072Z","caller":"traceutil/trace.go:171","msg":"trace[163238446] transaction","detail":"{read_only:false; response_revision:1256; number_of_response:1; }","duration":"102.279802ms","start":"2026-04-14T05:44:32.06076Z","end":"2026-04-14T05:44:32.163039Z","steps":["trace[163238446] 'process raft request' (duration: 84.30655ms)","trace[163238446] 'compare' (duration: 17.822468ms)"],"step_count":2} {"level":"info","ts":"2026-04-14T05:44:32.173483Z","caller":"traceutil/trace.go:171","msg":"trace[2025643939] transaction","detail":"{read_only:false; response_revision:1257; number_of_response:1; }","duration":"112.656922ms","start":"2026-04-14T05:44:32.060798Z","end":"2026-04-14T05:44:32.173454Z","steps":["trace[2025643939] 'process raft request' (duration: 112.442247ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:32.173959Z","caller":"traceutil/trace.go:171","msg":"trace[1100699126] transaction","detail":"{read_only:false; response_revision:1258; number_of_response:1; }","duration":"112.788805ms","start":"2026-04-14T05:44:32.061152Z","end":"2026-04-14T05:44:32.173941Z","steps":["trace[1100699126] 'process raft request' (duration: 112.253412ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:44.307253Z","caller":"traceutil/trace.go:171","msg":"trace[1318203367] transaction","detail":"{read_only:false; response_revision:1338; number_of_response:1; }","duration":"128.575323ms","start":"2026-04-14T05:44:44.178658Z","end":"2026-04-14T05:44:44.307233Z","steps":["trace[1318203367] 'process raft request' (duration: 128.053369ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:44.49663Z","caller":"traceutil/trace.go:171","msg":"trace[915763015] transaction","detail":"{read_only:false; response_revision:1340; number_of_response:1; }","duration":"183.907284ms","start":"2026-04-14T05:44:44.312696Z","end":"2026-04-14T05:44:44.496604Z","steps":["trace[915763015] 'process raft request' (duration: 183.708819ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:44.496981Z","caller":"traceutil/trace.go:171","msg":"trace[92181369] transaction","detail":"{read_only:false; response_revision:1342; number_of_response:1; }","duration":"184.039516ms","start":"2026-04-14T05:44:44.312906Z","end":"2026-04-14T05:44:44.496946Z","steps":["trace[92181369] 'process raft request' (duration: 183.877952ms)"],"step_count":1} {"level":"info","ts":"2026-04-14T05:44:44.497083Z","caller":"traceutil/trace.go:171","msg":"trace[213975130] transaction","detail":"{read_only:false; response_revision:1341; number_of_response:1; }","duration":"184.350894ms","start":"2026-04-14T05:44:44.3127Z","end":"2026-04-14T05:44:44.497051Z","steps":["trace[213975130] 'process raft request' (duration: 183.848412ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:44.986848Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.065199ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com\" ","response":"range_response_count:1 size:535"} {"level":"info","ts":"2026-04-14T05:44:44.986931Z","caller":"traceutil/trace.go:171","msg":"trace[206479075] range","detail":"{range_begin:/registry/leases/kube-system/external-snapshotter-leader-rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1342; }","duration":"153.209292ms","start":"2026-04-14T05:44:44.833704Z","end":"2026-04-14T05:44:44.986913Z","steps":["trace[206479075] 'range keys from in-memory index tree' (duration: 152.858613ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:44.98695Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"315.267817ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-04-14T05:44:44.987053Z","caller":"traceutil/trace.go:171","msg":"trace[816463301] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:1342; }","duration":"315.446621ms","start":"2026-04-14T05:44:44.671586Z","end":"2026-04-14T05:44:44.987032Z","steps":["trace[816463301] 'count revisions from in-memory index tree' (duration: 315.171744ms)"],"step_count":1} {"level":"warn","ts":"2026-04-14T05:44:44.987118Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-14T05:44:44.671565Z","time spent":"315.534413ms","remote":"127.0.0.1:55246","response type":"/etcdserverpb.KV/Range","request count":0,"request size":104,"response count":0,"response size":28,"request content":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" count_only:true "} {"level":"info","ts":"2026-04-14T05:45:37.911411Z","caller":"traceutil/trace.go:171","msg":"trace[451829612] transaction","detail":"{read_only:false; response_revision:1586; number_of_response:1; }","duration":"106.591696ms","start":"2026-04-14T05:45:37.804773Z","end":"2026-04-14T05:45:37.911365Z","steps":["trace[451829612] 'process raft request' (duration: 106.031402ms)"],"step_count":1}