{"level":"warn","ts":"2026-07-08T04:00:34.307474Z","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-08T04:00:34.307566Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.116:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.116:2380","--initial-cluster=instance=https://199.204.45.116:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.116:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.116: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-08T04:00:34.307631Z","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-08T04:00:34.307645Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.116:2380"]} {"level":"info","ts":"2026-07-08T04:00:34.307664Z","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-08T04:00:34.308286Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.116:2379"]} {"level":"info","ts":"2026-07-08T04:00:34.308357Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.116:2380"],"listen-peer-urls":["https://199.204.45.116:2380"],"advertise-client-urls":["https://199.204.45.116:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.116:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.116: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-08T04:00:34.319725Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"11.153786ms"} {"level":"info","ts":"2026-07-08T04:00:34.337743Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"5caa70ef1dd6dc04","cluster-id":"45afccab143d2c82"} {"level":"info","ts":"2026-07-08T04:00:34.337833Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=()"} {"level":"info","ts":"2026-07-08T04:00:34.33789Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became follower at term 0"} {"level":"info","ts":"2026-07-08T04:00:34.337907Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 5caa70ef1dd6dc04 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-07-08T04:00:34.337926Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became follower at term 1"} {"level":"info","ts":"2026-07-08T04:00:34.338004Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=(6677273569830296580)"} {"level":"warn","ts":"2026-07-08T04:00:34.343425Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-07-08T04:00:34.347756Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-07-08T04:00:34.349197Z","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-08T04:00:34.352934Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"5caa70ef1dd6dc04","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-07-08T04:00:34.353875Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"5caa70ef1dd6dc04","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-07-08T04:00:34.35401Z","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-08T04:00:34.354059Z","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-08T04:00:34.354068Z","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-08T04:00:34.354762Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=(6677273569830296580)"} {"level":"info","ts":"2026-07-08T04:00:34.354882Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"45afccab143d2c82","local-member-id":"5caa70ef1dd6dc04","added-peer-id":"5caa70ef1dd6dc04","added-peer-peer-urls":["https://199.204.45.116:2380"]} {"level":"info","ts":"2026-07-08T04:00:34.359608Z","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-08T04:00:34.359818Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"5caa70ef1dd6dc04","initial-advertise-peer-urls":["https://199.204.45.116:2380"],"listen-peer-urls":["https://199.204.45.116:2380"],"advertise-client-urls":["https://199.204.45.116:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.116:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-07-08T04:00:34.359862Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-07-08T04:00:34.359966Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.116:2380"} {"level":"info","ts":"2026-07-08T04:00:34.360037Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.116:2380"} {"level":"info","ts":"2026-07-08T04:00:34.738708Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 is starting a new election at term 1"} {"level":"info","ts":"2026-07-08T04:00:34.738758Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became pre-candidate at term 1"} {"level":"info","ts":"2026-07-08T04:00:34.738796Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 received MsgPreVoteResp from 5caa70ef1dd6dc04 at term 1"} {"level":"info","ts":"2026-07-08T04:00:34.738813Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became candidate at term 2"} {"level":"info","ts":"2026-07-08T04:00:34.738828Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 received MsgVoteResp from 5caa70ef1dd6dc04 at term 2"} {"level":"info","ts":"2026-07-08T04:00:34.738845Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became leader at term 2"} {"level":"info","ts":"2026-07-08T04:00:34.738859Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 5caa70ef1dd6dc04 elected leader 5caa70ef1dd6dc04 at term 2"} {"level":"info","ts":"2026-07-08T04:00:34.740039Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"5caa70ef1dd6dc04","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.116:2379]}","request-path":"/0/members/5caa70ef1dd6dc04/attributes","cluster-id":"45afccab143d2c82","publish-timeout":"7s"} {"level":"info","ts":"2026-07-08T04:00:34.740304Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-07-08T04:00:34.740433Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-08T04:00:34.740476Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-07-08T04:00:34.740601Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-07-08T04:00:34.740657Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-07-08T04:00:34.741686Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"45afccab143d2c82","local-member-id":"5caa70ef1dd6dc04","cluster-version":"3.5"} {"level":"info","ts":"2026-07-08T04:00:34.741812Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-07-08T04:00:34.741859Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-07-08T04:00:34.743366Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-07-08T04:00:34.743467Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.116:2379"} {"level":"info","ts":"2026-07-08T04:00:37.805574Z","caller":"traceutil/trace.go:171","msg":"trace[2056719483] transaction","detail":"{read_only:false; response_revision:165; number_of_response:1; }","duration":"107.511956ms","start":"2026-07-08T04:00:37.698025Z","end":"2026-07-08T04:00:37.805537Z","steps":["trace[2056719483] 'process raft request' (duration: 74.132738ms)","trace[2056719483] 'compare' (duration: 32.915359ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:00:39.088481Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.895275ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-07-08T04:00:39.088781Z","caller":"traceutil/trace.go:171","msg":"trace[1055438428] transaction","detail":"{read_only:false; response_revision:209; number_of_response:1; }","duration":"349.597657ms","start":"2026-07-08T04:00:38.739134Z","end":"2026-07-08T04:00:39.088732Z","steps":["trace[1055438428] 'process raft request' (duration: 141.531001ms)","trace[1055438428] 'compare' (duration: 206.704922ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:00:39.088818Z","caller":"traceutil/trace.go:171","msg":"trace[1836003296] linearizableReadLoop","detail":"{readStateIndex:215; appliedIndex:213; }","duration":"124.945832ms","start":"2026-07-08T04:00:38.963846Z","end":"2026-07-08T04:00:39.088792Z","steps":["trace[1836003296] 'read index received' (duration: 124.084717ms)","trace[1836003296] 'applied index is now lower than readState.Index' (duration: 859.395µs)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:00:39.088949Z","caller":"traceutil/trace.go:171","msg":"trace[1668772114] transaction","detail":"{read_only:false; response_revision:210; number_of_response:1; }","duration":"304.243006ms","start":"2026-07-08T04:00:38.784661Z","end":"2026-07-08T04:00:39.088904Z","steps":["trace[1668772114] 'process raft request' (duration: 303.986711ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:00:39.089006Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.137995ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-07-08T04:00:39.088972Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:00:38.739107Z","time spent":"349.770539ms","remote":"127.0.0.1:43752","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":732,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-08T04:00:39.089048Z","caller":"traceutil/trace.go:171","msg":"trace[466678975] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:0; response_revision:210; }","duration":"125.252477ms","start":"2026-07-08T04:00:38.963783Z","end":"2026-07-08T04:00:39.089035Z","steps":["trace[466678975] 'agreement among raft nodes before linearized reading' (duration: 125.125275ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:00:39.089126Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:00:38.784642Z","time spent":"304.403028ms","remote":"127.0.0.1:43606","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5498,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-07-08T04:00:39.36017Z","caller":"traceutil/trace.go:171","msg":"trace[1400551334] transaction","detail":"{read_only:false; response_revision:213; number_of_response:1; }","duration":"230.143052ms","start":"2026-07-08T04:00:39.129993Z","end":"2026-07-08T04:00:39.360136Z","steps":["trace[1400551334] 'process raft request' (duration: 135.59812ms)","trace[1400551334] 'compare' (duration: 94.335818ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:00:39.360245Z","caller":"traceutil/trace.go:171","msg":"trace[1641490006] transaction","detail":"{read_only:false; response_revision:214; number_of_response:1; }","duration":"225.406356ms","start":"2026-07-08T04:00:39.134809Z","end":"2026-07-08T04:00:39.360215Z","steps":["trace[1641490006] 'process raft request' (duration: 225.321755ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:00:39.360274Z","caller":"traceutil/trace.go:171","msg":"trace[482872127] linearizableReadLoop","detail":"{readStateIndex:218; appliedIndex:217; }","duration":"228.671925ms","start":"2026-07-08T04:00:39.131565Z","end":"2026-07-08T04:00:39.360237Z","steps":["trace[482872127] 'read index received' (duration: 134.036522ms)","trace[482872127] 'applied index is now lower than readState.Index' (duration: 94.632243ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:00:39.360577Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"230.865545ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-08T04:00:39.36067Z","caller":"traceutil/trace.go:171","msg":"trace[2023194303] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:214; }","duration":"230.974476ms","start":"2026-07-08T04:00:39.129651Z","end":"2026-07-08T04:00:39.360625Z","steps":["trace[2023194303] 'agreement among raft nodes before linearized reading' (duration: 230.782613ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:00:39.361056Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"227.498056ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/system:controller:ttl-controller\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-08T04:00:39.361115Z","caller":"traceutil/trace.go:171","msg":"trace[335485688] range","detail":"{range_begin:/registry/clusterrolebindings/system:controller:ttl-controller; range_end:; response_count:0; response_revision:214; }","duration":"227.602437ms","start":"2026-07-08T04:00:39.133494Z","end":"2026-07-08T04:00:39.361096Z","steps":["trace[335485688] 'agreement among raft nodes before linearized reading' (duration: 227.521835ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:00:39.361876Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.791006ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-08T04:00:39.362371Z","caller":"traceutil/trace.go:171","msg":"trace[937119830] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:214; }","duration":"155.289964ms","start":"2026-07-08T04:00:39.207015Z","end":"2026-07-08T04:00:39.362305Z","steps":["trace[937119830] 'agreement among raft nodes before linearized reading' (duration: 154.173484ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:00:39.592701Z","caller":"traceutil/trace.go:171","msg":"trace[1383695706] transaction","detail":"{read_only:false; response_revision:217; number_of_response:1; }","duration":"147.670057ms","start":"2026-07-08T04:00:39.445001Z","end":"2026-07-08T04:00:39.592671Z","steps":["trace[1383695706] 'process raft request' (duration: 79.309527ms)","trace[1383695706] 'compare' (duration: 68.190897ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:00:40.031383Z","caller":"traceutil/trace.go:171","msg":"trace[605411821] transaction","detail":"{read_only:false; response_revision:226; number_of_response:1; }","duration":"117.717606ms","start":"2026-07-08T04:00:39.913642Z","end":"2026-07-08T04:00:40.03136Z","steps":["trace[605411821] 'process raft request' (duration: 57.27428ms)","trace[605411821] 'compare' (duration: 60.237162ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:00:40.281786Z","caller":"traceutil/trace.go:171","msg":"trace[1494743264] transaction","detail":"{read_only:false; response_revision:227; number_of_response:1; }","duration":"243.220735ms","start":"2026-07-08T04:00:40.038539Z","end":"2026-07-08T04:00:40.281759Z","steps":["trace[1494743264] 'process raft request' (duration: 196.851505ms)","trace[1494743264] 'compare' (duration: 45.81612ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:00:42.520388Z","caller":"traceutil/trace.go:171","msg":"trace[632465374] transaction","detail":"{read_only:false; response_revision:280; number_of_response:1; }","duration":"106.161752ms","start":"2026-07-08T04:00:42.414205Z","end":"2026-07-08T04:00:42.520367Z","steps":["trace[632465374] 'process raft request' (duration: 106.04145ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:00:52.839528Z","caller":"traceutil/trace.go:171","msg":"trace[1615112252] transaction","detail":"{read_only:false; response_revision:407; number_of_response:1; }","duration":"124.368974ms","start":"2026-07-08T04:00:52.715129Z","end":"2026-07-08T04:00:52.839498Z","steps":["trace[1615112252] 'process raft request' (duration: 124.315883ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:00:52.840015Z","caller":"traceutil/trace.go:171","msg":"trace[1275096321] transaction","detail":"{read_only:false; response_revision:406; number_of_response:1; }","duration":"128.781449ms","start":"2026-07-08T04:00:52.711203Z","end":"2026-07-08T04:00:52.839984Z","steps":["trace[1275096321] 'process raft request' (duration: 128.107728ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:02.926105Z","caller":"traceutil/trace.go:171","msg":"trace[735230342] transaction","detail":"{read_only:false; response_revision:464; number_of_response:1; }","duration":"132.824968ms","start":"2026-07-08T04:01:02.793244Z","end":"2026-07-08T04:01:02.926069Z","steps":["trace[735230342] 'process raft request' (duration: 132.666765ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.704432Z","caller":"traceutil/trace.go:171","msg":"trace[1773618476] transaction","detail":"{read_only:false; response_revision:527; number_of_response:1; }","duration":"227.31511ms","start":"2026-07-08T04:01:14.477095Z","end":"2026-07-08T04:01:14.70441Z","steps":["trace[1773618476] 'process raft request' (duration: 227.215198ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713394Z","caller":"traceutil/trace.go:171","msg":"trace[1868900105] transaction","detail":"{read_only:false; response_revision:529; number_of_response:1; }","duration":"231.252872ms","start":"2026-07-08T04:01:14.482117Z","end":"2026-07-08T04:01:14.71337Z","steps":["trace[1868900105] 'process raft request' (duration: 230.940067ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713639Z","caller":"traceutil/trace.go:171","msg":"trace[1900332992] transaction","detail":"{read_only:false; response_revision:528; number_of_response:1; }","duration":"232.4004ms","start":"2026-07-08T04:01:14.481218Z","end":"2026-07-08T04:01:14.713619Z","steps":["trace[1900332992] 'process raft request' (duration: 230.318248ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713661Z","caller":"traceutil/trace.go:171","msg":"trace[1701928821] transaction","detail":"{read_only:false; response_revision:532; number_of_response:1; }","duration":"207.690895ms","start":"2026-07-08T04:01:14.505948Z","end":"2026-07-08T04:01:14.713639Z","steps":["trace[1701928821] 'process raft request' (duration: 207.244148ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.71372Z","caller":"traceutil/trace.go:171","msg":"trace[574488984] transaction","detail":"{read_only:false; response_revision:530; number_of_response:1; }","duration":"218.298575ms","start":"2026-07-08T04:01:14.495373Z","end":"2026-07-08T04:01:14.713672Z","steps":["trace[574488984] 'process raft request' (duration: 217.724716ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713742Z","caller":"traceutil/trace.go:171","msg":"trace[733448799] transaction","detail":"{read_only:false; response_revision:531; number_of_response:1; }","duration":"207.812667ms","start":"2026-07-08T04:01:14.505875Z","end":"2026-07-08T04:01:14.713688Z","steps":["trace[733448799] 'process raft request' (duration: 207.279038ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713806Z","caller":"traceutil/trace.go:171","msg":"trace[724866825] transaction","detail":"{read_only:false; response_revision:535; number_of_response:1; }","duration":"189.810808ms","start":"2026-07-08T04:01:14.523987Z","end":"2026-07-08T04:01:14.713798Z","steps":["trace[724866825] 'process raft request' (duration: 189.452703ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713889Z","caller":"traceutil/trace.go:171","msg":"trace[2018069513] transaction","detail":"{read_only:false; response_revision:533; number_of_response:1; }","duration":"204.106506ms","start":"2026-07-08T04:01:14.509771Z","end":"2026-07-08T04:01:14.713878Z","steps":["trace[2018069513] 'process raft request' (duration: 203.529387ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713905Z","caller":"traceutil/trace.go:171","msg":"trace[1595903908] transaction","detail":"{read_only:false; response_revision:536; number_of_response:1; }","duration":"187.616964ms","start":"2026-07-08T04:01:14.52628Z","end":"2026-07-08T04:01:14.713897Z","steps":["trace[1595903908] 'process raft request' (duration: 187.265518ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713874Z","caller":"traceutil/trace.go:171","msg":"trace[784957752] transaction","detail":"{read_only:false; response_revision:534; number_of_response:1; }","duration":"203.909023ms","start":"2026-07-08T04:01:14.509834Z","end":"2026-07-08T04:01:14.713743Z","steps":["trace[784957752] 'process raft request' (duration: 203.509957ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:14.713976Z","caller":"traceutil/trace.go:171","msg":"trace[1791085877] transaction","detail":"{read_only:false; response_revision:537; number_of_response:1; }","duration":"171.406704ms","start":"2026-07-08T04:01:14.542562Z","end":"2026-07-08T04:01:14.713968Z","steps":["trace[1791085877] 'process raft request' (duration: 171.15311ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:19.616871Z","caller":"traceutil/trace.go:171","msg":"trace[1845344761] transaction","detail":"{read_only:false; response_revision:612; number_of_response:1; }","duration":"105.022047ms","start":"2026-07-08T04:01:19.511789Z","end":"2026-07-08T04:01:19.616811Z","steps":["trace[1845344761] 'process raft request' (duration: 104.855685ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:21.075684Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":15853971684982269810,"retry-timeout":"500ms"} {"level":"info","ts":"2026-07-08T04:01:21.284324Z","caller":"traceutil/trace.go:171","msg":"trace[747828148] linearizableReadLoop","detail":"{readStateIndex:648; appliedIndex:647; }","duration":"709.116637ms","start":"2026-07-08T04:01:20.575178Z","end":"2026-07-08T04:01:21.284295Z","steps":["trace[747828148] 'read index received' (duration: 706.841701ms)","trace[747828148] 'applied index is now lower than readState.Index' (duration: 2.273706ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:01:21.284377Z","caller":"traceutil/trace.go:171","msg":"trace[145788567] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"768.302264ms","start":"2026-07-08T04:01:20.516042Z","end":"2026-07-08T04:01:21.284344Z","steps":["trace[145788567] 'process raft request' (duration: 766.236371ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:21.284595Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"674.884965ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.116\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-07-08T04:01:21.284645Z","caller":"traceutil/trace.go:171","msg":"trace[703152476] range","detail":"{range_begin:/registry/masterleases/199.204.45.116; range_end:; response_count:1; response_revision:622; }","duration":"674.981436ms","start":"2026-07-08T04:01:20.609651Z","end":"2026-07-08T04:01:21.284632Z","steps":["trace[703152476] 'agreement among raft nodes before linearized reading' (duration: 674.858894ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:21.284683Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:20.609633Z","time spent":"675.040947ms","remote":"127.0.0.1:43466","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/199.204.45.116\" "} {"level":"warn","ts":"2026-07-08T04:01:21.284717Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"263.106752ms","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-08T04:01:21.284794Z","caller":"traceutil/trace.go:171","msg":"trace[545915224] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:622; }","duration":"263.218694ms","start":"2026-07-08T04:01:21.02155Z","end":"2026-07-08T04:01:21.284768Z","steps":["trace[545915224] 'agreement among raft nodes before linearized reading' (duration: 262.994961ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:21.284855Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:20.516002Z","time spent":"768.474057ms","remote":"127.0.0.1:43510","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036109,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-08T04:01:21.285594Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"710.410037ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-mprv8\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-07-08T04:01:21.285664Z","caller":"traceutil/trace.go:171","msg":"trace[1996422831] range","detail":"{range_begin:/registry/pods/kube-system/cilium-mprv8; range_end:; response_count:1; response_revision:622; }","duration":"710.544389ms","start":"2026-07-08T04:01:20.575104Z","end":"2026-07-08T04:01:21.285648Z","steps":["trace[1996422831] 'agreement among raft nodes before linearized reading' (duration: 709.364011ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:21.285721Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:20.575078Z","time spent":"710.62833ms","remote":"127.0.0.1:43606","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-mprv8\" "} {"level":"info","ts":"2026-07-08T04:01:21.5788Z","caller":"traceutil/trace.go:171","msg":"trace[1348677632] transaction","detail":"{read_only:false; response_revision:623; number_of_response:1; }","duration":"285.003659ms","start":"2026-07-08T04:01:21.293773Z","end":"2026-07-08T04:01:21.578776Z","steps":["trace[1348677632] 'process raft request' (duration: 284.716934ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:21.578992Z","caller":"traceutil/trace.go:171","msg":"trace[636826564] transaction","detail":"{read_only:false; response_revision:624; number_of_response:1; }","duration":"272.321207ms","start":"2026-07-08T04:01:21.306661Z","end":"2026-07-08T04:01:21.578982Z","steps":["trace[636826564] 'process raft request' (duration: 272.032132ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:21.966407Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"133.358849ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-08T04:01:21.966567Z","caller":"traceutil/trace.go:171","msg":"trace[1149903391] linearizableReadLoop","detail":"{readStateIndex:653; appliedIndex:651; }","duration":"339.526038ms","start":"2026-07-08T04:01:21.627017Z","end":"2026-07-08T04:01:21.966543Z","steps":["trace[1149903391] 'read index received' (duration: 205.868405ms)","trace[1149903391] 'applied index is now lower than readState.Index' (duration: 133.656473ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:01:21.966639Z","caller":"traceutil/trace.go:171","msg":"trace[2060395037] transaction","detail":"{read_only:false; response_revision:625; number_of_response:1; }","duration":"629.394293ms","start":"2026-07-08T04:01:21.337237Z","end":"2026-07-08T04:01:21.966631Z","steps":["trace[2060395037] 'process raft request' (duration: 495.720809ms)","trace[2060395037] 'compare' (duration: 133.166106ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:01:21.96668Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:21.337223Z","time spent":"629.434374ms","remote":"127.0.0.1:43466","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-08T04:01:21.96688Z","caller":"traceutil/trace.go:171","msg":"trace[1154835142] transaction","detail":"{read_only:false; response_revision:626; number_of_response:1; }","duration":"615.387622ms","start":"2026-07-08T04:01:21.351486Z","end":"2026-07-08T04:01:21.966874Z","steps":["trace[1154835142] 'process raft request' (duration: 615.005435ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:21.966918Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:21.351465Z","time spent":"615.438074ms","remote":"127.0.0.1:43612","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":818,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-07-08T04:01:21.967171Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.155559ms","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-08T04:01:21.967201Z","caller":"traceutil/trace.go:171","msg":"trace[704098068] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:626; }","duration":"340.2205ms","start":"2026-07-08T04:01:21.626974Z","end":"2026-07-08T04:01:21.967194Z","steps":["trace[704098068] 'agreement among raft nodes before linearized reading' (duration: 340.016507ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:21.967223Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:21.626957Z","time spent":"340.260831ms","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-07-08T04:01:21.967379Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.842898ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-08T04:01:21.967488Z","caller":"traceutil/trace.go:171","msg":"trace[1856481509] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:626; }","duration":"117.027061ms","start":"2026-07-08T04:01:21.850433Z","end":"2026-07-08T04:01:21.96746Z","steps":["trace[1856481509] 'agreement among raft nodes before linearized reading' (duration: 116.858889ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:22.555134Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":15853971684982269828,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-07-08T04:01:23.152865Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"519.392ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-08T04:01:23.153002Z","caller":"traceutil/trace.go:171","msg":"trace[2003257796] transaction","detail":"{read_only:false; response_revision:628; number_of_response:1; }","duration":"1.104329928s","start":"2026-07-08T04:01:22.048647Z","end":"2026-07-08T04:01:23.152977Z","steps":["trace[2003257796] 'process raft request' (duration: 584.711674ms)","trace[2003257796] 'compare' (duration: 519.244458ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:01:23.153095Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:22.048616Z","time spent":"1.104435199s","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":422,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-08T04:01:23.160145Z","caller":"traceutil/trace.go:171","msg":"trace[1508087483] linearizableReadLoop","detail":"{readStateIndex:656; appliedIndex:654; }","duration":"1.105692449s","start":"2026-07-08T04:01:22.05444Z","end":"2026-07-08T04:01:23.160133Z","steps":["trace[1508087483] 'read index received' (duration: 578.867692ms)","trace[1508087483] 'applied index is now lower than readState.Index' (duration: 526.824007ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:01:23.160316Z","caller":"traceutil/trace.go:171","msg":"trace[530469018] transaction","detail":"{read_only:false; response_revision:629; number_of_response:1; }","duration":"784.952105ms","start":"2026-07-08T04:01:22.37535Z","end":"2026-07-08T04:01:23.160302Z","steps":["trace[530469018] 'process raft request' (duration: 784.283473ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:23.160387Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:22.375303Z","time spent":"785.049576ms","remote":"127.0.0.1:43510","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036161,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-08T04:01:23.160404Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"309.939202ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-08T04:01:23.160499Z","caller":"traceutil/trace.go:171","msg":"trace[330555298] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:629; }","duration":"310.073614ms","start":"2026-07-08T04:01:22.850375Z","end":"2026-07-08T04:01:23.160449Z","steps":["trace[330555298] 'agreement among raft nodes before linearized reading' (duration: 309.925082ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:23.160576Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:22.850353Z","time spent":"310.184936ms","remote":"127.0.0.1:43430","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-08T04:01:23.160572Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.106078395s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-07-08T04:01:23.160755Z","caller":"traceutil/trace.go:171","msg":"trace[855577866] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:629; }","duration":"1.106292439s","start":"2026-07-08T04:01:22.05441Z","end":"2026-07-08T04:01:23.160702Z","steps":["trace[855577866] 'agreement among raft nodes before linearized reading' (duration: 1.105856652s)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:23.160827Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:22.054397Z","time spent":"1.10641535s","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":455,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-07-08T04:01:24.935283Z","caller":"traceutil/trace.go:171","msg":"trace[152682395] transaction","detail":"{read_only:false; response_revision:667; number_of_response:1; }","duration":"166.482691ms","start":"2026-07-08T04:01:24.768782Z","end":"2026-07-08T04:01:24.935265Z","steps":["trace[152682395] 'process raft request' (duration: 166.382129ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:24.938477Z","caller":"traceutil/trace.go:171","msg":"trace[143629571] transaction","detail":"{read_only:false; response_revision:668; number_of_response:1; }","duration":"108.302455ms","start":"2026-07-08T04:01:24.830135Z","end":"2026-07-08T04:01:24.938437Z","steps":["trace[143629571] 'process raft request' (duration: 108.087941ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:28.884979Z","caller":"traceutil/trace.go:171","msg":"trace[1530713366] transaction","detail":"{read_only:false; response_revision:725; number_of_response:1; }","duration":"234.403832ms","start":"2026-07-08T04:01:28.650528Z","end":"2026-07-08T04:01:28.884932Z","steps":["trace[1530713366] 'process raft request' (duration: 233.801893ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:40.080649Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"798.260667ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"warn","ts":"2026-07-08T04:01:40.080659Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"766.264746ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-07-08T04:01:40.080735Z","caller":"traceutil/trace.go:171","msg":"trace[2129121677] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:802; }","duration":"798.417191ms","start":"2026-07-08T04:01:39.282298Z","end":"2026-07-08T04:01:40.080715Z","steps":["trace[2129121677] 'range keys from in-memory index tree' (duration: 798.080032ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:40.080744Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"402.958513ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"warn","ts":"2026-07-08T04:01:40.080791Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:39.282279Z","time spent":"798.500724ms","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-07-08T04:01:40.080801Z","caller":"traceutil/trace.go:171","msg":"trace[1604888066] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:802; }","duration":"766.448271ms","start":"2026-07-08T04:01:39.314319Z","end":"2026-07-08T04:01:40.080768Z","steps":["trace[1604888066] 'range keys from in-memory index tree' (duration: 765.967719ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:40.080836Z","caller":"traceutil/trace.go:171","msg":"trace[1779225528] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:802; }","duration":"403.127597ms","start":"2026-07-08T04:01:39.677678Z","end":"2026-07-08T04:01:40.080805Z","steps":["trace[1779225528] 'range keys from in-memory index tree' (duration: 402.578274ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:40.080882Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:39.677653Z","time spent":"403.21884ms","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":501,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-07-08T04:01:40.080868Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:39.314309Z","time spent":"766.543404ms","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-07-08T04:01:40.085359Z","caller":"traceutil/trace.go:171","msg":"trace[1029677387] linearizableReadLoop","detail":"{readStateIndex:835; appliedIndex:834; }","duration":"287.953433ms","start":"2026-07-08T04:01:39.79739Z","end":"2026-07-08T04:01:40.085344Z","steps":["trace[1029677387] 'read index received' (duration: 287.809739ms)","trace[1029677387] 'applied index is now lower than readState.Index' (duration: 142.294µs)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:01:40.085428Z","caller":"traceutil/trace.go:171","msg":"trace[1472449341] transaction","detail":"{read_only:false; response_revision:803; number_of_response:1; }","duration":"387.300175ms","start":"2026-07-08T04:01:39.698119Z","end":"2026-07-08T04:01:40.08542Z","steps":["trace[1472449341] 'process raft request' (duration: 386.877224ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:40.08553Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"288.110478ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/limitranges/\" range_end:\"/registry/limitranges0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-07-08T04:01:40.085601Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:01:39.698098Z","time spent":"387.373157ms","remote":"127.0.0.1:43648","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-08T04:01:40.085636Z","caller":"traceutil/trace.go:171","msg":"trace[1792298685] range","detail":"{range_begin:/registry/limitranges/; range_end:/registry/limitranges0; response_count:0; response_revision:803; }","duration":"288.252351ms","start":"2026-07-08T04:01:39.797351Z","end":"2026-07-08T04:01:40.085603Z","steps":["trace[1792298685] 'agreement among raft nodes before linearized reading' (duration: 288.102127ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:40.092859Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"241.984176ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-08T04:01:40.09293Z","caller":"traceutil/trace.go:171","msg":"trace[438469753] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:806; }","duration":"242.076129ms","start":"2026-07-08T04:01:39.850838Z","end":"2026-07-08T04:01:40.092914Z","steps":["trace[438469753] 'agreement among raft nodes before linearized reading' (duration: 241.976716ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:44.333845Z","caller":"traceutil/trace.go:171","msg":"trace[2057431110] transaction","detail":"{read_only:false; response_revision:854; number_of_response:1; }","duration":"223.19745ms","start":"2026-07-08T04:01:44.110628Z","end":"2026-07-08T04:01:44.333826Z","steps":["trace[2057431110] 'process raft request' (duration: 173.969536ms)","trace[2057431110] 'compare' (duration: 49.110731ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:01:44.334301Z","caller":"traceutil/trace.go:171","msg":"trace[1877404289] transaction","detail":"{read_only:false; response_revision:855; number_of_response:1; }","duration":"221.63597ms","start":"2026-07-08T04:01:44.112631Z","end":"2026-07-08T04:01:44.334267Z","steps":["trace[1877404289] 'process raft request' (duration: 221.173108ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:44.334284Z","caller":"traceutil/trace.go:171","msg":"trace[1335107911] linearizableReadLoop","detail":"{readStateIndex:888; appliedIndex:885; }","duration":"221.441785ms","start":"2026-07-08T04:01:44.112793Z","end":"2026-07-08T04:01:44.334235Z","steps":["trace[1335107911] 'read index received' (duration: 6.776951ms)","trace[1335107911] 'applied index is now lower than readState.Index' (duration: 214.662544ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:01:44.334441Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"221.632949ms","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-08T04:01:44.334583Z","caller":"traceutil/trace.go:171","msg":"trace[528520524] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:855; }","duration":"221.821594ms","start":"2026-07-08T04:01:44.112748Z","end":"2026-07-08T04:01:44.33457Z","steps":["trace[528520524] 'agreement among raft nodes before linearized reading' (duration: 221.579288ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:01:44.336209Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"220.802369ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets/envoy-gateway-system/\" range_end:\"/registry/secrets/envoy-gateway-system0\" ","response":"range_response_count:5 size:1050264"} {"level":"info","ts":"2026-07-08T04:01:44.336267Z","caller":"traceutil/trace.go:171","msg":"trace[467955500] range","detail":"{range_begin:/registry/secrets/envoy-gateway-system/; range_end:/registry/secrets/envoy-gateway-system0; response_count:5; response_revision:855; }","duration":"220.899151ms","start":"2026-07-08T04:01:44.115352Z","end":"2026-07-08T04:01:44.336251Z","steps":["trace[467955500] 'agreement among raft nodes before linearized reading' (duration: 219.834714ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:01:50.392198Z","caller":"traceutil/trace.go:171","msg":"trace[1908393798] transaction","detail":"{read_only:false; response_revision:921; number_of_response:1; }","duration":"246.000707ms","start":"2026-07-08T04:01:50.146171Z","end":"2026-07-08T04:01:50.392171Z","steps":["trace[1908393798] 'process raft request' (duration: 245.68346ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:02:06.8047Z","caller":"traceutil/trace.go:171","msg":"trace[1788253486] transaction","detail":"{read_only:false; response_revision:1019; number_of_response:1; }","duration":"301.984736ms","start":"2026-07-08T04:02:06.502688Z","end":"2026-07-08T04:02:06.804673Z","steps":["trace[1788253486] 'process raft request' (duration: 301.835402ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:02:06.804721Z","caller":"traceutil/trace.go:171","msg":"trace[679311089] transaction","detail":"{read_only:false; response_revision:1018; number_of_response:1; }","duration":"302.129438ms","start":"2026-07-08T04:02:06.502563Z","end":"2026-07-08T04:02:06.804693Z","steps":["trace[679311089] 'process raft request' (duration: 238.595229ms)","trace[679311089] 'compare' (duration: 63.074699ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:02:06.804861Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:06.502657Z","time spent":"302.119118ms","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-08T04:02:06.804867Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:06.502548Z","time spent":"302.237081ms","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-07-08T04:02:06.805377Z","caller":"traceutil/trace.go:171","msg":"trace[934780625] transaction","detail":"{read_only:false; response_revision:1020; number_of_response:1; }","duration":"302.263081ms","start":"2026-07-08T04:02:06.503089Z","end":"2026-07-08T04:02:06.805352Z","steps":["trace[934780625] 'process raft request' (duration: 301.547965ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:06.805522Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:06.503078Z","time spent":"302.367053ms","remote":"127.0.0.1:43666","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-08T04:02:07.151651Z","caller":"traceutil/trace.go:171","msg":"trace[242046409] transaction","detail":"{read_only:false; response_revision:1021; number_of_response:1; }","duration":"343.00325ms","start":"2026-07-08T04:02:06.808636Z","end":"2026-07-08T04:02:07.151639Z","steps":["trace[242046409] 'process raft request' (duration: 329.68906ms)","trace[242046409] 'compare' (duration: 12.704057ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:02:07.151753Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:06.808619Z","time spent":"343.075312ms","remote":"127.0.0.1:43666","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-08T04:02:07.151784Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"303.070495ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-07-08T04:02:07.151838Z","caller":"traceutil/trace.go:171","msg":"trace[1873886254] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1021; }","duration":"303.152666ms","start":"2026-07-08T04:02:06.848673Z","end":"2026-07-08T04:02:07.151826Z","steps":["trace[1873886254] 'agreement among raft nodes before linearized reading' (duration: 303.069585ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:07.151872Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:06.848662Z","time spent":"303.203498ms","remote":"127.0.0.1:43430","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-08T04:02:07.151459Z","caller":"traceutil/trace.go:171","msg":"trace[2042172996] linearizableReadLoop","detail":"{readStateIndex:1059; appliedIndex:1058; }","duration":"302.726498ms","start":"2026-07-08T04:02:06.848706Z","end":"2026-07-08T04:02:07.151432Z","steps":["trace[2042172996] 'read index received' (duration: 289.631752ms)","trace[2042172996] 'applied index is now lower than readState.Index' (duration: 13.093636ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:02:08.264918Z","caller":"traceutil/trace.go:171","msg":"trace[501643577] transaction","detail":"{read_only:false; response_revision:1023; number_of_response:1; }","duration":"125.534411ms","start":"2026-07-08T04:02:08.139365Z","end":"2026-07-08T04:02:08.264899Z","steps":["trace[501643577] 'process raft request' (duration: 125.401988ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:02:10.92985Z","caller":"traceutil/trace.go:171","msg":"trace[1846467285] linearizableReadLoop","detail":"{readStateIndex:1071; appliedIndex:1070; }","duration":"107.245431ms","start":"2026-07-08T04:02:10.822581Z","end":"2026-07-08T04:02:10.929827Z","steps":["trace[1846467285] 'read index received' (duration: 101.33445ms)","trace[1846467285] 'applied index is now lower than readState.Index' (duration: 5.909931ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:02:10.930142Z","caller":"traceutil/trace.go:171","msg":"trace[841981391] transaction","detail":"{read_only:false; response_revision:1032; number_of_response:1; }","duration":"108.699162ms","start":"2026-07-08T04:02:10.821411Z","end":"2026-07-08T04:02:10.930111Z","steps":["trace[841981391] 'process raft request' (duration: 102.502625ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:10.930289Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.681351ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-07-08T04:02:10.930331Z","caller":"traceutil/trace.go:171","msg":"trace[431659150] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1032; }","duration":"107.759312ms","start":"2026-07-08T04:02:10.822558Z","end":"2026-07-08T04:02:10.930318Z","steps":["trace[431659150] 'agreement among raft nodes before linearized reading' (duration: 107.604309ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:10.930639Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.990294ms","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-08T04:02:10.930668Z","caller":"traceutil/trace.go:171","msg":"trace[441287699] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1032; }","duration":"107.018375ms","start":"2026-07-08T04:02:10.823642Z","end":"2026-07-08T04:02:10.930661Z","steps":["trace[441287699] 'agreement among raft nodes before linearized reading' (duration: 106.951723ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:02:13.077984Z","caller":"traceutil/trace.go:171","msg":"trace[1840541415] linearizableReadLoop","detail":"{readStateIndex:1077; appliedIndex:1076; }","duration":"136.103642ms","start":"2026-07-08T04:02:12.941858Z","end":"2026-07-08T04:02:13.077962Z","steps":["trace[1840541415] 'read index received' (duration: 135.922278ms)","trace[1840541415] 'applied index is now lower than readState.Index' (duration: 179.884µs)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:02:13.078Z","caller":"traceutil/trace.go:171","msg":"trace[1037490243] transaction","detail":"{read_only:false; response_revision:1038; number_of_response:1; }","duration":"139.480947ms","start":"2026-07-08T04:02:12.938498Z","end":"2026-07-08T04:02:13.077979Z","steps":["trace[1037490243] 'process raft request' (duration: 139.293663ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:13.078308Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"136.421839ms","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-08T04:02:13.078349Z","caller":"traceutil/trace.go:171","msg":"trace[504081670] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1038; }","duration":"136.558531ms","start":"2026-07-08T04:02:12.941779Z","end":"2026-07-08T04:02:13.078337Z","steps":["trace[504081670] 'agreement among raft nodes before linearized reading' (duration: 136.310466ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:13.078392Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.758834ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-07-08T04:02:13.078426Z","caller":"traceutil/trace.go:171","msg":"trace[697209877] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1038; }","duration":"135.829486ms","start":"2026-07-08T04:02:12.942588Z","end":"2026-07-08T04:02:13.078418Z","steps":["trace[697209877] 'agreement among raft nodes before linearized reading' (duration: 135.53145ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:02:13.371963Z","caller":"traceutil/trace.go:171","msg":"trace[296156754] transaction","detail":"{read_only:false; response_revision:1039; number_of_response:1; }","duration":"289.156125ms","start":"2026-07-08T04:02:13.082775Z","end":"2026-07-08T04:02:13.371931Z","steps":["trace[296156754] 'process raft request' (duration: 288.97019ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:02:13.381294Z","caller":"traceutil/trace.go:171","msg":"trace[1005387453] linearizableReadLoop","detail":"{readStateIndex:1079; appliedIndex:1077; }","duration":"291.290822ms","start":"2026-07-08T04:02:13.089958Z","end":"2026-07-08T04:02:13.381248Z","steps":["trace[1005387453] 'read index received' (duration: 281.844404ms)","trace[1005387453] 'applied index is now lower than readState.Index' (duration: 9.445048ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:02:13.381345Z","caller":"traceutil/trace.go:171","msg":"trace[1338621904] transaction","detail":"{read_only:false; response_revision:1040; number_of_response:1; }","duration":"295.762601ms","start":"2026-07-08T04:02:13.085557Z","end":"2026-07-08T04:02:13.381319Z","steps":["trace[1338621904] 'process raft request' (duration: 295.486495ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:13.381576Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"291.584209ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:1 size:2897"} {"level":"info","ts":"2026-07-08T04:02:13.381634Z","caller":"traceutil/trace.go:171","msg":"trace[44733786] range","detail":"{range_begin:/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:1; response_revision:1041; }","duration":"291.68895ms","start":"2026-07-08T04:02:13.089932Z","end":"2026-07-08T04:02:13.381621Z","steps":["trace[44733786] 'agreement among raft nodes before linearized reading' (duration: 291.468986ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:13.381783Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"209.38393ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-07-08T04:02:13.381875Z","caller":"traceutil/trace.go:171","msg":"trace[700014880] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1041; }","duration":"209.534342ms","start":"2026-07-08T04:02:13.17232Z","end":"2026-07-08T04:02:13.381854Z","steps":["trace[700014880] 'agreement among raft nodes before linearized reading' (duration: 209.147904ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:02:13.93378Z","caller":"traceutil/trace.go:171","msg":"trace[1875562329] transaction","detail":"{read_only:false; response_revision:1042; number_of_response:1; }","duration":"547.741398ms","start":"2026-07-08T04:02:13.386013Z","end":"2026-07-08T04:02:13.933754Z","steps":["trace[1875562329] 'process raft request' (duration: 543.929534ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:13.933947Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:13.385995Z","time spent":"547.85949ms","remote":"127.0.0.1:43648","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2914,"response count":0,"response size":38,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-07-08T04:02:14.331759Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"298.669119ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-07-08T04:02:14.331903Z","caller":"traceutil/trace.go:171","msg":"trace[1367275075] linearizableReadLoop","detail":"{readStateIndex:1082; appliedIndex:1080; }","duration":"689.489488ms","start":"2026-07-08T04:02:13.64238Z","end":"2026-07-08T04:02:14.33187Z","steps":["trace[1367275075] 'read index received' (duration: 287.666462ms)","trace[1367275075] 'applied index is now lower than readState.Index' (duration: 401.821796ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:02:14.33196Z","caller":"traceutil/trace.go:171","msg":"trace[703462881] transaction","detail":"{read_only:false; response_revision:1043; number_of_response:1; }","duration":"945.76979ms","start":"2026-07-08T04:02:13.386142Z","end":"2026-07-08T04:02:14.331912Z","steps":["trace[703462881] 'process raft request' (duration: 646.843306ms)","trace[703462881] 'compare' (duration: 298.516996ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:02:14.332081Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"689.704464ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-07-08T04:02:14.332116Z","caller":"traceutil/trace.go:171","msg":"trace[135352810] range","detail":"{range_begin:/registry/clusterrolebindings/; range_end:/registry/clusterrolebindings0; response_count:0; response_revision:1043; }","duration":"689.795235ms","start":"2026-07-08T04:02:13.642306Z","end":"2026-07-08T04:02:14.332101Z","steps":["trace[135352810] 'agreement among raft nodes before linearized reading' (duration: 689.680393ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:14.332142Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"493.543045ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-07-08T04:02:14.332164Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:13.642249Z","time spent":"689.905158ms","remote":"127.0.0.1:43752","response type":"/etcdserverpb.KV/Range","request count":0,"request size":66,"response count":54,"response size":29,"request content":"key:\"/registry/clusterrolebindings/\" range_end:\"/registry/clusterrolebindings0\" count_only:true "} {"level":"warn","ts":"2026-07-08T04:02:14.332171Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:13.386119Z","time spent":"945.932693ms","remote":"127.0.0.1:43666","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-08T04:02:14.332203Z","caller":"traceutil/trace.go:171","msg":"trace[1760000194] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1043; }","duration":"493.661418ms","start":"2026-07-08T04:02:13.838523Z","end":"2026-07-08T04:02:14.332185Z","steps":["trace[1760000194] 'agreement among raft nodes before linearized reading' (duration: 493.553796ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:14.332501Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"387.4679ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-98gmt\" ","response":"range_response_count:1 size:4129"} {"level":"info","ts":"2026-07-08T04:02:14.332591Z","caller":"traceutil/trace.go:171","msg":"trace[129603243] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-98gmt; range_end:; response_count:1; response_revision:1043; }","duration":"387.633194ms","start":"2026-07-08T04:02:13.944937Z","end":"2026-07-08T04:02:14.33257Z","steps":["trace[129603243] 'agreement among raft nodes before linearized reading' (duration: 387.346947ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:14.332593Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"483.016403ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-07-08T04:02:14.332544Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"386.970559ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:1 size:2929"} {"level":"warn","ts":"2026-07-08T04:02:14.332641Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:13.944917Z","time spent":"387.715616ms","remote":"127.0.0.1:43606","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":1,"response size":4151,"request content":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-98gmt\" "} {"level":"info","ts":"2026-07-08T04:02:14.332645Z","caller":"traceutil/trace.go:171","msg":"trace[1055797033] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1043; }","duration":"483.109955ms","start":"2026-07-08T04:02:13.849519Z","end":"2026-07-08T04:02:14.332629Z","steps":["trace[1055797033] 'agreement among raft nodes before linearized reading' (duration: 483.020933ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:14.332683Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:13.849474Z","time spent":"483.204387ms","remote":"127.0.0.1:43432","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-08T04:02:14.332691Z","caller":"traceutil/trace.go:171","msg":"trace[609575066] range","detail":"{range_begin:/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:1; response_revision:1043; }","duration":"387.160863ms","start":"2026-07-08T04:02:13.945492Z","end":"2026-07-08T04:02:14.332652Z","steps":["trace[609575066] 'agreement among raft nodes before linearized reading' (duration: 386.799216ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:14.332758Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:13.945468Z","time spent":"387.274016ms","remote":"127.0.0.1:43648","response type":"/etcdserverpb.KV/Range","request count":0,"request size":72,"response count":1,"response size":2951,"request content":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" "} {"level":"warn","ts":"2026-07-08T04:02:14.332947Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-08T04:02:13.838493Z","time spent":"494.385464ms","remote":"127.0.0.1:43430","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-08T04:02:39.413351Z","caller":"traceutil/trace.go:171","msg":"trace[1060814133] transaction","detail":"{read_only:false; response_revision:1129; number_of_response:1; }","duration":"180.121485ms","start":"2026-07-08T04:02:39.2332Z","end":"2026-07-08T04:02:39.413321Z","steps":["trace[1060814133] 'process raft request' (duration: 179.861ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:02:39.714402Z","caller":"traceutil/trace.go:171","msg":"trace[1785885809] transaction","detail":"{read_only:false; response_revision:1130; number_of_response:1; }","duration":"225.054058ms","start":"2026-07-08T04:02:39.489327Z","end":"2026-07-08T04:02:39.714381Z","steps":["trace[1785885809] 'process raft request' (duration: 214.886204ms)","trace[1785885809] 'compare' (duration: 10.022442ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:02:39.714562Z","caller":"traceutil/trace.go:171","msg":"trace[1278507302] linearizableReadLoop","detail":"{readStateIndex:1174; appliedIndex:1173; }","duration":"188.662356ms","start":"2026-07-08T04:02:39.525661Z","end":"2026-07-08T04:02:39.714323Z","steps":["trace[1278507302] 'read index received' (duration: 178.619464ms)","trace[1278507302] 'applied index is now lower than readState.Index' (duration: 10.042282ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:02:39.714765Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"132.393353ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-07-08T04:02:39.714808Z","caller":"traceutil/trace.go:171","msg":"trace[290566541] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1130; }","duration":"132.487486ms","start":"2026-07-08T04:02:39.58231Z","end":"2026-07-08T04:02:39.714797Z","steps":["trace[290566541] 'agreement among raft nodes before linearized reading' (duration: 132.319032ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:02:39.714773Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.067074ms","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-08T04:02:39.714873Z","caller":"traceutil/trace.go:171","msg":"trace[1008930843] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1130; }","duration":"189.246798ms","start":"2026-07-08T04:02:39.525601Z","end":"2026-07-08T04:02:39.714847Z","steps":["trace[1008930843] 'agreement among raft nodes before linearized reading' (duration: 188.904741ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:03:46.319893Z","caller":"traceutil/trace.go:171","msg":"trace[1790005425] transaction","detail":"{read_only:false; response_revision:1391; number_of_response:1; }","duration":"152.035659ms","start":"2026-07-08T04:03:46.167839Z","end":"2026-07-08T04:03:46.319874Z","steps":["trace[1790005425] 'process raft request' (duration: 116.608212ms)","trace[1790005425] 'compare' (duration: 35.271255ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:03:46.519984Z","caller":"traceutil/trace.go:171","msg":"trace[90660668] transaction","detail":"{read_only:false; response_revision:1392; number_of_response:1; }","duration":"192.974804ms","start":"2026-07-08T04:03:46.326983Z","end":"2026-07-08T04:03:46.519958Z","steps":["trace[90660668] 'process raft request' (duration: 192.682469ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:03:46.521703Z","caller":"traceutil/trace.go:171","msg":"trace[439625626] linearizableReadLoop","detail":"{readStateIndex:1454; appliedIndex:1452; }","duration":"109.150622ms","start":"2026-07-08T04:03:46.412508Z","end":"2026-07-08T04:03:46.521658Z","steps":["trace[439625626] 'read index received' (duration: 107.268608ms)","trace[439625626] 'applied index is now lower than readState.Index' (duration: 1.880364ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:03:46.521963Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.412606ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:service-controller\" ","response":"range_response_count:1 size:724"} {"level":"info","ts":"2026-07-08T04:03:46.522011Z","caller":"traceutil/trace.go:171","msg":"trace[558716734] range","detail":"{range_begin:/registry/clusterroles/system:controller:service-controller; range_end:; response_count:1; response_revision:1393; }","duration":"109.526848ms","start":"2026-07-08T04:03:46.412464Z","end":"2026-07-08T04:03:46.521991Z","steps":["trace[558716734] 'agreement among raft nodes before linearized reading' (duration: 109.364475ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:03:46.521785Z","caller":"traceutil/trace.go:171","msg":"trace[945914876] transaction","detail":"{read_only:false; response_revision:1393; number_of_response:1; }","duration":"142.535523ms","start":"2026-07-08T04:03:46.37923Z","end":"2026-07-08T04:03:46.521766Z","steps":["trace[945914876] 'process raft request' (duration: 142.173496ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:03:46.523084Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.174888ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:controller:service-account-controller\" ","response":"range_response_count:1 size:677"} {"level":"info","ts":"2026-07-08T04:03:46.523206Z","caller":"traceutil/trace.go:171","msg":"trace[978134470] range","detail":"{range_begin:/registry/clusterroles/system:controller:service-account-controller; range_end:; response_count:1; response_revision:1393; }","duration":"107.34675ms","start":"2026-07-08T04:03:46.415841Z","end":"2026-07-08T04:03:46.523188Z","steps":["trace[978134470] 'agreement among raft nodes before linearized reading' (duration: 106.051347ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:03:48.41227Z","caller":"traceutil/trace.go:171","msg":"trace[1302758368] linearizableReadLoop","detail":"{readStateIndex:1459; appliedIndex:1458; }","duration":"161.456421ms","start":"2026-07-08T04:03:48.250782Z","end":"2026-07-08T04:03:48.412238Z","steps":["trace[1302758368] 'read index received' (duration: 161.302678ms)","trace[1302758368] 'applied index is now lower than readState.Index' (duration: 152.203µs)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:03:48.412353Z","caller":"traceutil/trace.go:171","msg":"trace[1660977869] transaction","detail":"{read_only:false; response_revision:1398; number_of_response:1; }","duration":"170.568341ms","start":"2026-07-08T04:03:48.24172Z","end":"2026-07-08T04:03:48.412288Z","steps":["trace[1660977869] 'process raft request' (duration: 170.327717ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:03:48.412547Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.969977ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:kubelet-api-admin\" ","response":"range_response_count:1 size:662"} {"level":"warn","ts":"2026-07-08T04:03:48.412528Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"161.706365ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:kube-scheduler\" ","response":"range_response_count:1 size:1383"} {"level":"info","ts":"2026-07-08T04:03:48.412599Z","caller":"traceutil/trace.go:171","msg":"trace[1866763058] range","detail":"{range_begin:/registry/clusterroles/system:kubelet-api-admin; range_end:; response_count:1; response_revision:1398; }","duration":"159.063769ms","start":"2026-07-08T04:03:48.253524Z","end":"2026-07-08T04:03:48.412588Z","steps":["trace[1866763058] 'agreement among raft nodes before linearized reading' (duration: 158.932946ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:03:48.412647Z","caller":"traceutil/trace.go:171","msg":"trace[1312233951] range","detail":"{range_begin:/registry/clusterroles/system:kube-scheduler; range_end:; response_count:1; response_revision:1398; }","duration":"161.877178ms","start":"2026-07-08T04:03:48.25074Z","end":"2026-07-08T04:03:48.412617Z","steps":["trace[1312233951] 'agreement among raft nodes before linearized reading' (duration: 161.629254ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:03:50.066739Z","caller":"traceutil/trace.go:171","msg":"trace[918772440] linearizableReadLoop","detail":"{readStateIndex:1464; appliedIndex:1463; }","duration":"152.475238ms","start":"2026-07-08T04:03:49.914235Z","end":"2026-07-08T04:03:50.06671Z","steps":["trace[918772440] 'read index received' (duration: 152.288434ms)","trace[918772440] 'applied index is now lower than readState.Index' (duration: 185.294µs)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:03:50.066856Z","caller":"traceutil/trace.go:171","msg":"trace[1859855739] transaction","detail":"{read_only:false; response_revision:1403; number_of_response:1; }","duration":"166.414074ms","start":"2026-07-08T04:03:49.900402Z","end":"2026-07-08T04:03:50.066816Z","steps":["trace[1859855739] 'process raft request' (duration: 166.146139ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:03:50.066962Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"152.704702ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles/system:public-info-viewer\" ","response":"range_response_count:1 size:613"} {"level":"info","ts":"2026-07-08T04:03:50.067004Z","caller":"traceutil/trace.go:171","msg":"trace[1219861639] range","detail":"{range_begin:/registry/clusterroles/system:public-info-viewer; range_end:; response_count:1; response_revision:1403; }","duration":"152.790423ms","start":"2026-07-08T04:03:49.9142Z","end":"2026-07-08T04:03:50.066991Z","steps":["trace[1219861639] 'agreement among raft nodes before linearized reading' (duration: 152.684941ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:03:50.067073Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.885098ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/system:controller:ephemeral-volume-controller\" ","response":"range_response_count:1 size:783"} {"level":"info","ts":"2026-07-08T04:03:50.067181Z","caller":"traceutil/trace.go:171","msg":"trace[1166722635] range","detail":"{range_begin:/registry/clusterrolebindings/system:controller:ephemeral-volume-controller; range_end:; response_count:1; response_revision:1403; }","duration":"143.031101ms","start":"2026-07-08T04:03:49.924124Z","end":"2026-07-08T04:03:50.067155Z","steps":["trace[1166722635] 'agreement among raft nodes before linearized reading' (duration: 142.831128ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:03:50.734494Z","caller":"traceutil/trace.go:171","msg":"trace[1397127564] linearizableReadLoop","detail":"{readStateIndex:1468; appliedIndex:1467; }","duration":"109.03165ms","start":"2026-07-08T04:03:50.625443Z","end":"2026-07-08T04:03:50.734475Z","steps":["trace[1397127564] 'read index received' (duration: 63.439517ms)","trace[1397127564] 'applied index is now lower than readState.Index' (duration: 45.590793ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:03:50.734641Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.186283ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/system:controller:horizontal-pod-autoscaler\" ","response":"range_response_count:1 size:775"} {"level":"info","ts":"2026-07-08T04:03:50.734662Z","caller":"traceutil/trace.go:171","msg":"trace[4094321] range","detail":"{range_begin:/registry/clusterrolebindings/system:controller:horizontal-pod-autoscaler; range_end:; response_count:1; response_revision:1406; }","duration":"109.237554ms","start":"2026-07-08T04:03:50.625418Z","end":"2026-07-08T04:03:50.734656Z","steps":["trace[4094321] 'agreement among raft nodes before linearized reading' (duration: 109.164343ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:03:50.904182Z","caller":"traceutil/trace.go:171","msg":"trace[103818749] linearizableReadLoop","detail":"{readStateIndex:1469; appliedIndex:1468; }","duration":"164.547298ms","start":"2026-07-08T04:03:50.739605Z","end":"2026-07-08T04:03:50.904152Z","steps":["trace[103818749] 'read index received' (duration: 112.760136ms)","trace[103818749] 'applied index is now lower than readState.Index' (duration: 51.785812ms)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:03:50.90424Z","caller":"traceutil/trace.go:171","msg":"trace[366552654] transaction","detail":"{read_only:false; response_revision:1407; number_of_response:1; }","duration":"168.182724ms","start":"2026-07-08T04:03:50.736002Z","end":"2026-07-08T04:03:50.904184Z","steps":["trace[366552654] 'process raft request' (duration: 116.429332ms)","trace[366552654] 'compare' (duration: 51.583678ms)"],"step_count":2} {"level":"warn","ts":"2026-07-08T04:03:50.904549Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.903575ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/system:controller:horizontal-pod-autoscaler\" ","response":"range_response_count:1 size:775"} {"level":"info","ts":"2026-07-08T04:03:50.904667Z","caller":"traceutil/trace.go:171","msg":"trace[1141066316] range","detail":"{range_begin:/registry/clusterrolebindings/system:controller:horizontal-pod-autoscaler; range_end:; response_count:1; response_revision:1407; }","duration":"165.055378ms","start":"2026-07-08T04:03:50.739584Z","end":"2026-07-08T04:03:50.904639Z","steps":["trace[1141066316] 'agreement among raft nodes before linearized reading' (duration: 164.696742ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:03:51.218088Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"206.941962ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/system:controller:namespace-controller\" ","response":"range_response_count:1 size:755"} {"level":"info","ts":"2026-07-08T04:03:51.218236Z","caller":"traceutil/trace.go:171","msg":"trace[1771331713] range","detail":"{range_begin:/registry/clusterrolebindings/system:controller:namespace-controller; range_end:; response_count:1; response_revision:1407; }","duration":"207.154785ms","start":"2026-07-08T04:03:51.011042Z","end":"2026-07-08T04:03:51.218197Z","steps":["trace[1771331713] 'range keys from in-memory index tree' (duration: 206.786609ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:03:51.218381Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.231376ms","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-08T04:03:51.218463Z","caller":"traceutil/trace.go:171","msg":"trace[24957261] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1407; }","duration":"199.361417ms","start":"2026-07-08T04:03:51.019084Z","end":"2026-07-08T04:03:51.218445Z","steps":["trace[24957261] 'range keys from in-memory index tree' (duration: 199.061663ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:03:51.218647Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.151856ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterrolebindings/system:controller:job-controller\" ","response":"range_response_count:1 size:731"} {"level":"info","ts":"2026-07-08T04:03:51.218698Z","caller":"traceutil/trace.go:171","msg":"trace[73242110] range","detail":"{range_begin:/registry/clusterrolebindings/system:controller:job-controller; range_end:; response_count:1; response_revision:1407; }","duration":"140.277669ms","start":"2026-07-08T04:03:51.078407Z","end":"2026-07-08T04:03:51.218684Z","steps":["trace[73242110] 'range keys from in-memory index tree' (duration: 140.057135ms)"],"step_count":1} {"level":"info","ts":"2026-07-08T04:04:02.40367Z","caller":"traceutil/trace.go:171","msg":"trace[862429757] linearizableReadLoop","detail":"{readStateIndex:1508; appliedIndex:1507; }","duration":"155.490586ms","start":"2026-07-08T04:04:02.248152Z","end":"2026-07-08T04:04:02.403643Z","steps":["trace[862429757] 'read index received' (duration: 155.268312ms)","trace[862429757] 'applied index is now lower than readState.Index' (duration: 221.004µs)"],"step_count":2} {"level":"info","ts":"2026-07-08T04:04:02.403785Z","caller":"traceutil/trace.go:171","msg":"trace[1085534622] transaction","detail":"{read_only:false; response_revision:1444; number_of_response:1; }","duration":"156.099657ms","start":"2026-07-08T04:04:02.247641Z","end":"2026-07-08T04:04:02.403741Z","steps":["trace[1085534622] 'process raft request' (duration: 155.846201ms)"],"step_count":1} {"level":"warn","ts":"2026-07-08T04:04:02.403849Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"155.66653ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/rolebindings/kube-system/kubeadm:nodes-kubeadm-config\" ","response":"range_response_count:1 size:556"} {"level":"info","ts":"2026-07-08T04:04:02.403895Z","caller":"traceutil/trace.go:171","msg":"trace[1583100215] range","detail":"{range_begin:/registry/rolebindings/kube-system/kubeadm:nodes-kubeadm-config; range_end:; response_count:1; response_revision:1444; }","duration":"155.758291ms","start":"2026-07-08T04:04:02.248121Z","end":"2026-07-08T04:04:02.403879Z","steps":["trace[1583100215] 'agreement among raft nodes before linearized reading' (duration: 155.659449ms)"],"step_count":1}