{"level":"warn","ts":"2026-07-21T05:24:46.462727Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-07-21T05:24:46.462808Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.194:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.194:2380","--initial-cluster=instance=https://199.19.213.194:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.194:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.194: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-07-21T05:24:46.46287Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-07-21T05:24:46.462882Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.194:2380"]} {"level":"info","ts":"2026-07-21T05:24:46.462902Z","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-07-21T05:24:46.46402Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.194:2379"]} {"level":"info","ts":"2026-07-21T05:24:46.464114Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.194:2380"],"listen-peer-urls":["https://199.19.213.194:2380"],"advertise-client-urls":["https://199.19.213.194:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.194:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.194: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-07-21T05:24:46.469032Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.691971ms"} {"level":"info","ts":"2026-07-21T05:24:46.476165Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"1444e0f5dfca45ef","cluster-id":"46f0df2abd5471c9"} {"level":"info","ts":"2026-07-21T05:24:46.476234Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef switched to configuration voters=()"} {"level":"info","ts":"2026-07-21T05:24:46.476257Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef became follower at term 0"} {"level":"info","ts":"2026-07-21T05:24:46.47628Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 1444e0f5dfca45ef [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-07-21T05:24:46.4763Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef became follower at term 1"} {"level":"info","ts":"2026-07-21T05:24:46.476338Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef switched to configuration voters=(1460539525801068015)"} {"level":"warn","ts":"2026-07-21T05:24:46.482839Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-07-21T05:24:46.484287Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-07-21T05:24:46.485304Z","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-07-21T05:24:46.489812Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"1444e0f5dfca45ef","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-07-21T05:24:46.496252Z","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-07-21T05:24:46.496327Z","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-07-21T05:24:46.496348Z","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-07-21T05:24:46.496492Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"1444e0f5dfca45ef","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-07-21T05:24:46.496752Z","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-07-21T05:24:46.496981Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.194:2380"} {"level":"info","ts":"2026-07-21T05:24:46.497015Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.194:2380"} {"level":"info","ts":"2026-07-21T05:24:46.496993Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"1444e0f5dfca45ef","initial-advertise-peer-urls":["https://199.19.213.194:2380"],"listen-peer-urls":["https://199.19.213.194:2380"],"advertise-client-urls":["https://199.19.213.194:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.194:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-07-21T05:24:46.49704Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-07-21T05:24:46.497805Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef switched to configuration voters=(1460539525801068015)"} {"level":"info","ts":"2026-07-21T05:24:46.497885Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"46f0df2abd5471c9","local-member-id":"1444e0f5dfca45ef","added-peer-id":"1444e0f5dfca45ef","added-peer-peer-urls":["https://199.19.213.194:2380"]} {"level":"info","ts":"2026-07-21T05:24:47.377261Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef is starting a new election at term 1"} {"level":"info","ts":"2026-07-21T05:24:47.377309Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef became pre-candidate at term 1"} {"level":"info","ts":"2026-07-21T05:24:47.377336Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef received MsgPreVoteResp from 1444e0f5dfca45ef at term 1"} {"level":"info","ts":"2026-07-21T05:24:47.37735Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef became candidate at term 2"} {"level":"info","ts":"2026-07-21T05:24:47.377357Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef received MsgVoteResp from 1444e0f5dfca45ef at term 2"} {"level":"info","ts":"2026-07-21T05:24:47.377481Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"1444e0f5dfca45ef became leader at term 2"} {"level":"info","ts":"2026-07-21T05:24:47.377543Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 1444e0f5dfca45ef elected leader 1444e0f5dfca45ef at term 2"} {"level":"info","ts":"2026-07-21T05:24:47.37855Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"1444e0f5dfca45ef","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.194:2379]}","request-path":"/0/members/1444e0f5dfca45ef/attributes","cluster-id":"46f0df2abd5471c9","publish-timeout":"7s"} {"level":"info","ts":"2026-07-21T05:24:47.378545Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-07-21T05:24:47.378623Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-21T05:24:47.378774Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-07-21T05:24:47.378793Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-07-21T05:24:47.379236Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"46f0df2abd5471c9","local-member-id":"1444e0f5dfca45ef","cluster-version":"3.5"} {"level":"info","ts":"2026-07-21T05:24:47.379358Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-07-21T05:24:47.379401Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-07-21T05:24:47.37961Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-21T05:24:47.380757Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-07-21T05:24:47.382717Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.194:2379"} {"level":"warn","ts":"2026-07-21T05:24:50.088662Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614701777,"retry-timeout":"500ms"} {"level":"info","ts":"2026-07-21T05:24:50.302153Z","caller":"traceutil/trace.go:171","msg":"trace[105528363] linearizableReadLoop","detail":"{readStateIndex:75; appliedIndex:74; }","duration":"713.965611ms","start":"2026-07-21T05:24:49.588165Z","end":"2026-07-21T05:24:50.30213Z","steps":["trace[105528363] 'read index received' (duration: 713.792355ms)","trace[105528363] 'applied index is now lower than readState.Index' (duration: 172.336µs)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:24:50.302247Z","caller":"traceutil/trace.go:171","msg":"trace[816557429] transaction","detail":"{read_only:false; response_revision:71; number_of_response:1; }","duration":"714.699226ms","start":"2026-07-21T05:24:49.58751Z","end":"2026-07-21T05:24:50.302209Z","steps":["trace[816557429] 'process raft request' (duration: 714.458027ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:50.302419Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"604.019692ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-07-21T05:24:50.30244Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"714.201228ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-07-21T05:24:50.302477Z","caller":"traceutil/trace.go:171","msg":"trace[963740112] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:71; }","duration":"604.167567ms","start":"2026-07-21T05:24:49.698296Z","end":"2026-07-21T05:24:50.302464Z","steps":["trace[963740112] 'agreement among raft nodes before linearized reading' (duration: 603.981581ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:24:50.302496Z","caller":"traceutil/trace.go:171","msg":"trace[681181259] range","detail":"{range_begin:/registry/clusterrolebindings/; range_end:/registry/clusterrolebindings0; response_count:0; response_revision:71; }","duration":"714.366464ms","start":"2026-07-21T05:24:49.588115Z","end":"2026-07-21T05:24:50.302481Z","steps":["trace[681181259] 'agreement among raft nodes before linearized reading' (duration: 714.131936ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:50.302516Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:49.69828Z","time spent":"604.226709ms","remote":"127.0.0.1:59888","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":26,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-07-21T05:24:50.302543Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:49.588104Z","time spent":"714.419856ms","remote":"127.0.0.1:55216","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":0,"response size":26,"request content":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" "} {"level":"warn","ts":"2026-07-21T05:24:50.302692Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:49.587491Z","time spent":"714.824909ms","remote":"127.0.0.1:55222","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":429,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:24:50.30286Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"156.374698ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/kube-system/\" range_end:\"/registry/limitranges/kube-system0\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-07-21T05:24:50.302915Z","caller":"traceutil/trace.go:171","msg":"trace[8206449] range","detail":"{range_begin:/registry/limitranges/kube-system/; range_end:/registry/limitranges/kube-system0; response_count:0; response_revision:71; }","duration":"156.470342ms","start":"2026-07-21T05:24:50.146428Z","end":"2026-07-21T05:24:50.302898Z","steps":["trace[8206449] 'agreement among raft nodes before linearized reading' (duration: 156.365748ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:50.808805Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614701783,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-07-21T05:24:51.309758Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614701783,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-07-21T05:24:51.810872Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614701783,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-07-21T05:24:51.897355Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.590548932s","expected-duration":"1s"} {"level":"warn","ts":"2026-07-21T05:24:52.101182Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"202.288488ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:14"} {"level":"info","ts":"2026-07-21T05:24:52.101412Z","caller":"traceutil/trace.go:171","msg":"trace[20608938] transaction","detail":"{read_only:false; response_revision:72; number_of_response:1; }","duration":"1.794633221s","start":"2026-07-21T05:24:50.306702Z","end":"2026-07-21T05:24:52.101335Z","steps":["trace[20608938] 'process raft request' (duration: 1.591094621s)","trace[20608938] 'compare' (duration: 202.132713ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:24:52.101585Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:50.306686Z","time spent":"1.794830327s","remote":"127.0.0.1:55062","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5882,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-21T05:24:52.159732Z","caller":"traceutil/trace.go:171","msg":"trace[1223475149] transaction","detail":"{read_only:false; response_revision:73; number_of_response:1; }","duration":"1.85109144s","start":"2026-07-21T05:24:50.308604Z","end":"2026-07-21T05:24:52.159695Z","steps":["trace[1223475149] 'process raft request' (duration: 1.850743148s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:52.159804Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:50.388612Z","time spent":"1.771183217s","remote":"127.0.0.1:54956","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""} {"level":"warn","ts":"2026-07-21T05:24:52.159923Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:50.308592Z","time spent":"1.851217963s","remote":"127.0.0.1:55222","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:24:52.16003Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.8522765s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/edit\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-07-21T05:24:52.160121Z","caller":"traceutil/trace.go:171","msg":"trace[1375879228] range","detail":"{range_begin:/registry/clusterroles/edit; range_end:; response_count:0; response_revision:73; }","duration":"1.852402554s","start":"2026-07-21T05:24:50.307697Z","end":"2026-07-21T05:24:52.160099Z","steps":["trace[1375879228] 'agreement among raft nodes before linearized reading' (duration: 1.852225268s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:52.160172Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:50.307686Z","time spent":"1.852476966s","remote":"127.0.0.1:55202","response type":"/etcdserverpb.KV/Range","request count":0,"request size":29,"response count":0,"response size":26,"request content":"key:\"/registry/clusterroles/edit\" "} {"level":"info","ts":"2026-07-21T05:24:52.160527Z","caller":"traceutil/trace.go:171","msg":"trace[2131755836] linearizableReadLoop","detail":"{readStateIndex:78; appliedIndex:75; }","duration":"1.852020971s","start":"2026-07-21T05:24:50.307721Z","end":"2026-07-21T05:24:52.159742Z","steps":["trace[2131755836] 'read index received' (duration: 1.589932451s)","trace[2131755836] 'applied index is now lower than readState.Index' (duration: 262.08709ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:24:52.160744Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.362854566s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-07-21T05:24:52.160805Z","caller":"traceutil/trace.go:171","msg":"trace[1630840980] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:73; }","duration":"1.36295441s","start":"2026-07-21T05:24:50.797822Z","end":"2026-07-21T05:24:52.160777Z","steps":["trace[1630840980] 'agreement among raft nodes before linearized reading' (duration: 1.362865267s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:52.160904Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"524.961715ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-07-21T05:24:52.160905Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"282.706618ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-07-21T05:24:52.160931Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:50.797801Z","time spent":"1.363117835s","remote":"127.0.0.1:59888","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":26,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-07-21T05:24:52.161207Z","caller":"traceutil/trace.go:171","msg":"trace[1751620029] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:0; response_revision:73; }","duration":"525.197963ms","start":"2026-07-21T05:24:51.635886Z","end":"2026-07-21T05:24:52.161084Z","steps":["trace[1751620029] 'agreement among raft nodes before linearized reading' (duration: 524.873122ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:52.161309Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:51.635865Z","time spent":"525.426952ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":0,"response size":26,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-07-21T05:24:52.161129Z","caller":"traceutil/trace.go:171","msg":"trace[1322363504] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:73; }","duration":"283.122872ms","start":"2026-07-21T05:24:51.877978Z","end":"2026-07-21T05:24:52.161101Z","steps":["trace[1322363504] 'agreement among raft nodes before linearized reading' (duration: 282.703448ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:53.404428Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"926.455654ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:14"} {"level":"info","ts":"2026-07-21T05:24:53.404698Z","caller":"traceutil/trace.go:171","msg":"trace[1790896188] transaction","detail":"{read_only:false; response_revision:76; number_of_response:1; }","duration":"1.239053565s","start":"2026-07-21T05:24:52.165628Z","end":"2026-07-21T05:24:53.404682Z","steps":["trace[1790896188] 'process raft request' (duration: 1.239020904s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:53.404759Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:52.165611Z","time spent":"1.239124028s","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":417,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-21T05:24:53.404945Z","caller":"traceutil/trace.go:171","msg":"trace[1049530688] transaction","detail":"{read_only:false; response_revision:74; number_of_response:1; }","duration":"1.243431073s","start":"2026-07-21T05:24:52.161499Z","end":"2026-07-21T05:24:53.40493Z","steps":["trace[1049530688] 'process raft request' (duration: 316.320706ms)","trace[1049530688] 'compare' (duration: 925.749671ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:24:53.404984Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:52.161475Z","time spent":"1.243493125s","remote":"127.0.0.1:54956","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":592,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-21T05:24:53.405097Z","caller":"traceutil/trace.go:171","msg":"trace[765177299] linearizableReadLoop","detail":"{readStateIndex:79; appliedIndex:78; }","duration":"1.243094042s","start":"2026-07-21T05:24:52.161995Z","end":"2026-07-21T05:24:53.405089Z","steps":["trace[765177299] 'read index received' (duration: 315.866832ms)","trace[765177299] 'applied index is now lower than readState.Index' (duration: 927.22589ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:24:53.405207Z","caller":"traceutil/trace.go:171","msg":"trace[2035183438] transaction","detail":"{read_only:false; response_revision:75; number_of_response:1; }","duration":"1.240107802s","start":"2026-07-21T05:24:52.165092Z","end":"2026-07-21T05:24:53.4052Z","steps":["trace[2035183438] 'process raft request' (duration: 1.239469659s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:53.405255Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:52.165072Z","time spent":"1.240158234s","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:24:53.405451Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.243446614s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-07-21T05:24:53.405482Z","caller":"traceutil/trace.go:171","msg":"trace[1073457472] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:76; }","duration":"1.243512837s","start":"2026-07-21T05:24:52.161962Z","end":"2026-07-21T05:24:53.405475Z","steps":["trace[1073457472] 'agreement among raft nodes before linearized reading' (duration: 1.243385372s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:53.405506Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:52.161953Z","time spent":"1.243548538s","remote":"127.0.0.1:59902","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":26,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-07-21T05:24:53.409058Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.245429791s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:aggregate-to-view\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-07-21T05:24:53.409135Z","caller":"traceutil/trace.go:171","msg":"trace[710065423] range","detail":"{range_begin:/registry/clusterroles/system:aggregate-to-view; range_end:; response_count:0; response_revision:78; }","duration":"1.245557135s","start":"2026-07-21T05:24:52.163564Z","end":"2026-07-21T05:24:53.409121Z","steps":["trace[710065423] 'agreement among raft nodes before linearized reading' (duration: 1.24538186s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:53.409169Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:52.163547Z","time spent":"1.245612698s","remote":"127.0.0.1:55202","response type":"/etcdserverpb.KV/Range","request count":0,"request size":49,"response count":0,"response size":26,"request content":"key:\"/registry/clusterroles/system:aggregate-to-view\" "} {"level":"info","ts":"2026-07-21T05:24:53.409203Z","caller":"traceutil/trace.go:171","msg":"trace[764348824] transaction","detail":"{read_only:false; response_revision:77; number_of_response:1; }","duration":"533.60436ms","start":"2026-07-21T05:24:52.875588Z","end":"2026-07-21T05:24:53.409193Z","steps":["trace[764348824] 'process raft request' (duration: 533.210627ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:53.409371Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:52.875562Z","time spent":"533.711143ms","remote":"127.0.0.1:55062","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2905,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-21T05:24:53.409096Z","caller":"traceutil/trace.go:171","msg":"trace[80714905] transaction","detail":"{read_only:false; response_revision:78; number_of_response:1; }","duration":"477.944738ms","start":"2026-07-21T05:24:52.931122Z","end":"2026-07-21T05:24:53.409066Z","steps":["trace[80714905] 'process raft request' (duration: 477.784232ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:24:53.409902Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:24:52.93109Z","time spent":"478.772405ms","remote":"127.0.0.1:55062","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3965,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:25:26.704129Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614702675,"retry-timeout":"500ms"} {"level":"info","ts":"2026-07-21T05:25:26.918496Z","caller":"traceutil/trace.go:171","msg":"trace[461303814] transaction","detail":"{read_only:false; response_revision:492; number_of_response:1; }","duration":"760.925738ms","start":"2026-07-21T05:25:26.157541Z","end":"2026-07-21T05:25:26.918466Z","steps":["trace[461303814] 'process raft request' (duration: 760.762543ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:26.919004Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:26.157516Z","time spent":"761.070102ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":462,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:26.95592Z","caller":"traceutil/trace.go:171","msg":"trace[89385981] linearizableReadLoop","detail":"{readStateIndex:516; appliedIndex:514; }","duration":"752.429068ms","start":"2026-07-21T05:25:26.203465Z","end":"2026-07-21T05:25:26.955895Z","steps":["trace[89385981] 'read index received' (duration: 714.850213ms)","trace[89385981] 'applied index is now lower than readState.Index' (duration: 37.577395ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:25:26.955962Z","caller":"traceutil/trace.go:171","msg":"trace[660227972] transaction","detail":"{read_only:false; response_revision:493; number_of_response:1; }","duration":"386.505596ms","start":"2026-07-21T05:25:26.569436Z","end":"2026-07-21T05:25:26.955941Z","steps":["trace[660227972] 'process raft request' (duration: 385.452233ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:26.956059Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:26.569409Z","time spent":"386.598789ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-21T05:25:26.956107Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"597.26429ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:25:26.956165Z","caller":"traceutil/trace.go:171","msg":"trace[13108716] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:493; }","duration":"597.380744ms","start":"2026-07-21T05:25:26.358773Z","end":"2026-07-21T05:25:26.956154Z","steps":["trace[13108716] 'agreement among raft nodes before linearized reading' (duration: 597.278011ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:26.956212Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:26.358753Z","time spent":"597.446446ms","remote":"127.0.0.1:59888","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-07-21T05:25:26.956215Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"752.723066ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/kube-system/\" range_end:\"/registry/secrets/kube-system0\" ","response":"range_response_count:3 size:12669"} {"level":"info","ts":"2026-07-21T05:25:26.956292Z","caller":"traceutil/trace.go:171","msg":"trace[701399837] range","detail":"{range_begin:/registry/secrets/kube-system/; range_end:/registry/secrets/kube-system0; response_count:3; response_revision:493; }","duration":"752.855212ms","start":"2026-07-21T05:25:26.203416Z","end":"2026-07-21T05:25:26.956271Z","steps":["trace[701399837] 'agreement among raft nodes before linearized reading' (duration: 752.610864ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:26.956348Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:26.203394Z","time spent":"752.944574ms","remote":"127.0.0.1:54978","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":3,"response size":12691,"request content":"key:\"/registry/secrets/kube-system/\" range_end:\"/registry/secrets/kube-system0\" "} {"level":"warn","ts":"2026-07-21T05:25:30.70083Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"548.118508ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-07-21T05:25:30.701204Z","caller":"traceutil/trace.go:171","msg":"trace[1805978084] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"1.091844058s","start":"2026-07-21T05:25:29.609343Z","end":"2026-07-21T05:25:30.701187Z","steps":["trace[1805978084] 'process raft request' (duration: 1.091773496s)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:30.70123Z","caller":"traceutil/trace.go:171","msg":"trace[1287630238] transaction","detail":"{read_only:false; response_revision:547; number_of_response:1; }","duration":"1.091948492s","start":"2026-07-21T05:25:29.609231Z","end":"2026-07-21T05:25:30.701179Z","steps":["trace[1287630238] 'process raft request' (duration: 543.416691ms)","trace[1287630238] 'compare' (duration: 547.735076ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:25:30.701287Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.609337Z","time spent":"1.09191557s","remote":"127.0.0.1:54924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":63889,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:25:30.701385Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.609209Z","time spent":"1.092106806s","remote":"127.0.0.1:54924","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-07-21T05:25:30.704853Z","caller":"traceutil/trace.go:171","msg":"trace[35283904] transaction","detail":"{read_only:false; response_revision:549; number_of_response:1; }","duration":"1.089106541s","start":"2026-07-21T05:25:29.61573Z","end":"2026-07-21T05:25:30.704836Z","steps":["trace[35283904] 'process raft request' (duration: 1.088981947s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.704953Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.615702Z","time spent":"1.089199474s","remote":"127.0.0.1:55148","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-07-21T05:25:30.705139Z","caller":"traceutil/trace.go:171","msg":"trace[1477742907] transaction","detail":"{read_only:false; response_revision:550; number_of_response:1; }","duration":"1.089312528s","start":"2026-07-21T05:25:29.615806Z","end":"2026-07-21T05:25:30.705119Z","steps":["trace[1477742907] 'process raft request' (duration: 1.088996918s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.705222Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.615803Z","time spent":"1.08937715s","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:30.705436Z","caller":"traceutil/trace.go:171","msg":"trace[2038268266] transaction","detail":"{read_only:false; response_revision:551; number_of_response:1; }","duration":"1.082836712s","start":"2026-07-21T05:25:29.62257Z","end":"2026-07-21T05:25:30.705407Z","steps":["trace[2038268266] 'process raft request' (duration: 1.082484781s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.705552Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.62255Z","time spent":"1.082945046s","remote":"127.0.0.1:54924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9125,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:30.706185Z","caller":"traceutil/trace.go:171","msg":"trace[1183901315] transaction","detail":"{read_only:false; response_revision:552; number_of_response:1; }","duration":"1.083454243s","start":"2026-07-21T05:25:29.622716Z","end":"2026-07-21T05:25:30.70617Z","steps":["trace[1183901315] 'process raft request' (duration: 1.082573294s)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:30.70619Z","caller":"traceutil/trace.go:171","msg":"trace[1354233571] linearizableReadLoop","detail":"{readStateIndex:583; appliedIndex:576; }","duration":"347.559321ms","start":"2026-07-21T05:25:30.358597Z","end":"2026-07-21T05:25:30.706156Z","steps":["trace[1354233571] 'read index received' (duration: 346.725544ms)","trace[1354233571] 'applied index is now lower than readState.Index' (duration: 832.927µs)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:25:30.706261Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.622712Z","time spent":"1.083515905s","remote":"127.0.0.1:55392","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":998,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:25:30.706451Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"347.85146ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:25:30.706514Z","caller":"traceutil/trace.go:171","msg":"trace[476826877] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:558; }","duration":"347.956383ms","start":"2026-07-21T05:25:30.358544Z","end":"2026-07-21T05:25:30.7065Z","steps":["trace[476826877] 'agreement among raft nodes before linearized reading' (duration: 347.704715ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.706677Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:30.358515Z","time spent":"348.149169ms","remote":"127.0.0.1:59888","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-07-21T05:25:30.706863Z","caller":"traceutil/trace.go:171","msg":"trace[846703571] transaction","detail":"{read_only:false; response_revision:553; number_of_response:1; }","duration":"1.06693962s","start":"2026-07-21T05:25:29.63991Z","end":"2026-07-21T05:25:30.70685Z","steps":["trace[846703571] 'process raft request' (duration: 1.065495824s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.70701Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.639885Z","time spent":"1.067082255s","remote":"127.0.0.1:54924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":30374,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:30.707082Z","caller":"traceutil/trace.go:171","msg":"trace[395101587] transaction","detail":"{read_only:false; response_revision:555; number_of_response:1; }","duration":"1.066651151s","start":"2026-07-21T05:25:29.640424Z","end":"2026-07-21T05:25:30.707075Z","steps":["trace[395101587] 'process raft request' (duration: 1.065092021s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.707141Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.640407Z","time spent":"1.066706852s","remote":"127.0.0.1:54924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":30393,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:30.70722Z","caller":"traceutil/trace.go:171","msg":"trace[1113826717] transaction","detail":"{read_only:false; response_revision:557; number_of_response:1; }","duration":"1.033242594s","start":"2026-07-21T05:25:29.673972Z","end":"2026-07-21T05:25:30.707214Z","steps":["trace[1113826717] 'process raft request' (duration: 1.032054116s)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:30.707286Z","caller":"traceutil/trace.go:171","msg":"trace[1648631842] transaction","detail":"{read_only:false; response_revision:558; number_of_response:1; }","duration":"936.850613ms","start":"2026-07-21T05:25:29.770429Z","end":"2026-07-21T05:25:30.70728Z","steps":["trace[1648631842] 'process raft request' (duration: 935.668626ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.707351Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.770401Z","time spent":"936.929174ms","remote":"127.0.0.1:54924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":149907,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:25:30.707493Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.673923Z","time spent":"1.033316115s","remote":"127.0.0.1:54924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":79374,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-21T05:25:30.707022Z","caller":"traceutil/trace.go:171","msg":"trace[445471911] transaction","detail":"{read_only:false; response_revision:556; number_of_response:1; }","duration":"1.060426294s","start":"2026-07-21T05:25:29.646579Z","end":"2026-07-21T05:25:30.707005Z","steps":["trace[445471911] 'process raft request' (duration: 1.059261848s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.707948Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.64657Z","time spent":"1.061352083s","remote":"127.0.0.1:54924","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28739,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:30.707056Z","caller":"traceutil/trace.go:171","msg":"trace[720765335] transaction","detail":"{read_only:false; response_revision:554; number_of_response:1; }","duration":"1.06696333s","start":"2026-07-21T05:25:29.640085Z","end":"2026-07-21T05:25:30.707048Z","steps":["trace[720765335] 'process raft request' (duration: 1.06539703s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:30.708023Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:29.640077Z","time spent":"1.067934512s","remote":"127.0.0.1:55392","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":998,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:25:37.338474Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"557.194598ms","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-07-21T05:25:37.338507Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"564.883377ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-07-21T05:25:37.33858Z","caller":"traceutil/trace.go:171","msg":"trace[411863484] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:640; }","duration":"557.306941ms","start":"2026-07-21T05:25:36.781248Z","end":"2026-07-21T05:25:37.338555Z","steps":["trace[411863484] 'range keys from in-memory index tree' (duration: 557.089044ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:37.338597Z","caller":"traceutil/trace.go:171","msg":"trace[1648119994] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:640; }","duration":"564.989011ms","start":"2026-07-21T05:25:36.773592Z","end":"2026-07-21T05:25:37.338581Z","steps":["trace[1648119994] 'range keys from in-memory index tree' (duration: 564.705322ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:37.338647Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:36.773569Z","time spent":"565.070024ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-07-21T05:25:37.338624Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"302.748012ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-8499f\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-07-21T05:25:37.338788Z","caller":"traceutil/trace.go:171","msg":"trace[493821953] range","detail":"{range_begin:/registry/pods/kube-system/cilium-8499f; range_end:; response_count:1; response_revision:640; }","duration":"302.960678ms","start":"2026-07-21T05:25:37.035808Z","end":"2026-07-21T05:25:37.338768Z","steps":["trace[493821953] 'range keys from in-memory index tree' (duration: 302.635619ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:37.338891Z","caller":"traceutil/trace.go:171","msg":"trace[1371971683] transaction","detail":"{read_only:false; response_revision:641; number_of_response:1; }","duration":"192.728807ms","start":"2026-07-21T05:25:37.146108Z","end":"2026-07-21T05:25:37.338837Z","steps":["trace[1371971683] 'process raft request' (duration: 94.323385ms)","trace[1371971683] 'compare' (duration: 97.462233ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:25:37.338641Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:36.781238Z","time spent":"557.388194ms","remote":"127.0.0.1:55148","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-07-21T05:25:37.338714Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"569.873623ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:25:37.33925Z","caller":"traceutil/trace.go:171","msg":"trace[383775626] range","detail":"{range_begin:/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:640; }","duration":"570.42411ms","start":"2026-07-21T05:25:36.768792Z","end":"2026-07-21T05:25:37.339216Z","steps":["trace[383775626] 'range keys from in-memory index tree' (duration: 569.823942ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:37.338352Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"360.687493ms","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-07-21T05:25:37.339357Z","caller":"traceutil/trace.go:171","msg":"trace[1410149874] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:640; }","duration":"361.751005ms","start":"2026-07-21T05:25:36.977592Z","end":"2026-07-21T05:25:37.339343Z","steps":["trace[1410149874] 'range keys from in-memory index tree' (duration: 360.324321ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:37.339362Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:36.768778Z","time spent":"570.561325ms","remote":"127.0.0.1:55122","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":0,"response size":27,"request content":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" "} {"level":"warn","ts":"2026-07-21T05:25:37.339527Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:36.977571Z","time spent":"361.804087ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":500,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-07-21T05:25:37.338843Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:37.035786Z","time spent":"303.044351ms","remote":"127.0.0.1:55062","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-8499f\" "} {"level":"warn","ts":"2026-07-21T05:25:37.722307Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"190.503347ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-21T05:25:37.722444Z","caller":"traceutil/trace.go:171","msg":"trace[1054676797] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"377.98078ms","start":"2026-07-21T05:25:37.344446Z","end":"2026-07-21T05:25:37.722427Z","steps":["trace[1054676797] 'process raft request' (duration: 187.280327ms)","trace[1054676797] 'compare' (duration: 190.381323ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:25:37.722495Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:37.344425Z","time spent":"378.050773ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":463,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:37.722713Z","caller":"traceutil/trace.go:171","msg":"trace[336029324] transaction","detail":"{read_only:false; response_revision:644; number_of_response:1; }","duration":"375.178453ms","start":"2026-07-21T05:25:37.347524Z","end":"2026-07-21T05:25:37.722702Z","steps":["trace[336029324] 'process raft request' (duration: 374.868493ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:37.72277Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:37.347502Z","time spent":"375.239655ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:37.722939Z","caller":"traceutil/trace.go:171","msg":"trace[1941107916] linearizableReadLoop","detail":"{readStateIndex:672; appliedIndex:668; }","duration":"362.827978ms","start":"2026-07-21T05:25:37.3601Z","end":"2026-07-21T05:25:37.722928Z","steps":["trace[1941107916] 'read index received' (duration: 171.757143ms)","trace[1941107916] 'applied index is now lower than readState.Index' (duration: 191.069495ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:25:37.723045Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"362.927691ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:25:37.723076Z","caller":"traceutil/trace.go:171","msg":"trace[212979484] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:646; }","duration":"363.015963ms","start":"2026-07-21T05:25:37.360051Z","end":"2026-07-21T05:25:37.723067Z","steps":["trace[212979484] 'agreement among raft nodes before linearized reading' (duration: 362.9218ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:37.723104Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:37.360031Z","time spent":"363.066155ms","remote":"127.0.0.1:59902","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-07-21T05:25:37.723271Z","caller":"traceutil/trace.go:171","msg":"trace[125090837] transaction","detail":"{read_only:false; response_revision:646; number_of_response:1; }","duration":"364.686237ms","start":"2026-07-21T05:25:37.358574Z","end":"2026-07-21T05:25:37.723261Z","steps":["trace[125090837] 'process raft request' (duration: 364.294734ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:37.723358Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:37.358542Z","time spent":"364.78588ms","remote":"127.0.0.1:55062","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-07-21T05:25:37.723518Z","caller":"traceutil/trace.go:171","msg":"trace[1499676849] transaction","detail":"{read_only:false; response_revision:645; number_of_response:1; }","duration":"375.933267ms","start":"2026-07-21T05:25:37.347532Z","end":"2026-07-21T05:25:37.723465Z","steps":["trace[1499676849] 'process raft request' (duration: 375.06909ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:37.723763Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:37.347513Z","time spent":"376.135144ms","remote":"127.0.0.1:55148","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-07-21T05:25:38.480123Z","caller":"traceutil/trace.go:171","msg":"trace[1905831853] linearizableReadLoop","detail":"{readStateIndex:673; appliedIndex:672; }","duration":"121.072445ms","start":"2026-07-21T05:25:38.359018Z","end":"2026-07-21T05:25:38.48009Z","steps":["trace[1905831853] 'read index received' (duration: 119.534086ms)","trace[1905831853] 'applied index is now lower than readState.Index' (duration: 1.537299ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:25:38.480334Z","caller":"traceutil/trace.go:171","msg":"trace[304278248] transaction","detail":"{read_only:false; response_revision:647; number_of_response:1; }","duration":"725.108804ms","start":"2026-07-21T05:25:37.755188Z","end":"2026-07-21T05:25:38.480297Z","steps":["trace[304278248] 'process raft request' (duration: 723.72083ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:38.480418Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.26094ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:25:38.48046Z","caller":"traceutil/trace.go:171","msg":"trace[781953757] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:647; }","duration":"121.510088ms","start":"2026-07-21T05:25:38.358935Z","end":"2026-07-21T05:25:38.480445Z","steps":["trace[781953757] 'agreement among raft nodes before linearized reading' (duration: 121.26774ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:38.480542Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:37.755144Z","time spent":"725.292219ms","remote":"127.0.0.1:54978","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036309,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-21T05:25:39.863345Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614702945,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-07-21T05:25:40.3637Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614702945,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-07-21T05:25:40.864118Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614702945,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-07-21T05:25:40.875564Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"2.326884152s","expected-duration":"1s"} {"level":"info","ts":"2026-07-21T05:25:40.891186Z","caller":"traceutil/trace.go:171","msg":"trace[1710418595] transaction","detail":"{read_only:false; response_revision:648; number_of_response:1; }","duration":"2.342696933s","start":"2026-07-21T05:25:38.548466Z","end":"2026-07-21T05:25:40.891163Z","steps":["trace[1710418595] 'process raft request' (duration: 2.327343546s)","trace[1710418595] 'compare' (duration: 14.79782ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:25:40.891292Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:38.548413Z","time spent":"2.342835857s","remote":"127.0.0.1:55122","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2603,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:25:41.163644Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"257.868341ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:27"} {"level":"info","ts":"2026-07-21T05:25:41.164454Z","caller":"traceutil/trace.go:171","msg":"trace[961241973] transaction","detail":"{read_only:false; response_revision:649; number_of_response:1; }","duration":"1.208418341s","start":"2026-07-21T05:25:39.956007Z","end":"2026-07-21T05:25:41.164426Z","steps":["trace[961241973] 'process raft request' (duration: 1.207804652s)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:41.164619Z","caller":"traceutil/trace.go:171","msg":"trace[999696344] linearizableReadLoop","detail":"{readStateIndex:676; appliedIndex:673; }","duration":"1.801565687s","start":"2026-07-21T05:25:39.362784Z","end":"2026-07-21T05:25:41.164349Z","steps":["trace[999696344] 'read index received' (duration: 1.513036083s)","trace[999696344] 'applied index is now lower than readState.Index' (duration: 288.527984ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:25:41.164686Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.801892236s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"warn","ts":"2026-07-21T05:25:41.164704Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:39.955982Z","time spent":"1.208598587s","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:41.164754Z","caller":"traceutil/trace.go:171","msg":"trace[1598039225] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:649; }","duration":"1.801965639s","start":"2026-07-21T05:25:39.362772Z","end":"2026-07-21T05:25:41.164737Z","steps":["trace[1598039225] 'agreement among raft nodes before linearized reading' (duration: 1.801747352s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:41.164794Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:39.362678Z","time spent":"1.802107253s","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-07-21T05:25:41.16495Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"808.520476ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:25:41.164986Z","caller":"traceutil/trace.go:171","msg":"trace[838533952] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:649; }","duration":"808.585768ms","start":"2026-07-21T05:25:40.35639Z","end":"2026-07-21T05:25:41.164976Z","steps":["trace[838533952] 'agreement among raft nodes before linearized reading' (duration: 808.535286ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:41.165017Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:40.356372Z","time spent":"808.639059ms","remote":"127.0.0.1:59888","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-07-21T05:25:41.165149Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.437097817s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"warn","ts":"2026-07-21T05:25:41.165135Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"269.383338ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/job-controller\" ","response":"range_response_count:1 size:193"} {"level":"info","ts":"2026-07-21T05:25:41.165184Z","caller":"traceutil/trace.go:171","msg":"trace[685529533] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:649; }","duration":"1.437153788s","start":"2026-07-21T05:25:39.728021Z","end":"2026-07-21T05:25:41.165175Z","steps":["trace[685529533] 'agreement among raft nodes before linearized reading' (duration: 1.437046815s)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:41.165211Z","caller":"traceutil/trace.go:171","msg":"trace[400993017] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/job-controller; range_end:; response_count:1; response_revision:649; }","duration":"269.486161ms","start":"2026-07-21T05:25:40.895703Z","end":"2026-07-21T05:25:41.165189Z","steps":["trace[400993017] 'agreement among raft nodes before linearized reading' (duration: 269.293436ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:41.165234Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:39.728013Z","time spent":"1.43721434s","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":500,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-07-21T05:25:41.164944Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.437004284s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"warn","ts":"2026-07-21T05:25:41.165818Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.437124207s","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-07-21T05:25:41.166256Z","caller":"traceutil/trace.go:171","msg":"trace[503484951] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:649; }","duration":"1.437572792s","start":"2026-07-21T05:25:39.728668Z","end":"2026-07-21T05:25:41.16624Z","steps":["trace[503484951] 'agreement among raft nodes before linearized reading' (duration: 1.436325252s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:41.166318Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:39.72866Z","time spent":"1.437634104s","remote":"127.0.0.1:55148","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":"info","ts":"2026-07-21T05:25:41.166178Z","caller":"traceutil/trace.go:171","msg":"trace[480485743] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:649; }","duration":"1.4381674s","start":"2026-07-21T05:25:39.727906Z","end":"2026-07-21T05:25:41.166074Z","steps":["trace[480485743] 'agreement among raft nodes before linearized reading' (duration: 1.436834979s)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:41.167024Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:39.727822Z","time spent":"1.439105669s","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":527,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-07-21T05:25:42.480046Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.05345ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:25:42.480158Z","caller":"traceutil/trace.go:171","msg":"trace[620551499] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:662; }","duration":"123.209015ms","start":"2026-07-21T05:25:42.356923Z","end":"2026-07-21T05:25:42.480132Z","steps":["trace[620551499] 'range keys from in-memory index tree' (duration: 122.934836ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:46.379593Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"101.386828ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumidentities.cilium.io\" ","response":"range_response_count:1 size:4333"} {"level":"info","ts":"2026-07-21T05:25:46.379654Z","caller":"traceutil/trace.go:171","msg":"trace[1016168935] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumidentities.cilium.io; range_end:; response_count:1; response_revision:726; }","duration":"101.523593ms","start":"2026-07-21T05:25:46.278117Z","end":"2026-07-21T05:25:46.379641Z","steps":["trace[1016168935] 'range keys from in-memory index tree' (duration: 101.176691ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.746146Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5039421893614703261,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-07-21T05:25:57.802497Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"846.910591ms","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-07-21T05:25:57.802594Z","caller":"traceutil/trace.go:171","msg":"trace[609408129] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:806; }","duration":"847.075376ms","start":"2026-07-21T05:25:56.955495Z","end":"2026-07-21T05:25:57.80257Z","steps":["trace[609408129] 'range keys from in-memory index tree' (duration: 846.683535ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.802646Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:56.955473Z","time spent":"847.160599ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":514,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-07-21T05:25:57.911014Z","caller":"traceutil/trace.go:171","msg":"trace[1813555092] transaction","detail":"{read_only:false; response_revision:807; number_of_response:1; }","duration":"899.542979ms","start":"2026-07-21T05:25:57.011447Z","end":"2026-07-21T05:25:57.91099Z","steps":["trace[1813555092] 'process raft request' (duration: 899.310892ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.911167Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:57.011426Z","time spent":"899.660493ms","remote":"127.0.0.1:55052","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5052,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:57.934521Z","caller":"traceutil/trace.go:171","msg":"trace[447479026] transaction","detail":"{read_only:false; response_revision:808; number_of_response:1; }","duration":"777.652406ms","start":"2026-07-21T05:25:57.156844Z","end":"2026-07-21T05:25:57.934496Z","steps":["trace[447479026] 'process raft request' (duration: 777.497872ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.934652Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:57.156818Z","time spent":"777.7627ms","remote":"127.0.0.1:55122","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2785,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:25:57.934744Z","caller":"traceutil/trace.go:171","msg":"trace[2098330884] transaction","detail":"{read_only:false; response_revision:809; number_of_response:1; }","duration":"212.55903ms","start":"2026-07-21T05:25:57.722167Z","end":"2026-07-21T05:25:57.934726Z","steps":["trace[2098330884] 'process raft request' (duration: 212.289882ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:57.934875Z","caller":"traceutil/trace.go:171","msg":"trace[1973982209] linearizableReadLoop","detail":"{readStateIndex:841; appliedIndex:838; }","duration":"689.810733ms","start":"2026-07-21T05:25:57.245057Z","end":"2026-07-21T05:25:57.934868Z","steps":["trace[1973982209] 'read index received' (duration: 665.771748ms)","trace[1973982209] 'applied index is now lower than readState.Index' (duration: 24.038325ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:25:57.935064Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"575.452489ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:25:57.935101Z","caller":"traceutil/trace.go:171","msg":"trace[704608926] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:810; }","duration":"575.528151ms","start":"2026-07-21T05:25:57.359564Z","end":"2026-07-21T05:25:57.935093Z","steps":["trace[704608926] 'agreement among raft nodes before linearized reading' (duration: 575.476949ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.935106Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"689.906846ms","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-07-21T05:25:57.935122Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:57.359518Z","time spent":"575.599914ms","remote":"127.0.0.1:59888","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-07-21T05:25:57.935127Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"685.275836ms","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-07-21T05:25:57.935155Z","caller":"traceutil/trace.go:171","msg":"trace[1652274347] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:810; }","duration":"685.323678ms","start":"2026-07-21T05:25:57.249825Z","end":"2026-07-21T05:25:57.935149Z","steps":["trace[1652274347] 'agreement among raft nodes before linearized reading' (duration: 685.251985ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:25:57.935143Z","caller":"traceutil/trace.go:171","msg":"trace[767277596] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:810; }","duration":"689.993499ms","start":"2026-07-21T05:25:57.245138Z","end":"2026-07-21T05:25:57.935132Z","steps":["trace[767277596] 'agreement among raft nodes before linearized reading' (duration: 689.857265ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.935179Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:57.249815Z","time spent":"685.358818ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":527,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-07-21T05:25:57.935187Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:57.245107Z","time spent":"690.074102ms","remote":"127.0.0.1:55148","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":"info","ts":"2026-07-21T05:25:57.935225Z","caller":"traceutil/trace.go:171","msg":"trace[808930986] transaction","detail":"{read_only:false; response_revision:810; number_of_response:1; }","duration":"126.768589ms","start":"2026-07-21T05:25:57.808449Z","end":"2026-07-21T05:25:57.935218Z","steps":["trace[808930986] 'process raft request' (duration: 126.212202ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.935271Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"690.212665ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:431"} {"level":"info","ts":"2026-07-21T05:25:57.935289Z","caller":"traceutil/trace.go:171","msg":"trace[1783776860] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:810; }","duration":"690.264127ms","start":"2026-07-21T05:25:57.245019Z","end":"2026-07-21T05:25:57.935283Z","steps":["trace[1783776860] 'agreement among raft nodes before linearized reading' (duration: 690.214415ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.935334Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:57.245001Z","time spent":"690.32608ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":453,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-07-21T05:25:57.935384Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"688.407361ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:477"} {"level":"info","ts":"2026-07-21T05:25:57.935424Z","caller":"traceutil/trace.go:171","msg":"trace[1434317616] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:810; }","duration":"688.445442ms","start":"2026-07-21T05:25:57.246968Z","end":"2026-07-21T05:25:57.935413Z","steps":["trace[1434317616] 'agreement among raft nodes before linearized reading' (duration: 688.313738ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:25:57.935453Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:25:57.246936Z","time spent":"688.509614ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":499,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-07-21T05:26:01.520223Z","caller":"traceutil/trace.go:171","msg":"trace[1718103154] transaction","detail":"{read_only:false; response_revision:834; number_of_response:1; }","duration":"136.996061ms","start":"2026-07-21T05:26:01.383187Z","end":"2026-07-21T05:26:01.520183Z","steps":["trace[1718103154] 'process raft request' (duration: 67.054692ms)","trace[1718103154] 'compare' (duration: 69.786005ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:01.641024Z","caller":"traceutil/trace.go:171","msg":"trace[1578911076] transaction","detail":"{read_only:false; response_revision:835; number_of_response:1; }","duration":"116.63262ms","start":"2026-07-21T05:26:01.524369Z","end":"2026-07-21T05:26:01.641001Z","steps":["trace[1578911076] 'process raft request' (duration: 101.755954ms)","trace[1578911076] 'compare' (duration: 14.583097ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:01.64122Z","caller":"traceutil/trace.go:171","msg":"trace[1408941880] transaction","detail":"{read_only:false; response_revision:836; number_of_response:1; }","duration":"101.853197ms","start":"2026-07-21T05:26:01.539107Z","end":"2026-07-21T05:26:01.64096Z","steps":["trace[1408941880] 'process raft request' (duration: 101.748854ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:01.837798Z","caller":"traceutil/trace.go:171","msg":"trace[136546235] transaction","detail":"{read_only:false; response_revision:837; number_of_response:1; }","duration":"192.494847ms","start":"2026-07-21T05:26:01.645274Z","end":"2026-07-21T05:26:01.837769Z","steps":["trace[136546235] 'process raft request' (duration: 152.559048ms)","trace[136546235] 'compare' (duration: 39.772103ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:02.248663Z","caller":"traceutil/trace.go:171","msg":"trace[2129844549] linearizableReadLoop","detail":"{readStateIndex:872; appliedIndex:871; }","duration":"299.95855ms","start":"2026-07-21T05:26:01.948684Z","end":"2026-07-21T05:26:02.248643Z","steps":["trace[2129844549] 'read index received' (duration: 299.788635ms)","trace[2129844549] 'applied index is now lower than readState.Index' (duration: 169.245µs)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:26:02.24895Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"277.040173ms","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-07-21T05:26:02.248984Z","caller":"traceutil/trace.go:171","msg":"trace[2058003812] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:839; }","duration":"277.111025ms","start":"2026-07-21T05:26:01.971864Z","end":"2026-07-21T05:26:02.248975Z","steps":["trace[2058003812] 'agreement among raft nodes before linearized reading' (duration: 276.959631ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:26:02.249038Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"300.324611ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"warn","ts":"2026-07-21T05:26:02.249036Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"277.167757ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-07-21T05:26:02.24913Z","caller":"traceutil/trace.go:171","msg":"trace[1503681672] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:839; }","duration":"300.492586ms","start":"2026-07-21T05:26:01.948618Z","end":"2026-07-21T05:26:02.249111Z","steps":["trace[1503681672] 'agreement among raft nodes before linearized reading' (duration: 300.246849ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.249134Z","caller":"traceutil/trace.go:171","msg":"trace[182142648] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:839; }","duration":"277.324911ms","start":"2026-07-21T05:26:01.971794Z","end":"2026-07-21T05:26:02.249118Z","steps":["trace[182142648] 'agreement among raft nodes before linearized reading' (duration: 277.032623ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:26:02.249183Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:26:01.9486Z","time spent":"300.572738ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":514,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"warn","ts":"2026-07-21T05:26:02.249165Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"278.355012ms","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-07-21T05:26:02.249282Z","caller":"traceutil/trace.go:171","msg":"trace[658990057] transaction","detail":"{read_only:false; response_revision:839; number_of_response:1; }","duration":"404.736064ms","start":"2026-07-21T05:26:01.844062Z","end":"2026-07-21T05:26:02.248798Z","steps":["trace[658990057] 'process raft request' (duration: 404.470676ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.249302Z","caller":"traceutil/trace.go:171","msg":"trace[1653456055] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:839; }","duration":"278.527607ms","start":"2026-07-21T05:26:01.970752Z","end":"2026-07-21T05:26:02.249279Z","steps":["trace[1653456055] 'agreement among raft nodes before linearized reading' (duration: 278.137176ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:26:02.249354Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:26:01.844035Z","time spent":"405.28221ms","remote":"127.0.0.1:55192","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1289,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-21T05:26:02.249396Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"289.847456ms","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-07-21T05:26:02.249442Z","caller":"traceutil/trace.go:171","msg":"trace[1859839830] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:839; }","duration":"289.931499ms","start":"2026-07-21T05:26:01.959498Z","end":"2026-07-21T05:26:02.249429Z","steps":["trace[1859839830] 'agreement among raft nodes before linearized reading' (duration: 289.30185ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.384452Z","caller":"traceutil/trace.go:171","msg":"trace[1630276411] transaction","detail":"{read_only:false; response_revision:840; number_of_response:1; }","duration":"131.402918ms","start":"2026-07-21T05:26:02.253025Z","end":"2026-07-21T05:26:02.384428Z","steps":["trace[1630276411] 'process raft request' (duration: 40.483843ms)","trace[1630276411] 'compare' (duration: 90.802141ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:02.4355Z","caller":"traceutil/trace.go:171","msg":"trace[231536709] transaction","detail":"{read_only:false; response_revision:841; number_of_response:1; }","duration":"181.711145ms","start":"2026-07-21T05:26:02.253752Z","end":"2026-07-21T05:26:02.435463Z","steps":["trace[231536709] 'process raft request' (duration: 181.437257ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.435658Z","caller":"traceutil/trace.go:171","msg":"trace[1844095168] transaction","detail":"{read_only:false; response_revision:844; number_of_response:1; }","duration":"180.895371ms","start":"2026-07-21T05:26:02.254724Z","end":"2026-07-21T05:26:02.435619Z","steps":["trace[1844095168] 'process raft request' (duration: 180.767808ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.435651Z","caller":"traceutil/trace.go:171","msg":"trace[1298940417] transaction","detail":"{read_only:false; response_revision:845; number_of_response:1; }","duration":"180.901511ms","start":"2026-07-21T05:26:02.25473Z","end":"2026-07-21T05:26:02.435631Z","steps":["trace[1298940417] 'process raft request' (duration: 180.806438ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.435875Z","caller":"traceutil/trace.go:171","msg":"trace[1525430044] transaction","detail":"{read_only:false; response_revision:842; number_of_response:1; }","duration":"181.949852ms","start":"2026-07-21T05:26:02.253899Z","end":"2026-07-21T05:26:02.435849Z","steps":["trace[1525430044] 'process raft request' (duration: 181.456038ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.435885Z","caller":"traceutil/trace.go:171","msg":"trace[996391055] transaction","detail":"{read_only:false; response_revision:846; number_of_response:1; }","duration":"179.636343ms","start":"2026-07-21T05:26:02.256213Z","end":"2026-07-21T05:26:02.435849Z","steps":["trace[996391055] 'process raft request' (duration: 179.370805ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.436011Z","caller":"traceutil/trace.go:171","msg":"trace[301918957] transaction","detail":"{read_only:false; response_revision:843; number_of_response:1; }","duration":"181.814698ms","start":"2026-07-21T05:26:02.25418Z","end":"2026-07-21T05:26:02.435995Z","steps":["trace[301918957] 'process raft request' (duration: 181.255052ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.614407Z","caller":"traceutil/trace.go:171","msg":"trace[164559510] transaction","detail":"{read_only:false; response_revision:847; number_of_response:1; }","duration":"172.129749ms","start":"2026-07-21T05:26:02.442252Z","end":"2026-07-21T05:26:02.614382Z","steps":["trace[164559510] 'process raft request' (duration: 171.676925ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:26:02.886051Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.572312ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-07-21T05:26:02.886281Z","caller":"traceutil/trace.go:171","msg":"trace[1447191551] transaction","detail":"{read_only:false; response_revision:849; number_of_response:1; }","duration":"213.167108ms","start":"2026-07-21T05:26:02.673072Z","end":"2026-07-21T05:26:02.886239Z","steps":["trace[1447191551] 'process raft request' (duration: 75.317417ms)","trace[1447191551] 'compare' (duration: 137.407458ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:02.886611Z","caller":"traceutil/trace.go:171","msg":"trace[1316214810] linearizableReadLoop","detail":"{readStateIndex:884; appliedIndex:881; }","duration":"108.933775ms","start":"2026-07-21T05:26:02.777653Z","end":"2026-07-21T05:26:02.886587Z","steps":["trace[1316214810] 'read index received' (duration: 108.276126ms)","trace[1316214810] 'applied index is now lower than readState.Index' (duration: 656.689µs)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:02.886766Z","caller":"traceutil/trace.go:171","msg":"trace[394353777] transaction","detail":"{read_only:false; response_revision:850; number_of_response:1; }","duration":"213.288242ms","start":"2026-07-21T05:26:02.673461Z","end":"2026-07-21T05:26:02.886749Z","steps":["trace[394353777] 'process raft request' (duration: 212.714945ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:02.886819Z","caller":"traceutil/trace.go:171","msg":"trace[1422327539] transaction","detail":"{read_only:false; response_revision:851; number_of_response:1; }","duration":"212.22508ms","start":"2026-07-21T05:26:02.67458Z","end":"2026-07-21T05:26:02.886806Z","steps":["trace[1422327539] 'process raft request' (duration: 211.944302ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:26:02.886774Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.10885ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/\" range_end:\"/registry/pods0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-07-21T05:26:02.88696Z","caller":"traceutil/trace.go:171","msg":"trace[1883052732] range","detail":"{range_begin:/registry/pods/; range_end:/registry/pods0; response_count:0; response_revision:851; }","duration":"109.344107ms","start":"2026-07-21T05:26:02.777603Z","end":"2026-07-21T05:26:02.886947Z","steps":["trace[1883052732] 'agreement among raft nodes before linearized reading' (duration: 109.071069ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:03.318088Z","caller":"traceutil/trace.go:171","msg":"trace[242398692] linearizableReadLoop","detail":"{readStateIndex:892; appliedIndex:891; }","duration":"229.268089ms","start":"2026-07-21T05:26:03.088792Z","end":"2026-07-21T05:26:03.31806Z","steps":["trace[242398692] 'read index received' (duration: 158.902064ms)","trace[242398692] 'applied index is now lower than readState.Index' (duration: 70.364595ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:03.318111Z","caller":"traceutil/trace.go:171","msg":"trace[511890949] transaction","detail":"{read_only:false; response_revision:859; number_of_response:1; }","duration":"229.939019ms","start":"2026-07-21T05:26:03.08814Z","end":"2026-07-21T05:26:03.318079Z","steps":["trace[511890949] 'process raft request' (duration: 159.541263ms)","trace[511890949] 'compare' (duration: 70.22589ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:26:03.318398Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.576378ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-78446f96c9-nmlkj\" ","response":"range_response_count:1 size:4495"} {"level":"info","ts":"2026-07-21T05:26:03.31849Z","caller":"traceutil/trace.go:171","msg":"trace[1140928623] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-78446f96c9-nmlkj; range_end:; response_count:1; response_revision:859; }","duration":"229.702292ms","start":"2026-07-21T05:26:03.088765Z","end":"2026-07-21T05:26:03.318467Z","steps":["trace[1140928623] 'agreement among raft nodes before linearized reading' (duration: 229.409103ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:03.371136Z","caller":"traceutil/trace.go:171","msg":"trace[1645296162] transaction","detail":"{read_only:false; response_revision:861; number_of_response:1; }","duration":"256.547355ms","start":"2026-07-21T05:26:03.114565Z","end":"2026-07-21T05:26:03.371112Z","steps":["trace[1645296162] 'process raft request' (duration: 256.484293ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:03.371561Z","caller":"traceutil/trace.go:171","msg":"trace[1032111273] transaction","detail":"{read_only:false; response_revision:860; number_of_response:1; }","duration":"278.670117ms","start":"2026-07-21T05:26:03.092447Z","end":"2026-07-21T05:26:03.371117Z","steps":["trace[1032111273] 'process raft request' (duration: 278.446811ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:03.565641Z","caller":"traceutil/trace.go:171","msg":"trace[1184863002] linearizableReadLoop","detail":"{readStateIndex:895; appliedIndex:892; }","duration":"247.34667ms","start":"2026-07-21T05:26:03.318271Z","end":"2026-07-21T05:26:03.565618Z","steps":["trace[1184863002] 'read index received' (duration: 52.683137ms)","trace[1184863002] 'applied index is now lower than readState.Index' (duration: 194.662332ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:03.565735Z","caller":"traceutil/trace.go:171","msg":"trace[1824561526] transaction","detail":"{read_only:false; response_revision:863; number_of_response:1; }","duration":"239.047381ms","start":"2026-07-21T05:26:03.326667Z","end":"2026-07-21T05:26:03.565714Z","steps":["trace[1824561526] 'process raft request' (duration: 238.880596ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:26:03.565876Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"268.738599ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/envoy-gateway-system/envoy-gateway\" ","response":"range_response_count:1 size:846"} {"level":"info","ts":"2026-07-21T05:26:03.565962Z","caller":"traceutil/trace.go:171","msg":"trace[1063599686] range","detail":"{range_begin:/registry/serviceaccounts/envoy-gateway-system/envoy-gateway; range_end:; response_count:1; response_revision:863; }","duration":"268.892395ms","start":"2026-07-21T05:26:03.297032Z","end":"2026-07-21T05:26:03.565924Z","steps":["trace[1063599686] 'agreement among raft nodes before linearized reading' (duration: 268.693239ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:26:03.565954Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"207.522178ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:26:03.566018Z","caller":"traceutil/trace.go:171","msg":"trace[1409721268] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:863; }","duration":"207.622311ms","start":"2026-07-21T05:26:03.358379Z","end":"2026-07-21T05:26:03.566001Z","steps":["trace[1409721268] 'agreement among raft nodes before linearized reading' (duration: 207.413745ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:26:03.566223Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"185.759208ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/envoy-gateway-system/envoy-gateway\" ","response":"range_response_count:1 size:5577"} {"level":"info","ts":"2026-07-21T05:26:03.565717Z","caller":"traceutil/trace.go:171","msg":"trace[102838623] transaction","detail":"{read_only:false; response_revision:862; number_of_response:1; }","duration":"282.087568ms","start":"2026-07-21T05:26:03.283596Z","end":"2026-07-21T05:26:03.565683Z","steps":["trace[102838623] 'process raft request' (duration: 227.442884ms)","trace[102838623] 'compare' (duration: 53.203722ms)"],"step_count":2} {"level":"info","ts":"2026-07-21T05:26:03.566283Z","caller":"traceutil/trace.go:171","msg":"trace[2125271633] range","detail":"{range_begin:/registry/deployments/envoy-gateway-system/envoy-gateway; range_end:; response_count:1; response_revision:863; }","duration":"185.860741ms","start":"2026-07-21T05:26:03.380409Z","end":"2026-07-21T05:26:03.56627Z","steps":["trace[2125271633] 'agreement among raft nodes before linearized reading' (duration: 185.592592ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:26:03.761437Z","caller":"traceutil/trace.go:171","msg":"trace[1381330948] transaction","detail":"{read_only:false; response_revision:864; number_of_response:1; }","duration":"183.645833ms","start":"2026-07-21T05:26:03.577765Z","end":"2026-07-21T05:26:03.761411Z","steps":["trace[1381330948] 'process raft request' (duration: 181.096976ms)"],"step_count":1} {"level":"info","ts":"2026-07-21T05:27:49.633182Z","caller":"traceutil/trace.go:171","msg":"trace[1315829363] transaction","detail":"{read_only:false; response_revision:1342; number_of_response:1; }","duration":"446.113121ms","start":"2026-07-21T05:27:49.187045Z","end":"2026-07-21T05:27:49.633158Z","steps":["trace[1315829363] 'process raft request' (duration: 445.795513ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:27:49.633326Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:27:49.187032Z","time spent":"446.224574ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":476,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:27:49.636026Z","caller":"traceutil/trace.go:171","msg":"trace[1485029757] transaction","detail":"{read_only:false; response_revision:1343; number_of_response:1; }","duration":"448.886542ms","start":"2026-07-21T05:27:49.187128Z","end":"2026-07-21T05:27:49.636015Z","steps":["trace[1485029757] 'process raft request' (duration: 448.81852ms)"],"step_count":1} {"level":"warn","ts":"2026-07-21T05:27:49.636093Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-21T05:27:49.187111Z","time spent":"448.951664ms","remote":"127.0.0.1:55148","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":417,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-21T05:27:49.638027Z","caller":"traceutil/trace.go:171","msg":"trace[1520920515] linearizableReadLoop","detail":"{readStateIndex:1401; appliedIndex:1398; }","duration":"279.414914ms","start":"2026-07-21T05:27:49.358598Z","end":"2026-07-21T05:27:49.638012Z","steps":["trace[1520920515] 'read index received' (duration: 274.24479ms)","trace[1520920515] 'applied index is now lower than readState.Index' (duration: 5.169254ms)"],"step_count":2} {"level":"warn","ts":"2026-07-21T05:27:49.638089Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"279.484975ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-21T05:27:49.638149Z","caller":"traceutil/trace.go:171","msg":"trace[1271645095] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1343; }","duration":"279.551977ms","start":"2026-07-21T05:27:49.358564Z","end":"2026-07-21T05:27:49.638116Z","steps":["trace[1271645095] 'agreement among raft nodes before linearized reading' (duration: 279.494086ms)"],"step_count":1}