{"level":"warn","ts":"2026-05-06T00:43:29.571856Z","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-06T00:43:29.571951Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.115: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.19.213.115:2380","--initial-cluster=instance=https://199.19.213.115:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.115:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.115: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-06T00:43:29.572023Z","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-06T00:43:29.572037Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.115:2380"]} {"level":"info","ts":"2026-05-06T00:43:29.572066Z","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-06T00:43:29.57277Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.115:2379"]} {"level":"info","ts":"2026-05-06T00:43:29.572861Z","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.19.213.115:2380"],"listen-peer-urls":["https://199.19.213.115:2380"],"advertise-client-urls":["https://199.19.213.115:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.115:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.115: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-06T00:43:29.578236Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"5.155936ms"} {"level":"info","ts":"2026-05-06T00:43:29.591799Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"76964ef0a001678d","cluster-id":"a26f37ac4c69834d"} {"level":"info","ts":"2026-05-06T00:43:29.591913Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d switched to configuration voters=()"} {"level":"info","ts":"2026-05-06T00:43:29.591949Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d became follower at term 0"} {"level":"info","ts":"2026-05-06T00:43:29.591974Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 76964ef0a001678d [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-06T00:43:29.591993Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d became follower at term 1"} {"level":"info","ts":"2026-05-06T00:43:29.592055Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d switched to configuration voters=(8545104138365659021)"} {"level":"warn","ts":"2026-05-06T00:43:29.602704Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-06T00:43:29.604549Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-06T00:43:29.605929Z","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-06T00:43:29.608799Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"76964ef0a001678d","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-06T00:43:29.609036Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"76964ef0a001678d","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-06T00:43:29.609284Z","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-06T00:43:29.609382Z","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-06T00:43:29.609407Z","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-06T00:43:29.609988Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d switched to configuration voters=(8545104138365659021)"} {"level":"info","ts":"2026-05-06T00:43:29.612459Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"a26f37ac4c69834d","local-member-id":"76964ef0a001678d","added-peer-id":"76964ef0a001678d","added-peer-peer-urls":["https://199.19.213.115:2380"]} {"level":"info","ts":"2026-05-06T00:43:29.614455Z","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-06T00:43:29.614731Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.115:2380"} {"level":"info","ts":"2026-05-06T00:43:29.614788Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.115:2380"} {"level":"info","ts":"2026-05-06T00:43:29.614809Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"76964ef0a001678d","initial-advertise-peer-urls":["https://199.19.213.115:2380"],"listen-peer-urls":["https://199.19.213.115:2380"],"advertise-client-urls":["https://199.19.213.115:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.115:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-06T00:43:29.61487Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-06T00:43:30.292411Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d is starting a new election at term 1"} {"level":"info","ts":"2026-05-06T00:43:30.292483Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d became pre-candidate at term 1"} {"level":"info","ts":"2026-05-06T00:43:30.292521Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d received MsgPreVoteResp from 76964ef0a001678d at term 1"} {"level":"info","ts":"2026-05-06T00:43:30.29254Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d became candidate at term 2"} {"level":"info","ts":"2026-05-06T00:43:30.29255Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d received MsgVoteResp from 76964ef0a001678d at term 2"} {"level":"info","ts":"2026-05-06T00:43:30.292566Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"76964ef0a001678d became leader at term 2"} {"level":"info","ts":"2026-05-06T00:43:30.292579Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 76964ef0a001678d elected leader 76964ef0a001678d at term 2"} {"level":"info","ts":"2026-05-06T00:43:30.295006Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-06T00:43:30.296786Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-06T00:43:30.296802Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-06T00:43:30.296789Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"76964ef0a001678d","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.115:2379]}","request-path":"/0/members/76964ef0a001678d/attributes","cluster-id":"a26f37ac4c69834d","publish-timeout":"7s"} {"level":"info","ts":"2026-05-06T00:43:30.297177Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-06T00:43:30.29722Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-06T00:43:30.298949Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-06T00:43:30.299358Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"a26f37ac4c69834d","local-member-id":"76964ef0a001678d","cluster-version":"3.5"} {"level":"info","ts":"2026-05-06T00:43:30.299469Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-06T00:43:30.299507Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-06T00:43:30.305897Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.115:2379"} {"level":"info","ts":"2026-05-06T00:43:33.724065Z","caller":"traceutil/trace.go:171","msg":"trace[1356480162] transaction","detail":"{read_only:false; response_revision:188; number_of_response:1; }","duration":"137.338259ms","start":"2026-05-06T00:43:33.586687Z","end":"2026-05-06T00:43:33.724026Z","steps":["trace[1356480162] 'process raft request' (duration: 49.426197ms)","trace[1356480162] 'compare' (duration: 87.748827ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T00:43:38.42477Z","caller":"traceutil/trace.go:171","msg":"trace[1623865412] transaction","detail":"{read_only:false; response_revision:288; number_of_response:1; }","duration":"105.018123ms","start":"2026-05-06T00:43:38.319723Z","end":"2026-05-06T00:43:38.424741Z","steps":["trace[1623865412] 'process raft request' (duration: 104.697264ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:43:38.773862Z","caller":"traceutil/trace.go:171","msg":"trace[2036593959] transaction","detail":"{read_only:false; response_revision:291; number_of_response:1; }","duration":"154.785979ms","start":"2026-05-06T00:43:38.618975Z","end":"2026-05-06T00:43:38.773761Z","steps":["trace[2036593959] 'process raft request' (duration: 104.341374ms)","trace[2036593959] 'compare' (duration: 50.27193ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T00:43:39.090719Z","caller":"traceutil/trace.go:171","msg":"trace[1589126366] linearizableReadLoop","detail":"{readStateIndex:304; appliedIndex:303; }","duration":"105.66268ms","start":"2026-05-06T00:43:38.985033Z","end":"2026-05-06T00:43:39.090696Z","steps":["trace[1589126366] 'read index received' (duration: 105.476355ms)","trace[1589126366] 'applied index is now lower than readState.Index' (duration: 184.715µs)"],"step_count":2} {"level":"warn","ts":"2026-05-06T00:43:39.090957Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"105.840835ms","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-06T00:43:39.091056Z","caller":"traceutil/trace.go:171","msg":"trace[812008919] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:292; }","duration":"106.0275ms","start":"2026-05-06T00:43:38.985015Z","end":"2026-05-06T00:43:39.091043Z","steps":["trace[812008919] 'agreement among raft nodes before linearized reading' (duration: 105.780063ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:43:39.090981Z","caller":"traceutil/trace.go:171","msg":"trace[855365847] transaction","detail":"{read_only:false; response_revision:292; number_of_response:1; }","duration":"170.829906ms","start":"2026-05-06T00:43:38.920095Z","end":"2026-05-06T00:43:39.090925Z","steps":["trace[855365847] 'process raft request' (duration: 170.475447ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:39.630008Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.081082ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-06T00:43:39.630129Z","caller":"traceutil/trace.go:171","msg":"trace[439362796] linearizableReadLoop","detail":"{readStateIndex:309; appliedIndex:308; }","duration":"111.16681ms","start":"2026-05-06T00:43:39.518944Z","end":"2026-05-06T00:43:39.630111Z","steps":["trace[439362796] 'read index received' (duration: 27.121µs)","trace[439362796] 'applied index is now lower than readState.Index' (duration: 111.138349ms)"],"step_count":2} {"level":"warn","ts":"2026-05-06T00:43:39.630193Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.257462ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpoint-controller\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-06T00:43:39.630225Z","caller":"traceutil/trace.go:171","msg":"trace[260767731] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpoint-controller; range_end:; response_count:0; response_revision:297; }","duration":"111.317814ms","start":"2026-05-06T00:43:39.518898Z","end":"2026-05-06T00:43:39.630216Z","steps":["trace[260767731] 'agreement among raft nodes before linearized reading' (duration: 111.259242ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:43:39.630338Z","caller":"traceutil/trace.go:171","msg":"trace[2028775676] transaction","detail":"{read_only:false; response_revision:297; number_of_response:1; }","duration":"123.859518ms","start":"2026-05-06T00:43:39.506277Z","end":"2026-05-06T00:43:39.630137Z","steps":["trace[2028775676] 'process raft request' (duration: 10.035365ms)","trace[2028775676] 'compare' (duration: 112.906867ms)"],"step_count":2} {"level":"warn","ts":"2026-05-06T00:43:39.914574Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.383698ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/root-ca-cert-publisher\" ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-05-06T00:43:39.914634Z","caller":"traceutil/trace.go:171","msg":"trace[2111415863] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/root-ca-cert-publisher; range_end:; response_count:1; response_revision:298; }","duration":"145.498861ms","start":"2026-05-06T00:43:39.769123Z","end":"2026-05-06T00:43:39.914622Z","steps":["trace[2111415863] 'range keys from in-memory index tree' (duration: 145.273524ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:43:40.190031Z","caller":"traceutil/trace.go:171","msg":"trace[1286829206] transaction","detail":"{read_only:false; response_revision:299; number_of_response:1; }","duration":"267.210292ms","start":"2026-05-06T00:43:39.922792Z","end":"2026-05-06T00:43:40.190002Z","steps":["trace[1286829206] 'process raft request' (duration: 267.080619ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:43:40.190795Z","caller":"traceutil/trace.go:171","msg":"trace[1682395145] linearizableReadLoop","detail":"{readStateIndex:312; appliedIndex:310; }","duration":"267.741807ms","start":"2026-05-06T00:43:39.923023Z","end":"2026-05-06T00:43:40.190765Z","steps":["trace[1682395145] 'read index received' (duration: 266.852823ms)","trace[1682395145] 'applied index is now lower than readState.Index' (duration: 887.814µs)"],"step_count":2} {"level":"info","ts":"2026-05-06T00:43:40.190961Z","caller":"traceutil/trace.go:171","msg":"trace[216299200] transaction","detail":"{read_only:false; response_revision:300; number_of_response:1; }","duration":"268.080146ms","start":"2026-05-06T00:43:39.922866Z","end":"2026-05-06T00:43:40.190946Z","steps":["trace[216299200] 'process raft request' (duration: 267.722056ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:40.191152Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.123507ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/service-account-controller\" ","response":"range_response_count:1 size:218"} {"level":"info","ts":"2026-05-06T00:43:40.19122Z","caller":"traceutil/trace.go:171","msg":"trace[166485536] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/service-account-controller; range_end:; response_count:1; response_revision:300; }","duration":"268.20125ms","start":"2026-05-06T00:43:39.922999Z","end":"2026-05-06T00:43:40.1912Z","steps":["trace[166485536] 'agreement among raft nodes before linearized reading' (duration: 268.066606ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:40.191217Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"180.714322ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-06T00:43:40.191293Z","caller":"traceutil/trace.go:171","msg":"trace[408038858] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:300; }","duration":"180.837497ms","start":"2026-05-06T00:43:40.010438Z","end":"2026-05-06T00:43:40.191275Z","steps":["trace[408038858] 'agreement among raft nodes before linearized reading' (duration: 180.739064ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:40.191369Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"222.348751ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/ttl-controller\" ","response":"range_response_count:1 size:193"} {"level":"info","ts":"2026-05-06T00:43:40.19141Z","caller":"traceutil/trace.go:171","msg":"trace[521185304] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/ttl-controller; range_end:; response_count:1; response_revision:300; }","duration":"222.407123ms","start":"2026-05-06T00:43:39.968991Z","end":"2026-05-06T00:43:40.191398Z","steps":["trace[521185304] 'agreement among raft nodes before linearized reading' (duration: 222.329681ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:40.191475Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.623983ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/certificate-controller\" ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-05-06T00:43:40.191535Z","caller":"traceutil/trace.go:171","msg":"trace[571299372] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/certificate-controller; range_end:; response_count:1; response_revision:300; }","duration":"122.707295ms","start":"2026-05-06T00:43:40.068812Z","end":"2026-05-06T00:43:40.19152Z","steps":["trace[571299372] 'agreement among raft nodes before linearized reading' (duration: 122.345525ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:40.191478Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.382799ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpointslice-controller\" ","response":"range_response_count:1 size:214"} {"level":"warn","ts":"2026-05-06T00:43:40.191635Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.03ms","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-06T00:43:40.19168Z","caller":"traceutil/trace.go:171","msg":"trace[1446712867] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:300; }","duration":"227.106031ms","start":"2026-05-06T00:43:39.964564Z","end":"2026-05-06T00:43:40.19167Z","steps":["trace[1446712867] 'agreement among raft nodes before linearized reading' (duration: 226.441033ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:43:40.19175Z","caller":"traceutil/trace.go:171","msg":"trace[971139995] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpointslice-controller; range_end:; response_count:1; response_revision:300; }","duration":"172.680867ms","start":"2026-05-06T00:43:40.018957Z","end":"2026-05-06T00:43:40.191637Z","steps":["trace[971139995] 'agreement among raft nodes before linearized reading' (duration: 172.187234ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:41.034465Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.73277ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-05-06T00:43:41.034569Z","caller":"traceutil/trace.go:171","msg":"trace[1740134140] linearizableReadLoop","detail":"{readStateIndex:348; appliedIndex:347; }","duration":"255.096704ms","start":"2026-05-06T00:43:40.779453Z","end":"2026-05-06T00:43:41.03455Z","steps":["trace[1740134140] 'read index received' (duration: 145.099417ms)","trace[1740134140] 'applied index is now lower than readState.Index' (duration: 109.995777ms)"],"step_count":2} {"level":"info","ts":"2026-05-06T00:43:41.034674Z","caller":"traceutil/trace.go:171","msg":"trace[1316464706] transaction","detail":"{read_only:false; response_revision:336; number_of_response:1; }","duration":"261.988078ms","start":"2026-05-06T00:43:40.772674Z","end":"2026-05-06T00:43:41.034662Z","steps":["trace[1316464706] 'process raft request' (duration: 151.966901ms)","trace[1316464706] 'compare' (duration: 109.451972ms)"],"step_count":2} {"level":"warn","ts":"2026-05-06T00:43:41.034885Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"255.409892ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/daemonsets/kube-system/kube-proxy\" ","response":"range_response_count:1 size:2901"} {"level":"info","ts":"2026-05-06T00:43:41.034967Z","caller":"traceutil/trace.go:171","msg":"trace[971498195] range","detail":"{range_begin:/registry/daemonsets/kube-system/kube-proxy; range_end:; response_count:1; response_revision:336; }","duration":"255.529306ms","start":"2026-05-06T00:43:40.779418Z","end":"2026-05-06T00:43:41.034947Z","steps":["trace[971498195] 'agreement among raft nodes before linearized reading' (duration: 255.370831ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:41.035165Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"215.298665ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/replicaset-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-05-06T00:43:41.035282Z","caller":"traceutil/trace.go:171","msg":"trace[465289481] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/replicaset-controller; range_end:; response_count:1; response_revision:336; }","duration":"215.787548ms","start":"2026-05-06T00:43:40.819476Z","end":"2026-05-06T00:43:41.035264Z","steps":["trace[465289481] 'agreement among raft nodes before linearized reading' (duration: 215.247184ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:43:41.199476Z","caller":"traceutil/trace.go:171","msg":"trace[1771695879] transaction","detail":"{read_only:false; response_revision:337; number_of_response:1; }","duration":"155.117689ms","start":"2026-05-06T00:43:41.04431Z","end":"2026-05-06T00:43:41.199427Z","steps":["trace[1771695879] 'process raft request' (duration: 152.820429ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:41.770943Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.938415ms","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-06T00:43:41.771033Z","caller":"traceutil/trace.go:171","msg":"trace[1301821598] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:349; }","duration":"136.090639ms","start":"2026-05-06T00:43:41.634923Z","end":"2026-05-06T00:43:41.771014Z","steps":["trace[1301821598] 'range keys from in-memory index tree' (duration: 135.769531ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:43:55.024585Z","caller":"traceutil/trace.go:171","msg":"trace[412026541] transaction","detail":"{read_only:false; response_revision:421; number_of_response:1; }","duration":"456.617921ms","start":"2026-05-06T00:43:54.567939Z","end":"2026-05-06T00:43:55.024557Z","steps":["trace[412026541] 'process raft request' (duration: 456.478898ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:43:55.024753Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:43:54.567923Z","time spent":"456.746113ms","remote":"127.0.0.1:42060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-06T00:44:04.675613Z","caller":"traceutil/trace.go:171","msg":"trace[951740106] transaction","detail":"{read_only:false; response_revision:547; number_of_response:1; }","duration":"126.977532ms","start":"2026-05-06T00:44:04.548596Z","end":"2026-05-06T00:44:04.675574Z","steps":["trace[951740106] 'process raft request' (duration: 120.770814ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:07.253653Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"175.364509ms","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-06T00:44:07.253744Z","caller":"traceutil/trace.go:171","msg":"trace[1548404846] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:597; }","duration":"175.486181ms","start":"2026-05-06T00:44:07.078236Z","end":"2026-05-06T00:44:07.253722Z","steps":["trace[1548404846] 'range keys from in-memory index tree' (duration: 175.238567ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:07.413321Z","caller":"traceutil/trace.go:171","msg":"trace[1639729346] transaction","detail":"{read_only:false; response_revision:598; number_of_response:1; }","duration":"191.330053ms","start":"2026-05-06T00:44:07.221963Z","end":"2026-05-06T00:44:07.413293Z","steps":["trace[1639729346] 'process raft request' (duration: 190.774914ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:07.414588Z","caller":"traceutil/trace.go:171","msg":"trace[307805109] transaction","detail":"{read_only:false; response_revision:599; number_of_response:1; }","duration":"156.75951ms","start":"2026-05-06T00:44:07.257808Z","end":"2026-05-06T00:44:07.414568Z","steps":["trace[307805109] 'process raft request' (duration: 156.444825ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:08.596231Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.868624ms","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-06T00:44:08.596351Z","caller":"traceutil/trace.go:171","msg":"trace[1559532393] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:608; }","duration":"190.053948ms","start":"2026-05-06T00:44:08.406282Z","end":"2026-05-06T00:44:08.596335Z","steps":["trace[1559532393] 'range keys from in-memory index tree' (duration: 189.747982ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:08.59654Z","caller":"traceutil/trace.go:171","msg":"trace[122025979] transaction","detail":"{read_only:false; response_revision:609; number_of_response:1; }","duration":"181.469627ms","start":"2026-05-06T00:44:08.415043Z","end":"2026-05-06T00:44:08.596512Z","steps":["trace[122025979] 'process raft request' (duration: 181.0308ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:08.597003Z","caller":"traceutil/trace.go:171","msg":"trace[829252625] transaction","detail":"{read_only:false; response_revision:610; number_of_response:1; }","duration":"147.836567ms","start":"2026-05-06T00:44:08.449148Z","end":"2026-05-06T00:44:08.596984Z","steps":["trace[829252625] 'process raft request' (duration: 147.722855ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:13.940012Z","caller":"traceutil/trace.go:171","msg":"trace[1236794946] transaction","detail":"{read_only:false; response_revision:646; number_of_response:1; }","duration":"487.589496ms","start":"2026-05-06T00:44:13.452393Z","end":"2026-05-06T00:44:13.939983Z","steps":["trace[1236794946] 'process raft request' (duration: 487.343393ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:13.940207Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:13.452373Z","time spent":"487.727749ms","remote":"127.0.0.1:42060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-06T00:44:13.940542Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"478.518839ms","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-06T00:44:13.940603Z","caller":"traceutil/trace.go:171","msg":"trace[1680200209] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:646; }","duration":"478.62262ms","start":"2026-05-06T00:44:13.461968Z","end":"2026-05-06T00:44:13.940591Z","steps":["trace[1680200209] 'agreement among raft nodes before linearized reading' (duration: 478.229284ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:13.94064Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:13.461954Z","time spent":"478.678041ms","remote":"127.0.0.1:42060","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-06T00:44:13.940152Z","caller":"traceutil/trace.go:171","msg":"trace[1997714432] linearizableReadLoop","detail":"{readStateIndex:668; appliedIndex:667; }","duration":"477.876439ms","start":"2026-05-06T00:44:13.462012Z","end":"2026-05-06T00:44:13.939889Z","steps":["trace[1997714432] 'read index received' (duration: 477.625755ms)","trace[1997714432] 'applied index is now lower than readState.Index' (duration: 249.634µs)"],"step_count":2} {"level":"warn","ts":"2026-05-06T00:44:13.94096Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"217.744885ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-dh975\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-05-06T00:44:13.940995Z","caller":"traceutil/trace.go:171","msg":"trace[1399215184] range","detail":"{range_begin:/registry/pods/kube-system/cilium-dh975; range_end:; response_count:1; response_revision:646; }","duration":"217.808487ms","start":"2026-05-06T00:44:13.723178Z","end":"2026-05-06T00:44:13.940986Z","steps":["trace[1399215184] 'agreement among raft nodes before linearized reading' (duration: 217.701875ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:13.940913Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"326.378845ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-05-06T00:44:13.941135Z","caller":"traceutil/trace.go:171","msg":"trace[1932529234] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:646; }","duration":"326.639729ms","start":"2026-05-06T00:44:13.61448Z","end":"2026-05-06T00:44:13.94112Z","steps":["trace[1932529234] 'agreement among raft nodes before linearized reading' (duration: 326.329324ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:13.94139Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:13.614461Z","time spent":"326.914693ms","remote":"127.0.0.1:42060","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-06T00:44:16.124668Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.170780057s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-06T00:44:16.12477Z","caller":"traceutil/trace.go:171","msg":"trace[1273544926] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:652; }","duration":"1.170925649s","start":"2026-05-06T00:44:14.953825Z","end":"2026-05-06T00:44:16.12475Z","steps":["trace[1273544926] 'range keys from in-memory index tree' (duration: 1.170700366s)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:16.124814Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:14.953784Z","time spent":"1.171020891s","remote":"127.0.0.1:41802","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-05-06T00:44:16.124893Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.534858ms","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-06T00:44:16.125Z","caller":"traceutil/trace.go:171","msg":"trace[914445764] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:652; }","duration":"100.66328ms","start":"2026-05-06T00:44:16.02432Z","end":"2026-05-06T00:44:16.124983Z","steps":["trace[914445764] 'range keys from in-memory index tree' (duration: 100.304654ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:16.124673Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.3738ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-05-06T00:44:16.125165Z","caller":"traceutil/trace.go:171","msg":"trace[2134258092] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:652; }","duration":"103.904768ms","start":"2026-05-06T00:44:16.021248Z","end":"2026-05-06T00:44:16.125153Z","steps":["trace[2134258092] 'range keys from in-memory index tree' (duration: 103.214427ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:16.124673Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.183275ms","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-06T00:44:16.125333Z","caller":"traceutil/trace.go:171","msg":"trace[1231965283] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:652; }","duration":"179.892856ms","start":"2026-05-06T00:44:15.94543Z","end":"2026-05-06T00:44:16.125323Z","steps":["trace[1231965283] 'range keys from in-memory index tree' (duration: 179.038093ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:16.125069Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"845.266301ms","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-06T00:44:16.125469Z","caller":"traceutil/trace.go:171","msg":"trace[1549663821] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:652; }","duration":"845.674057ms","start":"2026-05-06T00:44:15.279775Z","end":"2026-05-06T00:44:16.125449Z","steps":["trace[1549663821] 'range keys from in-memory index tree' (duration: 845.229641ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:16.230007Z","caller":"traceutil/trace.go:171","msg":"trace[562471477] transaction","detail":"{read_only:false; response_revision:653; number_of_response:1; }","duration":"100.247553ms","start":"2026-05-06T00:44:16.129736Z","end":"2026-05-06T00:44:16.229983Z","steps":["trace[562471477] 'process raft request' (duration: 100.06123ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:16.531248Z","caller":"traceutil/trace.go:171","msg":"trace[1981717929] transaction","detail":"{read_only:false; response_revision:654; number_of_response:1; }","duration":"400.541248ms","start":"2026-05-06T00:44:16.130676Z","end":"2026-05-06T00:44:16.531217Z","steps":["trace[1981717929] 'process raft request' (duration: 400.319355ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:16.531288Z","caller":"traceutil/trace.go:171","msg":"trace[417766454] linearizableReadLoop","detail":"{readStateIndex:679; appliedIndex:675; }","duration":"396.030262ms","start":"2026-05-06T00:44:16.135206Z","end":"2026-05-06T00:44:16.531236Z","steps":["trace[417766454] 'read index received' (duration: 94.66003ms)","trace[417766454] 'applied index is now lower than readState.Index' (duration: 301.363751ms)"],"step_count":2} {"level":"warn","ts":"2026-05-06T00:44:16.53139Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:16.130658Z","time spent":"400.656561ms","remote":"127.0.0.1:42060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-06T00:44:16.531436Z","caller":"traceutil/trace.go:171","msg":"trace[662421198] transaction","detail":"{read_only:false; response_revision:656; number_of_response:1; }","duration":"400.051801ms","start":"2026-05-06T00:44:16.131357Z","end":"2026-05-06T00:44:16.531409Z","steps":["trace[662421198] 'process raft request' (duration: 399.830218ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:16.531587Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:16.131347Z","time spent":"400.164113ms","remote":"127.0.0.1:42060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-05-06T00:44:16.531326Z","caller":"traceutil/trace.go:171","msg":"trace[2081471324] transaction","detail":"{read_only:false; response_revision:655; number_of_response:1; }","duration":"399.96374ms","start":"2026-05-06T00:44:16.131321Z","end":"2026-05-06T00:44:16.531285Z","steps":["trace[2081471324] 'process raft request' (duration: 399.827378ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:16.531734Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:16.131311Z","time spent":"400.388416ms","remote":"127.0.0.1:42060","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-05-06T00:44:16.531401Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"396.167045ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-06T00:44:16.53184Z","caller":"traceutil/trace.go:171","msg":"trace[309183191] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:656; }","duration":"396.646881ms","start":"2026-05-06T00:44:16.135182Z","end":"2026-05-06T00:44:16.531829Z","steps":["trace[309183191] 'agreement among raft nodes before linearized reading' (duration: 396.165244ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:16.531881Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:16.135172Z","time spent":"396.700062ms","remote":"127.0.0.1:41802","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-05-06T00:44:21.909029Z","caller":"traceutil/trace.go:171","msg":"trace[563654472] transaction","detail":"{read_only:false; response_revision:690; number_of_response:1; }","duration":"125.080225ms","start":"2026-05-06T00:44:21.78393Z","end":"2026-05-06T00:44:21.90901Z","steps":["trace[563654472] 'process raft request' (duration: 124.979853ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:22.736895Z","caller":"traceutil/trace.go:171","msg":"trace[854384451] linearizableReadLoop","detail":"{readStateIndex:718; appliedIndex:717; }","duration":"186.204454ms","start":"2026-05-06T00:44:22.550664Z","end":"2026-05-06T00:44:22.736869Z","steps":["trace[854384451] 'read index received' (duration: 185.978911ms)","trace[854384451] 'applied index is now lower than readState.Index' (duration: 224.683µs)"],"step_count":2} {"level":"info","ts":"2026-05-06T00:44:22.73701Z","caller":"traceutil/trace.go:171","msg":"trace[2147369779] transaction","detail":"{read_only:false; response_revision:694; number_of_response:1; }","duration":"190.30289ms","start":"2026-05-06T00:44:22.546668Z","end":"2026-05-06T00:44:22.736971Z","steps":["trace[2147369779] 'process raft request' (duration: 190.030137ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:22.737122Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.440337ms","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-06T00:44:22.737161Z","caller":"traceutil/trace.go:171","msg":"trace[1777549554] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:694; }","duration":"186.524259ms","start":"2026-05-06T00:44:22.550623Z","end":"2026-05-06T00:44:22.737147Z","steps":["trace[1777549554] 'agreement among raft nodes before linearized reading' (duration: 186.377917ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:22.737241Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"184.323998ms","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-06T00:44:22.73727Z","caller":"traceutil/trace.go:171","msg":"trace[115203648] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:694; }","duration":"184.386099ms","start":"2026-05-06T00:44:22.552874Z","end":"2026-05-06T00:44:22.73726Z","steps":["trace[115203648] 'agreement among raft nodes before linearized reading' (duration: 184.273398ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:22.737349Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.880342ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-05-06T00:44:22.737376Z","caller":"traceutil/trace.go:171","msg":"trace[328019467] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:694; }","duration":"156.937543ms","start":"2026-05-06T00:44:22.580431Z","end":"2026-05-06T00:44:22.737368Z","steps":["trace[328019467] 'agreement among raft nodes before linearized reading' (duration: 156.884402ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:22.737438Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"180.301243ms","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-06T00:44:22.738039Z","caller":"traceutil/trace.go:171","msg":"trace[1718748116] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:694; }","duration":"180.882792ms","start":"2026-05-06T00:44:22.557117Z","end":"2026-05-06T00:44:22.738Z","steps":["trace[1718748116] 'agreement among raft nodes before linearized reading' (duration: 180.256303ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:22.94048Z","caller":"traceutil/trace.go:171","msg":"trace[701518392] transaction","detail":"{read_only:false; response_revision:699; number_of_response:1; }","duration":"118.076629ms","start":"2026-05-06T00:44:22.822372Z","end":"2026-05-06T00:44:22.940449Z","steps":["trace[701518392] 'process raft request' (duration: 117.937467ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:29.007051Z","caller":"traceutil/trace.go:171","msg":"trace[757381186] transaction","detail":"{read_only:false; response_revision:742; number_of_response:1; }","duration":"136.869426ms","start":"2026-05-06T00:44:28.870157Z","end":"2026-05-06T00:44:29.007027Z","steps":["trace[757381186] 'process raft request' (duration: 136.721574ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:29.06487Z","caller":"traceutil/trace.go:171","msg":"trace[1044727430] transaction","detail":"{read_only:false; response_revision:743; number_of_response:1; }","duration":"194.525863ms","start":"2026-05-06T00:44:28.870313Z","end":"2026-05-06T00:44:29.064839Z","steps":["trace[1044727430] 'process raft request' (duration: 194.29926ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:29.06489Z","caller":"traceutil/trace.go:171","msg":"trace[1475309747] transaction","detail":"{read_only:false; response_revision:744; number_of_response:1; }","duration":"194.063436ms","start":"2026-05-06T00:44:28.870802Z","end":"2026-05-06T00:44:29.064866Z","steps":["trace[1475309747] 'process raft request' (duration: 193.942345ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:29.06526Z","caller":"traceutil/trace.go:171","msg":"trace[1619488923] transaction","detail":"{read_only:false; response_revision:745; number_of_response:1; }","duration":"193.241296ms","start":"2026-05-06T00:44:28.871988Z","end":"2026-05-06T00:44:29.065229Z","steps":["trace[1619488923] 'process raft request' (duration: 192.79855ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:29.065348Z","caller":"traceutil/trace.go:171","msg":"trace[823833093] transaction","detail":"{read_only:false; response_revision:746; number_of_response:1; }","duration":"192.387245ms","start":"2026-05-06T00:44:28.87293Z","end":"2026-05-06T00:44:29.065318Z","steps":["trace[823833093] 'process raft request' (duration: 192.071051ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:29.065374Z","caller":"traceutil/trace.go:171","msg":"trace[722946955] transaction","detail":"{read_only:false; response_revision:747; number_of_response:1; }","duration":"189.161273ms","start":"2026-05-06T00:44:28.876174Z","end":"2026-05-06T00:44:29.065335Z","steps":["trace[722946955] 'process raft request' (duration: 189.071342ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:29.175432Z","caller":"traceutil/trace.go:171","msg":"trace[129863719] transaction","detail":"{read_only:false; response_revision:750; number_of_response:1; }","duration":"101.601329ms","start":"2026-05-06T00:44:29.073806Z","end":"2026-05-06T00:44:29.175407Z","steps":["trace[129863719] 'process raft request' (duration: 101.532118ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:29.175456Z","caller":"traceutil/trace.go:171","msg":"trace[2100645148] transaction","detail":"{read_only:false; response_revision:749; number_of_response:1; }","duration":"103.116568ms","start":"2026-05-06T00:44:29.072302Z","end":"2026-05-06T00:44:29.175418Z","steps":["trace[2100645148] 'process raft request' (duration: 78.123878ms)","trace[2100645148] 'compare' (duration: 24.775567ms)"],"step_count":2} {"level":"warn","ts":"2026-05-06T00:44:29.373386Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.346473ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-05-06T00:44:29.373625Z","caller":"traceutil/trace.go:171","msg":"trace[1289190696] transaction","detail":"{read_only:false; response_revision:751; number_of_response:1; }","duration":"187.672659ms","start":"2026-05-06T00:44:29.185934Z","end":"2026-05-06T00:44:29.373607Z","steps":["trace[1289190696] 'process raft request' (duration: 187.554938ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:34.585114Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"698.034817ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.115\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-05-06T00:44:34.585197Z","caller":"traceutil/trace.go:171","msg":"trace[1593829248] range","detail":"{range_begin:/registry/masterleases/199.19.213.115; range_end:; response_count:1; response_revision:770; }","duration":"698.148558ms","start":"2026-05-06T00:44:33.887025Z","end":"2026-05-06T00:44:34.585174Z","steps":["trace[1593829248] 'range keys from in-memory index tree' (duration: 697.882074ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:34.585231Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"277.695716ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"warn","ts":"2026-05-06T00:44:34.585236Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:33.887011Z","time spent":"698.215929ms","remote":"127.0.0.1:41838","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":158,"request content":"key:\"/registry/masterleases/199.19.213.115\" "} {"level":"info","ts":"2026-05-06T00:44:34.585288Z","caller":"traceutil/trace.go:171","msg":"trace[1846751218] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:770; }","duration":"277.791157ms","start":"2026-05-06T00:44:34.307478Z","end":"2026-05-06T00:44:34.585269Z","steps":["trace[1846751218] 'range keys from in-memory index tree' (duration: 277.561744ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:34.585311Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"369.425957ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"warn","ts":"2026-05-06T00:44:34.585316Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"758.001506ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-5vr8t\" ","response":"range_response_count:1 size:3965"} {"level":"info","ts":"2026-05-06T00:44:34.585386Z","caller":"traceutil/trace.go:171","msg":"trace[473604784] range","detail":"{range_begin:/registry/pods/; range_end:/registry/pods0; response_count:0; response_revision:770; }","duration":"369.552969ms","start":"2026-05-06T00:44:34.215814Z","end":"2026-05-06T00:44:34.585367Z","steps":["trace[473604784] 'count revisions from in-memory index tree' (duration: 369.343717ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:34.5854Z","caller":"traceutil/trace.go:171","msg":"trace[180016833] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-5vr8t; range_end:; response_count:1; response_revision:770; }","duration":"758.141338ms","start":"2026-05-06T00:44:33.827239Z","end":"2026-05-06T00:44:34.58538Z","steps":["trace[180016833] 'range keys from in-memory index tree' (duration: 757.814383ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:34.585435Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:34.215792Z","time spent":"369.6324ms","remote":"127.0.0.1:41980","response type":"/etcdserverpb.KV/Range","request count":0,"request size":36,"response count":12,"response size":30,"request content":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true "} {"level":"warn","ts":"2026-05-06T00:44:34.585444Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-06T00:44:33.82722Z","time spent":"758.214509ms","remote":"127.0.0.1:41980","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":1,"response size":3988,"request content":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-5vr8t\" "} {"level":"info","ts":"2026-05-06T00:44:39.025459Z","caller":"traceutil/trace.go:171","msg":"trace[627644139] linearizableReadLoop","detail":"{readStateIndex:848; appliedIndex:847; }","duration":"164.665139ms","start":"2026-05-06T00:44:38.86077Z","end":"2026-05-06T00:44:39.025435Z","steps":["trace[627644139] 'read index received' (duration: 164.506717ms)","trace[627644139] 'applied index is now lower than readState.Index' (duration: 157.492µs)"],"step_count":2} {"level":"info","ts":"2026-05-06T00:44:39.025508Z","caller":"traceutil/trace.go:171","msg":"trace[1959425527] transaction","detail":"{read_only:false; response_revision:819; number_of_response:1; }","duration":"271.888298ms","start":"2026-05-06T00:44:38.753585Z","end":"2026-05-06T00:44:39.025474Z","steps":["trace[1959425527] 'process raft request' (duration: 271.709916ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:44:39.025735Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.942782ms","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-06T00:44:39.025745Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"144.673152ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/\" range_end:\"/registry/apiextensions.k8s.io/customresourcedefinitions0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-05-06T00:44:39.02578Z","caller":"traceutil/trace.go:171","msg":"trace[1902783953] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:819; }","duration":"165.036623ms","start":"2026-05-06T00:44:38.860732Z","end":"2026-05-06T00:44:39.025769Z","steps":["trace[1902783953] 'agreement among raft nodes before linearized reading' (duration: 164.841ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:44:39.025821Z","caller":"traceutil/trace.go:171","msg":"trace[1748233385] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/; range_end:/registry/apiextensions.k8s.io/customresourcedefinitions0; response_count:0; response_revision:819; }","duration":"144.775113ms","start":"2026-05-06T00:44:38.881028Z","end":"2026-05-06T00:44:39.025803Z","steps":["trace[1748233385] 'agreement among raft nodes before linearized reading' (duration: 144.611011ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:45:13.039783Z","caller":"traceutil/trace.go:171","msg":"trace[257031715] transaction","detail":"{read_only:false; response_revision:1028; number_of_response:1; }","duration":"104.426767ms","start":"2026-05-06T00:45:12.935325Z","end":"2026-05-06T00:45:13.039752Z","steps":["trace[257031715] 'process raft request' (duration: 104.200436ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:45:15.818505Z","caller":"traceutil/trace.go:171","msg":"trace[838624851] transaction","detail":"{read_only:false; response_revision:1041; number_of_response:1; }","duration":"119.85052ms","start":"2026-05-06T00:45:15.698628Z","end":"2026-05-06T00:45:15.818478Z","steps":["trace[838624851] 'process raft request' (duration: 119.695774ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:45:41.586534Z","caller":"traceutil/trace.go:171","msg":"trace[1622776533] linearizableReadLoop","detail":"{readStateIndex:1165; appliedIndex:1164; }","duration":"102.214521ms","start":"2026-05-06T00:45:41.484294Z","end":"2026-05-06T00:45:41.586508Z","steps":["trace[1622776533] 'read index received' (duration: 101.957493ms)","trace[1622776533] 'applied index is now lower than readState.Index' (duration: 255.818µs)"],"step_count":2} {"level":"info","ts":"2026-05-06T00:45:41.586603Z","caller":"traceutil/trace.go:171","msg":"trace[120953123] transaction","detail":"{read_only:false; response_revision:1122; number_of_response:1; }","duration":"122.204389ms","start":"2026-05-06T00:45:41.464365Z","end":"2026-05-06T00:45:41.58657Z","steps":["trace[120953123] 'process raft request' (duration: 121.995121ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:45:41.586797Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.47974ms","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-06T00:45:41.586846Z","caller":"traceutil/trace.go:171","msg":"trace[1488185706] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1122; }","duration":"102.566933ms","start":"2026-05-06T00:45:41.484266Z","end":"2026-05-06T00:45:41.586832Z","steps":["trace[1488185706] 'agreement among raft nodes before linearized reading' (duration: 102.377167ms)"],"step_count":1} {"level":"info","ts":"2026-05-06T00:46:50.436291Z","caller":"traceutil/trace.go:171","msg":"trace[1056966729] linearizableReadLoop","detail":"{readStateIndex:1453; appliedIndex:1452; }","duration":"118.613301ms","start":"2026-05-06T00:46:50.317653Z","end":"2026-05-06T00:46:50.436266Z","steps":["trace[1056966729] 'read index received' (duration: 118.374136ms)","trace[1056966729] 'applied index is now lower than readState.Index' (duration: 238.335µs)"],"step_count":2} {"level":"info","ts":"2026-05-06T00:46:50.436403Z","caller":"traceutil/trace.go:171","msg":"trace[487512265] transaction","detail":"{read_only:false; response_revision:1394; number_of_response:1; }","duration":"144.500259ms","start":"2026-05-06T00:46:50.291884Z","end":"2026-05-06T00:46:50.436385Z","steps":["trace[487512265] 'process raft request' (duration: 144.220624ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:46:50.436614Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.938047ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/envoy-gateway-system/\" range_end:\"/registry/configmaps/envoy-gateway-system0\" limit:500 ","response":"range_response_count:2 size:3307"} {"level":"info","ts":"2026-05-06T00:46:50.436673Z","caller":"traceutil/trace.go:171","msg":"trace[854086230] range","detail":"{range_begin:/registry/configmaps/envoy-gateway-system/; range_end:/registry/configmaps/envoy-gateway-system0; response_count:2; response_revision:1394; }","duration":"119.03928ms","start":"2026-05-06T00:46:50.317619Z","end":"2026-05-06T00:46:50.436658Z","steps":["trace[854086230] 'agreement among raft nodes before linearized reading' (duration: 118.785215ms)"],"step_count":1} {"level":"warn","ts":"2026-05-06T00:46:50.436665Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"110.607667ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/configmaps/default/\" range_end:\"/registry/configmaps/default0\" limit:500 ","response":"range_response_count:1 size:1738"} {"level":"info","ts":"2026-05-06T00:46:50.436766Z","caller":"traceutil/trace.go:171","msg":"trace[926936275] range","detail":"{range_begin:/registry/configmaps/default/; range_end:/registry/configmaps/default0; response_count:1; response_revision:1394; }","duration":"110.73096ms","start":"2026-05-06T00:46:50.326015Z","end":"2026-05-06T00:46:50.436746Z","steps":["trace[926936275] 'agreement among raft nodes before linearized reading' (duration: 110.507695ms)"],"step_count":1}