{"level":"warn","ts":"2026-05-13T01:10:27.382333Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-13T01:10:27.382424Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.95: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.95:2380","--initial-cluster=instance=https://199.204.45.95:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.95:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.95: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-05-13T01:10:27.382503Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-13T01:10:27.382515Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.95:2380"]} {"level":"info","ts":"2026-05-13T01:10:27.382533Z","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-05-13T01:10:27.38321Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.95:2379"]} {"level":"info","ts":"2026-05-13T01:10:27.383285Z","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.95:2380"],"listen-peer-urls":["https://199.204.45.95:2380"],"advertise-client-urls":["https://199.204.45.95:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.95:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.95: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-05-13T01:10:27.404045Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"20.520028ms"} {"level":"info","ts":"2026-05-13T01:10:27.417634Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"be773dfc027af3eb","cluster-id":"9ba5fbd7288fd5af"} {"level":"info","ts":"2026-05-13T01:10:27.417745Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb switched to configuration voters=()"} {"level":"info","ts":"2026-05-13T01:10:27.417774Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb became follower at term 0"} {"level":"info","ts":"2026-05-13T01:10:27.417789Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft be773dfc027af3eb [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-13T01:10:27.417799Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb became follower at term 1"} {"level":"info","ts":"2026-05-13T01:10:27.417842Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb switched to configuration voters=(13724506542017541099)"} {"level":"warn","ts":"2026-05-13T01:10:27.430954Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-13T01:10:27.432659Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-13T01:10:27.433748Z","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-05-13T01:10:27.436365Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"be773dfc027af3eb","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-13T01:10:27.436599Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"be773dfc027af3eb","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-13T01:10:27.436687Z","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-05-13T01:10:27.436838Z","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-05-13T01:10:27.436857Z","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-05-13T01:10:27.437684Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb switched to configuration voters=(13724506542017541099)"} {"level":"info","ts":"2026-05-13T01:10:27.437921Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"9ba5fbd7288fd5af","local-member-id":"be773dfc027af3eb","added-peer-id":"be773dfc027af3eb","added-peer-peer-urls":["https://199.204.45.95:2380"]} {"level":"info","ts":"2026-05-13T01:10:27.44261Z","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-05-13T01:10:27.442708Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.95:2380"} {"level":"info","ts":"2026-05-13T01:10:27.442809Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.95:2380"} {"level":"info","ts":"2026-05-13T01:10:27.442927Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"be773dfc027af3eb","initial-advertise-peer-urls":["https://199.204.45.95:2380"],"listen-peer-urls":["https://199.204.45.95:2380"],"advertise-client-urls":["https://199.204.45.95:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.95:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-13T01:10:27.442972Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-13T01:10:27.718995Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb is starting a new election at term 1"} {"level":"info","ts":"2026-05-13T01:10:27.719078Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb became pre-candidate at term 1"} {"level":"info","ts":"2026-05-13T01:10:27.7191Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb received MsgPreVoteResp from be773dfc027af3eb at term 1"} {"level":"info","ts":"2026-05-13T01:10:27.719115Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb became candidate at term 2"} {"level":"info","ts":"2026-05-13T01:10:27.719122Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb received MsgVoteResp from be773dfc027af3eb at term 2"} {"level":"info","ts":"2026-05-13T01:10:27.719132Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"be773dfc027af3eb became leader at term 2"} {"level":"info","ts":"2026-05-13T01:10:27.719141Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: be773dfc027af3eb elected leader be773dfc027af3eb at term 2"} {"level":"info","ts":"2026-05-13T01:10:27.722181Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"be773dfc027af3eb","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.95:2379]}","request-path":"/0/members/be773dfc027af3eb/attributes","cluster-id":"9ba5fbd7288fd5af","publish-timeout":"7s"} {"level":"info","ts":"2026-05-13T01:10:27.722423Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-13T01:10:27.722547Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-13T01:10:27.722594Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-13T01:10:27.723481Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"9ba5fbd7288fd5af","local-member-id":"be773dfc027af3eb","cluster-version":"3.5"} {"level":"info","ts":"2026-05-13T01:10:27.723582Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-13T01:10:27.723615Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-13T01:10:27.725068Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-13T01:10:27.725097Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-13T01:10:27.725891Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-13T01:10:27.732589Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.95:2379"} {"level":"warn","ts":"2026-05-13T01:10:34.452752Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.748133ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/cronjob-controller\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:10:34.452882Z","caller":"traceutil/trace.go:171","msg":"trace[2054404067] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/cronjob-controller; range_end:; response_count:0; response_revision:324; }","duration":"106.93215ms","start":"2026-05-13T01:10:34.345919Z","end":"2026-05-13T01:10:34.452851Z","steps":["trace[2054404067] 'range keys from in-memory index tree' (duration: 106.62958ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:39.888146Z","caller":"traceutil/trace.go:171","msg":"trace[725605757] transaction","detail":"{read_only:false; response_revision:399; number_of_response:1; }","duration":"184.644689ms","start":"2026-05-13T01:10:39.703463Z","end":"2026-05-13T01:10:39.888107Z","steps":["trace[725605757] 'process raft request' (duration: 184.340339ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:39.888282Z","caller":"traceutil/trace.go:171","msg":"trace[1356089997] linearizableReadLoop","detail":"{readStateIndex:414; appliedIndex:413; }","duration":"113.051395ms","start":"2026-05-13T01:10:39.775178Z","end":"2026-05-13T01:10:39.888229Z","steps":["trace[1356089997] 'read index received' (duration: 112.682413ms)","trace[1356089997] 'applied index is now lower than readState.Index' (duration: 359.632µs)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:10:39.888455Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.228732ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/kube-system/coredns\" ","response":"range_response_count:1 size:4056"} {"level":"info","ts":"2026-05-13T01:10:39.888543Z","caller":"traceutil/trace.go:171","msg":"trace[1330831165] range","detail":"{range_begin:/registry/deployments/kube-system/coredns; range_end:; response_count:1; response_revision:399; }","duration":"113.389257ms","start":"2026-05-13T01:10:39.775133Z","end":"2026-05-13T01:10:39.888522Z","steps":["trace[1330831165] 'agreement among raft nodes before linearized reading' (duration: 113.19661ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:40.169802Z","caller":"traceutil/trace.go:171","msg":"trace[114112664] transaction","detail":"{read_only:false; response_revision:407; number_of_response:1; }","duration":"154.939022ms","start":"2026-05-13T01:10:40.014832Z","end":"2026-05-13T01:10:40.169771Z","steps":["trace[114112664] 'process raft request' (duration: 113.11231ms)","trace[114112664] 'compare' (duration: 41.669216ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:10:40.17149Z","caller":"traceutil/trace.go:171","msg":"trace[548552154] transaction","detail":"{read_only:false; response_revision:410; number_of_response:1; }","duration":"155.54284ms","start":"2026-05-13T01:10:40.015909Z","end":"2026-05-13T01:10:40.171452Z","steps":["trace[548552154] 'process raft request' (duration: 155.429797ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:40.17167Z","caller":"traceutil/trace.go:171","msg":"trace[261616766] transaction","detail":"{read_only:false; response_revision:411; number_of_response:1; }","duration":"153.487312ms","start":"2026-05-13T01:10:40.01816Z","end":"2026-05-13T01:10:40.171647Z","steps":["trace[261616766] 'process raft request' (duration: 153.216653ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:40.171791Z","caller":"traceutil/trace.go:171","msg":"trace[1522525243] transaction","detail":"{read_only:false; response_revision:409; number_of_response:1; }","duration":"155.879051ms","start":"2026-05-13T01:10:40.0159Z","end":"2026-05-13T01:10:40.171779Z","steps":["trace[1522525243] 'process raft request' (duration: 155.378375ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:40.171791Z","caller":"traceutil/trace.go:171","msg":"trace[744565185] transaction","detail":"{read_only:false; response_revision:408; number_of_response:1; }","duration":"156.226673ms","start":"2026-05-13T01:10:40.015526Z","end":"2026-05-13T01:10:40.171752Z","steps":["trace[744565185] 'process raft request' (duration: 155.617363ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:51.627704Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":17576315826231401719,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-05-13T01:10:52.128784Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":17576315826231401719,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-05-13T01:10:52.62945Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":17576315826231401719,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-05-13T01:10:53.13059Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":17576315826231401719,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-05-13T01:10:53.407263Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"2.30422198s","expected-duration":"1s"} {"level":"info","ts":"2026-05-13T01:10:53.407588Z","caller":"traceutil/trace.go:171","msg":"trace[1787494370] linearizableReadLoop","detail":"{readStateIndex:475; appliedIndex:474; }","duration":"2.2802802s","start":"2026-05-13T01:10:51.127289Z","end":"2026-05-13T01:10:53.40757Z","steps":["trace[1787494370] 'read index received' (duration: 2.280236269s)","trace[1787494370] 'applied index is now lower than readState.Index' (duration: 43.071µs)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:10:53.407654Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:51.10289Z","time spent":"2.304758256s","remote":"127.0.0.1:54304","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"warn","ts":"2026-05-13T01:10:53.407738Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.935586119s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-05-13T01:10:53.40776Z","caller":"traceutil/trace.go:171","msg":"trace[875698821] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:456; }","duration":"1.935675991s","start":"2026-05-13T01:10:51.472076Z","end":"2026-05-13T01:10:53.407752Z","steps":["trace[875698821] 'agreement among raft nodes before linearized reading' (duration: 1.935606949s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.407783Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:51.472047Z","time spent":"1.935727552s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":462,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-13T01:10:53.4078Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"2.280487796s","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-05-13T01:10:53.40788Z","caller":"traceutil/trace.go:171","msg":"trace[875835607] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:456; }","duration":"2.280634371s","start":"2026-05-13T01:10:51.127219Z","end":"2026-05-13T01:10:53.407853Z","steps":["trace[875835607] 'agreement among raft nodes before linearized reading' (duration: 2.280457876s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.407938Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.051003303s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:10:53.407939Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:51.127157Z","time spent":"2.280769375s","remote":"127.0.0.1:54594","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-05-13T01:10:53.407979Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.331986397s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-05-13T01:10:53.407994Z","caller":"traceutil/trace.go:171","msg":"trace[978481826] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:456; }","duration":"1.33207253s","start":"2026-05-13T01:10:52.075917Z","end":"2026-05-13T01:10:53.40799Z","steps":["trace[978481826] 'agreement among raft nodes before linearized reading' (duration: 1.332047059s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.408007Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:52.075864Z","time spent":"1.332139672s","remote":"127.0.0.1:54594","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-05-13T01:10:53.407954Z","caller":"traceutil/trace.go:171","msg":"trace[692839130] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:456; }","duration":"1.051047494s","start":"2026-05-13T01:10:52.356902Z","end":"2026-05-13T01:10:53.40795Z","steps":["trace[692839130] 'agreement among raft nodes before linearized reading' (duration: 1.051016993s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.408039Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:52.356884Z","time spent":"1.051141577s","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-05-13T01:10:53.408239Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.833149135s","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-05-13T01:10:53.408346Z","caller":"traceutil/trace.go:171","msg":"trace[2054161367] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:456; }","duration":"1.833346851s","start":"2026-05-13T01:10:51.574972Z","end":"2026-05-13T01:10:53.408319Z","steps":["trace[2054161367] 'agreement among raft nodes before linearized reading' (duration: 1.833082194s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.408402Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:51.574953Z","time spent":"1.833436794s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-05-13T01:10:53.858312Z","caller":"traceutil/trace.go:171","msg":"trace[518783816] transaction","detail":"{read_only:false; response_revision:457; number_of_response:1; }","duration":"448.859623ms","start":"2026-05-13T01:10:53.409426Z","end":"2026-05-13T01:10:53.858286Z","steps":["trace[518783816] 'process raft request' (duration: 446.455072ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.859546Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:53.409346Z","time spent":"449.044169ms","remote":"127.0.0.1:54304","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":118,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:10:53.866187Z","caller":"traceutil/trace.go:171","msg":"trace[1895802709] transaction","detail":"{read_only:false; response_revision:458; number_of_response:1; }","duration":"454.462739ms","start":"2026-05-13T01:10:53.411708Z","end":"2026-05-13T01:10:53.866171Z","steps":["trace[1895802709] 'process raft request' (duration: 454.280364ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.866475Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:53.411693Z","time spent":"454.698736ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:10:53.866821Z","caller":"traceutil/trace.go:171","msg":"trace[1735822608] transaction","detail":"{read_only:false; response_revision:461; number_of_response:1; }","duration":"453.935484ms","start":"2026-05-13T01:10:53.412868Z","end":"2026-05-13T01:10:53.866804Z","steps":["trace[1735822608] 'process raft request' (duration: 453.612414ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:53.866877Z","caller":"traceutil/trace.go:171","msg":"trace[1952481217] linearizableReadLoop","detail":"{readStateIndex:480; appliedIndex:475; }","duration":"451.10688ms","start":"2026-05-13T01:10:53.415754Z","end":"2026-05-13T01:10:53.866861Z","steps":["trace[1952481217] 'read index received' (duration: 440.168077ms)","trace[1952481217] 'applied index is now lower than readState.Index' (duration: 10.937833ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:10:53.866534Z","caller":"traceutil/trace.go:171","msg":"trace[1182457941] transaction","detail":"{read_only:false; response_revision:460; number_of_response:1; }","duration":"453.960034ms","start":"2026-05-13T01:10:53.412563Z","end":"2026-05-13T01:10:53.866523Z","steps":["trace[1182457941] 'process raft request' (duration: 453.726218ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.867016Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:53.41254Z","time spent":"454.434049ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:10:53.866328Z","caller":"traceutil/trace.go:171","msg":"trace[517623672] transaction","detail":"{read_only:false; response_revision:459; number_of_response:1; }","duration":"454.026547ms","start":"2026-05-13T01:10:53.412293Z","end":"2026-05-13T01:10:53.86632Z","steps":["trace[517623672] 'process raft request' (duration: 453.828161ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.867149Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:53.412862Z","time spent":"454.002415ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:10:53.867174Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"451.411779ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:10:53.867296Z","caller":"traceutil/trace.go:171","msg":"trace[1936879911] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:462; }","duration":"451.581665ms","start":"2026-05-13T01:10:53.415702Z","end":"2026-05-13T01:10:53.867284Z","steps":["trace[1936879911] 'agreement among raft nodes before linearized reading' (duration: 451.266716ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:53.867297Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:53.412277Z","time spent":"454.85517ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:10:53.86741Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:10:53.415682Z","time spent":"451.682487ms","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-05-13T01:10:58.132015Z","caller":"traceutil/trace.go:171","msg":"trace[843225446] linearizableReadLoop","detail":"{readStateIndex:521; appliedIndex:520; }","duration":"248.984104ms","start":"2026-05-13T01:10:57.882994Z","end":"2026-05-13T01:10:58.131978Z","steps":["trace[843225446] 'read index received' (duration: 248.872541ms)","trace[843225446] 'applied index is now lower than readState.Index' (duration: 110.223µs)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:10:58.132167Z","caller":"traceutil/trace.go:171","msg":"trace[539948742] transaction","detail":"{read_only:false; response_revision:501; number_of_response:1; }","duration":"249.293672ms","start":"2026-05-13T01:10:57.882861Z","end":"2026-05-13T01:10:58.132154Z","steps":["trace[539948742] 'process raft request' (duration: 248.928281ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:58.132366Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"249.341364ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-05-13T01:10:58.132402Z","caller":"traceutil/trace.go:171","msg":"trace[455049800] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:501; }","duration":"249.402395ms","start":"2026-05-13T01:10:57.882988Z","end":"2026-05-13T01:10:58.132391Z","steps":["trace[455049800] 'agreement among raft nodes before linearized reading' (duration: 249.308113ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:10:58.133118Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"249.823576ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-13T01:10:58.133223Z","caller":"traceutil/trace.go:171","msg":"trace[1962826865] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:502; }","duration":"249.962061ms","start":"2026-05-13T01:10:57.88324Z","end":"2026-05-13T01:10:58.133202Z","steps":["trace[1962826865] 'agreement among raft nodes before linearized reading' (duration: 249.778396ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.133386Z","caller":"traceutil/trace.go:171","msg":"trace[649513286] transaction","detail":"{read_only:false; response_revision:502; number_of_response:1; }","duration":"248.566531ms","start":"2026-05-13T01:10:57.884788Z","end":"2026-05-13T01:10:58.133355Z","steps":["trace[649513286] 'process raft request' (duration: 248.054307ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.71454Z","caller":"traceutil/trace.go:171","msg":"trace[1542032718] transaction","detail":"{read_only:false; response_revision:523; number_of_response:1; }","duration":"219.598304ms","start":"2026-05-13T01:10:58.494911Z","end":"2026-05-13T01:10:58.714509Z","steps":["trace[1542032718] 'process raft request' (duration: 219.511221ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.714549Z","caller":"traceutil/trace.go:171","msg":"trace[1989579089] transaction","detail":"{read_only:false; response_revision:520; number_of_response:1; }","duration":"222.786923ms","start":"2026-05-13T01:10:58.491708Z","end":"2026-05-13T01:10:58.714494Z","steps":["trace[1989579089] 'process raft request' (duration: 222.605328ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.714644Z","caller":"traceutil/trace.go:171","msg":"trace[830722251] transaction","detail":"{read_only:false; response_revision:521; number_of_response:1; }","duration":"222.867125ms","start":"2026-05-13T01:10:58.49177Z","end":"2026-05-13T01:10:58.714637Z","steps":["trace[830722251] 'process raft request' (duration: 222.569467ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.714603Z","caller":"traceutil/trace.go:171","msg":"trace[1062514523] transaction","detail":"{read_only:false; response_revision:519; number_of_response:1; }","duration":"229.77239ms","start":"2026-05-13T01:10:58.484815Z","end":"2026-05-13T01:10:58.714587Z","steps":["trace[1062514523] 'process raft request' (duration: 229.461581ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.714824Z","caller":"traceutil/trace.go:171","msg":"trace[1862683609] transaction","detail":"{read_only:false; response_revision:518; number_of_response:1; }","duration":"229.881373ms","start":"2026-05-13T01:10:58.484628Z","end":"2026-05-13T01:10:58.714509Z","steps":["trace[1862683609] 'process raft request' (duration: 225.153399ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.71563Z","caller":"traceutil/trace.go:171","msg":"trace[1941053148] transaction","detail":"{read_only:false; response_revision:524; number_of_response:1; }","duration":"215.755984ms","start":"2026-05-13T01:10:58.499852Z","end":"2026-05-13T01:10:58.715608Z","steps":["trace[1941053148] 'process raft request' (duration: 214.615293ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.715846Z","caller":"traceutil/trace.go:171","msg":"trace[628811810] transaction","detail":"{read_only:false; response_revision:525; number_of_response:1; }","duration":"215.400415ms","start":"2026-05-13T01:10:58.500413Z","end":"2026-05-13T01:10:58.715814Z","steps":["trace[628811810] 'process raft request' (duration: 214.916302ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.716838Z","caller":"traceutil/trace.go:171","msg":"trace[1286341959] transaction","detail":"{read_only:false; response_revision:527; number_of_response:1; }","duration":"206.73591ms","start":"2026-05-13T01:10:58.51008Z","end":"2026-05-13T01:10:58.716816Z","steps":["trace[1286341959] 'process raft request' (duration: 205.9984ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.717018Z","caller":"traceutil/trace.go:171","msg":"trace[742014253] transaction","detail":"{read_only:false; response_revision:526; number_of_response:1; }","duration":"215.005223ms","start":"2026-05-13T01:10:58.501994Z","end":"2026-05-13T01:10:58.716999Z","steps":["trace[742014253] 'process raft request' (duration: 213.913253ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.714755Z","caller":"traceutil/trace.go:171","msg":"trace[439033455] transaction","detail":"{read_only:false; response_revision:522; number_of_response:1; }","duration":"222.760633ms","start":"2026-05-13T01:10:58.491946Z","end":"2026-05-13T01:10:58.714706Z","steps":["trace[439033455] 'process raft request' (duration: 222.423354ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.725384Z","caller":"traceutil/trace.go:171","msg":"trace[178053793] transaction","detail":"{read_only:false; response_revision:528; number_of_response:1; }","duration":"123.770021ms","start":"2026-05-13T01:10:58.601574Z","end":"2026-05-13T01:10:58.725344Z","steps":["trace[178053793] 'process raft request' (duration: 118.172333ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.948619Z","caller":"traceutil/trace.go:171","msg":"trace[181176499] transaction","detail":"{read_only:false; response_revision:529; number_of_response:1; }","duration":"185.886752ms","start":"2026-05-13T01:10:58.762706Z","end":"2026-05-13T01:10:58.948593Z","steps":["trace[181176499] 'process raft request' (duration: 177.575988ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.949189Z","caller":"traceutil/trace.go:171","msg":"trace[837980417] transaction","detail":"{read_only:false; response_revision:530; number_of_response:1; }","duration":"186.232511ms","start":"2026-05-13T01:10:58.76293Z","end":"2026-05-13T01:10:58.949162Z","steps":["trace[837980417] 'process raft request' (duration: 186.006695ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.949497Z","caller":"traceutil/trace.go:171","msg":"trace[2144056689] transaction","detail":"{read_only:false; response_revision:531; number_of_response:1; }","duration":"181.59453ms","start":"2026-05-13T01:10:58.767896Z","end":"2026-05-13T01:10:58.949491Z","steps":["trace[2144056689] 'process raft request' (duration: 181.270391ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.949605Z","caller":"traceutil/trace.go:171","msg":"trace[2106678228] transaction","detail":"{read_only:false; response_revision:532; number_of_response:1; }","duration":"158.49307ms","start":"2026-05-13T01:10:58.791013Z","end":"2026-05-13T01:10:58.949506Z","steps":["trace[2106678228] 'process raft request' (duration: 158.296694ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.949738Z","caller":"traceutil/trace.go:171","msg":"trace[792129832] transaction","detail":"{read_only:false; response_revision:534; number_of_response:1; }","duration":"109.927861ms","start":"2026-05-13T01:10:58.83979Z","end":"2026-05-13T01:10:58.949718Z","steps":["trace[792129832] 'process raft request' (duration: 109.713094ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:10:58.949627Z","caller":"traceutil/trace.go:171","msg":"trace[1719824899] transaction","detail":"{read_only:false; response_revision:533; number_of_response:1; }","duration":"141.518202ms","start":"2026-05-13T01:10:58.808084Z","end":"2026-05-13T01:10:58.949602Z","steps":["trace[1719824899] 'process raft request' (duration: 141.338766ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:03.920528Z","caller":"traceutil/trace.go:171","msg":"trace[504079619] transaction","detail":"{read_only:false; response_revision:599; number_of_response:1; }","duration":"402.779546ms","start":"2026-05-13T01:11:03.517721Z","end":"2026-05-13T01:11:03.920501Z","steps":["trace[504079619] 'process raft request' (duration: 402.636073ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:03.92069Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:03.517694Z","time spent":"402.91279ms","remote":"127.0.0.1:54670","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1044,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-13T01:11:04.367955Z","caller":"traceutil/trace.go:171","msg":"trace[1649766252] linearizableReadLoop","detail":"{readStateIndex:623; appliedIndex:622; }","duration":"212.317619ms","start":"2026-05-13T01:11:04.155521Z","end":"2026-05-13T01:11:04.367839Z","steps":["trace[1649766252] 'read index received' (duration: 153.364892ms)","trace[1649766252] 'applied index is now lower than readState.Index' (duration: 58.950997ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:04.368074Z","caller":"traceutil/trace.go:171","msg":"trace[1410380974] transaction","detail":"{read_only:false; response_revision:600; number_of_response:1; }","duration":"263.035745ms","start":"2026-05-13T01:11:04.105005Z","end":"2026-05-13T01:11:04.368041Z","steps":["trace[1410380974] 'process raft request' (duration: 203.894924ms)","trace[1410380974] 'compare' (duration: 58.664089ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:04.368385Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"212.780881ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-05-13T01:11:04.368465Z","caller":"traceutil/trace.go:171","msg":"trace[1361846810] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:600; }","duration":"212.966926ms","start":"2026-05-13T01:11:04.155459Z","end":"2026-05-13T01:11:04.368426Z","steps":["trace[1361846810] 'agreement among raft nodes before linearized reading' (duration: 212.676688ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:04.618312Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.41067ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-13T01:11:04.618586Z","caller":"traceutil/trace.go:171","msg":"trace[71386951] transaction","detail":"{read_only:false; response_revision:601; number_of_response:1; }","duration":"294.194088ms","start":"2026-05-13T01:11:04.324367Z","end":"2026-05-13T01:11:04.618562Z","steps":["trace[71386951] 'process raft request' (duration: 173.251284ms)","trace[71386951] 'compare' (duration: 119.913847ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:04.618978Z","caller":"traceutil/trace.go:171","msg":"trace[2035491822] linearizableReadLoop","detail":"{readStateIndex:624; appliedIndex:623; }","duration":"250.88629ms","start":"2026-05-13T01:11:04.368076Z","end":"2026-05-13T01:11:04.618962Z","steps":["trace[2035491822] 'read index received' (duration: 129.202356ms)","trace[2035491822] 'applied index is now lower than readState.Index' (duration: 121.682004ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:04.619372Z","caller":"traceutil/trace.go:171","msg":"trace[1476631949] transaction","detail":"{read_only:false; response_revision:602; number_of_response:1; }","duration":"246.39866ms","start":"2026-05-13T01:11:04.372942Z","end":"2026-05-13T01:11:04.619341Z","steps":["trace[1476631949] 'process raft request' (duration: 245.548097ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:04.619801Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"461.852923ms","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-05-13T01:11:04.619835Z","caller":"traceutil/trace.go:171","msg":"trace[1988392895] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:602; }","duration":"461.938825ms","start":"2026-05-13T01:11:04.157884Z","end":"2026-05-13T01:11:04.619823Z","steps":["trace[1988392895] 'agreement among raft nodes before linearized reading' (duration: 461.129122ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:04.619867Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:04.157857Z","time spent":"462.002596ms","remote":"127.0.0.1:54594","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-05-13T01:11:04.620016Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"258.753281ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:04.620042Z","caller":"traceutil/trace.go:171","msg":"trace[134156854] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:602; }","duration":"258.895465ms","start":"2026-05-13T01:11:04.361138Z","end":"2026-05-13T01:11:04.620033Z","steps":["trace[134156854] 'agreement among raft nodes before linearized reading' (duration: 257.892278ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:04.620206Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"411.742462ms","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-05-13T01:11:04.620232Z","caller":"traceutil/trace.go:171","msg":"trace[1148364336] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:602; }","duration":"411.816584ms","start":"2026-05-13T01:11:04.208408Z","end":"2026-05-13T01:11:04.620224Z","steps":["trace[1148364336] 'agreement among raft nodes before linearized reading' (duration: 410.632912ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:04.620257Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:04.208385Z","time spent":"411.865706ms","remote":"127.0.0.1:54594","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-05-13T01:11:04.620403Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"424.465303ms","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-05-13T01:11:04.620428Z","caller":"traceutil/trace.go:171","msg":"trace[1740402379] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:602; }","duration":"424.503204ms","start":"2026-05-13T01:11:04.195916Z","end":"2026-05-13T01:11:04.620419Z","steps":["trace[1740402379] 'agreement among raft nodes before linearized reading' (duration: 423.133787ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:04.620461Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:04.195908Z","time spent":"424.547825ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-13T01:11:05.149923Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"390.458479ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-13T01:11:05.150167Z","caller":"traceutil/trace.go:171","msg":"trace[775803773] transaction","detail":"{read_only:false; response_revision:606; number_of_response:1; }","duration":"476.042358ms","start":"2026-05-13T01:11:04.674105Z","end":"2026-05-13T01:11:05.150147Z","steps":["trace[775803773] 'process raft request' (duration: 476.000597ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:05.150195Z","caller":"traceutil/trace.go:171","msg":"trace[783115746] transaction","detail":"{read_only:false; response_revision:604; number_of_response:1; }","duration":"519.757768ms","start":"2026-05-13T01:11:04.630425Z","end":"2026-05-13T01:11:05.150182Z","steps":["trace[783115746] 'process raft request' (duration: 519.598043ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:05.150228Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:04.67408Z","time spent":"476.12222ms","remote":"127.0.0.1:54680","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1092,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-13T01:11:05.150255Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:04.6303Z","time spent":"519.920432ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:05.150202Z","caller":"traceutil/trace.go:171","msg":"trace[2122912541] transaction","detail":"{read_only:false; response_revision:603; number_of_response:1; }","duration":"521.716519ms","start":"2026-05-13T01:11:04.628405Z","end":"2026-05-13T01:11:05.150122Z","steps":["trace[2122912541] 'process raft request' (duration: 130.978472ms)","trace[2122912541] 'compare' (duration: 390.315106ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:05.150343Z","caller":"traceutil/trace.go:171","msg":"trace[475067668] transaction","detail":"{read_only:false; response_revision:605; number_of_response:1; }","duration":"517.379173ms","start":"2026-05-13T01:11:04.632944Z","end":"2026-05-13T01:11:05.150323Z","steps":["trace[475067668] 'process raft request' (duration: 517.127807ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:05.150433Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:04.632932Z","time spent":"517.457556ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:11:05.150525Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:04.628387Z","time spent":"521.961305ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:05.858883Z","caller":"traceutil/trace.go:171","msg":"trace[1414383137] transaction","detail":"{read_only:false; response_revision:607; number_of_response:1; }","duration":"286.832497ms","start":"2026-05-13T01:11:05.572012Z","end":"2026-05-13T01:11:05.858844Z","steps":["trace[1414383137] 'process raft request' (duration: 259.41773ms)","trace[1414383137] 'marshal mvccpb.KeyValue' {req_type:put; key:/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1; req_size:1036257; } (duration: 26.473712ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:06.604208Z","caller":"traceutil/trace.go:171","msg":"trace[1032110411] linearizableReadLoop","detail":"{readStateIndex:633; appliedIndex:631; }","duration":"130.377388ms","start":"2026-05-13T01:11:06.473806Z","end":"2026-05-13T01:11:06.604184Z","steps":["trace[1032110411] 'read index received' (duration: 54.139524ms)","trace[1032110411] 'applied index is now lower than readState.Index' (duration: 76.237014ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:06.60493Z","caller":"traceutil/trace.go:171","msg":"trace[324561531] transaction","detail":"{read_only:false; response_revision:610; number_of_response:1; }","duration":"139.855457ms","start":"2026-05-13T01:11:06.465065Z","end":"2026-05-13T01:11:06.60492Z","steps":["trace[324561531] 'process raft request' (duration: 138.524902ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:06.605123Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"131.294352ms","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-05-13T01:11:06.605156Z","caller":"traceutil/trace.go:171","msg":"trace[184123531] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:610; }","duration":"131.380374ms","start":"2026-05-13T01:11:06.473767Z","end":"2026-05-13T01:11:06.605147Z","steps":["trace[184123531] 'agreement among raft nodes before linearized reading' (duration: 131.306032ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:06.605358Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"131.365583ms","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-05-13T01:11:06.605453Z","caller":"traceutil/trace.go:171","msg":"trace[850276837] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:610; }","duration":"131.546628ms","start":"2026-05-13T01:11:06.473877Z","end":"2026-05-13T01:11:06.605423Z","steps":["trace[850276837] 'agreement among raft nodes before linearized reading' (duration: 131.389554ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:06.605634Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.325752ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:06.6057Z","caller":"traceutil/trace.go:171","msg":"trace[503159090] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:610; }","duration":"104.365943ms","start":"2026-05-13T01:11:06.501294Z","end":"2026-05-13T01:11:06.60566Z","steps":["trace[503159090] 'agreement among raft nodes before linearized reading' (duration: 104.298382ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:06.605773Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.744148ms","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-05-13T01:11:06.60581Z","caller":"traceutil/trace.go:171","msg":"trace[1648673867] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:610; }","duration":"130.817159ms","start":"2026-05-13T01:11:06.474986Z","end":"2026-05-13T01:11:06.605803Z","steps":["trace[1648673867] 'agreement among raft nodes before linearized reading' (duration: 130.760658ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:06.605773Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.502687ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:06.605873Z","caller":"traceutil/trace.go:171","msg":"trace[1306547273] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:610; }","duration":"104.679372ms","start":"2026-05-13T01:11:06.50117Z","end":"2026-05-13T01:11:06.605849Z","steps":["trace[1306547273] 'agreement among raft nodes before linearized reading' (duration: 104.446395ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:06.606405Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.294818ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:06.606448Z","caller":"traceutil/trace.go:171","msg":"trace[1502131566] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:610; }","duration":"105.384641ms","start":"2026-05-13T01:11:06.501054Z","end":"2026-05-13T01:11:06.606439Z","steps":["trace[1502131566] 'agreement among raft nodes before linearized reading' (duration: 105.257607ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.166291Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"437.838125ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-13T01:11:07.166482Z","caller":"traceutil/trace.go:171","msg":"trace[1374927339] linearizableReadLoop","detail":"{readStateIndex:635; appliedIndex:633; }","duration":"429.27179ms","start":"2026-05-13T01:11:06.73719Z","end":"2026-05-13T01:11:07.166462Z","steps":["trace[1374927339] 'read index received' (duration: 139.337113ms)","trace[1374927339] 'applied index is now lower than readState.Index' (duration: 289.933407ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:07.166682Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"429.482495ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.166725Z","caller":"traceutil/trace.go:171","msg":"trace[262989104] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:612; }","duration":"429.550207ms","start":"2026-05-13T01:11:06.737163Z","end":"2026-05-13T01:11:07.166713Z","steps":["trace[262989104] 'agreement among raft nodes before linearized reading' (duration: 429.400493ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:07.166667Z","caller":"traceutil/trace.go:171","msg":"trace[1765042444] transaction","detail":"{read_only:false; response_revision:612; number_of_response:1; }","duration":"508.936583ms","start":"2026-05-13T01:11:06.657628Z","end":"2026-05-13T01:11:07.166564Z","steps":["trace[1765042444] 'process raft request' (duration: 508.780349ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.166725Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.116365ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:07.166825Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"399.287241ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.166856Z","caller":"traceutil/trace.go:171","msg":"trace[11442457] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:612; }","duration":"399.326853ms","start":"2026-05-13T01:11:06.767519Z","end":"2026-05-13T01:11:07.166846Z","steps":["trace[11442457] 'agreement among raft nodes before linearized reading' (duration: 399.282102ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:07.166848Z","caller":"traceutil/trace.go:171","msg":"trace[716218124] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:612; }","duration":"129.273309ms","start":"2026-05-13T01:11:07.037564Z","end":"2026-05-13T01:11:07.166837Z","steps":["trace[716218124] 'agreement among raft nodes before linearized reading' (duration: 129.143716ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.16688Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"240.107296ms","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":"warn","ts":"2026-05-13T01:11:07.166891Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.767512Z","time spent":"399.371424ms","remote":"127.0.0.1:57848","response type":"/etcdserverpb.KV/Range","request count":0,"request size":89,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:500 "} {"level":"info","ts":"2026-05-13T01:11:07.166916Z","caller":"traceutil/trace.go:171","msg":"trace[601441953] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:612; }","duration":"240.162537ms","start":"2026-05-13T01:11:06.926741Z","end":"2026-05-13T01:11:07.166904Z","steps":["trace[601441953] 'agreement among raft nodes before linearized reading' (duration: 240.095545ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.166749Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.023403ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.167494Z","caller":"traceutil/trace.go:171","msg":"trace[616871180] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:612; }","duration":"129.838044ms","start":"2026-05-13T01:11:07.037646Z","end":"2026-05-13T01:11:07.167484Z","steps":["trace[616871180] 'agreement among raft nodes before linearized reading' (duration: 129.042354ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.166924Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.657606Z","time spent":"509.216471ms","remote":"127.0.0.1:54816","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1627,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-13T01:11:07.166764Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.737146Z","time spent":"429.604778ms","remote":"127.0.0.1:57836","response type":"/etcdserverpb.KV/Range","request count":0,"request size":97,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:07.166684Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"429.315871ms","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-05-13T01:11:07.167834Z","caller":"traceutil/trace.go:171","msg":"trace[125403184] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:612; }","duration":"430.470961ms","start":"2026-05-13T01:11:06.737344Z","end":"2026-05-13T01:11:07.167815Z","steps":["trace[125403184] 'agreement among raft nodes before linearized reading' (duration: 429.29952ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.167891Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.737341Z","time spent":"430.533782ms","remote":"127.0.0.1:57836","response type":"/etcdserverpb.KV/Range","request count":0,"request size":96,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:07.166949Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"272.475367ms","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-05-13T01:11:07.168045Z","caller":"traceutil/trace.go:171","msg":"trace[3726759] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:612; }","duration":"273.654807ms","start":"2026-05-13T01:11:06.894369Z","end":"2026-05-13T01:11:07.168024Z","steps":["trace[3726759] 'agreement among raft nodes before linearized reading' (duration: 272.410155ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:07.166951Z","caller":"traceutil/trace.go:171","msg":"trace[129671325] transaction","detail":"{read_only:false; response_revision:611; number_of_response:1; }","duration":"531.766434ms","start":"2026-05-13T01:11:06.634968Z","end":"2026-05-13T01:11:07.166735Z","steps":["trace[129671325] 'process raft request' (duration: 93.350234ms)","trace[129671325] 'compare' (duration: 437.695151ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:07.168285Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.634942Z","time spent":"533.208211ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:11:07.167036Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"240.335112ms","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-05-13T01:11:07.169084Z","caller":"traceutil/trace.go:171","msg":"trace[1175073671] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:612; }","duration":"241.869091ms","start":"2026-05-13T01:11:06.926643Z","end":"2026-05-13T01:11:07.168512Z","steps":["trace[1175073671] 'agreement among raft nodes before linearized reading' (duration: 240.368573ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.167057Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"400.928554ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.169303Z","caller":"traceutil/trace.go:171","msg":"trace[1083881637] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:612; }","duration":"403.066819ms","start":"2026-05-13T01:11:06.766106Z","end":"2026-05-13T01:11:07.169173Z","steps":["trace[1083881637] 'agreement among raft nodes before linearized reading' (duration: 400.925163ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.169349Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.766101Z","time spent":"403.235264ms","remote":"127.0.0.1:57848","response type":"/etcdserverpb.KV/Range","request count":0,"request size":88,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:07.167047Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.41889ms","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-05-13T01:11:07.169407Z","caller":"traceutil/trace.go:171","msg":"trace[365127448] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:612; }","duration":"208.841814ms","start":"2026-05-13T01:11:06.960547Z","end":"2026-05-13T01:11:07.169388Z","steps":["trace[365127448] 'agreement among raft nodes before linearized reading' (duration: 206.423661ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.167069Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"271.911751ms","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-05-13T01:11:07.169636Z","caller":"traceutil/trace.go:171","msg":"trace[701399113] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:612; }","duration":"274.489879ms","start":"2026-05-13T01:11:06.895135Z","end":"2026-05-13T01:11:07.169625Z","steps":["trace[701399113] 'agreement among raft nodes before linearized reading' (duration: 271.917482ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.16709Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"401.14939ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.1698Z","caller":"traceutil/trace.go:171","msg":"trace[229348643] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backends/; range_end:/registry/gateway.envoyproxy.io/backends0; response_count:0; response_revision:612; }","duration":"403.86519ms","start":"2026-05-13T01:11:06.765925Z","end":"2026-05-13T01:11:07.16979Z","steps":["trace[229348643] 'agreement among raft nodes before linearized reading' (duration: 401.14868ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.169845Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.765919Z","time spent":"403.911161ms","remote":"127.0.0.1:57848","response type":"/etcdserverpb.KV/Range","request count":0,"request size":89,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/backends/\" range_end:\"/registry/gateway.envoyproxy.io/backends0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:07.167086Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"377.314304ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.170006Z","caller":"traceutil/trace.go:171","msg":"trace[609081970] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:612; }","duration":"380.246669ms","start":"2026-05-13T01:11:06.789746Z","end":"2026-05-13T01:11:07.169993Z","steps":["trace[609081970] 'agreement among raft nodes before linearized reading' (duration: 377.306943ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.170049Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.789739Z","time spent":"380.2976ms","remote":"127.0.0.1:57854","response type":"/etcdserverpb.KV/Range","request count":0,"request size":110,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:07.167098Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"272.543308ms","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-05-13T01:11:07.170267Z","caller":"traceutil/trace.go:171","msg":"trace[222588400] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:612; }","duration":"275.791742ms","start":"2026-05-13T01:11:06.894462Z","end":"2026-05-13T01:11:07.170254Z","steps":["trace[222588400] 'agreement among raft nodes before linearized reading' (duration: 272.61918ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.167119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"429.582467ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.170438Z","caller":"traceutil/trace.go:171","msg":"trace[742872920] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyproxies/; range_end:/registry/gateway.envoyproxy.io/envoyproxies0; response_count:0; response_revision:612; }","duration":"432.897793ms","start":"2026-05-13T01:11:06.737531Z","end":"2026-05-13T01:11:07.170428Z","steps":["trace[742872920] 'agreement among raft nodes before linearized reading' (duration: 429.572946ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.170475Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.737518Z","time spent":"432.944544ms","remote":"127.0.0.1:57836","response type":"/etcdserverpb.KV/Range","request count":0,"request size":97,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/envoyproxies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyproxies0\" limit:500 "} {"level":"warn","ts":"2026-05-13T01:11:07.167115Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.04069ms","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-05-13T01:11:07.171394Z","caller":"traceutil/trace.go:171","msg":"trace[1024842740] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:612; }","duration":"210.317941ms","start":"2026-05-13T01:11:06.961064Z","end":"2026-05-13T01:11:07.171382Z","steps":["trace[1024842740] 'agreement among raft nodes before linearized reading' (duration: 206.01357ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.167128Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"377.402526ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.171656Z","caller":"traceutil/trace.go:171","msg":"trace[30618761] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:612; }","duration":"381.977225ms","start":"2026-05-13T01:11:06.789669Z","end":"2026-05-13T01:11:07.171647Z","steps":["trace[30618761] 'agreement among raft nodes before linearized reading' (duration: 377.438396ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.171756Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.789637Z","time spent":"382.090818ms","remote":"127.0.0.1:57854","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:500 "} {"level":"warn","ts":"2026-05-13T01:11:07.167119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.504643ms","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-05-13T01:11:07.171907Z","caller":"traceutil/trace.go:171","msg":"trace[1802121827] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:612; }","duration":"211.361369ms","start":"2026-05-13T01:11:06.960536Z","end":"2026-05-13T01:11:07.171897Z","steps":["trace[1802121827] 'agreement among raft nodes before linearized reading' (duration: 206.487242ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.16717Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"377.752315ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.172087Z","caller":"traceutil/trace.go:171","msg":"trace[747930249] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:612; }","duration":"382.705144ms","start":"2026-05-13T01:11:06.789369Z","end":"2026-05-13T01:11:07.172075Z","steps":["trace[747930249] 'agreement among raft nodes before linearized reading' (duration: 377.778325ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:07.172156Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:06.789345Z","time spent":"382.798687ms","remote":"127.0.0.1:57854","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:07.16718Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.683665ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:07.173454Z","caller":"traceutil/trace.go:171","msg":"trace[1846493032] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:612; }","duration":"134.987149ms","start":"2026-05-13T01:11:07.038452Z","end":"2026-05-13T01:11:07.173439Z","steps":["trace[1846493032] 'agreement among raft nodes before linearized reading' (duration: 128.703726ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.000408Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"297.968516ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.00062Z","caller":"traceutil/trace.go:171","msg":"trace[1813597071] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:612; }","duration":"298.211173ms","start":"2026-05-13T01:11:07.702377Z","end":"2026-05-13T01:11:08.000588Z","steps":["trace[1813597071] 'range keys from in-memory index tree' (duration: 297.940656ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.00089Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"370.398455ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-13T01:11:08.001183Z","caller":"traceutil/trace.go:171","msg":"trace[1824389780] transaction","detail":"{read_only:false; response_revision:613; number_of_response:1; }","duration":"825.351305ms","start":"2026-05-13T01:11:07.175812Z","end":"2026-05-13T01:11:08.001164Z","steps":["trace[1824389780] 'process raft request' (duration: 454.400855ms)","trace[1824389780] 'compare' (duration: 370.2368ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:08.001554Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.175774Z","time spent":"825.658912ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:08.004016Z","caller":"traceutil/trace.go:171","msg":"trace[1361020048] transaction","detail":"{read_only:false; response_revision:614; number_of_response:1; }","duration":"827.628544ms","start":"2026-05-13T01:11:07.176346Z","end":"2026-05-13T01:11:08.003974Z","steps":["trace[1361020048] 'process raft request' (duration: 827.267073ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:08.004297Z","caller":"traceutil/trace.go:171","msg":"trace[640104906] linearizableReadLoop","detail":"{readStateIndex:638; appliedIndex:635; }","duration":"821.862744ms","start":"2026-05-13T01:11:07.1824Z","end":"2026-05-13T01:11:08.004263Z","steps":["trace[640104906] 'read index received' (duration: 447.876435ms)","trace[640104906] 'applied index is now lower than readState.Index' (duration: 373.985109ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:08.00447Z","caller":"traceutil/trace.go:171","msg":"trace[1295663728] transaction","detail":"{read_only:false; response_revision:615; number_of_response:1; }","duration":"826.520244ms","start":"2026-05-13T01:11:07.17793Z","end":"2026-05-13T01:11:08.00445Z","steps":["trace[1295663728] 'process raft request' (duration: 825.890418ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.004587Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"681.930725ms","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-05-13T01:11:08.004652Z","caller":"traceutil/trace.go:171","msg":"trace[1953292838] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:615; }","duration":"682.0529ms","start":"2026-05-13T01:11:07.322582Z","end":"2026-05-13T01:11:08.004635Z","steps":["trace[1953292838] 'agreement among raft nodes before linearized reading' (duration: 681.931636ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.00469Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.32256Z","time spent":"682.119061ms","remote":"127.0.0.1:57946","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:08.00483Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"393.641141ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.004882Z","caller":"traceutil/trace.go:171","msg":"trace[1452171000] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:615; }","duration":"393.697572ms","start":"2026-05-13T01:11:07.611167Z","end":"2026-05-13T01:11:08.004865Z","steps":["trace[1452171000] 'agreement among raft nodes before linearized reading' (duration: 393.634281ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.004935Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.611161Z","time spent":"393.757255ms","remote":"127.0.0.1:58018","response type":"/etcdserverpb.KV/Range","request count":0,"request size":109,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:500 "} {"level":"warn","ts":"2026-05-13T01:11:08.005042Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"411.449125ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:08.005094Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"510.577749ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:08.005131Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"450.913163ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.00516Z","caller":"traceutil/trace.go:171","msg":"trace[972467730] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:615; }","duration":"411.566518ms","start":"2026-05-13T01:11:07.593547Z","end":"2026-05-13T01:11:08.005114Z","steps":["trace[972467730] 'agreement among raft nodes before linearized reading' (duration: 411.394233ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:08.005217Z","caller":"traceutil/trace.go:171","msg":"trace[712409432] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:615; }","duration":"451.046637ms","start":"2026-05-13T01:11:07.554148Z","end":"2026-05-13T01:11:08.005195Z","steps":["trace[712409432] 'agreement among raft nodes before linearized reading' (duration: 450.852742ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.00527Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"511.074822ms","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":"warn","ts":"2026-05-13T01:11:08.005271Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.554132Z","time spent":"451.126819ms","remote":"127.0.0.1:57990","response type":"/etcdserverpb.KV/Range","request count":0,"request size":130,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:08.005284Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"429.333291ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.005303Z","caller":"traceutil/trace.go:171","msg":"trace[1180479290] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:615; }","duration":"511.138542ms","start":"2026-05-13T01:11:07.494154Z","end":"2026-05-13T01:11:08.005293Z","steps":["trace[1180479290] 'agreement among raft nodes before linearized reading' (duration: 511.091721ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:08.005338Z","caller":"traceutil/trace.go:171","msg":"trace[1949453196] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xmeshes/; range_end:/registry/gateway.networking.x-k8s.io/xmeshes0; response_count:0; response_revision:615; }","duration":"429.389302ms","start":"2026-05-13T01:11:07.575935Z","end":"2026-05-13T01:11:08.005324Z","steps":["trace[1949453196] 'agreement among raft nodes before linearized reading' (duration: 429.30644ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.005366Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.494127Z","time spent":"511.220415ms","remote":"127.0.0.1:57962","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:08.005387Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.575861Z","time spent":"429.509545ms","remote":"127.0.0.1:58004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" limit:500 "} {"level":"warn","ts":"2026-05-13T01:11:08.005475Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.593537Z","time spent":"411.704271ms","remote":"127.0.0.1:58018","response type":"/etcdserverpb.KV/Range","request count":0,"request size":109,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:08.005585Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"647.446327ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:08.005614Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"434.30097ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:08.004846Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"477.739293ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:08.005619Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"451.262532ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:08.004714Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"449.635491ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.005713Z","caller":"traceutil/trace.go:171","msg":"trace[1253523638] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:615; }","duration":"451.461298ms","start":"2026-05-13T01:11:07.554239Z","end":"2026-05-13T01:11:08.0057Z","steps":["trace[1253523638] 'agreement among raft nodes before linearized reading' (duration: 451.297024ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.005733Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"434.455044ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.005735Z","caller":"traceutil/trace.go:171","msg":"trace[1298433995] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:615; }","duration":"478.667817ms","start":"2026-05-13T01:11:07.526999Z","end":"2026-05-13T01:11:08.005667Z","steps":["trace[1298433995] 'agreement among raft nodes before linearized reading' (duration: 477.660101ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:08.005773Z","caller":"traceutil/trace.go:171","msg":"trace[2034059846] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xmeshes/; range_end:/registry/gateway.networking.x-k8s.io/xmeshes0; response_count:0; response_revision:615; }","duration":"434.510386ms","start":"2026-05-13T01:11:07.571252Z","end":"2026-05-13T01:11:08.005763Z","steps":["trace[2034059846] 'agreement among raft nodes before linearized reading' (duration: 434.450975ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.005793Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.554199Z","time spent":"451.551ms","remote":"127.0.0.1:57990","response type":"/etcdserverpb.KV/Range","request count":0,"request size":131,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:08.005796Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.526971Z","time spent":"478.805461ms","remote":"127.0.0.1:57978","response type":"/etcdserverpb.KV/Range","request count":0,"request size":115,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:08.005679Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"682.844509ms","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":"warn","ts":"2026-05-13T01:11:08.006062Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"412.360948ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:08.00611Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"478.933984ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.006174Z","caller":"traceutil/trace.go:171","msg":"trace[1574976455] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:615; }","duration":"479.059617ms","start":"2026-05-13T01:11:07.5271Z","end":"2026-05-13T01:11:08.006159Z","steps":["trace[1574976455] 'agreement among raft nodes before linearized reading' (duration: 478.966065ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.006215Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.527062Z","time spent":"479.14074ms","remote":"127.0.0.1:57978","response type":"/etcdserverpb.KV/Range","request count":0,"request size":114,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:08.005221Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"510.882996ms","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-05-13T01:11:08.006469Z","caller":"traceutil/trace.go:171","msg":"trace[348185927] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:615; }","duration":"512.18254ms","start":"2026-05-13T01:11:07.494274Z","end":"2026-05-13T01:11:08.006456Z","steps":["trace[348185927] 'agreement among raft nodes before linearized reading' (duration: 510.908416ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.006529Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.494241Z","time spent":"512.266572ms","remote":"127.0.0.1:57962","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 "} {"level":"info","ts":"2026-05-13T01:11:08.005151Z","caller":"traceutil/trace.go:171","msg":"trace[190172694] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:615; }","duration":"510.65294ms","start":"2026-05-13T01:11:07.494482Z","end":"2026-05-13T01:11:08.005134Z","steps":["trace[190172694] 'agreement among raft nodes before linearized reading' (duration: 510.560938ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.006664Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.494474Z","time spent":"512.17257ms","remote":"127.0.0.1:57946","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:500 "} {"level":"info","ts":"2026-05-13T01:11:08.006096Z","caller":"traceutil/trace.go:171","msg":"trace[1810039705] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:615; }","duration":"683.317481ms","start":"2026-05-13T01:11:07.322763Z","end":"2026-05-13T01:11:08.00608Z","steps":["trace[1810039705] 'agreement among raft nodes before linearized reading' (duration: 682.88968ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.006859Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.322674Z","time spent":"684.168104ms","remote":"127.0.0.1:57946","response type":"/etcdserverpb.KV/Range","request count":0,"request size":101,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:08.005818Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.571243Z","time spent":"434.560547ms","remote":"127.0.0.1:58004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":98,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" count_only:true "} {"level":"info","ts":"2026-05-13T01:11:08.005722Z","caller":"traceutil/trace.go:171","msg":"trace[1026896044] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/; range_end:/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0; response_count:0; response_revision:615; }","duration":"450.686818ms","start":"2026-05-13T01:11:07.555019Z","end":"2026-05-13T01:11:08.005706Z","steps":["trace[1026896044] 'agreement among raft nodes before linearized reading' (duration: 449.637141ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.007148Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.554987Z","time spent":"452.140346ms","remote":"127.0.0.1:57990","response type":"/etcdserverpb.KV/Range","request count":0,"request size":131,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" limit:500 "} {"level":"info","ts":"2026-05-13T01:11:08.00563Z","caller":"traceutil/trace.go:171","msg":"trace[2127928947] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:615; }","duration":"647.486268ms","start":"2026-05-13T01:11:07.35813Z","end":"2026-05-13T01:11:08.005616Z","steps":["trace[2127928947] 'agreement among raft nodes before linearized reading' (duration: 647.426856ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.00733Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.358071Z","time spent":"649.233993ms","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-05-13T01:11:08.005676Z","caller":"traceutil/trace.go:171","msg":"trace[521396260] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xmeshes/; range_end:/registry/gateway.networking.x-k8s.io/xmeshes0; response_count:0; response_revision:615; }","duration":"434.383593ms","start":"2026-05-13T01:11:07.571274Z","end":"2026-05-13T01:11:08.005658Z","steps":["trace[521396260] 'agreement among raft nodes before linearized reading' (duration: 434.300601ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.007447Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.571257Z","time spent":"436.16737ms","remote":"127.0.0.1:58004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":99,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xmeshes/\" range_end:\"/registry/gateway.networking.x-k8s.io/xmeshes0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:08.005897Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"395.288853ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.007749Z","caller":"traceutil/trace.go:171","msg":"trace[1875216775] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:615; }","duration":"397.391768ms","start":"2026-05-13T01:11:07.61033Z","end":"2026-05-13T01:11:08.007722Z","steps":["trace[1875216775] 'agreement among raft nodes before linearized reading' (duration: 395.52428ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.007817Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.610312Z","time spent":"397.48242ms","remote":"127.0.0.1:58034","response type":"/etcdserverpb.KV/Range","request count":0,"request size":108,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:08.005945Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"395.826457ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.008032Z","caller":"traceutil/trace.go:171","msg":"trace[543293026] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:615; }","duration":"397.937272ms","start":"2026-05-13T01:11:07.61008Z","end":"2026-05-13T01:11:08.008017Z","steps":["trace[543293026] 'agreement among raft nodes before linearized reading' (duration: 395.844817ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.00808Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.610063Z","time spent":"398.001014ms","remote":"127.0.0.1:58034","response type":"/etcdserverpb.KV/Range","request count":0,"request size":109,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" limit:10000 "} {"level":"warn","ts":"2026-05-13T01:11:08.006422Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"478.631635ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.008225Z","caller":"traceutil/trace.go:171","msg":"trace[663527639] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/clienttrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/clienttrafficpolicies0; response_count:0; response_revision:615; }","duration":"480.456263ms","start":"2026-05-13T01:11:07.527757Z","end":"2026-05-13T01:11:08.008214Z","steps":["trace[663527639] 'agreement among raft nodes before linearized reading' (duration: 478.626915ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.00826Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.527744Z","time spent":"480.505824ms","remote":"127.0.0.1:57978","response type":"/etcdserverpb.KV/Range","request count":0,"request size":115,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/clienttrafficpolicies0\" limit:500 "} {"level":"warn","ts":"2026-05-13T01:11:08.004778Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"822.380897ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.008635Z","caller":"traceutil/trace.go:171","msg":"trace[371193470] range","detail":"{range_begin:/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:615; }","duration":"826.251247ms","start":"2026-05-13T01:11:07.182367Z","end":"2026-05-13T01:11:08.008618Z","steps":["trace[371193470] 'agreement among raft nodes before linearized reading' (duration: 822.384468ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.008669Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.182351Z","time spent":"826.307938ms","remote":"127.0.0.1:54560","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":0,"response size":29,"request content":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" "} {"level":"warn","ts":"2026-05-13T01:11:08.009176Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.176325Z","time spent":"827.783398ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:11:08.004603Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.177911Z","time spent":"826.596976ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:08.010932Z","caller":"traceutil/trace.go:171","msg":"trace[1047935712] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:615; }","duration":"412.545453ms","start":"2026-05-13T01:11:07.593594Z","end":"2026-05-13T01:11:08.006139Z","steps":["trace[1047935712] 'agreement among raft nodes before linearized reading' (duration: 412.369438ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.011009Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:07.593589Z","time spent":"417.402769ms","remote":"127.0.0.1:58018","response type":"/etcdserverpb.KV/Range","request count":0,"request size":108,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:08.512733Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.454562ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:08.512846Z","caller":"traceutil/trace.go:171","msg":"trace[870672723] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:616; }","duration":"154.653568ms","start":"2026-05-13T01:11:08.358173Z","end":"2026-05-13T01:11:08.512827Z","steps":["trace[870672723] 'range keys from in-memory index tree' (duration: 154.332159ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:08.979746Z","caller":"traceutil/trace.go:171","msg":"trace[317789665] transaction","detail":"{read_only:false; response_revision:617; number_of_response:1; }","duration":"551.249638ms","start":"2026-05-13T01:11:08.428458Z","end":"2026-05-13T01:11:08.979707Z","steps":["trace[317789665] 'process raft request' (duration: 550.486149ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:08.979909Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:08.428415Z","time spent":"551.408792ms","remote":"127.0.0.1:54394","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036305,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:11:09.717376Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"482.506427ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-05-13T01:11:09.717827Z","caller":"traceutil/trace.go:171","msg":"trace[1301273182] linearizableReadLoop","detail":"{readStateIndex:643; appliedIndex:640; }","duration":"543.824399ms","start":"2026-05-13T01:11:09.173974Z","end":"2026-05-13T01:11:09.717799Z","steps":["trace[1301273182] 'read index received' (duration: 60.882ms)","trace[1301273182] 'applied index is now lower than readState.Index' (duration: 482.940629ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:09.717981Z","caller":"traceutil/trace.go:171","msg":"trace[1298922902] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"679.734982ms","start":"2026-05-13T01:11:09.038203Z","end":"2026-05-13T01:11:09.717938Z","steps":["trace[1298922902] 'process raft request' (duration: 679.523697ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:09.717992Z","caller":"traceutil/trace.go:171","msg":"trace[1935591404] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"1.16975761s","start":"2026-05-13T01:11:08.548192Z","end":"2026-05-13T01:11:09.717949Z","steps":["trace[1935591404] 'process raft request' (duration: 1.169308769s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:09.718113Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"544.128478ms","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-05-13T01:11:09.718153Z","caller":"traceutil/trace.go:171","msg":"trace[1319130986] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:619; }","duration":"544.23896ms","start":"2026-05-13T01:11:09.173902Z","end":"2026-05-13T01:11:09.718141Z","steps":["trace[1319130986] 'agreement among raft nodes before linearized reading' (duration: 544.027634ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:09.718155Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:09.038169Z","time spent":"679.907818ms","remote":"127.0.0.1:54560","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-13T01:11:09.718197Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:09.173873Z","time spent":"544.313902ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-05-13T01:11:09.718311Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:08.548151Z","time spent":"1.170011788s","remote":"127.0.0.1:54372","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":688,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-13T01:11:09.718414Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"359.859244ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:09.718469Z","caller":"traceutil/trace.go:171","msg":"trace[465737830] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:619; }","duration":"360.054749ms","start":"2026-05-13T01:11:09.3584Z","end":"2026-05-13T01:11:09.718455Z","steps":["trace[465737830] 'agreement among raft nodes before linearized reading' (duration: 359.859264ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:09.718456Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"498.810635ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-7z7qg\" ","response":"range_response_count:1 size:16961"} {"level":"warn","ts":"2026-05-13T01:11:09.718508Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:09.35827Z","time spent":"360.164462ms","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-05-13T01:11:09.718561Z","caller":"traceutil/trace.go:171","msg":"trace[1936591300] range","detail":"{range_begin:/registry/pods/kube-system/cilium-7z7qg; range_end:; response_count:1; response_revision:619; }","duration":"498.971519ms","start":"2026-05-13T01:11:09.219562Z","end":"2026-05-13T01:11:09.718533Z","steps":["trace[1936591300] 'agreement among raft nodes before linearized reading' (duration: 498.657661ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:09.718618Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:09.219532Z","time spent":"499.075902ms","remote":"127.0.0.1:54506","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16985,"request content":"key:\"/registry/pods/kube-system/cilium-7z7qg\" "} {"level":"warn","ts":"2026-05-13T01:11:10.507657Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":17576315826231402028,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-05-13T01:11:10.958766Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.201773899s","expected-duration":"1s"} {"level":"info","ts":"2026-05-13T01:11:10.959359Z","caller":"traceutil/trace.go:171","msg":"trace[1952130796] transaction","detail":"{read_only:false; response_revision:621; number_of_response:1; }","duration":"1.222710446s","start":"2026-05-13T01:11:09.736629Z","end":"2026-05-13T01:11:10.959339Z","steps":["trace[1952130796] 'process raft request' (duration: 1.222356136s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:10.959475Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:09.736611Z","time spent":"1.222803029s","remote":"127.0.0.1:54506","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17130,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:11.895116Z","caller":"traceutil/trace.go:171","msg":"trace[453978191] linearizableReadLoop","detail":"{readStateIndex:647; appliedIndex:644; }","duration":"1.887586574s","start":"2026-05-13T01:11:10.007498Z","end":"2026-05-13T01:11:11.895085Z","steps":["trace[453978191] 'read index received' (duration: 951.488735ms)","trace[453978191] 'applied index is now lower than readState.Index' (duration: 936.096629ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:11.895236Z","caller":"traceutil/trace.go:171","msg":"trace[1144461695] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"2.145029371s","start":"2026-05-13T01:11:09.75013Z","end":"2026-05-13T01:11:11.895159Z","steps":["trace[1144461695] 'process raft request' (duration: 2.144676302s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:11.895463Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"536.559387ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:11.895442Z","caller":"traceutil/trace.go:171","msg":"trace[140846763] transaction","detail":"{read_only:false; response_revision:623; number_of_response:1; }","duration":"1.458509147s","start":"2026-05-13T01:11:10.436801Z","end":"2026-05-13T01:11:11.89531Z","steps":["trace[140846763] 'process raft request' (duration: 1.45819499s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:11.895424Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.887924392s","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-05-13T01:11:11.895607Z","caller":"traceutil/trace.go:171","msg":"trace[228342779] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:623; }","duration":"1.888177449s","start":"2026-05-13T01:11:10.007423Z","end":"2026-05-13T01:11:11.8956Z","steps":["trace[228342779] 'agreement among raft nodes before linearized reading' (duration: 1.887867741s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:11.895634Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:10.007391Z","time spent":"1.888235589s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-13T01:11:11.895628Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"793.849243ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.95\" ","response":"range_response_count:1 size:133"} {"level":"info","ts":"2026-05-13T01:11:11.895754Z","caller":"traceutil/trace.go:171","msg":"trace[387483383] range","detail":"{range_begin:/registry/masterleases/199.204.45.95; range_end:; response_count:1; response_revision:623; }","duration":"794.045028ms","start":"2026-05-13T01:11:11.101683Z","end":"2026-05-13T01:11:11.895728Z","steps":["trace[387483383] 'agreement among raft nodes before linearized reading' (duration: 793.779531ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:11.895651Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.881121849s","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-05-13T01:11:11.895748Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.197505ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"warn","ts":"2026-05-13T01:11:11.895816Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:11.101661Z","time spent":"794.143991ms","remote":"127.0.0.1:54304","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/199.204.45.95\" "} {"level":"info","ts":"2026-05-13T01:11:11.895851Z","caller":"traceutil/trace.go:171","msg":"trace[362358494] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:623; }","duration":"144.366889ms","start":"2026-05-13T01:11:11.751458Z","end":"2026-05-13T01:11:11.895825Z","steps":["trace[362358494] 'agreement among raft nodes before linearized reading' (duration: 144.00182ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:11.895826Z","caller":"traceutil/trace.go:171","msg":"trace[1272056803] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:623; }","duration":"1.881303024s","start":"2026-05-13T01:11:10.014501Z","end":"2026-05-13T01:11:11.895804Z","steps":["trace[1272056803] 'agreement among raft nodes before linearized reading' (duration: 1.880999366s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:11.895972Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:10.014465Z","time spent":"1.881445457s","remote":"127.0.0.1:54594","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-05-13T01:11:11.896Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:09.750109Z","time spent":"2.145693078s","remote":"127.0.0.1:54506","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2735,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-13T01:11:11.8955Z","caller":"traceutil/trace.go:171","msg":"trace[1488986230] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:623; }","duration":"536.634239ms","start":"2026-05-13T01:11:11.358857Z","end":"2026-05-13T01:11:11.895491Z","steps":["trace[1488986230] 'agreement among raft nodes before linearized reading' (duration: 536.591588ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:11.895805Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:10.436764Z","time spent":"1.458794445s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:11:11.896506Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:11.358832Z","time spent":"537.650214ms","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-05-13T01:11:11.897578Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.881722974s","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-05-13T01:11:11.897626Z","caller":"traceutil/trace.go:171","msg":"trace[389292288] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:623; }","duration":"1.883494939s","start":"2026-05-13T01:11:10.014119Z","end":"2026-05-13T01:11:11.897614Z","steps":["trace[389292288] 'agreement among raft nodes before linearized reading' (duration: 1.881291703s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:11.897655Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:10.014098Z","time spent":"1.88354875s","remote":"127.0.0.1:54594","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-05-13T01:11:13.065513Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:12.088159Z","time spent":"977.340874ms","remote":"127.0.0.1:42596","response type":"/etcdserverpb.Maintenance/Status","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"warn","ts":"2026-05-13T01:11:14.501029Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":17576315826231402051,"retry-timeout":"500ms"} {"level":"info","ts":"2026-05-13T01:11:14.822899Z","caller":"traceutil/trace.go:171","msg":"trace[1122127789] transaction","detail":"{read_only:false; response_revision:633; number_of_response:1; }","duration":"822.954217ms","start":"2026-05-13T01:11:13.999927Z","end":"2026-05-13T01:11:14.822881Z","steps":["trace[1122127789] 'process raft request' (duration: 822.820623ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:14.823023Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:13.999912Z","time spent":"823.041909ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:15.101137Z","caller":"traceutil/trace.go:171","msg":"trace[1286218837] linearizableReadLoop","detail":"{readStateIndex:659; appliedIndex:657; }","duration":"1.100953197s","start":"2026-05-13T01:11:14.000158Z","end":"2026-05-13T01:11:15.101111Z","steps":["trace[1286218837] 'read index received' (duration: 822.64295ms)","trace[1286218837] 'applied index is now lower than readState.Index' (duration: 278.309367ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:15.101214Z","caller":"traceutil/trace.go:171","msg":"trace[2140875814] transaction","detail":"{read_only:false; response_revision:634; number_of_response:1; }","duration":"1.099691704s","start":"2026-05-13T01:11:14.00145Z","end":"2026-05-13T01:11:15.101142Z","steps":["trace[2140875814] 'process raft request' (duration: 1.099462059s)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:15.101268Z","caller":"traceutil/trace.go:171","msg":"trace[1923643941] transaction","detail":"{read_only:false; response_revision:635; number_of_response:1; }","duration":"371.836458ms","start":"2026-05-13T01:11:14.72942Z","end":"2026-05-13T01:11:15.101257Z","steps":["trace[1923643941] 'process raft request' (duration: 371.645724ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:15.101398Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:14.729404Z","time spent":"371.90237ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:11:15.101407Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:14.001439Z","time spent":"1.099867328s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:11:15.101654Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.101488619s","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-05-13T01:11:15.101709Z","caller":"traceutil/trace.go:171","msg":"trace[1165683468] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:635; }","duration":"1.101559431s","start":"2026-05-13T01:11:14.000133Z","end":"2026-05-13T01:11:15.101692Z","steps":["trace[1165683468] 'agreement among raft nodes before linearized reading' (duration: 1.101403517s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:15.10175Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:14.000122Z","time spent":"1.101617742s","remote":"127.0.0.1:54594","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-05-13T01:11:15.101824Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.100552816s","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-05-13T01:11:15.101917Z","caller":"traceutil/trace.go:171","msg":"trace[2110165809] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:635; }","duration":"1.10067828s","start":"2026-05-13T01:11:14.001218Z","end":"2026-05-13T01:11:15.101897Z","steps":["trace[2110165809] 'agreement among raft nodes before linearized reading' (duration: 1.100421143s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:15.101958Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:14.001209Z","time spent":"1.100740421s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-13T01:11:15.102089Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"744.370303ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:15.102253Z","caller":"traceutil/trace.go:171","msg":"trace[1051138214] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:635; }","duration":"744.566627ms","start":"2026-05-13T01:11:14.35762Z","end":"2026-05-13T01:11:15.102186Z","steps":["trace[1051138214] 'agreement among raft nodes before linearized reading' (duration: 744.287291ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:15.102338Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:14.3576Z","time spent":"744.722672ms","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-05-13T01:11:15.342088Z","caller":"traceutil/trace.go:171","msg":"trace[938283853] transaction","detail":"{read_only:false; response_revision:637; number_of_response:1; }","duration":"233.644961ms","start":"2026-05-13T01:11:15.108423Z","end":"2026-05-13T01:11:15.342068Z","steps":["trace[938283853] 'process raft request' (duration: 233.60936ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:15.342184Z","caller":"traceutil/trace.go:171","msg":"trace[457903489] transaction","detail":"{read_only:false; response_revision:636; number_of_response:1; }","duration":"234.471992ms","start":"2026-05-13T01:11:15.107671Z","end":"2026-05-13T01:11:15.342143Z","steps":["trace[457903489] 'process raft request' (duration: 135.236871ms)","trace[457903489] 'compare' (duration: 99.023846ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:16.856296Z","caller":"traceutil/trace.go:171","msg":"trace[838292954] transaction","detail":"{read_only:false; response_revision:647; number_of_response:1; }","duration":"358.482ms","start":"2026-05-13T01:11:16.497729Z","end":"2026-05-13T01:11:16.856211Z","steps":["trace[838292954] 'process raft request' (duration: 342.874831ms)","trace[838292954] 'compare' (duration: 14.541442ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:16.856611Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:16.497701Z","time spent":"358.750657ms","remote":"127.0.0.1:54372","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":763,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-13T01:11:19.604417Z","caller":"traceutil/trace.go:171","msg":"trace[270372843] transaction","detail":"{read_only:false; response_revision:698; number_of_response:1; }","duration":"239.616158ms","start":"2026-05-13T01:11:19.364762Z","end":"2026-05-13T01:11:19.604378Z","steps":["trace[270372843] 'process raft request' (duration: 239.364831ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:19.762817Z","caller":"traceutil/trace.go:171","msg":"trace[378655202] linearizableReadLoop","detail":"{readStateIndex:725; appliedIndex:723; }","duration":"377.254182ms","start":"2026-05-13T01:11:19.385535Z","end":"2026-05-13T01:11:19.76279Z","steps":["trace[378655202] 'read index received' (duration: 218.686204ms)","trace[378655202] 'applied index is now lower than readState.Index' (duration: 158.566958ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:19.762878Z","caller":"traceutil/trace.go:171","msg":"trace[1053452377] transaction","detail":"{read_only:false; response_revision:699; number_of_response:1; }","duration":"397.409158ms","start":"2026-05-13T01:11:19.365422Z","end":"2026-05-13T01:11:19.762831Z","steps":["trace[1053452377] 'process raft request' (duration: 397.163322ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:19.763118Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.547108ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" ","response":"range_response_count:1 size:4083"} {"level":"warn","ts":"2026-05-13T01:11:19.763114Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:19.365412Z","time spent":"397.570922ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:19.763163Z","caller":"traceutil/trace.go:171","msg":"trace[1743948154] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io; range_end:; response_count:1; response_revision:700; }","duration":"295.66323ms","start":"2026-05-13T01:11:19.467483Z","end":"2026-05-13T01:11:19.763146Z","steps":["trace[1743948154] 'agreement among raft nodes before linearized reading' (duration: 295.459865ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:19.763267Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"377.661251ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-7z7qg\" ","response":"range_response_count:1 size:18063"} {"level":"info","ts":"2026-05-13T01:11:19.763374Z","caller":"traceutil/trace.go:171","msg":"trace[1267634367] range","detail":"{range_begin:/registry/pods/kube-system/cilium-7z7qg; range_end:; response_count:1; response_revision:700; }","duration":"377.908517ms","start":"2026-05-13T01:11:19.38544Z","end":"2026-05-13T01:11:19.763349Z","steps":["trace[1267634367] 'agreement among raft nodes before linearized reading' (duration: 377.472707ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:19.763325Z","caller":"traceutil/trace.go:171","msg":"trace[522400603] transaction","detail":"{read_only:false; response_revision:700; number_of_response:1; }","duration":"375.717685ms","start":"2026-05-13T01:11:19.387132Z","end":"2026-05-13T01:11:19.76285Z","steps":["trace[522400603] 'process raft request' (duration: 375.613363ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:19.763454Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:19.385411Z","time spent":"378.02142ms","remote":"127.0.0.1:54506","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":18087,"request content":"key:\"/registry/pods/kube-system/cilium-7z7qg\" "} {"level":"warn","ts":"2026-05-13T01:11:19.763754Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:19.387096Z","time spent":"376.434722ms","remote":"127.0.0.1:54372","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":773,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-13T01:11:20.767587Z","caller":"traceutil/trace.go:171","msg":"trace[517169437] transaction","detail":"{read_only:false; response_revision:703; number_of_response:1; }","duration":"293.635071ms","start":"2026-05-13T01:11:20.473915Z","end":"2026-05-13T01:11:20.76755Z","steps":["trace[517169437] 'process raft request' (duration: 293.429186ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:20.773299Z","caller":"traceutil/trace.go:171","msg":"trace[1460638528] linearizableReadLoop","detail":"{readStateIndex:730; appliedIndex:728; }","duration":"104.703458ms","start":"2026-05-13T01:11:20.668574Z","end":"2026-05-13T01:11:20.773277Z","steps":["trace[1460638528] 'read index received' (duration: 98.83686ms)","trace[1460638528] 'applied index is now lower than readState.Index' (duration: 5.865658ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:20.773341Z","caller":"traceutil/trace.go:171","msg":"trace[1436362551] transaction","detail":"{read_only:false; response_revision:704; number_of_response:1; }","duration":"269.388772ms","start":"2026-05-13T01:11:20.503928Z","end":"2026-05-13T01:11:20.773317Z","steps":["trace[1436362551] 'process raft request' (duration: 269.176428ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:20.773493Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.903082ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumcidrgroups.cilium.io\" ","response":"range_response_count:1 size:4180"} {"level":"info","ts":"2026-05-13T01:11:20.77353Z","caller":"traceutil/trace.go:171","msg":"trace[1640086088] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumcidrgroups.cilium.io; range_end:; response_count:1; response_revision:704; }","duration":"104.995144ms","start":"2026-05-13T01:11:20.668525Z","end":"2026-05-13T01:11:20.77352Z","steps":["trace[1640086088] 'agreement among raft nodes before linearized reading' (duration: 104.83192ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:21.071596Z","caller":"traceutil/trace.go:171","msg":"trace[1825120454] transaction","detail":"{read_only:false; response_revision:706; number_of_response:1; }","duration":"171.131515ms","start":"2026-05-13T01:11:20.900431Z","end":"2026-05-13T01:11:21.071562Z","steps":["trace[1825120454] 'process raft request' (duration: 169.203021ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:21.16305Z","caller":"traceutil/trace.go:171","msg":"trace[1291606067] transaction","detail":"{read_only:false; response_revision:707; number_of_response:1; }","duration":"258.881298ms","start":"2026-05-13T01:11:20.904114Z","end":"2026-05-13T01:11:21.162995Z","steps":["trace[1291606067] 'process raft request' (duration: 258.52975ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:21.163153Z","caller":"traceutil/trace.go:171","msg":"trace[371348246] transaction","detail":"{read_only:false; response_revision:708; number_of_response:1; }","duration":"186.542001ms","start":"2026-05-13T01:11:20.976582Z","end":"2026-05-13T01:11:21.163124Z","steps":["trace[371348246] 'process raft request' (duration: 186.280615ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:21.326827Z","caller":"traceutil/trace.go:171","msg":"trace[1558309756] transaction","detail":"{read_only:false; response_revision:709; number_of_response:1; }","duration":"159.008513ms","start":"2026-05-13T01:11:21.167784Z","end":"2026-05-13T01:11:21.326793Z","steps":["trace[1558309756] 'process raft request' (duration: 158.629035ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:21.327484Z","caller":"traceutil/trace.go:171","msg":"trace[1220366529] transaction","detail":"{read_only:false; response_revision:710; number_of_response:1; }","duration":"158.538293ms","start":"2026-05-13T01:11:21.168926Z","end":"2026-05-13T01:11:21.327464Z","steps":["trace[1220366529] 'process raft request' (duration: 157.804945ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:21.328104Z","caller":"traceutil/trace.go:171","msg":"trace[569324804] transaction","detail":"{read_only:false; response_revision:711; number_of_response:1; }","duration":"154.882767ms","start":"2026-05-13T01:11:21.173207Z","end":"2026-05-13T01:11:21.32809Z","steps":["trace[569324804] 'process raft request' (duration: 154.091539ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:21.523301Z","caller":"traceutil/trace.go:171","msg":"trace[877120185] transaction","detail":"{read_only:false; response_revision:713; number_of_response:1; }","duration":"118.911181ms","start":"2026-05-13T01:11:21.404352Z","end":"2026-05-13T01:11:21.523263Z","steps":["trace[877120185] 'process raft request' (duration: 118.528652ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:21.679723Z","caller":"traceutil/trace.go:171","msg":"trace[1244947795] transaction","detail":"{read_only:false; response_revision:715; number_of_response:1; }","duration":"133.12775ms","start":"2026-05-13T01:11:21.546533Z","end":"2026-05-13T01:11:21.679661Z","steps":["trace[1244947795] 'process raft request' (duration: 125.806021ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:22.411249Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.496683ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-13T01:11:22.411369Z","caller":"traceutil/trace.go:171","msg":"trace[1318631261] linearizableReadLoop","detail":"{readStateIndex:748; appliedIndex:747; }","duration":"174.144016ms","start":"2026-05-13T01:11:22.237205Z","end":"2026-05-13T01:11:22.411349Z","steps":["trace[1318631261] 'read index received' (duration: 62.641808ms)","trace[1318631261] 'applied index is now lower than readState.Index' (duration: 111.497398ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:22.411468Z","caller":"traceutil/trace.go:171","msg":"trace[251430699] transaction","detail":"{read_only:false; response_revision:721; number_of_response:1; }","duration":"197.27943ms","start":"2026-05-13T01:11:22.214178Z","end":"2026-05-13T01:11:22.411458Z","steps":["trace[251430699] 'process raft request' (duration: 86.146401ms)","trace[251430699] 'compare' (duration: 109.928261ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:22.411689Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.484094ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:22.412301Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.041567ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:11:22.412395Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.013386ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:22.412428Z","caller":"traceutil/trace.go:171","msg":"trace[2105369671] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:721; }","duration":"156.186751ms","start":"2026-05-13T01:11:22.256213Z","end":"2026-05-13T01:11:22.412399Z","steps":["trace[2105369671] 'agreement among raft nodes before linearized reading' (duration: 156.047467ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:22.412576Z","caller":"traceutil/trace.go:171","msg":"trace[758893459] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:721; }","duration":"156.303943ms","start":"2026-05-13T01:11:22.256242Z","end":"2026-05-13T01:11:22.412545Z","steps":["trace[758893459] 'agreement among raft nodes before linearized reading' (duration: 155.874383ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:22.412446Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.857373ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:22.41283Z","caller":"traceutil/trace.go:171","msg":"trace[664811511] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:721; }","duration":"156.239962ms","start":"2026-05-13T01:11:22.256562Z","end":"2026-05-13T01:11:22.412802Z","steps":["trace[664811511] 'agreement among raft nodes before linearized reading' (duration: 155.444134ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:22.41232Z","caller":"traceutil/trace.go:171","msg":"trace[306895168] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:721; }","duration":"175.120279ms","start":"2026-05-13T01:11:22.23719Z","end":"2026-05-13T01:11:22.41231Z","steps":["trace[306895168] 'agreement among raft nodes before linearized reading' (duration: 174.449373ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:22.412132Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.239954ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" limit:10 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:22.412931Z","caller":"traceutil/trace.go:171","msg":"trace[696518292] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:721; }","duration":"174.074843ms","start":"2026-05-13T01:11:22.238837Z","end":"2026-05-13T01:11:22.412912Z","steps":["trace[696518292] 'agreement among raft nodes before linearized reading' (duration: 173.273065ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:22.412166Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.361128ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumnetworkpolicies0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:22.413117Z","caller":"traceutil/trace.go:171","msg":"trace[140902309] range","detail":"{range_begin:/registry/cilium.io/ciliumnetworkpolicies/; range_end:/registry/cilium.io/ciliumnetworkpolicies0; response_count:0; response_revision:721; }","duration":"123.357342ms","start":"2026-05-13T01:11:22.289743Z","end":"2026-05-13T01:11:22.4131Z","steps":["trace[140902309] 'agreement among raft nodes before linearized reading' (duration: 122.277807ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:22.412171Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.345368ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumnetworkpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:22.413261Z","caller":"traceutil/trace.go:171","msg":"trace[1231368356] range","detail":"{range_begin:/registry/cilium.io/ciliumnetworkpolicies/; range_end:/registry/cilium.io/ciliumnetworkpolicies0; response_count:0; response_revision:721; }","duration":"123.480804ms","start":"2026-05-13T01:11:22.289766Z","end":"2026-05-13T01:11:22.413247Z","steps":["trace[1231368356] 'agreement among raft nodes before linearized reading' (duration: 122.312397ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:22.411964Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.716399ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:22.41337Z","caller":"traceutil/trace.go:171","msg":"trace[806348232] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies/; range_end:/registry/cilium.io/ciliumclusterwidenetworkpolicies0; response_count:0; response_revision:721; }","duration":"176.164093ms","start":"2026-05-13T01:11:22.2372Z","end":"2026-05-13T01:11:22.413364Z","steps":["trace[806348232] 'agreement among raft nodes before linearized reading' (duration: 174.543676ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:22.412289Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.567383ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnetworkpolicies/\" range_end:\"/registry/cilium.io/ciliumnetworkpolicies0\" limit:10 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:22.413557Z","caller":"traceutil/trace.go:171","msg":"trace[1541895862] range","detail":"{range_begin:/registry/cilium.io/ciliumnetworkpolicies/; range_end:/registry/cilium.io/ciliumnetworkpolicies0; response_count:0; response_revision:721; }","duration":"123.918754ms","start":"2026-05-13T01:11:22.289612Z","end":"2026-05-13T01:11:22.41353Z","steps":["trace[1541895862] 'agreement among raft nodes before linearized reading' (duration: 122.570344ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:23.037387Z","caller":"traceutil/trace.go:171","msg":"trace[38381226] transaction","detail":"{read_only:false; response_revision:724; number_of_response:1; }","duration":"199.961936ms","start":"2026-05-13T01:11:22.837382Z","end":"2026-05-13T01:11:23.037344Z","steps":["trace[38381226] 'process raft request' (duration: 166.61829ms)","trace[38381226] 'compare' (duration: 33.06093ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:28.213553Z","caller":"traceutil/trace.go:171","msg":"trace[1640804584] transaction","detail":"{read_only:false; response_revision:749; number_of_response:1; }","duration":"125.901865ms","start":"2026-05-13T01:11:28.087619Z","end":"2026-05-13T01:11:28.213521Z","steps":["trace[1640804584] 'process raft request' (duration: 110.35638ms)","trace[1640804584] 'compare' (duration: 15.400112ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:29.333275Z","caller":"traceutil/trace.go:171","msg":"trace[323590515] transaction","detail":"{read_only:false; response_revision:761; number_of_response:1; }","duration":"145.668849ms","start":"2026-05-13T01:11:29.187563Z","end":"2026-05-13T01:11:29.333232Z","steps":["trace[323590515] 'process raft request' (duration: 145.287011ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:30.006384Z","caller":"traceutil/trace.go:171","msg":"trace[1372187837] transaction","detail":"{read_only:false; response_revision:768; number_of_response:1; }","duration":"132.085911ms","start":"2026-05-13T01:11:29.874258Z","end":"2026-05-13T01:11:30.006344Z","steps":["trace[1372187837] 'process raft request' (duration: 83.280078ms)","trace[1372187837] 'compare' (duration: 48.65212ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:30.146194Z","caller":"traceutil/trace.go:171","msg":"trace[23617811] linearizableReadLoop","detail":"{readStateIndex:799; appliedIndex:797; }","duration":"237.179216ms","start":"2026-05-13T01:11:29.908984Z","end":"2026-05-13T01:11:30.146164Z","steps":["trace[23617811] 'read index received' (duration: 48.684148ms)","trace[23617811] 'applied index is now lower than readState.Index' (duration: 188.493878ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:30.146404Z","caller":"traceutil/trace.go:171","msg":"trace[240587593] transaction","detail":"{read_only:false; response_revision:769; number_of_response:1; }","duration":"268.77127ms","start":"2026-05-13T01:11:29.877564Z","end":"2026-05-13T01:11:30.146335Z","steps":["trace[240587593] 'process raft request' (duration: 262.309149ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:30.146524Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"237.499583ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/\" range_end:\"/registry/services/endpoints0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-13T01:11:30.146574Z","caller":"traceutil/trace.go:171","msg":"trace[546995038] range","detail":"{range_begin:/registry/services/endpoints/; range_end:/registry/services/endpoints0; response_count:0; response_revision:769; }","duration":"237.627586ms","start":"2026-05-13T01:11:29.908933Z","end":"2026-05-13T01:11:30.14656Z","steps":["trace[546995038] 'agreement among raft nodes before linearized reading' (duration: 237.35054ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:30.810167Z","caller":"traceutil/trace.go:171","msg":"trace[402520820] transaction","detail":"{read_only:false; response_revision:771; number_of_response:1; }","duration":"106.640625ms","start":"2026-05-13T01:11:30.703317Z","end":"2026-05-13T01:11:30.809958Z","steps":["trace[402520820] 'process raft request' (duration: 106.476531ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:31.719228Z","caller":"traceutil/trace.go:171","msg":"trace[1570156067] transaction","detail":"{read_only:false; response_revision:774; number_of_response:1; }","duration":"205.371876ms","start":"2026-05-13T01:11:31.513813Z","end":"2026-05-13T01:11:31.719185Z","steps":["trace[1570156067] 'process raft request' (duration: 205.206032ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:31.748201Z","caller":"traceutil/trace.go:171","msg":"trace[1779859897] transaction","detail":"{read_only:false; response_revision:775; number_of_response:1; }","duration":"234.19365ms","start":"2026-05-13T01:11:31.513944Z","end":"2026-05-13T01:11:31.748138Z","steps":["trace[1779859897] 'process raft request' (duration: 234.006325ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:31.967762Z","caller":"traceutil/trace.go:171","msg":"trace[1559178864] transaction","detail":"{read_only:false; response_revision:776; number_of_response:1; }","duration":"206.386068ms","start":"2026-05-13T01:11:31.761339Z","end":"2026-05-13T01:11:31.967725Z","steps":["trace[1559178864] 'process raft request' (duration: 136.105386ms)","trace[1559178864] 'compare' (duration: 69.972145ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:33.747746Z","caller":"traceutil/trace.go:171","msg":"trace[309944530] transaction","detail":"{read_only:false; response_revision:787; number_of_response:1; }","duration":"332.53253ms","start":"2026-05-13T01:11:33.415172Z","end":"2026-05-13T01:11:33.747705Z","steps":["trace[309944530] 'process raft request' (duration: 332.249744ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:33.747964Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:33.415143Z","time spent":"332.709764ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:33.868423Z","caller":"traceutil/trace.go:171","msg":"trace[1249246686] transaction","detail":"{read_only:false; response_revision:789; number_of_response:1; }","duration":"111.613302ms","start":"2026-05-13T01:11:33.756783Z","end":"2026-05-13T01:11:33.868397Z","steps":["trace[1249246686] 'process raft request' (duration: 111.482129ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:37.440974Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.454036641s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-13T01:11:37.4411Z","caller":"traceutil/trace.go:171","msg":"trace[127165647] range","detail":"{range_begin:/registry/roles/; range_end:/registry/roles0; response_count:0; response_revision:805; }","duration":"1.454242875s","start":"2026-05-13T01:11:35.986829Z","end":"2026-05-13T01:11:37.441072Z","steps":["trace[127165647] 'count revisions from in-memory index tree' (duration: 1.453856747s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:37.441169Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:35.986799Z","time spent":"1.454356458s","remote":"127.0.0.1:54654","response type":"/etcdserverpb.KV/Range","request count":0,"request size":38,"response count":14,"response size":31,"request content":"key:\"/registry/roles/\" range_end:\"/registry/roles0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:11:37.44355Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.2605803s","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-05-13T01:11:37.443677Z","caller":"traceutil/trace.go:171","msg":"trace[2014235398] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:805; }","duration":"1.260760214s","start":"2026-05-13T01:11:36.1829Z","end":"2026-05-13T01:11:37.44366Z","steps":["trace[2014235398] 'range keys from in-memory index tree' (duration: 1.259246013s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:37.443717Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:36.182858Z","time spent":"1.260845646s","remote":"127.0.0.1:54594","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-05-13T01:11:37.443866Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.345964426s","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-05-13T01:11:37.444049Z","caller":"traceutil/trace.go:171","msg":"trace[1015439753] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:805; }","duration":"1.346263813s","start":"2026-05-13T01:11:36.097756Z","end":"2026-05-13T01:11:37.44402Z","steps":["trace[1015439753] 'range keys from in-memory index tree' (duration: 1.345550178s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:37.444153Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:36.09769Z","time spent":"1.346446337s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-05-13T01:11:37.573223Z","caller":"traceutil/trace.go:171","msg":"trace[78792725] linearizableReadLoop","detail":"{readStateIndex:838; appliedIndex:836; }","duration":"215.403027ms","start":"2026-05-13T01:11:37.357784Z","end":"2026-05-13T01:11:37.573187Z","steps":["trace[78792725] 'read index received' (duration: 139.110662ms)","trace[78792725] 'applied index is now lower than readState.Index' (duration: 76.291185ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:37.573392Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"215.575562ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:37.573792Z","caller":"traceutil/trace.go:171","msg":"trace[1055420466] transaction","detail":"{read_only:false; response_revision:806; number_of_response:1; }","duration":"821.340026ms","start":"2026-05-13T01:11:36.752436Z","end":"2026-05-13T01:11:37.573776Z","steps":["trace[1055420466] 'process raft request' (duration: 820.474298ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:37.57415Z","caller":"traceutil/trace.go:171","msg":"trace[1979473970] transaction","detail":"{read_only:false; response_revision:807; number_of_response:1; }","duration":"124.480907ms","start":"2026-05-13T01:11:37.449624Z","end":"2026-05-13T01:11:37.574104Z","steps":["trace[1979473970] 'process raft request' (duration: 123.463046ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:37.574563Z","caller":"traceutil/trace.go:171","msg":"trace[255650914] transaction","detail":"{read_only:false; response_revision:808; number_of_response:1; }","duration":"124.880995ms","start":"2026-05-13T01:11:37.449666Z","end":"2026-05-13T01:11:37.574547Z","steps":["trace[255650914] 'process raft request' (duration: 123.466446ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:37.575361Z","caller":"traceutil/trace.go:171","msg":"trace[493398365] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:808; }","duration":"217.572283ms","start":"2026-05-13T01:11:37.357736Z","end":"2026-05-13T01:11:37.575308Z","steps":["trace[493398365] 'agreement among raft nodes before linearized reading' (duration: 215.573811ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:37.575781Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:36.752402Z","time spent":"821.454027ms","remote":"127.0.0.1:54560","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2785,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:11:41.140731Z","caller":"traceutil/trace.go:171","msg":"trace[1011374459] transaction","detail":"{read_only:false; response_revision:841; number_of_response:1; }","duration":"100.450863ms","start":"2026-05-13T01:11:41.040248Z","end":"2026-05-13T01:11:41.140699Z","steps":["trace[1011374459] 'process raft request' (duration: 100.056666ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:41.514603Z","caller":"traceutil/trace.go:171","msg":"trace[562627414] linearizableReadLoop","detail":"{readStateIndex:883; appliedIndex:882; }","duration":"176.231368ms","start":"2026-05-13T01:11:41.33835Z","end":"2026-05-13T01:11:41.514581Z","steps":["trace[562627414] 'read index received' (duration: 86.754006ms)","trace[562627414] 'applied index is now lower than readState.Index' (duration: 89.476082ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:41.514714Z","caller":"traceutil/trace.go:171","msg":"trace[1350665279] transaction","detail":"{read_only:false; response_revision:850; number_of_response:1; }","duration":"180.457785ms","start":"2026-05-13T01:11:41.334247Z","end":"2026-05-13T01:11:41.514705Z","steps":["trace[1350665279] 'process raft request' (duration: 90.883431ms)","trace[1350665279] 'compare' (duration: 89.157545ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:41.514915Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"176.541154ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/endpointslices/default/kubernetes\" ","response":"range_response_count:1 size:480"} {"level":"info","ts":"2026-05-13T01:11:41.514952Z","caller":"traceutil/trace.go:171","msg":"trace[1203606951] range","detail":"{range_begin:/registry/endpointslices/default/kubernetes; range_end:; response_count:1; response_revision:850; }","duration":"176.613746ms","start":"2026-05-13T01:11:41.338328Z","end":"2026-05-13T01:11:41.514941Z","steps":["trace[1203606951] 'agreement among raft nodes before linearized reading' (duration: 176.525465ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:41.71991Z","caller":"traceutil/trace.go:171","msg":"trace[1920410149] transaction","detail":"{read_only:false; response_revision:851; number_of_response:1; }","duration":"292.86825ms","start":"2026-05-13T01:11:41.427008Z","end":"2026-05-13T01:11:41.719876Z","steps":["trace[1920410149] 'process raft request' (duration: 219.291781ms)","trace[1920410149] 'compare' (duration: 72.380405ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:41.720765Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"304.352512ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/envoy-gateway-system/envoy-gateway\" ","response":"range_response_count:1 size:846"} {"level":"info","ts":"2026-05-13T01:11:41.720822Z","caller":"traceutil/trace.go:171","msg":"trace[1336937321] range","detail":"{range_begin:/registry/serviceaccounts/envoy-gateway-system/envoy-gateway; range_end:; response_count:1; response_revision:851; }","duration":"304.492124ms","start":"2026-05-13T01:11:41.416317Z","end":"2026-05-13T01:11:41.720809Z","steps":["trace[1336937321] 'agreement among raft nodes before linearized reading' (duration: 304.247709ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:41.720858Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:41.416286Z","time spent":"304.563066ms","remote":"127.0.0.1:54518","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":1,"response size":870,"request content":"key:\"/registry/serviceaccounts/envoy-gateway-system/envoy-gateway\" "} {"level":"info","ts":"2026-05-13T01:11:41.721386Z","caller":"traceutil/trace.go:171","msg":"trace[612168733] linearizableReadLoop","detail":"{readStateIndex:884; appliedIndex:883; }","duration":"205.860608ms","start":"2026-05-13T01:11:41.514672Z","end":"2026-05-13T01:11:41.720533Z","steps":["trace[612168733] 'read index received' (duration: 130.988143ms)","trace[612168733] 'applied index is now lower than readState.Index' (duration: 74.870995ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:41.721367Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"364.562942ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:11:41.721748Z","caller":"traceutil/trace.go:171","msg":"trace[879819020] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:851; }","duration":"365.013501ms","start":"2026-05-13T01:11:41.356719Z","end":"2026-05-13T01:11:41.721732Z","steps":["trace[879819020] 'agreement among raft nodes before linearized reading' (duration: 364.487741ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:41.722239Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:11:41.356696Z","time spent":"365.534731ms","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-05-13T01:11:41.722301Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.989832ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-05-13T01:11:41.722412Z","caller":"traceutil/trace.go:171","msg":"trace[1913487944] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:851; }","duration":"131.133825ms","start":"2026-05-13T01:11:41.591252Z","end":"2026-05-13T01:11:41.722386Z","steps":["trace[1913487944] 'agreement among raft nodes before linearized reading' (duration: 130.804328ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:41.722158Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.962032ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-13T01:11:41.722547Z","caller":"traceutil/trace.go:171","msg":"trace[1889483242] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:851; }","duration":"131.40452ms","start":"2026-05-13T01:11:41.591131Z","end":"2026-05-13T01:11:41.722535Z","steps":["trace[1889483242] 'agreement among raft nodes before linearized reading' (duration: 130.911081ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:41.951218Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.521783ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-13T01:11:41.951372Z","caller":"traceutil/trace.go:171","msg":"trace[953101889] linearizableReadLoop","detail":"{readStateIndex:886; appliedIndex:884; }","duration":"173.245599ms","start":"2026-05-13T01:11:41.77809Z","end":"2026-05-13T01:11:41.951335Z","steps":["trace[953101889] 'read index received' (duration: 36.938778ms)","trace[953101889] 'applied index is now lower than readState.Index' (duration: 136.30475ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:11:41.951479Z","caller":"traceutil/trace.go:171","msg":"trace[1936111557] transaction","detail":"{read_only:false; response_revision:853; number_of_response:1; }","duration":"223.796292ms","start":"2026-05-13T01:11:41.727648Z","end":"2026-05-13T01:11:41.951445Z","steps":["trace[1936111557] 'process raft request' (duration: 93.885011ms)","trace[1936111557] 'compare' (duration: 129.297888ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:11:41.951763Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.659247ms","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-05-13T01:11:41.951829Z","caller":"traceutil/trace.go:171","msg":"trace[1965259751] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:853; }","duration":"173.782259ms","start":"2026-05-13T01:11:41.77803Z","end":"2026-05-13T01:11:41.951813Z","steps":["trace[1965259751] 'agreement among raft nodes before linearized reading' (duration: 173.536194ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:11:41.953262Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.585537ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/envoy-gateway-system/\" range_end:\"/registry/secrets/envoy-gateway-system0\" ","response":"range_response_count:5 size:1050260"} {"level":"info","ts":"2026-05-13T01:11:41.953314Z","caller":"traceutil/trace.go:171","msg":"trace[137611296] range","detail":"{range_begin:/registry/secrets/envoy-gateway-system/; range_end:/registry/secrets/envoy-gateway-system0; response_count:5; response_revision:853; }","duration":"102.681669ms","start":"2026-05-13T01:11:41.850617Z","end":"2026-05-13T01:11:41.953298Z","steps":["trace[137611296] 'agreement among raft nodes before linearized reading' (duration: 101.540316ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:11:42.228321Z","caller":"traceutil/trace.go:171","msg":"trace[1633260191] transaction","detail":"{read_only:false; response_revision:857; number_of_response:1; }","duration":"126.047546ms","start":"2026-05-13T01:11:42.102242Z","end":"2026-05-13T01:11:42.22829Z","steps":["trace[1633260191] 'process raft request' (duration: 66.412116ms)","trace[1633260191] 'compare' (duration: 59.339294ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:15.550249Z","caller":"traceutil/trace.go:171","msg":"trace[653150793] transaction","detail":"{read_only:false; response_revision:1074; number_of_response:1; }","duration":"412.393757ms","start":"2026-05-13T01:12:15.137824Z","end":"2026-05-13T01:12:15.550218Z","steps":["trace[653150793] 'process raft request' (duration: 412.151572ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:15.550439Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:15.137797Z","time spent":"412.550109ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:16.401625Z","caller":"traceutil/trace.go:171","msg":"trace[244506713] linearizableReadLoop","detail":"{readStateIndex:1118; appliedIndex:1117; }","duration":"173.789644ms","start":"2026-05-13T01:12:16.227762Z","end":"2026-05-13T01:12:16.401551Z","steps":["trace[244506713] 'read index received' (duration: 173.53355ms)","trace[244506713] 'applied index is now lower than readState.Index' (duration: 254.824µs)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:16.401691Z","caller":"traceutil/trace.go:171","msg":"trace[549969527] transaction","detail":"{read_only:false; response_revision:1076; number_of_response:1; }","duration":"174.407124ms","start":"2026-05-13T01:12:16.227262Z","end":"2026-05-13T01:12:16.401669Z","steps":["trace[549969527] 'process raft request' (duration: 174.064348ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:16.401965Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.173251ms","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-05-13T01:12:16.402022Z","caller":"traceutil/trace.go:171","msg":"trace[167653812] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1076; }","duration":"174.272822ms","start":"2026-05-13T01:12:16.227733Z","end":"2026-05-13T01:12:16.402006Z","steps":["trace[167653812] 'agreement among raft nodes before linearized reading' (duration: 174.007867ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:16.402179Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"139.352597ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:12:16.402274Z","caller":"traceutil/trace.go:171","msg":"trace[1338334480] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1076; }","duration":"139.482718ms","start":"2026-05-13T01:12:16.262772Z","end":"2026-05-13T01:12:16.402254Z","steps":["trace[1338334480] 'agreement among raft nodes before linearized reading' (duration: 139.247784ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:16.402244Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.749971ms","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-05-13T01:12:16.402411Z","caller":"traceutil/trace.go:171","msg":"trace[993424775] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1076; }","duration":"140.947784ms","start":"2026-05-13T01:12:16.261443Z","end":"2026-05-13T01:12:16.402391Z","steps":["trace[993424775] 'agreement among raft nodes before linearized reading' (duration: 140.663039ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:16.402947Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.036101ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:490"} {"level":"info","ts":"2026-05-13T01:12:16.40309Z","caller":"traceutil/trace.go:171","msg":"trace[1432653646] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1076; }","duration":"173.215935ms","start":"2026-05-13T01:12:16.229853Z","end":"2026-05-13T01:12:16.403069Z","steps":["trace[1432653646] 'agreement among raft nodes before linearized reading' (duration: 172.094146ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:16.662289Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.521531ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-4af8a284-b6fc-4858-a31c-ef269f90ae44\" ","response":"range_response_count:1 size:3578"} {"level":"info","ts":"2026-05-13T01:12:16.662387Z","caller":"traceutil/trace.go:171","msg":"trace[740620638] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-4af8a284-b6fc-4858-a31c-ef269f90ae44; range_end:; response_count:1; response_revision:1079; }","duration":"101.663835ms","start":"2026-05-13T01:12:16.560701Z","end":"2026-05-13T01:12:16.662365Z","steps":["trace[740620638] 'range keys from in-memory index tree' (duration: 101.325328ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:18.055672Z","caller":"traceutil/trace.go:171","msg":"trace[1283626] transaction","detail":"{read_only:false; response_revision:1084; number_of_response:1; }","duration":"122.869227ms","start":"2026-05-13T01:12:17.932777Z","end":"2026-05-13T01:12:18.055646Z","steps":["trace[1283626] 'process raft request' (duration: 122.652604ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:18.22882Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.556982ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-05-13T01:12:18.228923Z","caller":"traceutil/trace.go:171","msg":"trace[412920788] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1084; }","duration":"121.710185ms","start":"2026-05-13T01:12:18.107185Z","end":"2026-05-13T01:12:18.228895Z","steps":["trace[412920788] 'range keys from in-memory index tree' (duration: 121.392189ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:18.365355Z","caller":"traceutil/trace.go:171","msg":"trace[2031261153] transaction","detail":"{read_only:false; response_revision:1085; number_of_response:1; }","duration":"132.224027ms","start":"2026-05-13T01:12:18.233093Z","end":"2026-05-13T01:12:18.365317Z","steps":["trace[2031261153] 'process raft request' (duration: 131.898302ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:18.532898Z","caller":"traceutil/trace.go:171","msg":"trace[2111258195] transaction","detail":"{read_only:false; response_revision:1086; number_of_response:1; }","duration":"123.257258ms","start":"2026-05-13T01:12:18.409606Z","end":"2026-05-13T01:12:18.532863Z","steps":["trace[2111258195] 'process raft request' (duration: 95.226972ms)","trace[2111258195] 'compare' (duration: 26.959109ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:12:19.00538Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"329.572778ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-4af8a284-b6fc-4858-a31c-ef269f90ae44\" ","response":"range_response_count:1 size:3578"} {"level":"info","ts":"2026-05-13T01:12:19.00549Z","caller":"traceutil/trace.go:171","msg":"trace[814509710] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-4af8a284-b6fc-4858-a31c-ef269f90ae44; range_end:; response_count:1; response_revision:1089; }","duration":"329.72254ms","start":"2026-05-13T01:12:18.675735Z","end":"2026-05-13T01:12:19.005458Z","steps":["trace[814509710] 'range keys from in-memory index tree' (duration: 329.274793ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:19.005545Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:18.675711Z","time spent":"329.820992ms","remote":"127.0.0.1:54506","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":1,"response size":3602,"request content":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-4af8a284-b6fc-4858-a31c-ef269f90ae44\" "} {"level":"info","ts":"2026-05-13T01:12:23.032286Z","caller":"traceutil/trace.go:171","msg":"trace[1760868344] transaction","detail":"{read_only:false; response_revision:1118; number_of_response:1; }","duration":"110.021736ms","start":"2026-05-13T01:12:22.922177Z","end":"2026-05-13T01:12:23.032199Z","steps":["trace[1760868344] 'process raft request' (duration: 109.842533ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:24.773874Z","caller":"traceutil/trace.go:171","msg":"trace[1982284827] transaction","detail":"{read_only:false; response_revision:1124; number_of_response:1; }","duration":"144.38724ms","start":"2026-05-13T01:12:24.629453Z","end":"2026-05-13T01:12:24.77384Z","steps":["trace[1982284827] 'process raft request' (duration: 144.193796ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:24.776939Z","caller":"traceutil/trace.go:171","msg":"trace[800178322] linearizableReadLoop","detail":"{readStateIndex:1169; appliedIndex:1167; }","duration":"143.932382ms","start":"2026-05-13T01:12:24.632981Z","end":"2026-05-13T01:12:24.776913Z","steps":["trace[800178322] 'read index received' (duration: 140.832332ms)","trace[800178322] 'applied index is now lower than readState.Index' (duration: 3.09842ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:12:24.777201Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.186466ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-05-13T01:12:24.777249Z","caller":"traceutil/trace.go:171","msg":"trace[1931386660] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1125; }","duration":"144.259047ms","start":"2026-05-13T01:12:24.632976Z","end":"2026-05-13T01:12:24.777235Z","steps":["trace[1931386660] 'agreement among raft nodes before linearized reading' (duration: 144.065554ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:24.777335Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"143.19581ms","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-05-13T01:12:24.777237Z","caller":"traceutil/trace.go:171","msg":"trace[288037959] transaction","detail":"{read_only:false; response_revision:1125; number_of_response:1; }","duration":"145.646261ms","start":"2026-05-13T01:12:24.631377Z","end":"2026-05-13T01:12:24.777023Z","steps":["trace[288037959] 'process raft request' (duration: 145.385477ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:24.777418Z","caller":"traceutil/trace.go:171","msg":"trace[1439015083] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1125; }","duration":"143.309163ms","start":"2026-05-13T01:12:24.634095Z","end":"2026-05-13T01:12:24.777404Z","steps":["trace[1439015083] 'agreement among raft nodes before linearized reading' (duration: 143.031759ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:35.370696Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"788.52963ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"warn","ts":"2026-05-13T01:12:35.370726Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"392.738125ms","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-05-13T01:12:35.370791Z","caller":"traceutil/trace.go:171","msg":"trace[729379389] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1161; }","duration":"392.854667ms","start":"2026-05-13T01:12:34.977922Z","end":"2026-05-13T01:12:35.370777Z","steps":["trace[729379389] 'range keys from in-memory index tree' (duration: 392.533612ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:35.370834Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:34.977896Z","time spent":"392.931328ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":503,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-05-13T01:12:35.370785Z","caller":"traceutil/trace.go:171","msg":"trace[568298340] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1161; }","duration":"788.674992ms","start":"2026-05-13T01:12:34.582092Z","end":"2026-05-13T01:12:35.370767Z","steps":["trace[568298340] 'range keys from in-memory index tree' (duration: 788.334207ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:35.370974Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:34.582067Z","time spent":"788.900015ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":462,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-05-13T01:12:35.371022Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"453.847209ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-05-13T01:12:35.371088Z","caller":"traceutil/trace.go:171","msg":"trace[201024418] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1161; }","duration":"453.954221ms","start":"2026-05-13T01:12:34.917117Z","end":"2026-05-13T01:12:35.371071Z","steps":["trace[201024418] 'range keys from in-memory index tree' (duration: 453.704906ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:35.371124Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:34.917097Z","time spent":"454.018622ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-05-13T01:12:35.371235Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"464.345983ms","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-05-13T01:12:35.371221Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"545.010321ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-13T01:12:35.371298Z","caller":"traceutil/trace.go:171","msg":"trace[88431524] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1161; }","duration":"545.183224ms","start":"2026-05-13T01:12:34.826098Z","end":"2026-05-13T01:12:35.371281Z","steps":["trace[88431524] 'range keys from in-memory index tree' (duration: 544.802128ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:35.371332Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:34.826066Z","time spent":"545.257105ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-05-13T01:12:35.371259Z","caller":"traceutil/trace.go:171","msg":"trace[1439835254] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1161; }","duration":"464.406664ms","start":"2026-05-13T01:12:34.906845Z","end":"2026-05-13T01:12:35.371252Z","steps":["trace[1439835254] 'range keys from in-memory index tree' (duration: 463.964277ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:35.371414Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:34.906825Z","time spent":"464.582007ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":530,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"info","ts":"2026-05-13T01:12:35.705604Z","caller":"traceutil/trace.go:171","msg":"trace[397762058] transaction","detail":"{read_only:false; response_revision:1162; number_of_response:1; }","duration":"327.059873ms","start":"2026-05-13T01:12:35.378523Z","end":"2026-05-13T01:12:35.705583Z","steps":["trace[397762058] 'process raft request' (duration: 326.929431ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:35.705733Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:35.378494Z","time spent":"327.177004ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:36.535315Z","caller":"traceutil/trace.go:171","msg":"trace[737765238] transaction","detail":"{read_only:false; response_revision:1163; number_of_response:1; }","duration":"1.156590878s","start":"2026-05-13T01:12:35.378656Z","end":"2026-05-13T01:12:36.535247Z","steps":["trace[737765238] 'process raft request' (duration: 1.140298125s)","trace[737765238] 'compare' (duration: 15.582871ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:36.535419Z","caller":"traceutil/trace.go:171","msg":"trace[1670803516] linearizableReadLoop","detail":"{readStateIndex:1213; appliedIndex:1208; }","duration":"1.126211205s","start":"2026-05-13T01:12:35.409179Z","end":"2026-05-13T01:12:36.53539Z","steps":["trace[1670803516] 'read index received' (duration: 296.328105ms)","trace[1670803516] 'applied index is now lower than readState.Index' (duration: 829.88147ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:36.535536Z","caller":"traceutil/trace.go:171","msg":"trace[1697308450] transaction","detail":"{read_only:false; response_revision:1164; number_of_response:1; }","duration":"1.1567841s","start":"2026-05-13T01:12:35.378741Z","end":"2026-05-13T01:12:36.535525Z","steps":["trace[1697308450] 'process raft request' (duration: 1.156387863s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:36.535563Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:35.378635Z","time spent":"1.15678785s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:36.535606Z","caller":"traceutil/trace.go:171","msg":"trace[2072072845] transaction","detail":"{read_only:false; response_revision:1166; number_of_response:1; }","duration":"1.156484016s","start":"2026-05-13T01:12:35.379095Z","end":"2026-05-13T01:12:36.535579Z","steps":["trace[2072072845] 'process raft request' (duration: 1.156222512s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:36.535663Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:35.378733Z","time spent":"1.156832381s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:12:36.535755Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:35.379076Z","time spent":"1.156598027s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:36.535806Z","caller":"traceutil/trace.go:171","msg":"trace[1383124827] transaction","detail":"{read_only:false; response_revision:1167; number_of_response:1; }","duration":"891.117331ms","start":"2026-05-13T01:12:35.644676Z","end":"2026-05-13T01:12:36.535794Z","steps":["trace[1383124827] 'process raft request' (duration: 890.672524ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:36.535866Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:35.644653Z","time spent":"891.175981ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:36.535912Z","caller":"traceutil/trace.go:171","msg":"trace[21629255] transaction","detail":"{read_only:false; response_revision:1165; number_of_response:1; }","duration":"1.157083404s","start":"2026-05-13T01:12:35.378816Z","end":"2026-05-13T01:12:36.535899Z","steps":["trace[21629255] 'process raft request' (duration: 1.156459725s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:36.535978Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:35.378798Z","time spent":"1.157138496s","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:12:36.536031Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.126844594s","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-05-13T01:12:36.536074Z","caller":"traceutil/trace.go:171","msg":"trace[1587890270] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:1167; }","duration":"1.126923976s","start":"2026-05-13T01:12:35.409136Z","end":"2026-05-13T01:12:36.53606Z","steps":["trace[1587890270] 'agreement among raft nodes before linearized reading' (duration: 1.126827824s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:36.536108Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:35.409103Z","time spent":"1.126995866s","remote":"127.0.0.1:57946","response type":"/etcdserverpb.KV/Range","request count":0,"request size":100,"response count":0,"response size":29,"request content":"key:\"/registry/gateway.networking.k8s.io/httproutes/\" range_end:\"/registry/gateway.networking.k8s.io/httproutes0\" count_only:true "} {"level":"info","ts":"2026-05-13T01:12:36.899242Z","caller":"traceutil/trace.go:171","msg":"trace[1047915049] transaction","detail":"{read_only:false; response_revision:1168; number_of_response:1; }","duration":"1.058681455s","start":"2026-05-13T01:12:35.840499Z","end":"2026-05-13T01:12:36.899181Z","steps":["trace[1047915049] 'process raft request' (duration: 960.046467ms)","trace[1047915049] 'compare' (duration: 98.203561ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:12:36.899428Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:35.840475Z","time spent":"1.058856279s","remote":"127.0.0.1:54490","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5897,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:12:36.966387Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"474.798403ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-13T01:12:36.966485Z","caller":"traceutil/trace.go:171","msg":"trace[250440312] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes/; range_end:/registry/cilium.io/ciliumnodes0; response_count:0; response_revision:1168; }","duration":"474.985676ms","start":"2026-05-13T01:12:36.491486Z","end":"2026-05-13T01:12:36.966472Z","steps":["trace[250440312] 'agreement among raft nodes before linearized reading' (duration: 474.804453ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:36.966545Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:36.491454Z","time spent":"475.071378ms","remote":"127.0.0.1:44796","response type":"/etcdserverpb.KV/Range","request count":0,"request size":70,"response count":1,"response size":31,"request content":"key:\"/registry/cilium.io/ciliumnodes/\" range_end:\"/registry/cilium.io/ciliumnodes0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:12:36.966587Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"607.873855ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:12:36.96672Z","caller":"traceutil/trace.go:171","msg":"trace[1202548298] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1168; }","duration":"608.104149ms","start":"2026-05-13T01:12:36.358592Z","end":"2026-05-13T01:12:36.966696Z","steps":["trace[1202548298] 'agreement among raft nodes before linearized reading' (duration: 607.827324ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:36.966776Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:36.35857Z","time spent":"608.195091ms","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-05-13T01:12:36.966259Z","caller":"traceutil/trace.go:171","msg":"trace[1111735273] linearizableReadLoop","detail":"{readStateIndex:1216; appliedIndex:1214; }","duration":"430.726511ms","start":"2026-05-13T01:12:36.535489Z","end":"2026-05-13T01:12:36.966215Z","steps":["trace[1111735273] 'read index received' (duration: 265.133676ms)","trace[1111735273] 'applied index is now lower than readState.Index' (duration: 165.591455ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:37.257757Z","caller":"traceutil/trace.go:171","msg":"trace[1421828643] transaction","detail":"{read_only:false; response_revision:1169; number_of_response:1; }","duration":"103.643459ms","start":"2026-05-13T01:12:37.15408Z","end":"2026-05-13T01:12:37.257724Z","steps":["trace[1421828643] 'process raft request' (duration: 103.452526ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:38.629114Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"918.931439ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-13T01:12:38.629203Z","caller":"traceutil/trace.go:171","msg":"trace[1516533648] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1169; }","duration":"919.087072ms","start":"2026-05-13T01:12:37.710096Z","end":"2026-05-13T01:12:38.629183Z","steps":["trace[1516533648] 'range keys from in-memory index tree' (duration: 918.735637ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:38.629242Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:37.710068Z","time spent":"919.164573ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-05-13T01:12:38.629282Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"902.427695ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-13T01:12:38.629358Z","caller":"traceutil/trace.go:171","msg":"trace[150647716] range","detail":"{range_begin:/registry/clusterroles/; range_end:/registry/clusterroles0; response_count:0; response_revision:1169; }","duration":"902.553046ms","start":"2026-05-13T01:12:37.72679Z","end":"2026-05-13T01:12:38.629343Z","steps":["trace[150647716] 'count revisions from in-memory index tree' (duration: 902.354534ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:38.629399Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:37.726776Z","time spent":"902.614857ms","remote":"127.0.0.1:54680","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":69,"response size":31,"request content":"key:\"/registry/clusterroles/\" range_end:\"/registry/clusterroles0\" count_only:true "} {"level":"warn","ts":"2026-05-13T01:12:38.629457Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"926.674539ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:12:38.629532Z","caller":"traceutil/trace.go:171","msg":"trace[1860633141] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:1169; }","duration":"926.74838ms","start":"2026-05-13T01:12:37.702769Z","end":"2026-05-13T01:12:38.629517Z","steps":["trace[1860633141] 'range keys from in-memory index tree' (duration: 926.664039ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:38.629665Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.267771044s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:12:38.629776Z","caller":"traceutil/trace.go:171","msg":"trace[797751444] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1169; }","duration":"1.267950206s","start":"2026-05-13T01:12:37.361801Z","end":"2026-05-13T01:12:38.629752Z","steps":["trace[797751444] 'range keys from in-memory index tree' (duration: 1.267648701s)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:38.62983Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:37.361774Z","time spent":"1.268045088s","remote":"127.0.0.1:54282","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-05-13T01:12:38.629927Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"493.088484ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-13T01:12:38.63035Z","caller":"traceutil/trace.go:171","msg":"trace[320723482] range","detail":"{range_begin:/registry/apiregistration.k8s.io/apiservices/; range_end:/registry/apiregistration.k8s.io/apiservices0; response_count:0; response_revision:1169; }","duration":"493.577481ms","start":"2026-05-13T01:12:38.136747Z","end":"2026-05-13T01:12:38.630325Z","steps":["trace[320723482] 'count revisions from in-memory index tree' (duration: 492.921472ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:38.630439Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.136718Z","time spent":"493.703503ms","remote":"127.0.0.1:54834","response type":"/etcdserverpb.KV/Range","request count":0,"request size":96,"response count":29,"response size":31,"request content":"key:\"/registry/apiregistration.k8s.io/apiservices/\" range_end:\"/registry/apiregistration.k8s.io/apiservices0\" count_only:true "} {"level":"info","ts":"2026-05-13T01:12:38.859328Z","caller":"traceutil/trace.go:171","msg":"trace[1890704987] transaction","detail":"{read_only:false; response_revision:1170; number_of_response:1; }","duration":"316.393796ms","start":"2026-05-13T01:12:38.542906Z","end":"2026-05-13T01:12:38.8593Z","steps":["trace[1890704987] 'process raft request' (duration: 316.240494ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:38.859352Z","caller":"traceutil/trace.go:171","msg":"trace[1587297118] linearizableReadLoop","detail":"{readStateIndex:1218; appliedIndex:1218; }","duration":"246.803716ms","start":"2026-05-13T01:12:38.612501Z","end":"2026-05-13T01:12:38.859305Z","steps":["trace[1587297118] 'read index received' (duration: 246.785876ms)","trace[1587297118] 'applied index is now lower than readState.Index' (duration: 14.84µs)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:12:38.859494Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.542885Z","time spent":"316.515188ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":535,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:12:38.859595Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"247.06156ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/gatewayclasses/\" range_end:\"/registry/gateway.networking.k8s.io/gatewayclasses0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-13T01:12:38.85964Z","caller":"traceutil/trace.go:171","msg":"trace[928236987] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/gatewayclasses/; range_end:/registry/gateway.networking.k8s.io/gatewayclasses0; response_count:0; response_revision:1170; }","duration":"247.200152ms","start":"2026-05-13T01:12:38.612428Z","end":"2026-05-13T01:12:38.859628Z","steps":["trace[928236987] 'agreement among raft nodes before linearized reading' (duration: 247.04894ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:39.360158Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":17576315826231403225,"retry-timeout":"500ms"} {"level":"info","ts":"2026-05-13T01:12:39.496086Z","caller":"traceutil/trace.go:171","msg":"trace[122358646] transaction","detail":"{read_only:false; response_revision:1171; number_of_response:1; }","duration":"857.766138ms","start":"2026-05-13T01:12:38.638285Z","end":"2026-05-13T01:12:39.496051Z","steps":["trace[122358646] 'process raft request' (duration: 857.448373ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:39.496098Z","caller":"traceutil/trace.go:171","msg":"trace[83765047] transaction","detail":"{read_only:false; response_revision:1172; number_of_response:1; }","duration":"857.752298ms","start":"2026-05-13T01:12:38.638309Z","end":"2026-05-13T01:12:39.496061Z","steps":["trace[83765047] 'process raft request' (duration: 857.637156ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:39.496291Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.638267Z","time spent":"857.904552ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:39.496493Z","caller":"traceutil/trace.go:171","msg":"trace[723874967] transaction","detail":"{read_only:false; response_revision:1173; number_of_response:1; }","duration":"858.129834ms","start":"2026-05-13T01:12:38.638339Z","end":"2026-05-13T01:12:39.496468Z","steps":["trace[723874967] 'process raft request' (duration: 857.656966ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:39.496663Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.63831Z","time spent":"858.254716ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:39.496841Z","caller":"traceutil/trace.go:171","msg":"trace[1533085466] transaction","detail":"{read_only:false; response_revision:1174; number_of_response:1; }","duration":"858.407228ms","start":"2026-05-13T01:12:38.638425Z","end":"2026-05-13T01:12:39.496832Z","steps":["trace[1533085466] 'process raft request' (duration: 857.950362ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:39.496904Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.638416Z","time spent":"858.460009ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:39.497024Z","caller":"traceutil/trace.go:171","msg":"trace[1784415234] linearizableReadLoop","detail":"{readStateIndex:1223; appliedIndex:1218; }","duration":"637.588142ms","start":"2026-05-13T01:12:38.859428Z","end":"2026-05-13T01:12:39.497016Z","steps":["trace[1784415234] 'read index received' (duration: 636.269982ms)","trace[1784415234] 'applied index is now lower than readState.Index' (duration: 1.31754ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:12:39.497164Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"862.610953ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-13T01:12:39.497208Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.020723ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:12:39.497247Z","caller":"traceutil/trace.go:171","msg":"trace[901795400] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:1175; }","duration":"128.109714ms","start":"2026-05-13T01:12:39.369128Z","end":"2026-05-13T01:12:39.497238Z","steps":["trace[901795400] 'agreement among raft nodes before linearized reading' (duration: 128.043914ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:39.49732Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"801.320599ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-13T01:12:39.497214Z","caller":"traceutil/trace.go:171","msg":"trace[701426158] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1175; }","duration":"862.685194ms","start":"2026-05-13T01:12:38.634517Z","end":"2026-05-13T01:12:39.497202Z","steps":["trace[701426158] 'agreement among raft nodes before linearized reading' (duration: 862.608383ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:39.497384Z","caller":"traceutil/trace.go:171","msg":"trace[1275905910] range","detail":"{range_begin:/registry/prioritylevelconfigurations/; range_end:/registry/prioritylevelconfigurations0; response_count:0; response_revision:1175; }","duration":"801.429571ms","start":"2026-05-13T01:12:38.695938Z","end":"2026-05-13T01:12:39.497367Z","steps":["trace[1275905910] 'agreement among raft nodes before linearized reading' (duration: 801.33104ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:39.49742Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.634494Z","time spent":"862.918127ms","remote":"127.0.0.1:54286","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-05-13T01:12:39.497436Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.695907Z","time spent":"801.516282ms","remote":"127.0.0.1:54760","response type":"/etcdserverpb.KV/Range","request count":0,"request size":82,"response count":8,"response size":31,"request content":"key:\"/registry/prioritylevelconfigurations/\" range_end:\"/registry/prioritylevelconfigurations0\" count_only:true "} {"level":"info","ts":"2026-05-13T01:12:39.497248Z","caller":"traceutil/trace.go:171","msg":"trace[2022136370] transaction","detail":"{read_only:false; response_revision:1175; number_of_response:1; }","duration":"858.625941ms","start":"2026-05-13T01:12:38.638613Z","end":"2026-05-13T01:12:39.497239Z","steps":["trace[2022136370] 'process raft request' (duration: 858.143294ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:39.497554Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.638602Z","time spent":"858.928937ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-13T01:12:39.498979Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-13T01:12:38.638272Z","time spent":"857.945152ms","remote":"127.0.0.1:54594","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-13T01:12:39.979666Z","caller":"traceutil/trace.go:171","msg":"trace[154427753] transaction","detail":"{read_only:false; response_revision:1177; number_of_response:1; }","duration":"108.100788ms","start":"2026-05-13T01:12:39.871539Z","end":"2026-05-13T01:12:39.979639Z","steps":["trace[154427753] 'process raft request' (duration: 107.925125ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:43.626963Z","caller":"traceutil/trace.go:171","msg":"trace[2116472657] transaction","detail":"{read_only:false; response_revision:1188; number_of_response:1; }","duration":"101.597437ms","start":"2026-05-13T01:12:43.525329Z","end":"2026-05-13T01:12:43.626926Z","steps":["trace[2116472657] 'process raft request' (duration: 101.328423ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:43.787622Z","caller":"traceutil/trace.go:171","msg":"trace[1896488733] transaction","detail":"{read_only:false; response_revision:1189; number_of_response:1; }","duration":"154.350934ms","start":"2026-05-13T01:12:43.633228Z","end":"2026-05-13T01:12:43.787579Z","steps":["trace[1896488733] 'process raft request' (duration: 70.302443ms)","trace[1896488733] 'compare' (duration: 83.731357ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:43.873719Z","caller":"traceutil/trace.go:171","msg":"trace[1471661995] linearizableReadLoop","detail":"{readStateIndex:1241; appliedIndex:1237; }","duration":"219.008832ms","start":"2026-05-13T01:12:43.654685Z","end":"2026-05-13T01:12:43.873694Z","steps":["trace[1471661995] 'read index received' (duration: 48.858968ms)","trace[1471661995] 'applied index is now lower than readState.Index' (duration: 170.148474ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:43.873849Z","caller":"traceutil/trace.go:171","msg":"trace[1549253887] transaction","detail":"{read_only:false; response_revision:1192; number_of_response:1; }","duration":"237.267458ms","start":"2026-05-13T01:12:43.636566Z","end":"2026-05-13T01:12:43.873834Z","steps":["trace[1549253887] 'process raft request' (duration: 237.079726ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:43.873807Z","caller":"traceutil/trace.go:171","msg":"trace[744865655] transaction","detail":"{read_only:false; response_revision:1191; number_of_response:1; }","duration":"237.189697ms","start":"2026-05-13T01:12:43.636567Z","end":"2026-05-13T01:12:43.873757Z","steps":["trace[744865655] 'process raft request' (duration: 237.030665ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:43.874152Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"219.47265ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/local-path-provisioner\" ","response":"range_response_count:1 size:1106"} {"level":"info","ts":"2026-05-13T01:12:43.874201Z","caller":"traceutil/trace.go:171","msg":"trace[591105489] range","detail":"{range_begin:/registry/clusterroles/local-path-provisioner; range_end:; response_count:1; response_revision:1192; }","duration":"219.583812ms","start":"2026-05-13T01:12:43.654604Z","end":"2026-05-13T01:12:43.874188Z","steps":["trace[591105489] 'agreement among raft nodes before linearized reading' (duration: 219.363538ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:43.874138Z","caller":"traceutil/trace.go:171","msg":"trace[2133974270] transaction","detail":"{read_only:false; response_revision:1190; number_of_response:1; }","duration":"239.635095ms","start":"2026-05-13T01:12:43.634434Z","end":"2026-05-13T01:12:43.874069Z","steps":["trace[2133974270] 'process raft request' (duration: 239.023336ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:43.96628Z","caller":"traceutil/trace.go:171","msg":"trace[131271131] transaction","detail":"{read_only:false; response_revision:1193; number_of_response:1; }","duration":"142.263712ms","start":"2026-05-13T01:12:43.823973Z","end":"2026-05-13T01:12:43.966237Z","steps":["trace[131271131] 'process raft request' (duration: 65.085655ms)","trace[131271131] 'compare' (duration: 76.781142ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:12:43.967016Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"258.860165ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:aggregate-to-admin\" ","response":"range_response_count:1 size:840"} {"level":"info","ts":"2026-05-13T01:12:43.967119Z","caller":"traceutil/trace.go:171","msg":"trace[1531738695] range","detail":"{range_begin:/registry/clusterroles/system:aggregate-to-admin; range_end:; response_count:1; response_revision:1193; }","duration":"258.979917ms","start":"2026-05-13T01:12:43.708117Z","end":"2026-05-13T01:12:43.967097Z","steps":["trace[1531738695] 'agreement among raft nodes before linearized reading' (duration: 258.776744ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:46.095893Z","caller":"traceutil/trace.go:171","msg":"trace[602485651] transaction","detail":"{read_only:false; response_revision:1197; number_of_response:1; }","duration":"212.57701ms","start":"2026-05-13T01:12:45.883267Z","end":"2026-05-13T01:12:46.095844Z","steps":["trace[602485651] 'process raft request' (duration: 146.042344ms)","trace[602485651] 'compare' (duration: 66.313473ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:46.122889Z","caller":"traceutil/trace.go:171","msg":"trace[1729610275] linearizableReadLoop","detail":"{readStateIndex:1248; appliedIndex:1245; }","duration":"207.93145ms","start":"2026-05-13T01:12:45.914908Z","end":"2026-05-13T01:12:46.122839Z","steps":["trace[1729610275] 'read index received' (duration: 114.668413ms)","trace[1729610275] 'applied index is now lower than readState.Index' (duration: 93.261587ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:12:46.123216Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"208.242044ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:endpoint-controller\" ","response":"range_response_count:1 size:756"} {"level":"info","ts":"2026-05-13T01:12:46.12327Z","caller":"traceutil/trace.go:171","msg":"trace[985377197] range","detail":"{range_begin:/registry/clusterroles/system:controller:endpoint-controller; range_end:; response_count:1; response_revision:1199; }","duration":"208.381406ms","start":"2026-05-13T01:12:45.914873Z","end":"2026-05-13T01:12:46.123254Z","steps":["trace[985377197] 'agreement among raft nodes before linearized reading' (duration: 208.115452ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:46.12356Z","caller":"traceutil/trace.go:171","msg":"trace[1119351904] transaction","detail":"{read_only:false; response_revision:1199; number_of_response:1; }","duration":"239.780598ms","start":"2026-05-13T01:12:45.88373Z","end":"2026-05-13T01:12:46.12351Z","steps":["trace[1119351904] 'process raft request' (duration: 239.062467ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:46.123591Z","caller":"traceutil/trace.go:171","msg":"trace[1600391943] transaction","detail":"{read_only:false; response_revision:1198; number_of_response:1; }","duration":"239.9563ms","start":"2026-05-13T01:12:45.883529Z","end":"2026-05-13T01:12:46.123486Z","steps":["trace[1600391943] 'process raft request' (duration: 239.101928ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:46.123598Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"200.126252ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:endpointslice-controller\" ","response":"range_response_count:1 size:793"} {"level":"info","ts":"2026-05-13T01:12:46.123768Z","caller":"traceutil/trace.go:171","msg":"trace[1293215127] range","detail":"{range_begin:/registry/clusterroles/system:controller:endpointslice-controller; range_end:; response_count:1; response_revision:1199; }","duration":"200.335745ms","start":"2026-05-13T01:12:45.923415Z","end":"2026-05-13T01:12:46.123751Z","steps":["trace[1293215127] 'agreement among raft nodes before linearized reading' (duration: 200.058441ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:47.603463Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"183.773315ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/kubeadm:get-nodes\" ","response":"range_response_count:1 size:469"} {"level":"info","ts":"2026-05-13T01:12:47.603591Z","caller":"traceutil/trace.go:171","msg":"trace[1742992260] range","detail":"{range_begin:/registry/clusterrolebindings/kubeadm:get-nodes; range_end:; response_count:1; response_revision:1201; }","duration":"183.996218ms","start":"2026-05-13T01:12:47.419566Z","end":"2026-05-13T01:12:47.603562Z","steps":["trace[1742992260] 'range keys from in-memory index tree' (duration: 183.538202ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:47.603671Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"180.169912ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:job-controller\" ","response":"range_response_count:1 size:782"} {"level":"info","ts":"2026-05-13T01:12:47.603794Z","caller":"traceutil/trace.go:171","msg":"trace[194004021] range","detail":"{range_begin:/registry/clusterroles/system:controller:job-controller; range_end:; response_count:1; response_revision:1201; }","duration":"180.372835ms","start":"2026-05-13T01:12:47.423392Z","end":"2026-05-13T01:12:47.603764Z","steps":["trace[194004021] 'range keys from in-memory index tree' (duration: 180.01953ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:47.925358Z","caller":"traceutil/trace.go:171","msg":"trace[1311619497] linearizableReadLoop","detail":"{readStateIndex:1252; appliedIndex:1251; }","duration":"228.036707ms","start":"2026-05-13T01:12:47.697293Z","end":"2026-05-13T01:12:47.92533Z","steps":["trace[1311619497] 'read index received' (duration: 227.718992ms)","trace[1311619497] 'applied index is now lower than readState.Index' (duration: 315.564µs)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:47.925407Z","caller":"traceutil/trace.go:171","msg":"trace[1594144051] transaction","detail":"{read_only:false; response_revision:1202; number_of_response:1; }","duration":"244.752666ms","start":"2026-05-13T01:12:47.680604Z","end":"2026-05-13T01:12:47.925357Z","steps":["trace[1594144051] 'process raft request' (duration: 244.427051ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:47.925559Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"148.737502ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/kubeadm:kubelet-bootstrap\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-05-13T01:12:47.925599Z","caller":"traceutil/trace.go:171","msg":"trace[938820313] range","detail":"{range_begin:/registry/clusterrolebindings/kubeadm:kubelet-bootstrap; range_end:; response_count:1; response_revision:1202; }","duration":"148.842424ms","start":"2026-05-13T01:12:47.776743Z","end":"2026-05-13T01:12:47.925585Z","steps":["trace[938820313] 'agreement among raft nodes before linearized reading' (duration: 148.738273ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:47.925573Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.24976ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:job-controller\" ","response":"range_response_count:1 size:782"} {"level":"info","ts":"2026-05-13T01:12:47.925673Z","caller":"traceutil/trace.go:171","msg":"trace[1419279800] range","detail":"{range_begin:/registry/clusterroles/system:controller:job-controller; range_end:; response_count:1; response_revision:1202; }","duration":"228.411962ms","start":"2026-05-13T01:12:47.697237Z","end":"2026-05-13T01:12:47.925649Z","steps":["trace[1419279800] 'agreement among raft nodes before linearized reading' (duration: 228.152687ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:47.925816Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"104.537882ms","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-05-13T01:12:47.925856Z","caller":"traceutil/trace.go:171","msg":"trace[1408593234] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1202; }","duration":"104.652884ms","start":"2026-05-13T01:12:47.821192Z","end":"2026-05-13T01:12:47.925845Z","steps":["trace[1408593234] 'agreement among raft nodes before linearized reading' (duration: 104.459321ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:48.147098Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.770662ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/kubeadm:kubelet-bootstrap\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-05-13T01:12:48.147249Z","caller":"traceutil/trace.go:171","msg":"trace[46029814] range","detail":"{range_begin:/registry/clusterrolebindings/kubeadm:kubelet-bootstrap; range_end:; response_count:1; response_revision:1203; }","duration":"141.952765ms","start":"2026-05-13T01:12:48.005231Z","end":"2026-05-13T01:12:48.147184Z","steps":["trace[46029814] 'range keys from in-memory index tree' (duration: 141.614619ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:48.147466Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.589865ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:namespace-controller\" ","response":"range_response_count:1 size:725"} {"level":"info","ts":"2026-05-13T01:12:48.147508Z","caller":"traceutil/trace.go:171","msg":"trace[382811458] range","detail":"{range_begin:/registry/clusterroles/system:controller:namespace-controller; range_end:; response_count:1; response_revision:1203; }","duration":"126.665706ms","start":"2026-05-13T01:12:48.020832Z","end":"2026-05-13T01:12:48.147498Z","steps":["trace[382811458] 'range keys from in-memory index tree' (duration: 126.459314ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:48.311903Z","caller":"traceutil/trace.go:171","msg":"trace[1576866788] transaction","detail":"{read_only:false; response_revision:1205; number_of_response:1; }","duration":"158.042564ms","start":"2026-05-13T01:12:48.153823Z","end":"2026-05-13T01:12:48.311865Z","steps":["trace[1576866788] 'process raft request' (duration: 108.638938ms)","trace[1576866788] 'compare' (duration: 49.133032ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:48.312219Z","caller":"traceutil/trace.go:171","msg":"trace[757183002] transaction","detail":"{read_only:false; response_revision:1206; number_of_response:1; }","duration":"156.656063ms","start":"2026-05-13T01:12:48.15551Z","end":"2026-05-13T01:12:48.312166Z","steps":["trace[757183002] 'process raft request' (duration: 156.292887ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:12:48.590174Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"159.471005ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:node-controller\" ","response":"range_response_count:1 size:837"} {"level":"info","ts":"2026-05-13T01:12:48.590305Z","caller":"traceutil/trace.go:171","msg":"trace[880623122] range","detail":"{range_begin:/registry/clusterroles/system:controller:node-controller; range_end:; response_count:1; response_revision:1206; }","duration":"159.637207ms","start":"2026-05-13T01:12:48.430633Z","end":"2026-05-13T01:12:48.59027Z","steps":["trace[880623122] 'range keys from in-memory index tree' (duration: 159.318412ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:51.350116Z","caller":"traceutil/trace.go:171","msg":"trace[2044956392] transaction","detail":"{read_only:false; response_revision:1214; number_of_response:1; }","duration":"148.889868ms","start":"2026-05-13T01:12:51.201199Z","end":"2026-05-13T01:12:51.350089Z","steps":["trace[2044956392] 'process raft request' (duration: 118.063533ms)","trace[2044956392] 'compare' (duration: 30.656433ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:12:51.3501Z","caller":"traceutil/trace.go:171","msg":"trace[1832012919] linearizableReadLoop","detail":"{readStateIndex:1265; appliedIndex:1264; }","duration":"145.300895ms","start":"2026-05-13T01:12:51.204764Z","end":"2026-05-13T01:12:51.350065Z","steps":["trace[1832012919] 'read index received' (duration: 114.49087ms)","trace[1832012919] 'applied index is now lower than readState.Index' (duration: 30.808715ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:12:51.350282Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.503198ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:statefulset-controller\" ","response":"range_response_count:1 size:990"} {"level":"info","ts":"2026-05-13T01:12:51.350346Z","caller":"traceutil/trace.go:171","msg":"trace[633627933] range","detail":"{range_begin:/registry/clusterroles/system:controller:statefulset-controller; range_end:; response_count:1; response_revision:1214; }","duration":"145.63559ms","start":"2026-05-13T01:12:51.204677Z","end":"2026-05-13T01:12:51.350313Z","steps":["trace[633627933] 'agreement among raft nodes before linearized reading' (duration: 145.483818ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:12:58.435944Z","caller":"traceutil/trace.go:171","msg":"trace[1088301826] transaction","detail":"{read_only:false; response_revision:1237; number_of_response:1; }","duration":"157.846355ms","start":"2026-05-13T01:12:58.278073Z","end":"2026-05-13T01:12:58.435919Z","steps":["trace[1088301826] 'process raft request' (duration: 157.49064ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:13:08.73248Z","caller":"traceutil/trace.go:171","msg":"trace[533144517] transaction","detail":"{read_only:false; response_revision:1272; number_of_response:1; }","duration":"130.053686ms","start":"2026-05-13T01:13:08.602399Z","end":"2026-05-13T01:13:08.732453Z","steps":["trace[533144517] 'process raft request' (duration: 129.801552ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:13:08.971275Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.049949ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/kube-system/\" range_end:\"/registry/events/kube-system0\" limit:500 ","response":"range_response_count:85 size:63172"} {"level":"info","ts":"2026-05-13T01:13:08.971398Z","caller":"traceutil/trace.go:171","msg":"trace[1635513911] range","detail":"{range_begin:/registry/events/kube-system/; range_end:/registry/events/kube-system0; response_count:85; response_revision:1272; }","duration":"121.218831ms","start":"2026-05-13T01:13:08.850154Z","end":"2026-05-13T01:13:08.971373Z","steps":["trace[1635513911] 'range keys from in-memory index tree' (duration: 120.436401ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:13:08.971536Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.717364ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/kube-system/\" range_end:\"/registry/events/kube-system0\" limit:500 ","response":"range_response_count:85 size:63172"} {"level":"info","ts":"2026-05-13T01:13:08.971642Z","caller":"traceutil/trace.go:171","msg":"trace[101547535] range","detail":"{range_begin:/registry/events/kube-system/; range_end:/registry/events/kube-system0; response_count:85; response_revision:1272; }","duration":"103.876766ms","start":"2026-05-13T01:13:08.867739Z","end":"2026-05-13T01:13:08.971615Z","steps":["trace[101547535] 'range keys from in-memory index tree' (duration: 103.105506ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:13:11.223949Z","caller":"traceutil/trace.go:171","msg":"trace[348376855] transaction","detail":"{read_only:false; response_revision:1279; number_of_response:1; }","duration":"111.852008ms","start":"2026-05-13T01:13:11.112046Z","end":"2026-05-13T01:13:11.223898Z","steps":["trace[348376855] 'process raft request' (duration: 62.887422ms)","trace[348376855] 'compare' (duration: 48.791044ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:13:12.768815Z","caller":"traceutil/trace.go:171","msg":"trace[110173742] transaction","detail":"{read_only:false; response_revision:1284; number_of_response:1; }","duration":"136.935187ms","start":"2026-05-13T01:13:12.631857Z","end":"2026-05-13T01:13:12.768792Z","steps":["trace[110173742] 'process raft request' (duration: 136.342269ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:13:14.683454Z","caller":"traceutil/trace.go:171","msg":"trace[886139746] linearizableReadLoop","detail":"{readStateIndex:1344; appliedIndex:1343; }","duration":"142.357223ms","start":"2026-05-13T01:13:14.541073Z","end":"2026-05-13T01:13:14.68343Z","steps":["trace[886139746] 'read index received' (duration: 142.223391ms)","trace[886139746] 'applied index is now lower than readState.Index' (duration: 132.402µs)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:13:14.683602Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.506864ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/default/\" range_end:\"/registry/pods/default0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-13T01:13:14.683642Z","caller":"traceutil/trace.go:171","msg":"trace[2145322638] range","detail":"{range_begin:/registry/pods/default/; range_end:/registry/pods/default0; response_count:0; response_revision:1289; }","duration":"142.587906ms","start":"2026-05-13T01:13:14.541043Z","end":"2026-05-13T01:13:14.683631Z","steps":["trace[2145322638] 'agreement among raft nodes before linearized reading' (duration: 142.483015ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:13:14.683833Z","caller":"traceutil/trace.go:171","msg":"trace[1851891448] transaction","detail":"{read_only:false; response_revision:1289; number_of_response:1; }","duration":"144.963219ms","start":"2026-05-13T01:13:14.53853Z","end":"2026-05-13T01:13:14.683493Z","steps":["trace[1851891448] 'process raft request' (duration: 144.760917ms)"],"step_count":1} {"level":"warn","ts":"2026-05-13T01:13:16.343848Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.961489ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-05-13T01:13:16.344338Z","caller":"traceutil/trace.go:171","msg":"trace[811264699] linearizableReadLoop","detail":"{readStateIndex:1349; appliedIndex:1348; }","duration":"128.26759ms","start":"2026-05-13T01:13:16.215691Z","end":"2026-05-13T01:13:16.343959Z","steps":["trace[811264699] 'read index received' (duration: 12.122729ms)","trace[811264699] 'applied index is now lower than readState.Index' (duration: 116.142811ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:13:16.344467Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.750646ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-7z7qg\" ","response":"range_response_count:1 size:18521"} {"level":"info","ts":"2026-05-13T01:13:16.344527Z","caller":"traceutil/trace.go:171","msg":"trace[1191879980] range","detail":"{range_begin:/registry/pods/kube-system/cilium-7z7qg; range_end:; response_count:1; response_revision:1293; }","duration":"128.838887ms","start":"2026-05-13T01:13:16.215673Z","end":"2026-05-13T01:13:16.344512Z","steps":["trace[1191879980] 'agreement among raft nodes before linearized reading' (duration: 128.577104ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:13:16.452808Z","caller":"traceutil/trace.go:171","msg":"trace[497661082] transaction","detail":"{read_only:false; response_revision:1294; number_of_response:1; }","duration":"102.459112ms","start":"2026-05-13T01:13:16.350318Z","end":"2026-05-13T01:13:16.452777Z","steps":["trace[497661082] 'process raft request' (duration: 102.070276ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:13:16.630961Z","caller":"traceutil/trace.go:171","msg":"trace[432278350] linearizableReadLoop","detail":"{readStateIndex:1351; appliedIndex:1350; }","duration":"167.91638ms","start":"2026-05-13T01:13:16.463013Z","end":"2026-05-13T01:13:16.630929Z","steps":["trace[432278350] 'read index received' (duration: 122.204435ms)","trace[432278350] 'applied index is now lower than readState.Index' (duration: 45.710845ms)"],"step_count":2} {"level":"info","ts":"2026-05-13T01:13:16.631457Z","caller":"traceutil/trace.go:171","msg":"trace[217973339] transaction","detail":"{read_only:false; response_revision:1295; number_of_response:1; }","duration":"173.631819ms","start":"2026-05-13T01:13:16.457756Z","end":"2026-05-13T01:13:16.631388Z","steps":["trace[217973339] 'process raft request' (duration: 127.421017ms)","trace[217973339] 'compare' (duration: 45.589312ms)"],"step_count":2} {"level":"warn","ts":"2026-05-13T01:13:16.631817Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.778871ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-7z7qg\" ","response":"range_response_count:1 size:18521"} {"level":"info","ts":"2026-05-13T01:13:16.631878Z","caller":"traceutil/trace.go:171","msg":"trace[1464358833] range","detail":"{range_begin:/registry/pods/kube-system/cilium-7z7qg; range_end:; response_count:1; response_revision:1295; }","duration":"168.945693ms","start":"2026-05-13T01:13:16.462918Z","end":"2026-05-13T01:13:16.631864Z","steps":["trace[1464358833] 'agreement among raft nodes before linearized reading' (duration: 168.127112ms)"],"step_count":1} {"level":"info","ts":"2026-05-13T01:13:18.081243Z","caller":"traceutil/trace.go:171","msg":"trace[875476506] transaction","detail":"{read_only:false; response_revision:1300; number_of_response:1; }","duration":"116.401159ms","start":"2026-05-13T01:13:17.964817Z","end":"2026-05-13T01:13:18.081218Z","steps":["trace[875476506] 'process raft request' (duration: 115.77072ms)"],"step_count":1}