{"level":"warn","ts":"2026-10-03T22:10:37.189025Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-10-03T22:10:37.189187Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.152:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://162.253.55.152:2380","--initial-cluster=instance=https://162.253.55.152:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.152:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.152: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-10-03T22:10:37.189318Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-10-03T22:10:37.189347Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.152:2380"]} {"level":"info","ts":"2026-10-03T22:10:37.189408Z","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-10-03T22:10:37.190886Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.152:2379"]} {"level":"info","ts":"2026-10-03T22:10:37.191122Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://162.253.55.152:2380"],"listen-peer-urls":["https://162.253.55.152:2380"],"advertise-client-urls":["https://162.253.55.152:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.152:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.152: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-10-03T22:10:37.857725Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"659.252208ms"} {"level":"info","ts":"2026-10-03T22:10:37.961697Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"3211802a8f385ce6","cluster-id":"25d088d9a9519f25"} {"level":"info","ts":"2026-10-03T22:10:37.961905Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 switched to configuration voters=()"} {"level":"info","ts":"2026-10-03T22:10:37.961965Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 became follower at term 0"} {"level":"info","ts":"2026-10-03T22:10:37.961995Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 3211802a8f385ce6 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-10-03T22:10:37.962017Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 became follower at term 1"} {"level":"info","ts":"2026-10-03T22:10:37.962104Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 switched to configuration voters=(3607805696780295398)"} {"level":"warn","ts":"2026-10-03T22:10:38.03208Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-10-03T22:10:38.058871Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-10-03T22:10:38.077218Z","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-10-03T22:10:38.088853Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"3211802a8f385ce6","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-10-03T22:10:38.089122Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"3211802a8f385ce6","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-10-03T22:10:38.089967Z","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-10-03T22:10:38.090145Z","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-10-03T22:10:38.090192Z","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-10-03T22:10:38.094485Z","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-10-03T22:10:38.09471Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.152:2380"} {"level":"info","ts":"2026-10-03T22:10:38.094782Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.152:2380"} {"level":"info","ts":"2026-10-03T22:10:38.094843Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"3211802a8f385ce6","initial-advertise-peer-urls":["https://162.253.55.152:2380"],"listen-peer-urls":["https://162.253.55.152:2380"],"advertise-client-urls":["https://162.253.55.152:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.152:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-10-03T22:10:38.09495Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-10-03T22:10:38.124913Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 switched to configuration voters=(3607805696780295398)"} {"level":"info","ts":"2026-10-03T22:10:38.125174Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"25d088d9a9519f25","local-member-id":"3211802a8f385ce6","added-peer-id":"3211802a8f385ce6","added-peer-peer-urls":["https://162.253.55.152:2380"]} {"level":"info","ts":"2026-10-03T22:10:38.867513Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 is starting a new election at term 1"} {"level":"info","ts":"2026-10-03T22:10:38.867597Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 became pre-candidate at term 1"} {"level":"info","ts":"2026-10-03T22:10:38.867645Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 received MsgPreVoteResp from 3211802a8f385ce6 at term 1"} {"level":"info","ts":"2026-10-03T22:10:38.867685Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 became candidate at term 2"} {"level":"info","ts":"2026-10-03T22:10:38.867697Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 received MsgVoteResp from 3211802a8f385ce6 at term 2"} {"level":"info","ts":"2026-10-03T22:10:38.867713Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"3211802a8f385ce6 became leader at term 2"} {"level":"info","ts":"2026-10-03T22:10:38.867735Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 3211802a8f385ce6 elected leader 3211802a8f385ce6 at term 2"} {"level":"info","ts":"2026-10-03T22:10:38.91777Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"3211802a8f385ce6","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.152:2379]}","request-path":"/0/members/3211802a8f385ce6/attributes","cluster-id":"25d088d9a9519f25","publish-timeout":"7s"} {"level":"info","ts":"2026-10-03T22:10:38.917828Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-10-03T22:10:38.917883Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-10-03T22:10:38.918021Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-10-03T22:10:38.918049Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-10-03T22:10:38.91802Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-10-03T22:10:38.921736Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.152:2379"} {"level":"info","ts":"2026-10-03T22:10:38.922167Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-10-03T22:10:38.939826Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"25d088d9a9519f25","local-member-id":"3211802a8f385ce6","cluster-version":"3.5"} {"level":"info","ts":"2026-10-03T22:10:38.940114Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-10-03T22:10:38.940207Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-10-03T22:10:42.940348Z","caller":"traceutil/trace.go:171","msg":"trace[470865500] transaction","detail":"{read_only:false; response_revision:202; number_of_response:1; }","duration":"276.525826ms","start":"2026-10-03T22:10:42.663792Z","end":"2026-10-03T22:10:42.940317Z","steps":["trace[470865500] 'process raft request' (duration: 276.347503ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:43.325431Z","caller":"traceutil/trace.go:171","msg":"trace[80919062] linearizableReadLoop","detail":"{readStateIndex:208; appliedIndex:205; }","duration":"521.928983ms","start":"2026-10-03T22:10:42.803475Z","end":"2026-10-03T22:10:43.325404Z","steps":["trace[80919062] 'read index received' (duration: 136.698597ms)","trace[80919062] 'applied index is now lower than readState.Index' (duration: 385.228996ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:43.325494Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:42.788747Z","time spent":"536.739402ms","remote":"127.0.0.1:60272","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"info","ts":"2026-10-03T22:10:43.325536Z","caller":"traceutil/trace.go:171","msg":"trace[288374218] transaction","detail":"{read_only:false; response_revision:203; number_of_response:1; }","duration":"660.939468ms","start":"2026-10-03T22:10:42.664502Z","end":"2026-10-03T22:10:43.325441Z","steps":["trace[288374218] 'process raft request' (duration: 620.415687ms)","trace[288374218] 'compare' (duration: 40.144984ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:43.325577Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"522.071697ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:10:43.325647Z","caller":"traceutil/trace.go:171","msg":"trace[1592364802] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:203; }","duration":"522.19969ms","start":"2026-10-03T22:10:42.803434Z","end":"2026-10-03T22:10:43.325634Z","steps":["trace[1592364802] 'agreement among raft nodes before linearized reading' (duration: 522.075487ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:43.325684Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:42.803423Z","time spent":"522.251101ms","remote":"127.0.0.1:60194","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-10-03T22:10:43.326851Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:42.664484Z","time spent":"661.171433ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:45.631925Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.645540767s","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:45.632143Z","caller":"traceutil/trace.go:171","msg":"trace[2029129383] linearizableReadLoop","detail":"{readStateIndex:212; appliedIndex:210; }","duration":"999.970093ms","start":"2026-10-03T22:10:44.632154Z","end":"2026-10-03T22:10:45.632124Z","steps":["trace[2029129383] 'read index received' (duration: 384.726345ms)","trace[2029129383] 'applied index is now lower than readState.Index' (duration: 615.242648ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:45.632281Z","caller":"traceutil/trace.go:171","msg":"trace[534895517] transaction","detail":"{read_only:false; response_revision:207; number_of_response:1; }","duration":"2.255242611s","start":"2026-10-03T22:10:43.377028Z","end":"2026-10-03T22:10:45.63227Z","steps":["trace[534895517] 'process raft request' (duration: 2.255018557s)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:45.6323Z","caller":"traceutil/trace.go:171","msg":"trace[369348092] transaction","detail":"{read_only:false; response_revision:206; number_of_response:1; }","duration":"2.291787784s","start":"2026-10-03T22:10:43.340465Z","end":"2026-10-03T22:10:45.632253Z","steps":["trace[369348092] 'process raft request' (duration: 645.655535ms)","trace[369348092] 'compare' (duration: 1.644966906s)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:45.632469Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.00031096s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-10-03T22:10:45.632487Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:43.340439Z","time spent":"2.291967968s","remote":"127.0.0.1:60272","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":625,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:10:45.632502Z","caller":"traceutil/trace.go:171","msg":"trace[918276691] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:0; response_revision:207; }","duration":"1.000383121s","start":"2026-10-03T22:10:44.63211Z","end":"2026-10-03T22:10:45.632493Z","steps":["trace[918276691] 'agreement among raft nodes before linearized reading' (duration: 1.000276299s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:45.632534Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:44.632088Z","time spent":"1.000438942s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":0,"response size":27,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-10-03T22:10:45.63234Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:43.377004Z","time spent":"2.255305003s","remote":"127.0.0.1:60552","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":342,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:10:45.632733Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"773.472282ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:10:45.632765Z","caller":"traceutil/trace.go:171","msg":"trace[883453395] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:0; response_revision:207; }","duration":"773.524643ms","start":"2026-10-03T22:10:44.859232Z","end":"2026-10-03T22:10:45.632756Z","steps":["trace[883453395] 'agreement among raft nodes before linearized reading' (duration: 773.478412ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:45.632788Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:44.859221Z","time spent":"773.561464ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":0,"response size":27,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-10-03T22:10:45.632987Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"301.847134ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-10-03T22:10:45.633014Z","caller":"traceutil/trace.go:171","msg":"trace[949747615] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:207; }","duration":"301.898086ms","start":"2026-10-03T22:10:45.331107Z","end":"2026-10-03T22:10:45.633006Z","steps":["trace[949747615] 'agreement among raft nodes before linearized reading' (duration: 301.831144ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:45.633039Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.331095Z","time spent":"301.934896ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":458,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-10-03T22:10:45.633062Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"688.182077ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-10-03T22:10:45.633108Z","caller":"traceutil/trace.go:171","msg":"trace[1203076040] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:207; }","duration":"688.276519ms","start":"2026-10-03T22:10:44.944819Z","end":"2026-10-03T22:10:45.633096Z","steps":["trace[1203076040] 'agreement among raft nodes before linearized reading' (duration: 688.175647ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:45.633164Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:44.944796Z","time spent":"688.36087ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":454,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-10-03T22:10:45.633291Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"582.068677ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-vip-instance\" ","response":"range_response_count:1 size:3466"} {"level":"info","ts":"2026-10-03T22:10:45.633321Z","caller":"traceutil/trace.go:171","msg":"trace[1114857748] range","detail":"{range_begin:/registry/pods/kube-system/kube-vip-instance; range_end:; response_count:1; response_revision:207; }","duration":"582.120477ms","start":"2026-10-03T22:10:45.051192Z","end":"2026-10-03T22:10:45.633313Z","steps":["trace[1114857748] 'agreement among raft nodes before linearized reading' (duration: 582.065616ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:45.633346Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.051177Z","time spent":"582.162518ms","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":3488,"request content":"key:\"/registry/pods/kube-system/kube-vip-instance\" "} {"level":"warn","ts":"2026-10-03T22:10:46.687432Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.049968493s","expected-duration":"1s"} {"level":"info","ts":"2026-10-03T22:10:46.687874Z","caller":"traceutil/trace.go:171","msg":"trace[1692571687] transaction","detail":"{read_only:false; response_revision:208; number_of_response:1; }","duration":"1.050491863s","start":"2026-10-03T22:10:45.637351Z","end":"2026-10-03T22:10:46.687843Z","steps":["trace[1692571687] 'process raft request' (duration: 1.05033656s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:46.688028Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.637329Z","time spent":"1.050625425s","remote":"127.0.0.1:60556","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":541,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:10:46.72588Z","caller":"traceutil/trace.go:171","msg":"trace[2138440802] transaction","detail":"{read_only:false; response_revision:209; number_of_response:1; }","duration":"1.087388418s","start":"2026-10-03T22:10:45.638445Z","end":"2026-10-03T22:10:46.725833Z","steps":["trace[2138440802] 'process raft request' (duration: 1.087137393s)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:46.725985Z","caller":"traceutil/trace.go:171","msg":"trace[176393928] transaction","detail":"{read_only:false; response_revision:212; number_of_response:1; }","duration":"1.083599702s","start":"2026-10-03T22:10:45.64236Z","end":"2026-10-03T22:10:46.725959Z","steps":["trace[176393928] 'process raft request' (duration: 1.083437679s)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:46.725987Z","caller":"traceutil/trace.go:171","msg":"trace[235715075] transaction","detail":"{read_only:false; response_revision:211; number_of_response:1; }","duration":"1.085487629s","start":"2026-10-03T22:10:45.640413Z","end":"2026-10-03T22:10:46.7259Z","steps":["trace[235715075] 'process raft request' (duration: 1.085328346s)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:46.726052Z","caller":"traceutil/trace.go:171","msg":"trace[333639740] transaction","detail":"{read_only:false; response_revision:215; number_of_response:1; }","duration":"513.682167ms","start":"2026-10-03T22:10:46.212345Z","end":"2026-10-03T22:10:46.726027Z","steps":["trace[333639740] 'process raft request' (duration: 513.645057ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:46.726141Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.64234Z","time spent":"1.083718384s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:10:46.726189Z","caller":"traceutil/trace.go:171","msg":"trace[1275566916] transaction","detail":"{read_only:false; response_revision:213; number_of_response:1; }","duration":"1.083425717s","start":"2026-10-03T22:10:45.642745Z","end":"2026-10-03T22:10:46.726171Z","steps":["trace[1275566916] 'process raft request' (duration: 1.083095191s)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:46.726246Z","caller":"traceutil/trace.go:171","msg":"trace[2009570138] transaction","detail":"{read_only:false; response_revision:214; number_of_response:1; }","duration":"1.068784525s","start":"2026-10-03T22:10:45.657451Z","end":"2026-10-03T22:10:46.726236Z","steps":["trace[2009570138] 'process raft request' (duration: 1.068423958s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:46.726235Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.640389Z","time spent":"1.085729404s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:10:46.726308Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.642732Z","time spent":"1.083500629s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:46.726314Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.65744Z","time spent":"1.068837196s","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4649,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:46.726188Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:46.212313Z","time spent":"513.81531ms","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3965,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:10:46.725995Z","caller":"traceutil/trace.go:171","msg":"trace[2000847691] transaction","detail":"{read_only:false; response_revision:210; number_of_response:1; }","duration":"1.087349746s","start":"2026-10-03T22:10:45.638615Z","end":"2026-10-03T22:10:46.725964Z","steps":["trace[2000847691] 'process raft request' (duration: 1.087082851s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:46.726746Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.63843Z","time spent":"1.088239425s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:10:46.726836Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:45.638607Z","time spent":"1.088183023s","remote":"127.0.0.1:60272","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":642,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} 2026/10/03 22:10:48 WARNING: [core] [Server #8] grpc: Server.processUnaryRPC failed to write status: connection error: desc = "transport is closing" {"level":"info","ts":"2026-10-03T22:10:48.58236Z","caller":"traceutil/trace.go:171","msg":"trace[1339731030] transaction","detail":"{read_only:false; response_revision:299; number_of_response:1; }","duration":"115.080141ms","start":"2026-10-03T22:10:48.467243Z","end":"2026-10-03T22:10:48.582323Z","steps":["trace[1339731030] 'process raft request' (duration: 35.220438ms)","trace[1339731030] 'compare' (duration: 79.452725ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:49.30316Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"279.09601ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:49.303281Z","caller":"traceutil/trace.go:171","msg":"trace[2111076454] linearizableReadLoop","detail":"{readStateIndex:328; appliedIndex:327; }","duration":"525.506092ms","start":"2026-10-03T22:10:48.777756Z","end":"2026-10-03T22:10:49.303262Z","steps":["trace[2111076454] 'read index received' (duration: 246.029564ms)","trace[2111076454] 'applied index is now lower than readState.Index' (duration: 279.475128ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:49.303408Z","caller":"traceutil/trace.go:171","msg":"trace[1705478057] transaction","detail":"{read_only:false; response_revision:319; number_of_response:1; }","duration":"535.014539ms","start":"2026-10-03T22:10:48.768294Z","end":"2026-10-03T22:10:49.303309Z","steps":["trace[1705478057] 'process raft request' (duration: 255.601764ms)","trace[1705478057] 'compare' (duration: 278.937156ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:49.303567Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"525.791427ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"warn","ts":"2026-10-03T22:10:49.303636Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"521.158495ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-10-03T22:10:49.303681Z","caller":"traceutil/trace.go:171","msg":"trace[1307673342] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:319; }","duration":"525.94303ms","start":"2026-10-03T22:10:48.777711Z","end":"2026-10-03T22:10:49.303654Z","steps":["trace[1307673342] 'agreement among raft nodes before linearized reading' (duration: 525.707016ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:49.303696Z","caller":"traceutil/trace.go:171","msg":"trace[176180585] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:319; }","duration":"521.261066ms","start":"2026-10-03T22:10:48.782415Z","end":"2026-10-03T22:10:49.303676Z","steps":["trace[176180585] 'agreement among raft nodes before linearized reading' (duration: 521.152104ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:49.303742Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:48.777699Z","time spent":"526.028731ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-10-03T22:10:49.303755Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:48.768279Z","time spent":"535.295846ms","remote":"127.0.0.1:60426","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":170,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:10:49.304045Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"518.275508ms","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-10-03T22:10:49.303767Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:48.782398Z","time spent":"521.359329ms","remote":"127.0.0.1:60322","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":1,"response size":373,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"warn","ts":"2026-10-03T22:10:49.30373Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"264.119832ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:10:49.304273Z","caller":"traceutil/trace.go:171","msg":"trace[879757386] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:319; }","duration":"518.377341ms","start":"2026-10-03T22:10:48.785727Z","end":"2026-10-03T22:10:49.304105Z","steps":["trace[879757386] 'agreement among raft nodes before linearized reading' (duration: 518.242897ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:49.304677Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:48.785717Z","time spent":"518.941501ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"info","ts":"2026-10-03T22:10:49.304471Z","caller":"traceutil/trace.go:171","msg":"trace[1153816144] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:319; }","duration":"264.825926ms","start":"2026-10-03T22:10:49.039591Z","end":"2026-10-03T22:10:49.304417Z","steps":["trace[1153816144] 'agreement among raft nodes before linearized reading' (duration: 264.064661ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:49.501264Z","caller":"traceutil/trace.go:171","msg":"trace[371396115] transaction","detail":"{read_only:false; response_revision:325; number_of_response:1; }","duration":"133.056801ms","start":"2026-10-03T22:10:49.368182Z","end":"2026-10-03T22:10:49.501238Z","steps":["trace[371396115] 'process raft request' (duration: 132.99642ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:49.501433Z","caller":"traceutil/trace.go:171","msg":"trace[1375814375] transaction","detail":"{read_only:false; response_revision:324; number_of_response:1; }","duration":"135.329645ms","start":"2026-10-03T22:10:49.36607Z","end":"2026-10-03T22:10:49.501399Z","steps":["trace[1375814375] 'process raft request' (duration: 78.480002ms)","trace[1375814375] 'compare' (duration: 56.502096ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:49.834824Z","caller":"traceutil/trace.go:171","msg":"trace[968439824] linearizableReadLoop","detail":"{readStateIndex:346; appliedIndex:345; }","duration":"101.457146ms","start":"2026-10-03T22:10:49.73333Z","end":"2026-10-03T22:10:49.834787Z","steps":["trace[968439824] 'read index received' (duration: 34.769477ms)","trace[968439824] 'applied index is now lower than readState.Index' (duration: 66.686019ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:49.835477Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.12359ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-10-03T22:10:49.83583Z","caller":"traceutil/trace.go:171","msg":"trace[501470660] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:335; }","duration":"102.488857ms","start":"2026-10-03T22:10:49.733317Z","end":"2026-10-03T22:10:49.835805Z","steps":["trace[501470660] 'agreement among raft nodes before linearized reading' (duration: 101.991977ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:49.835494Z","caller":"traceutil/trace.go:171","msg":"trace[2134897152] transaction","detail":"{read_only:false; response_revision:335; number_of_response:1; }","duration":"118.432952ms","start":"2026-10-03T22:10:49.717037Z","end":"2026-10-03T22:10:49.83547Z","steps":["trace[2134897152] 'process raft request' (duration: 51.06685ms)","trace[2134897152] 'compare' (duration: 66.300461ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:49.958136Z","caller":"traceutil/trace.go:171","msg":"trace[754330270] transaction","detail":"{read_only:false; response_revision:337; number_of_response:1; }","duration":"109.930144ms","start":"2026-10-03T22:10:49.848181Z","end":"2026-10-03T22:10:49.958111Z","steps":["trace[754330270] 'process raft request' (duration: 93.503179ms)","trace[754330270] 'compare' (duration: 15.965295ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:50.190344Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.715018ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-10-03T22:10:50.190958Z","caller":"traceutil/trace.go:171","msg":"trace[1257615394] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:339; }","duration":"133.375581ms","start":"2026-10-03T22:10:50.057559Z","end":"2026-10-03T22:10:50.190934Z","steps":["trace[1257615394] 'range keys from in-memory index tree' (duration: 132.591055ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:50.190496Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.238419ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/etcd-instance\" ","response":"range_response_count:1 size:5164"} {"level":"info","ts":"2026-10-03T22:10:50.19122Z","caller":"traceutil/trace.go:171","msg":"trace[1109912333] range","detail":"{range_begin:/registry/pods/kube-system/etcd-instance; range_end:; response_count:1; response_revision:339; }","duration":"132.973564ms","start":"2026-10-03T22:10:50.058205Z","end":"2026-10-03T22:10:50.191178Z","steps":["trace[1109912333] 'range keys from in-memory index tree' (duration: 132.145528ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:50.47207Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"169.76415ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:50.472238Z","caller":"traceutil/trace.go:171","msg":"trace[256264030] transaction","detail":"{read_only:false; response_revision:342; number_of_response:1; }","duration":"200.329942ms","start":"2026-10-03T22:10:50.271887Z","end":"2026-10-03T22:10:50.472217Z","steps":["trace[256264030] 'process raft request' (duration: 30.311037ms)","trace[256264030] 'compare' (duration: 169.544066ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:50.472428Z","caller":"traceutil/trace.go:171","msg":"trace[1728420949] transaction","detail":"{read_only:false; response_revision:343; number_of_response:1; }","duration":"188.837476ms","start":"2026-10-03T22:10:50.283577Z","end":"2026-10-03T22:10:50.472415Z","steps":["trace[1728420949] 'process raft request' (duration: 188.604491ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.057927Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"272.567012ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:52.058129Z","caller":"traceutil/trace.go:171","msg":"trace[1869868114] linearizableReadLoop","detail":"{readStateIndex:371; appliedIndex:370; }","duration":"324.976646ms","start":"2026-10-03T22:10:51.733132Z","end":"2026-10-03T22:10:52.058108Z","steps":["trace[1869868114] 'read index received' (duration: 52.046176ms)","trace[1869868114] 'applied index is now lower than readState.Index' (duration: 272.92921ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:52.058217Z","caller":"traceutil/trace.go:171","msg":"trace[807191798] transaction","detail":"{read_only:false; response_revision:360; number_of_response:1; }","duration":"333.659146ms","start":"2026-10-03T22:10:51.724533Z","end":"2026-10-03T22:10:52.058192Z","steps":["trace[807191798] 'process raft request' (duration: 60.728336ms)","trace[807191798] 'compare' (duration: 272.42655ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:52.05828Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"325.135529ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/service-account-controller\" ","response":"range_response_count:1 size:218"} {"level":"warn","ts":"2026-10-03T22:10:52.058407Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:51.724503Z","time spent":"333.804619ms","remote":"127.0.0.1:60484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2259,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:10:52.058499Z","caller":"traceutil/trace.go:171","msg":"trace[1809025080] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/service-account-controller; range_end:; response_count:1; response_revision:360; }","duration":"325.374353ms","start":"2026-10-03T22:10:51.733059Z","end":"2026-10-03T22:10:52.058434Z","steps":["trace[1809025080] 'agreement among raft nodes before linearized reading' (duration: 325.110538ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.058536Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.30669ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/daemon-set-controller\" ","response":"range_response_count:1 size:207"} {"level":"warn","ts":"2026-10-03T22:10:52.058628Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:51.733043Z","time spent":"325.537686ms","remote":"127.0.0.1:60426","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":1,"response size":240,"request content":"key:\"/registry/serviceaccounts/kube-system/service-account-controller\" "} {"level":"warn","ts":"2026-10-03T22:10:52.05867Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.312335ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/endpoint-controller\" ","response":"range_response_count:1 size:203"} {"level":"info","ts":"2026-10-03T22:10:52.058708Z","caller":"traceutil/trace.go:171","msg":"trace[215048964] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/daemon-set-controller; range_end:; response_count:1; response_revision:360; }","duration":"174.467542ms","start":"2026-10-03T22:10:51.884196Z","end":"2026-10-03T22:10:52.058663Z","steps":["trace[215048964] 'agreement among raft nodes before linearized reading' (duration: 174.247138ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.058764Z","caller":"traceutil/trace.go:171","msg":"trace[1467482955] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/endpoint-controller; range_end:; response_count:1; response_revision:360; }","duration":"124.411687ms","start":"2026-10-03T22:10:51.93433Z","end":"2026-10-03T22:10:52.058742Z","steps":["trace[1467482955] 'agreement among raft nodes before linearized reading' (duration: 124.254474ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.058977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"225.855673ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/clusterrole-aggregation-controller\" ","response":"range_response_count:1 size:234"} {"level":"info","ts":"2026-10-03T22:10:52.059092Z","caller":"traceutil/trace.go:171","msg":"trace[1326268138] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/clusterrole-aggregation-controller; range_end:; response_count:1; response_revision:360; }","duration":"226.021206ms","start":"2026-10-03T22:10:51.833047Z","end":"2026-10-03T22:10:52.059068Z","steps":["trace[1326268138] 'agreement among raft nodes before linearized reading' (duration: 225.493346ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.058989Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"275.899728ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/deployment-controller\" ","response":"range_response_count:1 size:207"} {"level":"info","ts":"2026-10-03T22:10:52.059462Z","caller":"traceutil/trace.go:171","msg":"trace[1399864711] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/deployment-controller; range_end:; response_count:1; response_revision:360; }","duration":"276.370617ms","start":"2026-10-03T22:10:51.783078Z","end":"2026-10-03T22:10:52.059448Z","steps":["trace[1399864711] 'agreement among raft nodes before linearized reading' (duration: 275.239316ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.214632Z","caller":"traceutil/trace.go:171","msg":"trace[954645550] transaction","detail":"{read_only:false; response_revision:365; number_of_response:1; }","duration":"141.677133ms","start":"2026-10-03T22:10:52.072915Z","end":"2026-10-03T22:10:52.214592Z","steps":["trace[954645550] 'process raft request' (duration: 97.938034ms)","trace[954645550] 'compare' (duration: 43.478904ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:52.214676Z","caller":"traceutil/trace.go:171","msg":"trace[1626861955] transaction","detail":"{read_only:false; response_revision:368; number_of_response:1; }","duration":"138.636503ms","start":"2026-10-03T22:10:52.076018Z","end":"2026-10-03T22:10:52.214654Z","steps":["trace[1626861955] 'process raft request' (duration: 138.586972ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.214815Z","caller":"traceutil/trace.go:171","msg":"trace[63977838] transaction","detail":"{read_only:false; response_revision:367; number_of_response:1; }","duration":"139.105222ms","start":"2026-10-03T22:10:52.075694Z","end":"2026-10-03T22:10:52.214799Z","steps":["trace[63977838] 'process raft request' (duration: 138.870407ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.214704Z","caller":"traceutil/trace.go:171","msg":"trace[1458964740] transaction","detail":"{read_only:false; response_revision:366; number_of_response:1; }","duration":"139.56714ms","start":"2026-10-03T22:10:52.075107Z","end":"2026-10-03T22:10:52.214674Z","steps":["trace[1458964740] 'process raft request' (duration: 139.382497ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.472399Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.714888ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:52.472592Z","caller":"traceutil/trace.go:171","msg":"trace[1821467541] linearizableReadLoop","detail":"{readStateIndex:392; appliedIndex:390; }","duration":"167.707065ms","start":"2026-10-03T22:10:52.304868Z","end":"2026-10-03T22:10:52.472575Z","steps":["trace[1821467541] 'read index received' (duration: 40.800792ms)","trace[1821467541] 'applied index is now lower than readState.Index' (duration: 126.905032ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:52.472675Z","caller":"traceutil/trace.go:171","msg":"trace[523369045] transaction","detail":"{read_only:false; response_revision:381; number_of_response:1; }","duration":"201.689931ms","start":"2026-10-03T22:10:52.270973Z","end":"2026-10-03T22:10:52.472663Z","steps":["trace[523369045] 'process raft request' (duration: 201.531267ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.472937Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.668571ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-proxy-xrq52\" ","response":"range_response_count:1 size:3439"} {"level":"info","ts":"2026-10-03T22:10:52.473012Z","caller":"traceutil/trace.go:171","msg":"trace[1318584921] range","detail":"{range_begin:/registry/pods/kube-system/kube-proxy-xrq52; range_end:; response_count:1; response_revision:381; }","duration":"202.784423ms","start":"2026-10-03T22:10:52.270215Z","end":"2026-10-03T22:10:52.472999Z","steps":["trace[1318584921] 'agreement among raft nodes before linearized reading' (duration: 202.59231ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.473147Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.445018ms","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-10-03T22:10:52.473267Z","caller":"traceutil/trace.go:171","msg":"trace[1138913828] range","detail":"{range_begin:/registry/daemonsets/kube-system/kube-proxy; range_end:; response_count:1; response_revision:381; }","duration":"199.598241ms","start":"2026-10-03T22:10:52.273631Z","end":"2026-10-03T22:10:52.473229Z","steps":["trace[1138913828] 'agreement among raft nodes before linearized reading' (duration: 199.164323ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.473349Z","caller":"traceutil/trace.go:171","msg":"trace[1537255027] transaction","detail":"{read_only:false; response_revision:380; number_of_response:1; }","duration":"202.405906ms","start":"2026-10-03T22:10:52.270348Z","end":"2026-10-03T22:10:52.472754Z","steps":["trace[1537255027] 'process raft request' (duration: 75.242318ms)","trace[1537255027] 'compare' (duration: 126.535095ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:52.480194Z","caller":"traceutil/trace.go:171","msg":"trace[909946508] transaction","detail":"{read_only:false; response_revision:384; number_of_response:1; }","duration":"165.458479ms","start":"2026-10-03T22:10:52.314718Z","end":"2026-10-03T22:10:52.480177Z","steps":["trace[909946508] 'process raft request' (duration: 165.256015ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.480299Z","caller":"traceutil/trace.go:171","msg":"trace[1350504083] transaction","detail":"{read_only:false; response_revision:383; number_of_response:1; }","duration":"168.525289ms","start":"2026-10-03T22:10:52.311758Z","end":"2026-10-03T22:10:52.480283Z","steps":["trace[1350504083] 'process raft request' (duration: 168.151542ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.480482Z","caller":"traceutil/trace.go:171","msg":"trace[1237015868] transaction","detail":"{read_only:false; response_revision:385; number_of_response:1; }","duration":"163.074813ms","start":"2026-10-03T22:10:52.317348Z","end":"2026-10-03T22:10:52.480422Z","steps":["trace[1237015868] 'process raft request' (duration: 162.706006ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.480493Z","caller":"traceutil/trace.go:171","msg":"trace[797528242] transaction","detail":"{read_only:false; response_revision:382; number_of_response:1; }","duration":"169.02299ms","start":"2026-10-03T22:10:52.311451Z","end":"2026-10-03T22:10:52.480474Z","steps":["trace[797528242] 'process raft request' (duration: 168.331857ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.481142Z","caller":"traceutil/trace.go:171","msg":"trace[1364542647] transaction","detail":"{read_only:false; response_revision:386; number_of_response:1; }","duration":"163.275197ms","start":"2026-10-03T22:10:52.317853Z","end":"2026-10-03T22:10:52.481128Z","steps":["trace[1364542647] 'process raft request' (duration: 162.259517ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.481756Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.153072ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:10:52.481833Z","caller":"traceutil/trace.go:171","msg":"trace[1090431341] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:386; }","duration":"115.239194ms","start":"2026-10-03T22:10:52.366583Z","end":"2026-10-03T22:10:52.481822Z","steps":["trace[1090431341] 'agreement among raft nodes before linearized reading' (duration: 115.142172ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.860737Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.681738ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:52.860991Z","caller":"traceutil/trace.go:171","msg":"trace[1312094823] linearizableReadLoop","detail":"{readStateIndex:406; appliedIndex:404; }","duration":"290.741221ms","start":"2026-10-03T22:10:52.570195Z","end":"2026-10-03T22:10:52.860936Z","steps":["trace[1312094823] 'read index received' (duration: 133.695846ms)","trace[1312094823] 'applied index is now lower than readState.Index' (duration: 157.044265ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:52.861103Z","caller":"traceutil/trace.go:171","msg":"trace[1256172197] transaction","detail":"{read_only:false; response_revision:394; number_of_response:1; }","duration":"319.625858ms","start":"2026-10-03T22:10:52.541465Z","end":"2026-10-03T22:10:52.86109Z","steps":["trace[1256172197] 'process raft request' (duration: 319.398954ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:52.86109Z","caller":"traceutil/trace.go:171","msg":"trace[6591721] transaction","detail":"{read_only:false; response_revision:393; number_of_response:1; }","duration":"326.570594ms","start":"2026-10-03T22:10:52.534471Z","end":"2026-10-03T22:10:52.861041Z","steps":["trace[6591721] 'process raft request' (duration: 169.479048ms)","trace[6591721] 'compare' (duration: 156.528975ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:52.861164Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:52.541446Z","time spent":"319.683879ms","remote":"127.0.0.1:60706","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3804,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:52.861327Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"323.900641ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-scheduler-instance\" ","response":"range_response_count:1 size:4326"} {"level":"warn","ts":"2026-10-03T22:10:52.861318Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:52.534452Z","time spent":"326.744797ms","remote":"127.0.0.1:60224","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:10:52.861355Z","caller":"traceutil/trace.go:171","msg":"trace[1322909519] range","detail":"{range_begin:/registry/pods/kube-system/kube-scheduler-instance; range_end:; response_count:1; response_revision:394; }","duration":"323.999014ms","start":"2026-10-03T22:10:52.537347Z","end":"2026-10-03T22:10:52.861346Z","steps":["trace[1322909519] 'agreement among raft nodes before linearized reading' (duration: 323.936922ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:52.861406Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:52.537325Z","time spent":"324.074625ms","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Range","request count":0,"request size":52,"response count":1,"response size":4348,"request content":"key:\"/registry/pods/kube-system/kube-scheduler-instance\" "} {"level":"warn","ts":"2026-10-03T22:10:53.181968Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"187.113588ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:53.182406Z","caller":"traceutil/trace.go:171","msg":"trace[1559988956] transaction","detail":"{read_only:false; response_revision:396; number_of_response:1; }","duration":"314.355976ms","start":"2026-10-03T22:10:52.868004Z","end":"2026-10-03T22:10:53.18236Z","steps":["trace[1559988956] 'process raft request' (duration: 314.178202ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:53.182409Z","caller":"traceutil/trace.go:171","msg":"trace[1586790869] transaction","detail":"{read_only:false; response_revision:395; number_of_response:1; }","duration":"315.203244ms","start":"2026-10-03T22:10:52.867146Z","end":"2026-10-03T22:10:53.182349Z","steps":["trace[1586790869] 'process raft request' (duration: 127.628317ms)","trace[1586790869] 'compare' (duration: 186.994536ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:53.182458Z","caller":"traceutil/trace.go:171","msg":"trace[306052457] transaction","detail":"{read_only:false; response_revision:397; number_of_response:1; }","duration":"312.116723ms","start":"2026-10-03T22:10:52.870297Z","end":"2026-10-03T22:10:53.182414Z","steps":["trace[306052457] 'process raft request' (duration: 311.950199ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:53.182606Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:52.867124Z","time spent":"315.389168ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:53.182608Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:52.867981Z","time spent":"314.51082ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:53.182671Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:52.870279Z","time spent":"312.276675ms","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4311,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:10:53.182743Z","caller":"traceutil/trace.go:171","msg":"trace[1554216501] linearizableReadLoop","detail":"{readStateIndex:408; appliedIndex:406; }","duration":"314.635362ms","start":"2026-10-03T22:10:52.868071Z","end":"2026-10-03T22:10:53.182706Z","steps":["trace[1554216501] 'read index received' (duration: 126.654857ms)","trace[1554216501] 'applied index is now lower than readState.Index' (duration: 187.978975ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:53.182808Z","caller":"traceutil/trace.go:171","msg":"trace[139490855] transaction","detail":"{read_only:false; response_revision:398; number_of_response:1; }","duration":"311.019891ms","start":"2026-10-03T22:10:52.871752Z","end":"2026-10-03T22:10:53.182772Z","steps":["trace[139490855] 'process raft request' (duration: 310.551061ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:53.182988Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"314.907487ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/\" range_end:\"/registry/masterleases0\" ","response":"range_response_count:1 size:135"} {"level":"warn","ts":"2026-10-03T22:10:53.182972Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.130026ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:10:53.183098Z","caller":"traceutil/trace.go:171","msg":"trace[116168393] range","detail":"{range_begin:/registry/masterleases/; range_end:/registry/masterleases0; response_count:1; response_revision:398; }","duration":"315.02101ms","start":"2026-10-03T22:10:52.868027Z","end":"2026-10-03T22:10:53.183048Z","steps":["trace[116168393] 'agreement among raft nodes before linearized reading' (duration: 314.838566ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:53.18312Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:52.871736Z","time spent":"311.236805ms","remote":"127.0.0.1:60690","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4041,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:53.183204Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:52.868007Z","time spent":"315.143422ms","remote":"127.0.0.1:60224","response type":"/etcdserverpb.KV/Range","request count":0,"request size":50,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/\" range_end:\"/registry/masterleases0\" "} {"level":"info","ts":"2026-10-03T22:10:53.183259Z","caller":"traceutil/trace.go:171","msg":"trace[1849986079] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:398; }","duration":"141.277709ms","start":"2026-10-03T22:10:53.04178Z","end":"2026-10-03T22:10:53.183057Z","steps":["trace[1849986079] 'agreement among raft nodes before linearized reading' (duration: 141.105666ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:53.582559Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.71945ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:53.582779Z","caller":"traceutil/trace.go:171","msg":"trace[1262714308] linearizableReadLoop","detail":"{readStateIndex:411; appliedIndex:410; }","duration":"206.1441ms","start":"2026-10-03T22:10:53.376509Z","end":"2026-10-03T22:10:53.582653Z","steps":["trace[1262714308] 'read index received' (duration: 72.141694ms)","trace[1262714308] 'applied index is now lower than readState.Index' (duration: 133.998716ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:53.582734Z","caller":"traceutil/trace.go:171","msg":"trace[915567050] transaction","detail":"{read_only:false; response_revision:399; number_of_response:1; }","duration":"388.183838ms","start":"2026-10-03T22:10:53.194524Z","end":"2026-10-03T22:10:53.582707Z","steps":["trace[915567050] 'process raft request' (duration: 254.191593ms)","trace[915567050] 'compare' (duration: 133.534456ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:53.58296Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:53.194506Z","time spent":"388.381122ms","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5321,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:53.583136Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"193.83853ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"warn","ts":"2026-10-03T22:10:53.583174Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.63833ms","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-10-03T22:10:53.583262Z","caller":"traceutil/trace.go:171","msg":"trace[921261858] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:399; }","duration":"206.766483ms","start":"2026-10-03T22:10:53.376477Z","end":"2026-10-03T22:10:53.583243Z","steps":["trace[921261858] 'agreement among raft nodes before linearized reading' (duration: 206.577129ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:53.583175Z","caller":"traceutil/trace.go:171","msg":"trace[831320240] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:399; }","duration":"193.90143ms","start":"2026-10-03T22:10:53.389262Z","end":"2026-10-03T22:10:53.583163Z","steps":["trace[831320240] 'agreement among raft nodes before linearized reading' (duration: 193.799388ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:54.024161Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.503383ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:54.024428Z","caller":"traceutil/trace.go:171","msg":"trace[359038781] transaction","detail":"{read_only:false; response_revision:403; number_of_response:1; }","duration":"140.561034ms","start":"2026-10-03T22:10:53.883843Z","end":"2026-10-03T22:10:54.024404Z","steps":["trace[359038781] 'process raft request' (duration: 140.452372ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:10:54.024441Z","caller":"traceutil/trace.go:171","msg":"trace[329792534] transaction","detail":"{read_only:false; response_revision:402; number_of_response:1; }","duration":"428.118299ms","start":"2026-10-03T22:10:53.596287Z","end":"2026-10-03T22:10:54.024405Z","steps":["trace[329792534] 'process raft request' (duration: 312.238879ms)","trace[329792534] 'compare' (duration: 115.326909ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:54.024633Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:53.596269Z","time spent":"428.260612ms","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4119,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:10:54.800652Z","caller":"traceutil/trace.go:171","msg":"trace[1087224525] transaction","detail":"{read_only:false; response_revision:408; number_of_response:1; }","duration":"165.292333ms","start":"2026-10-03T22:10:54.635328Z","end":"2026-10-03T22:10:54.80062Z","steps":["trace[1087224525] 'process raft request' (duration: 126.119477ms)","trace[1087224525] 'compare' (duration: 38.85405ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:55.956616Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"521.774971ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:10:55.956777Z","caller":"traceutil/trace.go:171","msg":"trace[147455090] linearizableReadLoop","detail":"{readStateIndex:424; appliedIndex:423; }","duration":"358.619137ms","start":"2026-10-03T22:10:55.598137Z","end":"2026-10-03T22:10:55.956756Z","steps":["trace[147455090] 'read index received' (duration: 34.551µs)","trace[147455090] 'applied index is now lower than readState.Index' (duration: 358.582906ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:10:55.956889Z","caller":"traceutil/trace.go:171","msg":"trace[386522126] transaction","detail":"{read_only:false; response_revision:411; number_of_response:1; }","duration":"761.534068ms","start":"2026-10-03T22:10:55.195339Z","end":"2026-10-03T22:10:55.956873Z","steps":["trace[386522126] 'process raft request' (duration: 239.326939ms)","trace[386522126] 'compare' (duration: 521.467955ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:10:55.956978Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:55.195321Z","time spent":"761.61165ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":417,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:10:55.957248Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"359.111536ms","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-10-03T22:10:55.957308Z","caller":"traceutil/trace.go:171","msg":"trace[1259947395] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:411; }","duration":"359.198078ms","start":"2026-10-03T22:10:55.598092Z","end":"2026-10-03T22:10:55.957291Z","steps":["trace[1259947395] 'agreement among raft nodes before linearized reading' (duration: 359.096026ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:10:55.957348Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:10:55.598069Z","time spent":"359.267739ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-10-03T22:10:55.957428Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"291.511587ms","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-10-03T22:10:55.957495Z","caller":"traceutil/trace.go:171","msg":"trace[86144365] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:411; }","duration":"291.619821ms","start":"2026-10-03T22:10:55.665861Z","end":"2026-10-03T22:10:55.95748Z","steps":["trace[86144365] 'agreement among raft nodes before linearized reading' (duration: 291.483117ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:12.234577Z","caller":"traceutil/trace.go:171","msg":"trace[1457743171] linearizableReadLoop","detail":"{readStateIndex:499; appliedIndex:498; }","duration":"171.243264ms","start":"2026-10-03T22:11:12.063305Z","end":"2026-10-03T22:11:12.234548Z","steps":["trace[1457743171] 'read index received' (duration: 171.00685ms)","trace[1457743171] 'applied index is now lower than readState.Index' (duration: 235.364µs)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:11:12.234606Z","caller":"traceutil/trace.go:171","msg":"trace[1563647185] transaction","detail":"{read_only:false; response_revision:481; number_of_response:1; }","duration":"199.400426ms","start":"2026-10-03T22:11:12.035181Z","end":"2026-10-03T22:11:12.234582Z","steps":["trace[1563647185] 'process raft request' (duration: 199.208912ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:12.23479Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.484859ms","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-10-03T22:11:12.234859Z","caller":"traceutil/trace.go:171","msg":"trace[548594171] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:481; }","duration":"171.58631ms","start":"2026-10-03T22:11:12.06326Z","end":"2026-10-03T22:11:12.234846Z","steps":["trace[548594171] 'agreement among raft nodes before linearized reading' (duration: 171.411637ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:12.23479Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.881172ms","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-10-03T22:11:12.235013Z","caller":"traceutil/trace.go:171","msg":"trace[1038566855] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:481; }","duration":"151.166916ms","start":"2026-10-03T22:11:12.083838Z","end":"2026-10-03T22:11:12.235005Z","steps":["trace[1038566855] 'agreement among raft nodes before linearized reading' (duration: 150.884541ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:12.444995Z","caller":"traceutil/trace.go:171","msg":"trace[21649608] transaction","detail":"{read_only:false; response_revision:482; number_of_response:1; }","duration":"205.429839ms","start":"2026-10-03T22:11:12.23954Z","end":"2026-10-03T22:11:12.444969Z","steps":["trace[21649608] 'process raft request' (duration: 205.205555ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:12.447096Z","caller":"traceutil/trace.go:171","msg":"trace[528552284] transaction","detail":"{read_only:false; response_revision:483; number_of_response:1; }","duration":"206.01996ms","start":"2026-10-03T22:11:12.241011Z","end":"2026-10-03T22:11:12.447031Z","steps":["trace[528552284] 'process raft request' (duration: 204.906749ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:26.301803Z","caller":"traceutil/trace.go:171","msg":"trace[565518702] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"394.378123ms","start":"2026-10-03T22:11:25.907386Z","end":"2026-10-03T22:11:26.301764Z","steps":["trace[565518702] 'process raft request' (duration: 394.148069ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:26.302066Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.907338Z","time spent":"394.585557ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":6315,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:26.313584Z","caller":"traceutil/trace.go:171","msg":"trace[1983151561] transaction","detail":"{read_only:false; response_revision:550; number_of_response:1; }","duration":"394.220769ms","start":"2026-10-03T22:11:25.919337Z","end":"2026-10-03T22:11:26.313557Z","steps":["trace[1983151561] 'process raft request' (duration: 394.060226ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:26.313731Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.919332Z","time spent":"394.329121ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9490,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:26.313829Z","caller":"traceutil/trace.go:171","msg":"trace[1663401487] transaction","detail":"{read_only:false; response_revision:551; number_of_response:1; }","duration":"385.603031ms","start":"2026-10-03T22:11:25.928081Z","end":"2026-10-03T22:11:26.313684Z","steps":["trace[1663401487] 'process raft request' (duration: 385.395098ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:26.3139Z","caller":"traceutil/trace.go:171","msg":"trace[359719262] transaction","detail":"{read_only:false; response_revision:549; number_of_response:1; }","duration":"394.574886ms","start":"2026-10-03T22:11:25.919281Z","end":"2026-10-03T22:11:26.313856Z","steps":["trace[359719262] 'process raft request' (duration: 393.937124ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:26.313862Z","caller":"traceutil/trace.go:171","msg":"trace[289684317] transaction","detail":"{read_only:false; response_revision:552; number_of_response:1; }","duration":"382.526045ms","start":"2026-10-03T22:11:25.931224Z","end":"2026-10-03T22:11:26.31375Z","steps":["trace[289684317] 'process raft request' (duration: 382.309462ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:26.313961Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.91926Z","time spent":"394.673399ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":8162,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:11:26.314134Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.931202Z","time spent":"382.77649ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29801,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:11:26.314154Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.928072Z","time spent":"385.856607ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28462,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:26.314601Z","caller":"traceutil/trace.go:171","msg":"trace[1968619860] transaction","detail":"{read_only:false; response_revision:553; number_of_response:1; }","duration":"382.991643ms","start":"2026-10-03T22:11:25.931596Z","end":"2026-10-03T22:11:26.314588Z","steps":["trace[1968619860] 'process raft request' (duration: 382.622847ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:26.314658Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.931588Z","time spent":"383.045824ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29820,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:26.315274Z","caller":"traceutil/trace.go:171","msg":"trace[1430885058] transaction","detail":"{read_only:false; response_revision:554; number_of_response:1; }","duration":"383.499074ms","start":"2026-10-03T22:11:25.93173Z","end":"2026-10-03T22:11:26.315229Z","steps":["trace[1430885058] 'process raft request' (duration: 382.843291ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:26.315593Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.931704Z","time spent":"383.800998ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28166,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:26.315439Z","caller":"traceutil/trace.go:171","msg":"trace[1133112035] transaction","detail":"{read_only:false; response_revision:555; number_of_response:1; }","duration":"367.088032ms","start":"2026-10-03T22:11:25.948322Z","end":"2026-10-03T22:11:26.31541Z","steps":["trace[1133112035] 'process raft request' (duration: 366.549681ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:26.316039Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.948311Z","time spent":"367.697023ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":22019,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:11:26.316231Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.491939ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:26.316286Z","caller":"traceutil/trace.go:171","msg":"trace[1062232836] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:559; }","duration":"276.589131ms","start":"2026-10-03T22:11:26.039683Z","end":"2026-10-03T22:11:26.316272Z","steps":["trace[1062232836] 'agreement among raft nodes before linearized reading' (duration: 276.463599ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:26.316082Z","caller":"traceutil/trace.go:171","msg":"trace[16118192] linearizableReadLoop","detail":"{readStateIndex:579; appliedIndex:568; }","duration":"276.339156ms","start":"2026-10-03T22:11:26.039716Z","end":"2026-10-03T22:11:26.316055Z","steps":["trace[16118192] 'read index received' (duration: 261.83708ms)","trace[16118192] 'applied index is now lower than readState.Index' (duration: 14.500756ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:11:26.315948Z","caller":"traceutil/trace.go:171","msg":"trace[849776978] transaction","detail":"{read_only:false; response_revision:557; number_of_response:1; }","duration":"335.068573ms","start":"2026-10-03T22:11:25.980867Z","end":"2026-10-03T22:11:26.315936Z","steps":["trace[849776978] 'process raft request' (duration: 334.231547ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:26.316137Z","caller":"traceutil/trace.go:171","msg":"trace[183503595] transaction","detail":"{read_only:false; response_revision:558; number_of_response:1; }","duration":"322.551923ms","start":"2026-10-03T22:11:25.993573Z","end":"2026-10-03T22:11:26.316125Z","steps":["trace[183503595] 'process raft request' (duration: 322.172057ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:26.316578Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.993559Z","time spent":"322.96626ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":79374,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:11:26.316488Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.980858Z","time spent":"335.588472ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":58271,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:26.315675Z","caller":"traceutil/trace.go:171","msg":"trace[15769338] transaction","detail":"{read_only:false; response_revision:556; number_of_response:1; }","duration":"341.440441ms","start":"2026-10-03T22:11:25.974223Z","end":"2026-10-03T22:11:26.315663Z","steps":["trace[15769338] 'process raft request' (duration: 340.801769ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:26.316183Z","caller":"traceutil/trace.go:171","msg":"trace[1792063542] transaction","detail":"{read_only:false; response_revision:559; number_of_response:1; }","duration":"186.352206ms","start":"2026-10-03T22:11:26.129823Z","end":"2026-10-03T22:11:26.316175Z","steps":["trace[1792063542] 'process raft request' (duration: 186.118682ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:26.317134Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:25.974195Z","time spent":"342.871727ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":63889,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:32.578688Z","caller":"traceutil/trace.go:171","msg":"trace[861900180] linearizableReadLoop","detail":"{readStateIndex:679; appliedIndex:678; }","duration":"185.875591ms","start":"2026-10-03T22:11:32.392782Z","end":"2026-10-03T22:11:32.578658Z","steps":["trace[861900180] 'read index received' (duration: 185.758299ms)","trace[861900180] 'applied index is now lower than readState.Index' (duration: 116.082µs)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:11:32.578778Z","caller":"traceutil/trace.go:171","msg":"trace[696586125] transaction","detail":"{read_only:false; response_revision:652; number_of_response:1; }","duration":"203.918869ms","start":"2026-10-03T22:11:32.374834Z","end":"2026-10-03T22:11:32.578753Z","steps":["trace[696586125] 'process raft request' (duration: 203.631684ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:32.578854Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"186.039234ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.152\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-10-03T22:11:32.578944Z","caller":"traceutil/trace.go:171","msg":"trace[390098084] range","detail":"{range_begin:/registry/masterleases/162.253.55.152; range_end:; response_count:1; response_revision:652; }","duration":"186.118706ms","start":"2026-10-03T22:11:32.392764Z","end":"2026-10-03T22:11:32.578883Z","steps":["trace[390098084] 'agreement among raft nodes before linearized reading' (duration: 186.010844ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:32.96498Z","caller":"traceutil/trace.go:171","msg":"trace[852060300] transaction","detail":"{read_only:false; response_revision:653; number_of_response:1; }","duration":"473.994917ms","start":"2026-10-03T22:11:32.490956Z","end":"2026-10-03T22:11:32.964951Z","steps":["trace[852060300] 'process raft request' (duration: 473.213103ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:32.965928Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:32.490911Z","time spent":"474.15391ms","remote":"127.0.0.1:60290","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036265,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:11:33.750026Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"631.86814ms","expected-duration":"100ms","prefix":"","request":"header: lease_grant:","response":"size:39"} {"level":"info","ts":"2026-10-03T22:11:33.750557Z","caller":"traceutil/trace.go:171","msg":"trace[1462934058] transaction","detail":"{read_only:false; response_revision:654; number_of_response:1; }","duration":"682.930715ms","start":"2026-10-03T22:11:33.067603Z","end":"2026-10-03T22:11:33.750533Z","steps":["trace[1462934058] 'process raft request' (duration: 682.758352ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:33.750706Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:33.067581Z","time spent":"683.059317ms","remote":"127.0.0.1:60578","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1087,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:11:33.750686Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:32.580741Z","time spent":"1.169937326s","remote":"127.0.0.1:60224","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"info","ts":"2026-10-03T22:11:33.750833Z","caller":"traceutil/trace.go:171","msg":"trace[1977873727] linearizableReadLoop","detail":"{readStateIndex:681; appliedIndex:679; }","duration":"1.13217667s","start":"2026-10-03T22:11:32.618532Z","end":"2026-10-03T22:11:33.750709Z","steps":["trace[1977873727] 'read index received' (duration: 345.389994ms)","trace[1977873727] 'applied index is now lower than readState.Index' (duration: 786.780896ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:11:33.751213Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.132684629s","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-10-03T22:11:33.751287Z","caller":"traceutil/trace.go:171","msg":"trace[637972516] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:654; }","duration":"1.132828273s","start":"2026-10-03T22:11:32.618445Z","end":"2026-10-03T22:11:33.751274Z","steps":["trace[637972516] 'agreement among raft nodes before linearized reading' (duration: 1.132589538s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:33.75138Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:32.618414Z","time spent":"1.132951585s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-10-03T22:11:33.751492Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"168.790877ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"warn","ts":"2026-10-03T22:11:33.751309Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"712.599411ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:33.751566Z","caller":"traceutil/trace.go:171","msg":"trace[1796166959] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:654; }","duration":"168.911159ms","start":"2026-10-03T22:11:33.582637Z","end":"2026-10-03T22:11:33.751549Z","steps":["trace[1796166959] 'agreement among raft nodes before linearized reading' (duration: 168.742376ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:33.751566Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.083345875s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"warn","ts":"2026-10-03T22:11:33.751617Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.077277155s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-s2txv\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-10-03T22:11:33.751599Z","caller":"traceutil/trace.go:171","msg":"trace[663389866] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:654; }","duration":"712.918357ms","start":"2026-10-03T22:11:33.038647Z","end":"2026-10-03T22:11:33.751565Z","steps":["trace[663389866] 'agreement among raft nodes before linearized reading' (duration: 712.58726ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:33.751646Z","caller":"traceutil/trace.go:171","msg":"trace[341172507] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:654; }","duration":"1.083473587s","start":"2026-10-03T22:11:32.668156Z","end":"2026-10-03T22:11:33.75163Z","steps":["trace[341172507] 'agreement among raft nodes before linearized reading' (duration: 1.083079319s)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:33.751682Z","caller":"traceutil/trace.go:171","msg":"trace[1950030071] range","detail":"{range_begin:/registry/pods/kube-system/cilium-s2txv; range_end:; response_count:1; response_revision:654; }","duration":"1.077364707s","start":"2026-10-03T22:11:32.6743Z","end":"2026-10-03T22:11:33.751664Z","steps":["trace[1950030071] 'agreement among raft nodes before linearized reading' (duration: 1.077225624s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:33.751718Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:32.67429Z","time spent":"1.077419548s","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16987,"request content":"key:\"/registry/pods/kube-system/cilium-s2txv\" "} {"level":"warn","ts":"2026-10-03T22:11:33.751716Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:33.038621Z","time spent":"713.05955ms","remote":"127.0.0.1:60182","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-10-03T22:11:33.751723Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:32.668109Z","time spent":"1.083600629s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-10-03T22:11:34.096962Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"219.142124ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:11:34.097101Z","caller":"traceutil/trace.go:171","msg":"trace[2073846237] transaction","detail":"{read_only:false; response_revision:655; number_of_response:1; }","duration":"343.054658ms","start":"2026-10-03T22:11:33.754025Z","end":"2026-10-03T22:11:34.097079Z","steps":["trace[2073846237] 'process raft request' (duration: 123.71712ms)","trace[2073846237] 'compare' (duration: 218.998872ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:11:34.097166Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:33.753992Z","time spent":"343.144531ms","remote":"127.0.0.1:60224","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:11:35.381585Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"553.225946ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:11:35.381784Z","caller":"traceutil/trace.go:171","msg":"trace[1328611578] transaction","detail":"{read_only:false; response_revision:656; number_of_response:1; }","duration":"1.624621558s","start":"2026-10-03T22:11:33.757141Z","end":"2026-10-03T22:11:35.381763Z","steps":["trace[1328611578] 'process raft request' (duration: 1.071079066s)","trace[1328611578] 'compare' (duration: 552.950082ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:11:35.381858Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:33.757117Z","time spent":"1.62471005s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:11:35.382402Z","caller":"traceutil/trace.go:171","msg":"trace[1077907723] transaction","detail":"{read_only:false; response_revision:657; number_of_response:1; }","duration":"1.624684949s","start":"2026-10-03T22:11:33.757623Z","end":"2026-10-03T22:11:35.382308Z","steps":["trace[1077907723] 'process raft request' (duration: 1.624050218s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:35.382731Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:33.757611Z","time spent":"1.624913054s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:11:35.383632Z","caller":"traceutil/trace.go:171","msg":"trace[1920959607] transaction","detail":"{read_only:false; response_revision:658; number_of_response:1; }","duration":"1.624726549s","start":"2026-10-03T22:11:33.758859Z","end":"2026-10-03T22:11:35.383586Z","steps":["trace[1920959607] 'process raft request' (duration: 1.623314214s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:35.38388Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:33.758845Z","time spent":"1.624906203s","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:11:35.384239Z","caller":"traceutil/trace.go:171","msg":"trace[519032286] linearizableReadLoop","detail":"{readStateIndex:686; appliedIndex:682; }","duration":"1.618764612s","start":"2026-10-03T22:11:33.765448Z","end":"2026-10-03T22:11:35.384213Z","steps":["trace[519032286] 'read index received' (duration: 112.312144ms)","trace[519032286] 'applied index is now lower than readState.Index' (duration: 1.506451438s)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:11:35.384371Z","caller":"traceutil/trace.go:171","msg":"trace[29066631] transaction","detail":"{read_only:false; response_revision:659; number_of_response:1; }","duration":"1.609467754s","start":"2026-10-03T22:11:33.774845Z","end":"2026-10-03T22:11:35.384313Z","steps":["trace[29066631] 'process raft request' (duration: 1.608621988s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:35.384514Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"798.823646ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"warn","ts":"2026-10-03T22:11:35.384498Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.342885698s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-10-03T22:11:35.384521Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:33.774814Z","time spent":"1.609627547s","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":17134,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:11:35.384546Z","caller":"traceutil/trace.go:171","msg":"trace[373996796] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:659; }","duration":"798.896967ms","start":"2026-10-03T22:11:34.585636Z","end":"2026-10-03T22:11:35.384533Z","steps":["trace[373996796] 'agreement among raft nodes before linearized reading' (duration: 798.799355ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:35.38457Z","caller":"traceutil/trace.go:171","msg":"trace[886991962] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:659; }","duration":"1.34299681s","start":"2026-10-03T22:11:34.04155Z","end":"2026-10-03T22:11:35.384547Z","steps":["trace[886991962] 'agreement among raft nodes before linearized reading' (duration: 1.342889198s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:35.384583Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:34.585609Z","time spent":"798.966769ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":454,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-10-03T22:11:35.384621Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:34.04152Z","time spent":"1.343087642s","remote":"127.0.0.1:60194","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-10-03T22:11:35.384401Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.618957535s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/mutatingwebhookconfigurations/envoy-gateway-topology-injector.envoy-gateway-system\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:35.384715Z","caller":"traceutil/trace.go:171","msg":"trace[1677826463] range","detail":"{range_begin:/registry/mutatingwebhookconfigurations/envoy-gateway-topology-injector.envoy-gateway-system; range_end:; response_count:0; response_revision:659; }","duration":"1.619314812s","start":"2026-10-03T22:11:33.765386Z","end":"2026-10-03T22:11:35.384701Z","steps":["trace[1677826463] 'agreement among raft nodes before linearized reading' (duration: 1.618963366s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:35.38477Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:33.765369Z","time spent":"1.619375842s","remote":"127.0.0.1:60720","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":0,"response size":27,"request content":"key:\"/registry/mutatingwebhookconfigurations/envoy-gateway-topology-injector.envoy-gateway-system\" "} {"level":"warn","ts":"2026-10-03T22:11:35.3849Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.284988311s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/default/kubernetes\" ","response":"range_response_count:1 size:422"} {"level":"info","ts":"2026-10-03T22:11:35.384946Z","caller":"traceutil/trace.go:171","msg":"trace[1738600200] range","detail":"{range_begin:/registry/services/endpoints/default/kubernetes; range_end:; response_count:1; response_revision:659; }","duration":"1.285085494s","start":"2026-10-03T22:11:34.099846Z","end":"2026-10-03T22:11:35.384932Z","steps":["trace[1738600200] 'agreement among raft nodes before linearized reading' (duration: 1.284985432s)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:35.384991Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:34.099812Z","time spent":"1.285168916s","remote":"127.0.0.1:60378","response type":"/etcdserverpb.KV/Range","request count":0,"request size":49,"response count":1,"response size":444,"request content":"key:\"/registry/services/endpoints/default/kubernetes\" "} {"level":"info","ts":"2026-10-03T22:11:37.189049Z","caller":"traceutil/trace.go:171","msg":"trace[1736395576] transaction","detail":"{read_only:false; response_revision:682; number_of_response:1; }","duration":"316.350261ms","start":"2026-10-03T22:11:36.872671Z","end":"2026-10-03T22:11:37.189021Z","steps":["trace[1736395576] 'process raft request' (duration: 305.845002ms)","trace[1736395576] 'compare' (duration: 10.182594ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:11:37.189206Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:36.872661Z","time spent":"316.467664ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-03T22:11:37.193882Z","caller":"traceutil/trace.go:171","msg":"trace[590269890] transaction","detail":"{read_only:false; response_revision:683; number_of_response:1; }","duration":"314.764193ms","start":"2026-10-03T22:11:36.879093Z","end":"2026-10-03T22:11:37.193857Z","steps":["trace[590269890] 'process raft request' (duration: 314.516299ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:37.19393Z","caller":"traceutil/trace.go:171","msg":"trace[569655371] transaction","detail":"{read_only:false; response_revision:685; number_of_response:1; }","duration":"313.178404ms","start":"2026-10-03T22:11:36.880727Z","end":"2026-10-03T22:11:37.193905Z","steps":["trace[569655371] 'process raft request' (duration: 313.069352ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:37.1939Z","caller":"traceutil/trace.go:171","msg":"trace[1916181220] linearizableReadLoop","detail":"{readStateIndex:711; appliedIndex:709; }","duration":"314.737132ms","start":"2026-10-03T22:11:36.879132Z","end":"2026-10-03T22:11:37.193869Z","steps":["trace[1916181220] 'read index received' (duration: 299.423907ms)","trace[1916181220] 'applied index is now lower than readState.Index' (duration: 15.312135ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:11:37.193962Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:36.879075Z","time spent":"314.851114ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4234,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-03T22:11:37.194015Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:36.880714Z","time spent":"313.257815ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4580,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:37.194018Z","caller":"traceutil/trace.go:171","msg":"trace[1413030173] transaction","detail":"{read_only:false; response_revision:684; number_of_response:1; }","duration":"313.275075ms","start":"2026-10-03T22:11:36.880695Z","end":"2026-10-03T22:11:37.19397Z","steps":["trace[1413030173] 'process raft request' (duration: 313.059941ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:37.194034Z","caller":"traceutil/trace.go:171","msg":"trace[205256099] transaction","detail":"{read_only:false; response_revision:686; number_of_response:1; }","duration":"125.73114ms","start":"2026-10-03T22:11:37.068275Z","end":"2026-10-03T22:11:37.194006Z","steps":["trace[205256099] 'process raft request' (duration: 125.552616ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:37.194106Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"314.945996ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-10-03T22:11:37.194139Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"313.462549ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:37.194161Z","caller":"traceutil/trace.go:171","msg":"trace[900226089] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io; range_end:; response_count:0; response_revision:686; }","duration":"315.057448ms","start":"2026-10-03T22:11:36.879088Z","end":"2026-10-03T22:11:37.194145Z","steps":["trace[900226089] 'agreement among raft nodes before linearized reading' (duration: 314.933186ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:37.194178Z","caller":"traceutil/trace.go:171","msg":"trace[1680306788] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io; range_end:; response_count:0; response_revision:686; }","duration":"313.539199ms","start":"2026-10-03T22:11:36.880623Z","end":"2026-10-03T22:11:37.194162Z","steps":["trace[1680306788] 'agreement among raft nodes before linearized reading' (duration: 313.474848ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:37.194179Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"313.54338ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-10-03T22:11:37.194204Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:36.879069Z","time spent":"315.12612ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Range","request count":0,"request size":85,"response count":0,"response size":27,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumpodippools.cilium.io\" "} {"level":"warn","ts":"2026-10-03T22:11:37.194207Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:36.880599Z","time spent":"313.600402ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":0,"response size":27,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnodes.cilium.io\" "} {"level":"warn","ts":"2026-10-03T22:11:37.194197Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.248155ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-10-03T22:11:37.19423Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:36.88067Z","time spent":"313.458909ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3353,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-03T22:11:37.19426Z","caller":"traceutil/trace.go:171","msg":"trace[405070450] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io; range_end:; response_count:0; response_revision:686; }","duration":"313.659793ms","start":"2026-10-03T22:11:36.880578Z","end":"2026-10-03T22:11:37.194237Z","steps":["trace[405070450] 'agreement among raft nodes before linearized reading' (duration: 313.506049ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:37.194315Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:36.880566Z","time spent":"313.736264ms","remote":"127.0.0.1:60254","response type":"/etcdserverpb.KV/Range","request count":0,"request size":94,"response count":0,"response size":27,"request content":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumloadbalancerippools.cilium.io\" "} {"level":"info","ts":"2026-10-03T22:11:37.194313Z","caller":"traceutil/trace.go:171","msg":"trace[1130963239] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:686; }","duration":"153.386248ms","start":"2026-10-03T22:11:37.040896Z","end":"2026-10-03T22:11:37.194282Z","steps":["trace[1130963239] 'agreement among raft nodes before linearized reading' (duration: 153.197394ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:50.978399Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"321.709331ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:50.978522Z","caller":"traceutil/trace.go:171","msg":"trace[1977093061] range","detail":"{range_begin:/registry/volumeattachments/; range_end:/registry/volumeattachments0; response_count:0; response_revision:823; }","duration":"321.914285ms","start":"2026-10-03T22:11:50.656583Z","end":"2026-10-03T22:11:50.978497Z","steps":["trace[1977093061] 'count revisions from in-memory index tree' (duration: 321.59456ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:50.978507Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"179.0021ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-7zq95\" ","response":"range_response_count:1 size:3965"} {"level":"warn","ts":"2026-10-03T22:11:50.978584Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:50.656553Z","time spent":"322.011918ms","remote":"127.0.0.1:60602","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":0,"response size":27,"request content":"key:\"/registry/volumeattachments/\" range_end:\"/registry/volumeattachments0\" count_only:true "} {"level":"info","ts":"2026-10-03T22:11:50.978602Z","caller":"traceutil/trace.go:171","msg":"trace[1026475645] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-7zq95; range_end:; response_count:1; response_revision:823; }","duration":"179.153813ms","start":"2026-10-03T22:11:50.799425Z","end":"2026-10-03T22:11:50.978579Z","steps":["trace[1026475645] 'range keys from in-memory index tree' (duration: 178.821406ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:51.590363Z","caller":"traceutil/trace.go:171","msg":"trace[1486718375] linearizableReadLoop","detail":"{readStateIndex:857; appliedIndex:856; }","duration":"491.906344ms","start":"2026-10-03T22:11:51.098432Z","end":"2026-10-03T22:11:51.590339Z","steps":["trace[1486718375] 'read index received' (duration: 491.605498ms)","trace[1486718375] 'applied index is now lower than readState.Index' (duration: 299.756µs)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:11:51.59083Z","caller":"traceutil/trace.go:171","msg":"trace[1776826214] transaction","detail":"{read_only:false; response_revision:824; number_of_response:1; }","duration":"603.531605ms","start":"2026-10-03T22:11:50.987287Z","end":"2026-10-03T22:11:51.590818Z","steps":["trace[1776826214] 'process raft request' (duration: 602.845152ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.591018Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:50.987263Z","time spent":"603.673108ms","remote":"127.0.0.1:60394","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4028,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-03T22:11:51.591345Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"492.81003ms","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":"warn","ts":"2026-10-03T22:11:51.591365Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"329.118914ms","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-10-03T22:11:51.591453Z","caller":"traceutil/trace.go:171","msg":"trace[1966532927] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:824; }","duration":"493.012452ms","start":"2026-10-03T22:11:51.098409Z","end":"2026-10-03T22:11:51.591422Z","steps":["trace[1966532927] 'agreement among raft nodes before linearized reading' (duration: 492.798379ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.591473Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"415.335387ms","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-10-03T22:11:51.591507Z","caller":"traceutil/trace.go:171","msg":"trace[2128216329] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:824; }","duration":"415.419678ms","start":"2026-10-03T22:11:51.176078Z","end":"2026-10-03T22:11:51.591498Z","steps":["trace[2128216329] 'agreement among raft nodes before linearized reading' (duration: 415.336497ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.591515Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.098371Z","time spent":"493.131045ms","remote":"127.0.0.1:57284","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" count_only:true "} {"level":"warn","ts":"2026-10-03T22:11:51.59156Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.176066Z","time spent":"415.48464ms","remote":"127.0.0.1:57294","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:500 "} {"level":"warn","ts":"2026-10-03T22:11:51.591645Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"348.079366ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:51.591733Z","caller":"traceutil/trace.go:171","msg":"trace[1050359667] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:824; }","duration":"348.224878ms","start":"2026-10-03T22:11:51.243493Z","end":"2026-10-03T22:11:51.591718Z","steps":["trace[1050359667] 'agreement among raft nodes before linearized reading' (duration: 348.029355ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.591791Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"416.408988ms","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-10-03T22:11:51.591845Z","caller":"traceutil/trace.go:171","msg":"trace[2001544191] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:824; }","duration":"416.472639ms","start":"2026-10-03T22:11:51.175345Z","end":"2026-10-03T22:11:51.591818Z","steps":["trace[2001544191] 'agreement among raft nodes before linearized reading' (duration: 416.403748ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.59189Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"390.192257ms","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-10-03T22:11:51.591888Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.175328Z","time spent":"416.55048ms","remote":"127.0.0.1:57304","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:10000 "} {"level":"warn","ts":"2026-10-03T22:11:51.591807Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.243467Z","time spent":"348.326451ms","remote":"127.0.0.1:57310","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:500 "} {"level":"warn","ts":"2026-10-03T22:11:51.592091Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"493.034783ms","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":"warn","ts":"2026-10-03T22:11:51.592104Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"416.748853ms","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-10-03T22:11:51.592156Z","caller":"traceutil/trace.go:171","msg":"trace[628918190] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:824; }","duration":"416.854105ms","start":"2026-10-03T22:11:51.175289Z","end":"2026-10-03T22:11:51.592143Z","steps":["trace[628918190] 'agreement among raft nodes before linearized reading' (duration: 416.761244ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592179Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"456.068914ms","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-10-03T22:11:51.592202Z","caller":"traceutil/trace.go:171","msg":"trace[33047731] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:824; }","duration":"456.115725ms","start":"2026-10-03T22:11:51.136079Z","end":"2026-10-03T22:11:51.592195Z","steps":["trace[33047731] 'agreement among raft nodes before linearized reading' (duration: 456.078745ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592199Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.175274Z","time spent":"416.914156ms","remote":"127.0.0.1:57304","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true "} {"level":"warn","ts":"2026-10-03T22:11:51.592245Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.136062Z","time spent":"456.175906ms","remote":"127.0.0.1:57294","response type":"/etcdserverpb.KV/Range","request count":0,"request size":116,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" count_only:true "} {"level":"warn","ts":"2026-10-03T22:11:51.59227Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"117.575136ms","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-10-03T22:11:51.591455Z","caller":"traceutil/trace.go:171","msg":"trace[1543296350] 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:824; }","duration":"329.254865ms","start":"2026-10-03T22:11:51.262182Z","end":"2026-10-03T22:11:51.591436Z","steps":["trace[1543296350] 'agreement among raft nodes before linearized reading' (duration: 329.079102ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:51.592347Z","caller":"traceutil/trace.go:171","msg":"trace[1620169812] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:824; }","duration":"117.681948ms","start":"2026-10-03T22:11:51.474655Z","end":"2026-10-03T22:11:51.592337Z","steps":["trace[1620169812] 'agreement among raft nodes before linearized reading' (duration: 117.548365ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592379Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.262164Z","time spent":"330.200062ms","remote":"127.0.0.1:57326","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":27,"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-10-03T22:11:51.592404Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"456.38481ms","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-10-03T22:11:51.59245Z","caller":"traceutil/trace.go:171","msg":"trace[364003936] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/backendtlspolicies/; range_end:/registry/gateway.networking.k8s.io/backendtlspolicies0; response_count:0; response_revision:824; }","duration":"456.45503ms","start":"2026-10-03T22:11:51.135987Z","end":"2026-10-03T22:11:51.592442Z","steps":["trace[364003936] 'agreement among raft nodes before linearized reading' (duration: 456.394869ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592495Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.135974Z","time spent":"456.513461ms","remote":"127.0.0.1:57294","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.k8s.io/backendtlspolicies/\" range_end:\"/registry/gateway.networking.k8s.io/backendtlspolicies0\" limit:10000 "} {"level":"warn","ts":"2026-10-03T22:11:51.592425Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"348.610736ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:51.592123Z","caller":"traceutil/trace.go:171","msg":"trace[1308230474] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:824; }","duration":"493.102724ms","start":"2026-10-03T22:11:51.099009Z","end":"2026-10-03T22:11:51.592112Z","steps":["trace[1308230474] 'agreement among raft nodes before linearized reading' (duration: 493.056553ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592603Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"477.393069ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-10-03T22:11:51.592612Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.09899Z","time spent":"493.607963ms","remote":"127.0.0.1:57284","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:500 "} {"level":"info","ts":"2026-10-03T22:11:51.592643Z","caller":"traceutil/trace.go:171","msg":"trace[298327669] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:824; }","duration":"477.437179ms","start":"2026-10-03T22:11:51.11518Z","end":"2026-10-03T22:11:51.592617Z","steps":["trace[298327669] 'agreement among raft nodes before linearized reading' (duration: 477.406109ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592645Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.312315ms","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-10-03T22:11:51.592682Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.115143Z","time spent":"477.516221ms","remote":"127.0.0.1:60194","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-10-03T22:11:51.592581Z","caller":"traceutil/trace.go:171","msg":"trace[720325907] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:824; }","duration":"348.921711ms","start":"2026-10-03T22:11:51.243641Z","end":"2026-10-03T22:11:51.592563Z","steps":["trace[720325907] 'agreement among raft nodes before linearized reading' (duration: 348.526645ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592754Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.780136ms","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-10-03T22:11:51.592788Z","caller":"traceutil/trace.go:171","msg":"trace[1021279007] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:824; }","duration":"172.839446ms","start":"2026-10-03T22:11:51.419941Z","end":"2026-10-03T22:11:51.59278Z","steps":["trace[1021279007] 'agreement among raft nodes before linearized reading' (duration: 172.793825ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592556Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.341732ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-10-03T22:11:51.592678Z","caller":"traceutil/trace.go:171","msg":"trace[313303288] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:824; }","duration":"124.401276ms","start":"2026-10-03T22:11:51.468267Z","end":"2026-10-03T22:11:51.592668Z","steps":["trace[313303288] 'agreement among raft nodes before linearized reading' (duration: 124.314285ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:51.592849Z","caller":"traceutil/trace.go:171","msg":"trace[1631030435] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:824; }","duration":"121.650938ms","start":"2026-10-03T22:11:51.471186Z","end":"2026-10-03T22:11:51.592837Z","steps":["trace[1631030435] 'agreement among raft nodes before linearized reading' (duration: 121.288942ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.592873Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.243622Z","time spent":"349.147795ms","remote":"127.0.0.1:57310","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:10000 "} {"level":"warn","ts":"2026-10-03T22:11:51.592975Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"329.807455ms","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-10-03T22:11:51.593013Z","caller":"traceutil/trace.go:171","msg":"trace[1074674793] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:824; }","duration":"329.859786ms","start":"2026-10-03T22:11:51.263143Z","end":"2026-10-03T22:11:51.593003Z","steps":["trace[1074674793] 'agreement among raft nodes before linearized reading' (duration: 329.767614ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.59304Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.263138Z","time spent":"329.893706ms","remote":"127.0.0.1:60498","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":513,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-10-03T22:11:51.59272Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"172.684334ms","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-10-03T22:11:51.593231Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.988327ms","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-10-03T22:11:51.593263Z","caller":"traceutil/trace.go:171","msg":"trace[2141705878] 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:824; }","duration":"331.027687ms","start":"2026-10-03T22:11:51.262225Z","end":"2026-10-03T22:11:51.593252Z","steps":["trace[2141705878] 'agreement among raft nodes before linearized reading' (duration: 330.983576ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.593328Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.26222Z","time spent":"331.072618ms","remote":"127.0.0.1:57326","response type":"/etcdserverpb.KV/Range","request count":0,"request size":110,"response count":0,"response size":27,"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-10-03T22:11:51.591506Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"493.078373ms","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":"warn","ts":"2026-10-03T22:11:51.591835Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"389.524465ms","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-10-03T22:11:51.593514Z","caller":"traceutil/trace.go:171","msg":"trace[942948438] 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:824; }","duration":"391.262556ms","start":"2026-10-03T22:11:51.202235Z","end":"2026-10-03T22:11:51.593497Z","steps":["trace[942948438] 'agreement among raft nodes before linearized reading' (duration: 389.525766ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.591745Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"389.381983ms","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":"warn","ts":"2026-10-03T22:11:51.593572Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.202217Z","time spent":"391.336597ms","remote":"127.0.0.1:57306","response type":"/etcdserverpb.KV/Range","request count":0,"request size":130,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies/\" range_end:\"/registry/gateway.networking.x-k8s.io/xbackendtrafficpolicies0\" count_only:true "} {"level":"info","ts":"2026-10-03T22:11:51.593247Z","caller":"traceutil/trace.go:171","msg":"trace[625455109] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/httproutes/; range_end:/registry/gateway.networking.k8s.io/httproutes0; response_count:0; response_revision:824; }","duration":"173.286285ms","start":"2026-10-03T22:11:51.419941Z","end":"2026-10-03T22:11:51.593227Z","steps":["trace[625455109] 'agreement among raft nodes before linearized reading' (duration: 172.754055ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.593206Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"349.576803ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:51.593754Z","caller":"traceutil/trace.go:171","msg":"trace[1266741765] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:824; }","duration":"350.122192ms","start":"2026-10-03T22:11:51.243615Z","end":"2026-10-03T22:11:51.593737Z","steps":["trace[1266741765] 'agreement among raft nodes before linearized reading' (duration: 349.547873ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:51.591938Z","caller":"traceutil/trace.go:171","msg":"trace[673672180] 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:824; }","duration":"390.239707ms","start":"2026-10-03T22:11:51.201669Z","end":"2026-10-03T22:11:51.591909Z","steps":["trace[673672180] 'agreement among raft nodes before linearized reading' (duration: 390.199287ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.5938Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.243611Z","time spent":"350.175093ms","remote":"127.0.0.1:57310","response type":"/etcdserverpb.KV/Range","request count":0,"request size":110,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" count_only:true "} {"level":"info","ts":"2026-10-03T22:11:51.593572Z","caller":"traceutil/trace.go:171","msg":"trace[856952332] 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:824; }","duration":"391.224445ms","start":"2026-10-03T22:11:51.202331Z","end":"2026-10-03T22:11:51.593556Z","steps":["trace[856952332] 'agreement among raft nodes before linearized reading' (duration: 389.386762ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.593832Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.201654Z","time spent":"392.162261ms","remote":"127.0.0.1:57306","response type":"/etcdserverpb.KV/Range","request count":0,"request size":131,"response count":0,"response size":27,"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-10-03T22:11:51.59319Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"330.213063ms","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":"warn","ts":"2026-10-03T22:11:51.593867Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.202294Z","time spent":"391.558931ms","remote":"127.0.0.1:57306","response type":"/etcdserverpb.KV/Range","request count":0,"request size":131,"response count":0,"response size":27,"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-10-03T22:11:51.593878Z","caller":"traceutil/trace.go:171","msg":"trace[150448903] 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:824; }","duration":"330.943136ms","start":"2026-10-03T22:11:51.262923Z","end":"2026-10-03T22:11:51.593867Z","steps":["trace[150448903] 'agreement among raft nodes before linearized reading' (duration: 330.239494ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:11:51.593456Z","caller":"traceutil/trace.go:171","msg":"trace[1509191677] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/backendtrafficpolicies/; range_end:/registry/gateway.envoyproxy.io/backendtrafficpolicies0; response_count:0; response_revision:824; }","duration":"495.063409ms","start":"2026-10-03T22:11:51.098376Z","end":"2026-10-03T22:11:51.59344Z","steps":["trace[1509191677] 'agreement among raft nodes before linearized reading' (duration: 493.106604ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:51.593909Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.262883Z","time spent":"331.015236ms","remote":"127.0.0.1:57326","response type":"/etcdserverpb.KV/Range","request count":0,"request size":111,"response count":0,"response size":27,"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-10-03T22:11:51.59393Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-03T22:11:51.098349Z","time spent":"495.571557ms","remote":"127.0.0.1:57284","response type":"/etcdserverpb.KV/Range","request count":0,"request size":117,"response count":0,"response size":27,"request content":"key:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/backendtrafficpolicies0\" limit:10000 "} {"level":"info","ts":"2026-10-03T22:11:52.525021Z","caller":"traceutil/trace.go:171","msg":"trace[2087763708] linearizableReadLoop","detail":"{readStateIndex:865; appliedIndex:864; }","duration":"120.663397ms","start":"2026-10-03T22:11:52.404333Z","end":"2026-10-03T22:11:52.524996Z","steps":["trace[2087763708] 'read index received' (duration: 37.195862ms)","trace[2087763708] 'applied index is now lower than readState.Index' (duration: 83.466285ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:11:52.525245Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.564126ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:52.525349Z","caller":"traceutil/trace.go:171","msg":"trace[992131350] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:831; }","duration":"120.688167ms","start":"2026-10-03T22:11:52.404638Z","end":"2026-10-03T22:11:52.525326Z","steps":["trace[992131350] 'agreement among raft nodes before linearized reading' (duration: 120.554135ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:52.52539Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.82946ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:52.525475Z","caller":"traceutil/trace.go:171","msg":"trace[1519508107] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:831; }","duration":"121.173546ms","start":"2026-10-03T22:11:52.404288Z","end":"2026-10-03T22:11:52.525462Z","steps":["trace[1519508107] 'agreement among raft nodes before linearized reading' (duration: 120.84484ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:11:52.526091Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"120.958173ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/grpcroutes/\" range_end:\"/registry/gateway.networking.k8s.io/grpcroutes0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:11:52.526162Z","caller":"traceutil/trace.go:171","msg":"trace[1436037274] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/grpcroutes/; range_end:/registry/gateway.networking.k8s.io/grpcroutes0; response_count:0; response_revision:831; }","duration":"121.023454ms","start":"2026-10-03T22:11:52.405102Z","end":"2026-10-03T22:11:52.526126Z","steps":["trace[1436037274] 'agreement among raft nodes before linearized reading' (duration: 120.960793ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:12:18.082071Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"286.923194ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-10-03T22:12:18.082496Z","caller":"traceutil/trace.go:171","msg":"trace[1472018099] transaction","detail":"{read_only:false; response_revision:1037; number_of_response:1; }","duration":"299.626119ms","start":"2026-10-03T22:12:17.782821Z","end":"2026-10-03T22:12:18.082447Z","steps":["trace[1472018099] 'process raft request' (duration: 12.169345ms)","trace[1472018099] 'compare' (duration: 286.739921ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:12:18.122323Z","caller":"traceutil/trace.go:171","msg":"trace[660034910] linearizableReadLoop","detail":"{readStateIndex:1076; appliedIndex:1074; }","duration":"298.315546ms","start":"2026-10-03T22:12:17.823963Z","end":"2026-10-03T22:12:18.122278Z","steps":["trace[660034910] 'read index received' (duration: 113.155125ms)","trace[660034910] 'applied index is now lower than readState.Index' (duration: 185.157951ms)"],"step_count":2} {"level":"warn","ts":"2026-10-03T22:12:18.122711Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.718522ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"warn","ts":"2026-10-03T22:12:18.122774Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"291.662753ms","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-10-03T22:12:18.122813Z","caller":"traceutil/trace.go:171","msg":"trace[2078700744] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1037; }","duration":"298.856045ms","start":"2026-10-03T22:12:17.823929Z","end":"2026-10-03T22:12:18.122785Z","steps":["trace[2078700744] 'agreement among raft nodes before linearized reading' (duration: 298.55912ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:12:18.122836Z","caller":"traceutil/trace.go:171","msg":"trace[1034118266] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1037; }","duration":"291.821167ms","start":"2026-10-03T22:12:17.830994Z","end":"2026-10-03T22:12:18.122815Z","steps":["trace[1034118266] 'agreement among raft nodes before linearized reading' (duration: 291.536701ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:12:18.123139Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.390766ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-10-03T22:12:18.123185Z","caller":"traceutil/trace.go:171","msg":"trace[564785958] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1037; }","duration":"276.491937ms","start":"2026-10-03T22:12:17.846679Z","end":"2026-10-03T22:12:18.123171Z","steps":["trace[564785958] 'agreement among raft nodes before linearized reading' (duration: 276.375555ms)"],"step_count":1} {"level":"warn","ts":"2026-10-03T22:12:18.123211Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"187.804775ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumes/\" range_end:\"/registry/persistentvolumes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-03T22:12:18.123307Z","caller":"traceutil/trace.go:171","msg":"trace[1584937819] range","detail":"{range_begin:/registry/persistentvolumes/; range_end:/registry/persistentvolumes0; response_count:0; response_revision:1037; }","duration":"187.929438ms","start":"2026-10-03T22:12:17.935352Z","end":"2026-10-03T22:12:18.123281Z","steps":["trace[1584937819] 'agreement among raft nodes before linearized reading' (duration: 187.769135ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:12:30.698543Z","caller":"traceutil/trace.go:171","msg":"trace[1771130446] transaction","detail":"{read_only:false; response_revision:1085; number_of_response:1; }","duration":"157.792416ms","start":"2026-10-03T22:12:30.540716Z","end":"2026-10-03T22:12:30.698508Z","steps":["trace[1771130446] 'process raft request' (duration: 157.612713ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:12:48.682278Z","caller":"traceutil/trace.go:171","msg":"trace[1538516017] transaction","detail":"{read_only:false; response_revision:1144; number_of_response:1; }","duration":"107.989161ms","start":"2026-10-03T22:12:48.574258Z","end":"2026-10-03T22:12:48.682247Z","steps":["trace[1538516017] 'process raft request' (duration: 102.668784ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:12:50.988674Z","caller":"traceutil/trace.go:171","msg":"trace[1664723462] transaction","detail":"{read_only:false; response_revision:1151; number_of_response:1; }","duration":"112.086433ms","start":"2026-10-03T22:12:50.876556Z","end":"2026-10-03T22:12:50.988643Z","steps":["trace[1664723462] 'process raft request' (duration: 35.628769ms)","trace[1664723462] 'compare' (duration: 76.311742ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:12:52.943778Z","caller":"traceutil/trace.go:171","msg":"trace[461503774] transaction","detail":"{read_only:false; response_revision:1158; number_of_response:1; }","duration":"135.716004ms","start":"2026-10-03T22:12:52.80804Z","end":"2026-10-03T22:12:52.943756Z","steps":["trace[461503774] 'process raft request' (duration: 135.579741ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:12:53.12249Z","caller":"traceutil/trace.go:171","msg":"trace[1964752673] transaction","detail":"{read_only:false; response_revision:1159; number_of_response:1; }","duration":"128.28319ms","start":"2026-10-03T22:12:52.994152Z","end":"2026-10-03T22:12:53.122436Z","steps":["trace[1964752673] 'process raft request' (duration: 32.144311ms)","trace[1964752673] 'compare' (duration: 95.882196ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:12:54.423356Z","caller":"traceutil/trace.go:171","msg":"trace[1832227939] transaction","detail":"{read_only:false; response_revision:1161; number_of_response:1; }","duration":"208.916154ms","start":"2026-10-03T22:12:54.214411Z","end":"2026-10-03T22:12:54.423327Z","steps":["trace[1832227939] 'process raft request' (duration: 150.828843ms)","trace[1832227939] 'compare' (duration: 57.950989ms)"],"step_count":2} {"level":"info","ts":"2026-10-03T22:13:57.521585Z","caller":"traceutil/trace.go:171","msg":"trace[1494010388] transaction","detail":"{read_only:false; response_revision:1402; number_of_response:1; }","duration":"123.819252ms","start":"2026-10-03T22:13:57.397727Z","end":"2026-10-03T22:13:57.521546Z","steps":["trace[1494010388] 'process raft request' (duration: 123.355105ms)"],"step_count":1} {"level":"info","ts":"2026-10-03T22:13:57.523433Z","caller":"traceutil/trace.go:171","msg":"trace[1217723084] transaction","detail":"{read_only:false; response_revision:1403; number_of_response:1; }","duration":"116.876435ms","start":"2026-10-03T22:13:57.406503Z","end":"2026-10-03T22:13:57.523379Z","steps":["trace[1217723084] 'process raft request' (duration: 116.659022ms)"],"step_count":1}