{"level":"warn","ts":"2026-02-25T19:25:33.904263Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-02-25T19:25:33.904343Z","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-02-25T19:25:33.904977Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-02-25T19:25:33.904994Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.116:2380"]}
{"level":"info","ts":"2026-02-25T19:25:33.905011Z","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-02-25T19:25:33.905868Z","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-02-25T19:25:33.905938Z","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-02-25T19:25:33.910116Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"3.923669ms"}
{"level":"info","ts":"2026-02-25T19:25:33.924669Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"5caa70ef1dd6dc04","cluster-id":"45afccab143d2c82"}
{"level":"info","ts":"2026-02-25T19:25:33.924782Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=()"}
{"level":"info","ts":"2026-02-25T19:25:33.924818Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became follower at term 0"}
{"level":"info","ts":"2026-02-25T19:25:33.924828Z","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-02-25T19:25:33.924837Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became follower at term 1"}
{"level":"info","ts":"2026-02-25T19:25:33.924905Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=(6677273569830296580)"}
{"level":"warn","ts":"2026-02-25T19:25:33.939327Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-02-25T19:25:33.940824Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-02-25T19:25:33.941762Z","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-02-25T19:25:33.943763Z","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-02-25T19:25:33.94387Z","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-02-25T19:25:33.943943Z","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-02-25T19:25:33.943956Z","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-02-25T19:25:33.943954Z","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-02-25T19:25:33.945252Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 switched to configuration voters=(6677273569830296580)"}
{"level":"info","ts":"2026-02-25T19:25:33.945382Z","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-02-25T19:25:33.956296Z","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-02-25T19:25:33.956376Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.116:2380"}
{"level":"info","ts":"2026-02-25T19:25:33.956408Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.116:2380"}
{"level":"info","ts":"2026-02-25T19:25:33.956531Z","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-02-25T19:25:33.956566Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-02-25T19:25:34.725244Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 is starting a new election at term 1"}
{"level":"info","ts":"2026-02-25T19:25:34.725379Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became pre-candidate at term 1"}
{"level":"info","ts":"2026-02-25T19:25:34.725421Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 received MsgPreVoteResp from 5caa70ef1dd6dc04 at term 1"}
{"level":"info","ts":"2026-02-25T19:25:34.725458Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became candidate at term 2"}
{"level":"info","ts":"2026-02-25T19:25:34.725472Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 received MsgVoteResp from 5caa70ef1dd6dc04 at term 2"}
{"level":"info","ts":"2026-02-25T19:25:34.725507Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"5caa70ef1dd6dc04 became leader at term 2"}
{"level":"info","ts":"2026-02-25T19:25:34.725532Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 5caa70ef1dd6dc04 elected leader 5caa70ef1dd6dc04 at term 2"}
{"level":"info","ts":"2026-02-25T19:25:34.727177Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-02-25T19:25:34.728451Z","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-02-25T19:25:34.728502Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-02-25T19:25:34.728554Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-02-25T19:25:34.728384Z","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-02-25T19:25:34.7291Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-02-25T19:25:34.730212Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-02-25T19:25:34.731541Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-02-25T19:25:34.731605Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-02-25T19:25:34.731859Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-02-25T19:25:34.731981Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.116:2379"}
{"level":"warn","ts":"2026-02-25T19:25:39.413785Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"706.984783ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:3492"}
{"level":"info","ts":"2026-02-25T19:25:39.413883Z","caller":"traceutil/trace.go:171","msg":"trace[1322177248] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:208; }","duration":"707.14032ms","start":"2026-02-25T19:25:38.706726Z","end":"2026-02-25T19:25:39.413866Z","steps":["trace[1322177248] 'range keys from in-memory index tree'  (duration: 706.895989ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:25:39.413918Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:25:38.706706Z","time spent":"707.205223ms","remote":"127.0.0.1:38966","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":1,"response size":3514,"request content":"key:\"/registry/minions/instance\" "}
{"level":"info","ts":"2026-02-25T19:25:39.824406Z","caller":"traceutil/trace.go:171","msg":"trace[584178992] linearizableReadLoop","detail":"{readStateIndex:214; appliedIndex:213; }","duration":"264.727257ms","start":"2026-02-25T19:25:39.55965Z","end":"2026-02-25T19:25:39.824377Z","steps":["trace[584178992] 'read index received'  (duration: 264.468166ms)","trace[584178992] 'applied index is now lower than readState.Index'  (duration: 258.181µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T19:25:39.82474Z","caller":"traceutil/trace.go:171","msg":"trace[1057845839] transaction","detail":"{read_only:false; response_revision:209; number_of_response:1; }","duration":"383.750909ms","start":"2026-02-25T19:25:39.440977Z","end":"2026-02-25T19:25:39.824728Z","steps":["trace[1057845839] 'process raft request'  (duration: 383.261668ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:25:39.824966Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"265.27682ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T19:25:39.825128Z","caller":"traceutil/trace.go:171","msg":"trace[1056445553] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:0; response_revision:209; }","duration":"265.512398ms","start":"2026-02-25T19:25:39.559578Z","end":"2026-02-25T19:25:39.82509Z","steps":["trace[1056445553] 'agreement among raft nodes before linearized reading'  (duration: 265.28028ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:25:39.824963Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"207.346078ms","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:5"}
{"level":"info","ts":"2026-02-25T19:25:39.82525Z","caller":"traceutil/trace.go:171","msg":"trace[1448083096] range","detail":"{range_begin:/registry/limitranges/kube-system/; range_end:/registry/limitranges/kube-system0; response_count:0; response_revision:209; }","duration":"207.724422ms","start":"2026-02-25T19:25:39.617499Z","end":"2026-02-25T19:25:39.825223Z","steps":["trace[1448083096] 'agreement among raft nodes before linearized reading'  (duration: 207.294915ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:25:39.825372Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:25:39.440953Z","time spent":"383.821481ms","remote":"127.0.0.1:38966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3695,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:42 > success:<request_put:<key:\"/registry/minions/instance\" value_size:3661 >> failure:<request_range:<key:\"/registry/minions/instance\" > >"}
{"level":"info","ts":"2026-02-25T19:25:41.50212Z","caller":"traceutil/trace.go:171","msg":"trace[886911386] transaction","detail":"{read_only:false; response_revision:274; number_of_response:1; }","duration":"114.067221ms","start":"2026-02-25T19:25:41.388016Z","end":"2026-02-25T19:25:41.502083Z","steps":["trace[886911386] 'process raft request'  (duration: 113.830482ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:04.531902Z","caller":"traceutil/trace.go:171","msg":"trace[676660720] transaction","detail":"{read_only:false; response_revision:468; number_of_response:1; }","duration":"229.695697ms","start":"2026-02-25T19:26:04.30218Z","end":"2026-02-25T19:26:04.531875Z","steps":["trace[676660720] 'process raft request'  (duration: 229.539452ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:04.537594Z","caller":"traceutil/trace.go:171","msg":"trace[1638744962] linearizableReadLoop","detail":"{readStateIndex:485; appliedIndex:484; }","duration":"203.412693ms","start":"2026-02-25T19:26:04.334165Z","end":"2026-02-25T19:26:04.537578Z","steps":["trace[1638744962] 'read index received'  (duration: 199.660987ms)","trace[1638744962] 'applied index is now lower than readState.Index'  (duration: 3.750826ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T19:26:04.537695Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"203.509516ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T19:26:04.537723Z","caller":"traceutil/trace.go:171","msg":"trace[697851843] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:469; }","duration":"203.568777ms","start":"2026-02-25T19:26:04.334147Z","end":"2026-02-25T19:26:04.537715Z","steps":["trace[697851843] 'agreement among raft nodes before linearized reading'  (duration: 203.489164ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:04.537907Z","caller":"traceutil/trace.go:171","msg":"trace[1998012127] transaction","detail":"{read_only:false; response_revision:469; number_of_response:1; }","duration":"233.053292ms","start":"2026-02-25T19:26:04.304846Z","end":"2026-02-25T19:26:04.537899Z","steps":["trace[1998012127] 'process raft request'  (duration: 232.67344ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:11.17576Z","caller":"traceutil/trace.go:171","msg":"trace[1562213147] transaction","detail":"{read_only:false; response_revision:511; number_of_response:1; }","duration":"144.98071ms","start":"2026-02-25T19:26:11.03075Z","end":"2026-02-25T19:26:11.175731Z","steps":["trace[1562213147] 'process raft request'  (duration: 144.795185ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:11.628636Z","caller":"traceutil/trace.go:171","msg":"trace[1171290287] transaction","detail":"{read_only:false; response_revision:512; number_of_response:1; }","duration":"195.597699ms","start":"2026-02-25T19:26:11.432796Z","end":"2026-02-25T19:26:11.628394Z","steps":["trace[1171290287] 'process raft request'  (duration: 195.451415ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:12.193334Z","caller":"traceutil/trace.go:171","msg":"trace[769470268] transaction","detail":"{read_only:false; response_revision:513; number_of_response:1; }","duration":"339.825213ms","start":"2026-02-25T19:26:11.853485Z","end":"2026-02-25T19:26:12.19331Z","steps":["trace[769470268] 'process raft request'  (duration: 339.653988ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:12.19348Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:26:11.853461Z","time spent":"339.942797ms","remote":"127.0.0.1:38966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4745,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/minions/instance\" mod_revision:471 > success:<request_put:<key:\"/registry/minions/instance\" value_size:4711 >> failure:<request_range:<key:\"/registry/minions/instance\" > >"}
{"level":"info","ts":"2026-02-25T19:26:12.193667Z","caller":"traceutil/trace.go:171","msg":"trace[1689463646] linearizableReadLoop","detail":"{readStateIndex:530; appliedIndex:529; }","duration":"196.1255ms","start":"2026-02-25T19:26:11.997521Z","end":"2026-02-25T19:26:12.193647Z","steps":["trace[1689463646] 'read index received'  (duration: 195.543123ms)","trace[1689463646] 'applied index is now lower than readState.Index'  (duration: 580.747µs)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T19:26:12.193826Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.308614ms","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-02-25T19:26:12.193869Z","caller":"traceutil/trace.go:171","msg":"trace[1478880862] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:513; }","duration":"196.376616ms","start":"2026-02-25T19:26:11.997477Z","end":"2026-02-25T19:26:12.193854Z","steps":["trace[1478880862] 'agreement among raft nodes before linearized reading'  (duration: 196.240052ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:12.31352Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.415214ms","expected-duration":"100ms","prefix":"","request":"header:<ID:15853968757442963839 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:504 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >>","response":"size:16"}
{"level":"info","ts":"2026-02-25T19:26:12.313631Z","caller":"traceutil/trace.go:171","msg":"trace[1550376852] transaction","detail":"{read_only:false; response_revision:514; number_of_response:1; }","duration":"115.408465ms","start":"2026-02-25T19:26:12.198194Z","end":"2026-02-25T19:26:12.313602Z","steps":["trace[1550376852] 'compare'  (duration: 108.309471ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:14.035062Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.459871918s","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-02-25T19:26:14.035124Z","caller":"traceutil/trace.go:171","msg":"trace[547041783] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:514; }","duration":"1.45994629s","start":"2026-02-25T19:26:12.575164Z","end":"2026-02-25T19:26:14.03511Z","steps":["trace[547041783] 'range keys from in-memory index tree'  (duration: 1.459728554s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:14.035153Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:26:12.575111Z","time spent":"1.460035973s","remote":"127.0.0.1:39056","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-02-25T19:26:14.03531Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.459852458s","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-02-25T19:26:14.035329Z","caller":"traceutil/trace.go:171","msg":"trace[44982155] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:514; }","duration":"1.459886678s","start":"2026-02-25T19:26:12.575436Z","end":"2026-02-25T19:26:14.035322Z","steps":["trace[44982155] 'range keys from in-memory index tree'  (duration: 1.459783306s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:14.035346Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:26:12.575429Z","time spent":"1.459913629s","remote":"127.0.0.1:39056","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":"warn","ts":"2026-02-25T19:26:14.035977Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.198872548s","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-02-25T19:26:14.036083Z","caller":"traceutil/trace.go:171","msg":"trace[476710876] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:514; }","duration":"1.199195246s","start":"2026-02-25T19:26:12.836867Z","end":"2026-02-25T19:26:14.036062Z","steps":["trace[476710876] 'range keys from in-memory index tree'  (duration: 1.198708513s)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:14.036123Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:26:12.836851Z","time spent":"1.199260138s","remote":"127.0.0.1:39056","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-02-25T19:26:14.277075Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.066990206s","expected-duration":"100ms","prefix":"","request":"header:<ID:15853968757442963843 > lease_revoke:<id:5c049c96438768bb>","response":"size:27"}
{"level":"info","ts":"2026-02-25T19:26:14.277376Z","caller":"traceutil/trace.go:171","msg":"trace[1561331314] linearizableReadLoop","detail":"{readStateIndex:532; appliedIndex:531; }","duration":"940.928414ms","start":"2026-02-25T19:26:13.336354Z","end":"2026-02-25T19:26:14.277282Z","steps":["trace[1561331314] 'read index received'  (duration: 88.133µs)","trace[1561331314] 'applied index is now lower than readState.Index'  (duration: 940.838061ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T19:26:14.277505Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"941.135029ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T19:26:14.277599Z","caller":"traceutil/trace.go:171","msg":"trace[1218512249] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:514; }","duration":"941.439978ms","start":"2026-02-25T19:26:13.336138Z","end":"2026-02-25T19:26:14.277578Z","steps":["trace[1218512249] 'agreement among raft nodes before linearized reading'  (duration: 941.261583ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:14.277642Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:26:13.336122Z","time spent":"941.51409ms","remote":"127.0.0.1:38780","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-02-25T19:26:14.279567Z","caller":"traceutil/trace.go:171","msg":"trace[378953245] transaction","detail":"{read_only:false; response_revision:515; number_of_response:1; }","duration":"240.418406ms","start":"2026-02-25T19:26:14.039106Z","end":"2026-02-25T19:26:14.279524Z","steps":["trace[378953245] 'process raft request'  (duration: 240.132819ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:14.282333Z","caller":"traceutil/trace.go:171","msg":"trace[53061691] transaction","detail":"{read_only:false; response_revision:516; number_of_response:1; }","duration":"242.238277ms","start":"2026-02-25T19:26:14.040063Z","end":"2026-02-25T19:26:14.282301Z","steps":["trace[53061691] 'process raft request'  (duration: 242.002221ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:14.282424Z","caller":"traceutil/trace.go:171","msg":"trace[677560593] transaction","detail":"{read_only:false; response_revision:517; number_of_response:1; }","duration":"242.276448ms","start":"2026-02-25T19:26:14.0401Z","end":"2026-02-25T19:26:14.282376Z","steps":["trace[677560593] 'process raft request'  (duration: 242.124244ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:15.476303Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.885444ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-02-25T19:26:15.476382Z","caller":"traceutil/trace.go:171","msg":"trace[128823408] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:522; }","duration":"141.017967ms","start":"2026-02-25T19:26:15.335346Z","end":"2026-02-25T19:26:15.476364Z","steps":["trace[128823408] 'range keys from in-memory index tree'  (duration: 140.821952ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:34.549002Z","caller":"traceutil/trace.go:171","msg":"trace[1106653286] transaction","detail":"{read_only:false; response_revision:715; number_of_response:1; }","duration":"106.862641ms","start":"2026-02-25T19:26:34.442114Z","end":"2026-02-25T19:26:34.548977Z","steps":["trace[1106653286] 'process raft request'  (duration: 106.663086ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:26:34.549159Z","caller":"traceutil/trace.go:171","msg":"trace[1793230636] linearizableReadLoop","detail":"{readStateIndex:741; appliedIndex:738; }","duration":"101.819224ms","start":"2026-02-25T19:26:34.447318Z","end":"2026-02-25T19:26:34.549137Z","steps":["trace[1793230636] 'read index received'  (duration: 89.702482ms)","trace[1793230636] 'applied index is now lower than readState.Index'  (duration: 12.114852ms)"],"step_count":2}
{"level":"info","ts":"2026-02-25T19:26:34.549199Z","caller":"traceutil/trace.go:171","msg":"trace[236302435] transaction","detail":"{read_only:false; response_revision:716; number_of_response:1; }","duration":"106.785269ms","start":"2026-02-25T19:26:34.442384Z","end":"2026-02-25T19:26:34.549169Z","steps":["trace[236302435] 'process raft request'  (duration: 106.538034ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:26:34.549349Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"102.012398ms","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-02-25T19:26:34.54938Z","caller":"traceutil/trace.go:171","msg":"trace[1113253716] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:716; }","duration":"102.07398ms","start":"2026-02-25T19:26:34.447298Z","end":"2026-02-25T19:26:34.549372Z","steps":["trace[1113253716] 'agreement among raft nodes before linearized reading'  (duration: 101.909766ms)"],"step_count":1}
{"level":"info","ts":"2026-02-25T19:27:49.256124Z","caller":"traceutil/trace.go:171","msg":"trace[32395639] linearizableReadLoop","detail":"{readStateIndex:1008; appliedIndex:1007; }","duration":"306.094344ms","start":"2026-02-25T19:27:48.949998Z","end":"2026-02-25T19:27:49.256092Z","steps":["trace[32395639] 'read index received'  (duration: 305.968652ms)","trace[32395639] 'applied index is now lower than readState.Index'  (duration: 124.202µs)"],"step_count":2}
{"level":"info","ts":"2026-02-25T19:27:49.25644Z","caller":"traceutil/trace.go:171","msg":"trace[1151011729] transaction","detail":"{read_only:false; response_revision:965; number_of_response:1; }","duration":"306.588011ms","start":"2026-02-25T19:27:48.949841Z","end":"2026-02-25T19:27:49.256429Z","steps":["trace[1151011729] 'process raft request'  (duration: 306.108824ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:27:49.256533Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:27:48.94982Z","time spent":"306.647682ms","remote":"127.0.0.1:39056","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:957 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"warn","ts":"2026-02-25T19:27:49.256794Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"306.792653ms","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-02-25T19:27:49.256827Z","caller":"traceutil/trace.go:171","msg":"trace[44044065] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:965; }","duration":"306.866045ms","start":"2026-02-25T19:27:48.94995Z","end":"2026-02-25T19:27:49.256816Z","steps":["trace[44044065] 'agreement among raft nodes before linearized reading'  (duration: 306.756043ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:27:49.256855Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:27:48.949931Z","time spent":"306.917915ms","remote":"127.0.0.1:39056","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":"info","ts":"2026-02-25T19:27:49.320448Z","caller":"traceutil/trace.go:171","msg":"trace[1648537927] transaction","detail":"{read_only:false; response_revision:966; number_of_response:1; }","duration":"209.726881ms","start":"2026-02-25T19:27:49.110703Z","end":"2026-02-25T19:27:49.32043Z","steps":["trace[1648537927] 'process raft request'  (duration: 175.036734ms)","trace[1648537927] 'compare'  (duration: 34.535765ms)"],"step_count":2}
{"level":"warn","ts":"2026-02-25T19:27:49.320728Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"370.368524ms","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-02-25T19:27:49.320762Z","caller":"traceutil/trace.go:171","msg":"trace[691283937] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:967; }","duration":"370.434775ms","start":"2026-02-25T19:27:48.950317Z","end":"2026-02-25T19:27:49.320752Z","steps":["trace[691283937] 'agreement among raft nodes before linearized reading'  (duration: 370.0962ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:27:49.32079Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:27:48.950301Z","time spent":"370.481825ms","remote":"127.0.0.1:39056","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-02-25T19:27:49.321023Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"369.243247ms","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-02-25T19:27:49.321098Z","caller":"traceutil/trace.go:171","msg":"trace[2108741549] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:967; }","duration":"369.336928ms","start":"2026-02-25T19:27:48.95174Z","end":"2026-02-25T19:27:49.321077Z","steps":["trace[2108741549] 'agreement among raft nodes before linearized reading'  (duration: 368.827642ms)"],"step_count":1}
{"level":"warn","ts":"2026-02-25T19:27:49.321607Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-02-25T19:27:48.951734Z","time spent":"369.857196ms","remote":"127.0.0.1:39056","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\" "}