{"level":"warn","ts":"2026-04-16T02:44:05.467123Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-16T02:44:05.467241Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.19.213.177:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.19.213.177:2380","--initial-cluster=instance=https://199.19.213.177:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.19.213.177:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.19.213.177: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-04-16T02:44:05.467327Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-04-16T02:44:05.46734Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.19.213.177:2380"]} {"level":"info","ts":"2026-04-16T02:44:05.467362Z","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-04-16T02:44:05.468317Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.177:2379"]} {"level":"info","ts":"2026-04-16T02:44:05.468409Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.19.213.177:2380"],"listen-peer-urls":["https://199.19.213.177:2380"],"advertise-client-urls":["https://199.19.213.177:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.177:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.19.213.177: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-04-16T02:44:05.480715Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"12.033568ms"} {"level":"info","ts":"2026-04-16T02:44:05.506186Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"f577bc5ae95d61e1","cluster-id":"735860b212d0f0b6"} {"level":"info","ts":"2026-04-16T02:44:05.506571Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 switched to configuration voters=()"} {"level":"info","ts":"2026-04-16T02:44:05.506722Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 became follower at term 0"} {"level":"info","ts":"2026-04-16T02:44:05.506759Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft f577bc5ae95d61e1 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-04-16T02:44:05.506865Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 became follower at term 1"} {"level":"info","ts":"2026-04-16T02:44:05.507035Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 switched to configuration voters=(17687813160169202145)"} {"level":"warn","ts":"2026-04-16T02:44:05.514109Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-04-16T02:44:05.51537Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-04-16T02:44:05.51744Z","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-04-16T02:44:05.520943Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"f577bc5ae95d61e1","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-04-16T02:44:05.522069Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"f577bc5ae95d61e1","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-04-16T02:44:05.52227Z","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-04-16T02:44:05.522317Z","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-04-16T02:44:05.522328Z","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-04-16T02:44:05.523Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 switched to configuration voters=(17687813160169202145)"} {"level":"info","ts":"2026-04-16T02:44:05.523379Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"735860b212d0f0b6","local-member-id":"f577bc5ae95d61e1","added-peer-id":"f577bc5ae95d61e1","added-peer-peer-urls":["https://199.19.213.177:2380"]} {"level":"info","ts":"2026-04-16T02:44:05.528922Z","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-04-16T02:44:05.52912Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.19.213.177:2380"} {"level":"info","ts":"2026-04-16T02:44:05.529172Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.19.213.177:2380"} {"level":"info","ts":"2026-04-16T02:44:05.529422Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"f577bc5ae95d61e1","initial-advertise-peer-urls":["https://199.19.213.177:2380"],"listen-peer-urls":["https://199.19.213.177:2380"],"advertise-client-urls":["https://199.19.213.177:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.19.213.177:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-04-16T02:44:05.529461Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-04-16T02:44:05.608236Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 is starting a new election at term 1"} {"level":"info","ts":"2026-04-16T02:44:05.608358Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 became pre-candidate at term 1"} {"level":"info","ts":"2026-04-16T02:44:05.608403Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 received MsgPreVoteResp from f577bc5ae95d61e1 at term 1"} {"level":"info","ts":"2026-04-16T02:44:05.608458Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 became candidate at term 2"} {"level":"info","ts":"2026-04-16T02:44:05.608496Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 received MsgVoteResp from f577bc5ae95d61e1 at term 2"} {"level":"info","ts":"2026-04-16T02:44:05.608546Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"f577bc5ae95d61e1 became leader at term 2"} {"level":"info","ts":"2026-04-16T02:44:05.608586Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: f577bc5ae95d61e1 elected leader f577bc5ae95d61e1 at term 2"} {"level":"info","ts":"2026-04-16T02:44:05.609589Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"f577bc5ae95d61e1","local-member-attributes":"{Name:instance ClientURLs:[https://199.19.213.177:2379]}","request-path":"/0/members/f577bc5ae95d61e1/attributes","cluster-id":"735860b212d0f0b6","publish-timeout":"7s"} {"level":"info","ts":"2026-04-16T02:44:05.60983Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-16T02:44:05.60992Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-04-16T02:44:05.609991Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-04-16T02:44:05.610159Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-04-16T02:44:05.610191Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-04-16T02:44:05.610834Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"735860b212d0f0b6","local-member-id":"f577bc5ae95d61e1","cluster-version":"3.5"} {"level":"info","ts":"2026-04-16T02:44:05.61092Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-04-16T02:44:05.610951Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-04-16T02:44:05.613098Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.19.213.177:2379"} {"level":"info","ts":"2026-04-16T02:44:05.615712Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-04-16T02:44:10.674879Z","caller":"traceutil/trace.go:171","msg":"trace[1636737668] transaction","detail":"{read_only:false; response_revision:264; number_of_response:1; }","duration":"147.703611ms","start":"2026-04-16T02:44:10.527153Z","end":"2026-04-16T02:44:10.674856Z","steps":["trace[1636737668] 'process raft request' (duration: 147.55699ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.159765Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.760312ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-04-16T02:44:11.159899Z","caller":"traceutil/trace.go:171","msg":"trace[219283758] linearizableReadLoop","detail":"{readStateIndex:272; appliedIndex:271; }","duration":"474.660039ms","start":"2026-04-16T02:44:10.685219Z","end":"2026-04-16T02:44:11.159879Z","steps":["trace[219283758] 'read index received' (duration: 178.213672ms)","trace[219283758] 'applied index is now lower than readState.Index' (duration: 296.444707ms)"],"step_count":2} {"level":"info","ts":"2026-04-16T02:44:11.159941Z","caller":"traceutil/trace.go:171","msg":"trace[411061473] transaction","detail":"{read_only:false; response_revision:266; number_of_response:1; }","duration":"482.557243ms","start":"2026-04-16T02:44:10.677339Z","end":"2026-04-16T02:44:11.159896Z","steps":["trace[411061473] 'process raft request' (duration: 186.081426ms)","trace[411061473] 'compare' (duration: 295.618431ms)"],"step_count":2} {"level":"warn","ts":"2026-04-16T02:44:11.160051Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"483.047808ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes/instance\" ","response":"range_response_count:1 size:664"} {"level":"info","ts":"2026-04-16T02:44:11.160104Z","caller":"traceutil/trace.go:171","msg":"trace[824967575] range","detail":"{range_begin:/registry/csinodes/instance; range_end:; response_count:1; response_revision:266; }","duration":"483.134908ms","start":"2026-04-16T02:44:10.676956Z","end":"2026-04-16T02:44:11.160091Z","steps":["trace[824967575] 'agreement among raft nodes before linearized reading' (duration: 483.006946ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.160146Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.676944Z","time spent":"483.190778ms","remote":"127.0.0.1:33462","response type":"/etcdserverpb.KV/Range","request count":0,"request size":29,"response count":1,"response size":687,"request content":"key:\"/registry/csinodes/instance\" "} {"level":"warn","ts":"2026-04-16T02:44:11.160267Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.677325Z","time spent":"482.679065ms","remote":"127.0.0.1:33406","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":373,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-16T02:44:11.184223Z","caller":"traceutil/trace.go:171","msg":"trace[1076844216] transaction","detail":"{read_only:false; response_revision:267; number_of_response:1; }","duration":"496.653169ms","start":"2026-04-16T02:44:10.687544Z","end":"2026-04-16T02:44:11.184197Z","steps":["trace[1076844216] 'process raft request' (duration: 496.530218ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.184348Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.687534Z","time spent":"496.758099ms","remote":"127.0.0.1:33124","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":625,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-16T02:44:11.184442Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"496.84201ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:4017"} {"level":"info","ts":"2026-04-16T02:44:11.184295Z","caller":"traceutil/trace.go:171","msg":"trace[83145716] transaction","detail":"{read_only:false; number_of_response:0; response_revision:267; }","duration":"419.109493ms","start":"2026-04-16T02:44:10.765153Z","end":"2026-04-16T02:44:11.184262Z","steps":["trace[83145716] 'process raft request' (duration: 419.012552ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:11.184505Z","caller":"traceutil/trace.go:171","msg":"trace[977077316] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:271; }","duration":"496.94943ms","start":"2026-04-16T02:44:10.687543Z","end":"2026-04-16T02:44:11.184492Z","steps":["trace[977077316] 'agreement among raft nodes before linearized reading' (duration: 496.83097ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:11.184555Z","caller":"traceutil/trace.go:171","msg":"trace[833967574] transaction","detail":"{read_only:false; response_revision:271; number_of_response:1; }","duration":"395.330709ms","start":"2026-04-16T02:44:10.789195Z","end":"2026-04-16T02:44:11.184525Z","steps":["trace[833967574] 'process raft request' (duration: 395.146598ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.18455Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.687528Z","time spent":"497.014891ms","remote":"127.0.0.1:33200","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":1,"response size":4040,"request content":"key:\"/registry/minions/instance\" "} {"level":"info","ts":"2026-04-16T02:44:11.184634Z","caller":"traceutil/trace.go:171","msg":"trace[799032215] transaction","detail":"{read_only:false; response_revision:268; number_of_response:1; }","duration":"397.817296ms","start":"2026-04-16T02:44:10.78679Z","end":"2026-04-16T02:44:11.184607Z","steps":["trace[799032215] 'process raft request' (duration: 397.408484ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.184651Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.789176Z","time spent":"395.438269ms","remote":"127.0.0.1:33208","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5498,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-16T02:44:11.184718Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.786772Z","time spent":"397.908277ms","remote":"127.0.0.1:33208","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3965,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-16T02:44:11.184754Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.765127Z","time spent":"419.382785ms","remote":"127.0.0.1:33200","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":28,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-16T02:44:11.184817Z","caller":"traceutil/trace.go:171","msg":"trace[174035903] transaction","detail":"{read_only:false; response_revision:269; number_of_response:1; }","duration":"397.800977ms","start":"2026-04-16T02:44:10.787006Z","end":"2026-04-16T02:44:11.184807Z","steps":["trace[174035903] 'process raft request' (duration: 397.240393ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.184866Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.786997Z","time spent":"397.849947ms","remote":"127.0.0.1:33208","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3453,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-16T02:44:11.184823Z","caller":"traceutil/trace.go:171","msg":"trace[1774392076] transaction","detail":"{read_only:false; response_revision:270; number_of_response:1; }","duration":"396.318615ms","start":"2026-04-16T02:44:10.788421Z","end":"2026-04-16T02:44:11.18474Z","steps":["trace[1774392076] 'process raft request' (duration: 395.878772ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:11.184421Z","caller":"traceutil/trace.go:171","msg":"trace[105402510] transaction","detail":"{read_only:false; number_of_response:0; response_revision:269; }","duration":"397.186802ms","start":"2026-04-16T02:44:10.787217Z","end":"2026-04-16T02:44:11.184404Z","steps":["trace[105402510] 'process raft request' (duration: 397.057891ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.185111Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.787207Z","time spent":"397.849076ms","remote":"127.0.0.1:33208","response type":"/etcdserverpb.KV/Txn","request count":0,"request size":0,"response count":0,"response size":28,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-04-16T02:44:11.18523Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:10.78839Z","time spent":"396.644928ms","remote":"127.0.0.1:33208","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2905,"response count":0,"response size":39,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-04-16T02:44:11.350955Z","caller":"traceutil/trace.go:171","msg":"trace[1231568474] transaction","detail":"{read_only:false; response_revision:275; number_of_response:1; }","duration":"161.076082ms","start":"2026-04-16T02:44:11.189861Z","end":"2026-04-16T02:44:11.350937Z","steps":["trace[1231568474] 'process raft request' (duration: 161.045362ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:11.351152Z","caller":"traceutil/trace.go:171","msg":"trace[237985406] linearizableReadLoop","detail":"{readStateIndex:280; appliedIndex:279; }","duration":"164.304944ms","start":"2026-04-16T02:44:11.186798Z","end":"2026-04-16T02:44:11.351103Z","steps":["trace[237985406] 'read index received' (duration: 160.613538ms)","trace[237985406] 'applied index is now lower than readState.Index' (duration: 3.689656ms)"],"step_count":2} {"level":"info","ts":"2026-04-16T02:44:11.351188Z","caller":"traceutil/trace.go:171","msg":"trace[796067112] transaction","detail":"{read_only:false; response_revision:273; number_of_response:1; }","duration":"162.477221ms","start":"2026-04-16T02:44:11.188678Z","end":"2026-04-16T02:44:11.351155Z","steps":["trace[796067112] 'process raft request' (duration: 162.155289ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.351295Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"164.478885ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-apiserver-instance\" ","response":"range_response_count:1 size:5895"} {"level":"info","ts":"2026-04-16T02:44:11.351735Z","caller":"traceutil/trace.go:171","msg":"trace[2072753352] range","detail":"{range_begin:/registry/pods/kube-system/kube-apiserver-instance; range_end:; response_count:1; response_revision:275; }","duration":"164.982008ms","start":"2026-04-16T02:44:11.186735Z","end":"2026-04-16T02:44:11.351717Z","steps":["trace[2072753352] 'agreement among raft nodes before linearized reading' (duration: 164.442184ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:11.351333Z","caller":"traceutil/trace.go:171","msg":"trace[1745096736] transaction","detail":"{read_only:false; response_revision:272; number_of_response:1; }","duration":"187.345191ms","start":"2026-04-16T02:44:11.163978Z","end":"2026-04-16T02:44:11.351323Z","steps":["trace[1745096736] 'process raft request' (duration: 183.310273ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:11.3513Z","caller":"traceutil/trace.go:171","msg":"trace[1861161297] transaction","detail":"{read_only:false; response_revision:274; number_of_response:1; }","duration":"161.520975ms","start":"2026-04-16T02:44:11.189745Z","end":"2026-04-16T02:44:11.351266Z","steps":["trace[1861161297] 'process raft request' (duration: 161.125712ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:11.352477Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"165.18445ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:4017"} {"level":"info","ts":"2026-04-16T02:44:11.352535Z","caller":"traceutil/trace.go:171","msg":"trace[160721263] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:275; }","duration":"165.29175ms","start":"2026-04-16T02:44:11.187227Z","end":"2026-04-16T02:44:11.352518Z","steps":["trace[160721263] 'agreement among raft nodes before linearized reading' (duration: 165.030158ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:41.150959Z","caller":"traceutil/trace.go:171","msg":"trace[2005034319] transaction","detail":"{read_only:false; response_revision:610; number_of_response:1; }","duration":"238.743906ms","start":"2026-04-16T02:44:40.912176Z","end":"2026-04-16T02:44:41.15092Z","steps":["trace[2005034319] 'process raft request' (duration: 238.126602ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:42.010823Z","caller":"traceutil/trace.go:171","msg":"trace[1685331787] linearizableReadLoop","detail":"{readStateIndex:635; appliedIndex:634; }","duration":"223.69971ms","start":"2026-04-16T02:44:41.787095Z","end":"2026-04-16T02:44:42.010794Z","steps":["trace[1685331787] 'read index received' (duration: 222.782856ms)","trace[1685331787] 'applied index is now lower than readState.Index' (duration: 915.744µs)"],"step_count":2} {"level":"info","ts":"2026-04-16T02:44:42.010919Z","caller":"traceutil/trace.go:171","msg":"trace[1325110974] transaction","detail":"{read_only:false; response_revision:616; number_of_response:1; }","duration":"363.665608ms","start":"2026-04-16T02:44:41.647224Z","end":"2026-04-16T02:44:42.01089Z","steps":["trace[1325110974] 'process raft request' (duration: 362.922274ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:42.011863Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:41.647202Z","time spent":"363.781809ms","remote":"127.0.0.1:33140","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036289,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-04-16T02:44:42.012353Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"225.258509ms","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-04-16T02:44:42.012422Z","caller":"traceutil/trace.go:171","msg":"trace[1489685562] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:616; }","duration":"225.34741ms","start":"2026-04-16T02:44:41.787039Z","end":"2026-04-16T02:44:42.012386Z","steps":["trace[1489685562] 'agreement among raft nodes before linearized reading' (duration: 223.884671ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:42.034495Z","caller":"traceutil/trace.go:171","msg":"trace[1444302252] transaction","detail":"{read_only:false; response_revision:617; number_of_response:1; }","duration":"194.355192ms","start":"2026-04-16T02:44:41.840111Z","end":"2026-04-16T02:44:42.034466Z","steps":["trace[1444302252] 'process raft request' (duration: 194.140831ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:42.034547Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"235.526685ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-lpsc9\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-04-16T02:44:42.034575Z","caller":"traceutil/trace.go:171","msg":"trace[24684909] range","detail":"{range_begin:/registry/pods/kube-system/cilium-lpsc9; range_end:; response_count:1; response_revision:617; }","duration":"235.606805ms","start":"2026-04-16T02:44:41.79896Z","end":"2026-04-16T02:44:42.034567Z","steps":["trace[24684909] 'agreement among raft nodes before linearized reading' (duration: 235.448034ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:42.0347Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"108.455587ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-04-16T02:44:42.034749Z","caller":"traceutil/trace.go:171","msg":"trace[738979073] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:617; }","duration":"108.556367ms","start":"2026-04-16T02:44:41.926178Z","end":"2026-04-16T02:44:42.034734Z","steps":["trace[738979073] 'agreement among raft nodes before linearized reading' (duration: 108.442527ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:42.034683Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"106.319405ms","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-04-16T02:44:42.034894Z","caller":"traceutil/trace.go:171","msg":"trace[413193423] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:617; }","duration":"106.554647ms","start":"2026-04-16T02:44:41.928322Z","end":"2026-04-16T02:44:42.034876Z","steps":["trace[413193423] 'agreement among raft nodes before linearized reading' (duration: 106.219455ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:42.23936Z","caller":"traceutil/trace.go:171","msg":"trace[134100942] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"218.073425ms","start":"2026-04-16T02:44:42.021258Z","end":"2026-04-16T02:44:42.239332Z","steps":["trace[134100942] 'process raft request' (duration: 123.707486ms)","trace[134100942] 'compare' (duration: 94.214539ms)"],"step_count":2} {"level":"info","ts":"2026-04-16T02:44:42.240857Z","caller":"traceutil/trace.go:171","msg":"trace[1413074151] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"198.909002ms","start":"2026-04-16T02:44:42.041924Z","end":"2026-04-16T02:44:42.240833Z","steps":["trace[1413074151] 'process raft request' (duration: 198.289838ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:42.241185Z","caller":"traceutil/trace.go:171","msg":"trace[1460794147] transaction","detail":"{read_only:false; response_revision:620; number_of_response:1; }","duration":"198.821431ms","start":"2026-04-16T02:44:42.042337Z","end":"2026-04-16T02:44:42.241159Z","steps":["trace[1460794147] 'process raft request' (duration: 197.967196ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:42.241213Z","caller":"traceutil/trace.go:171","msg":"trace[2066278442] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"166.549587ms","start":"2026-04-16T02:44:42.074589Z","end":"2026-04-16T02:44:42.241138Z","steps":["trace[2066278442] 'process raft request' (duration: 165.867693ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:42.241365Z","caller":"traceutil/trace.go:171","msg":"trace[1551525143] transaction","detail":"{read_only:false; response_revision:621; number_of_response:1; }","duration":"190.549416ms","start":"2026-04-16T02:44:42.050783Z","end":"2026-04-16T02:44:42.241332Z","steps":["trace[1551525143] 'process raft request' (duration: 189.628441ms)"],"step_count":1} {"level":"info","ts":"2026-04-16T02:44:59.101214Z","caller":"traceutil/trace.go:171","msg":"trace[1340811613] linearizableReadLoop","detail":"{readStateIndex:808; appliedIndex:807; }","duration":"188.434469ms","start":"2026-04-16T02:44:58.912754Z","end":"2026-04-16T02:44:59.101188Z","steps":["trace[1340811613] 'read index received' (duration: 188.22932ms)","trace[1340811613] 'applied index is now lower than readState.Index' (duration: 204.189µs)"],"step_count":2} {"level":"info","ts":"2026-04-16T02:44:59.101499Z","caller":"traceutil/trace.go:171","msg":"trace[123394169] transaction","detail":"{read_only:false; response_revision:785; number_of_response:1; }","duration":"405.542477ms","start":"2026-04-16T02:44:58.69581Z","end":"2026-04-16T02:44:59.101352Z","steps":["trace[123394169] 'process raft request' (duration: 405.138579ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:59.101792Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.209788ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.19.213.177\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-04-16T02:44:59.101915Z","caller":"traceutil/trace.go:171","msg":"trace[751375810] range","detail":"{range_begin:/registry/masterleases/199.19.213.177; range_end:; response_count:1; response_revision:785; }","duration":"107.397495ms","start":"2026-04-16T02:44:58.994458Z","end":"2026-04-16T02:44:59.101856Z","steps":["trace[751375810] 'agreement among raft nodes before linearized reading' (duration: 107.133214ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:59.101524Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"188.741572ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-lqlvg\" ","response":"range_response_count:1 size:3965"} {"level":"info","ts":"2026-04-16T02:44:59.102201Z","caller":"traceutil/trace.go:171","msg":"trace[1527076175] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-lqlvg; range_end:; response_count:1; response_revision:785; }","duration":"189.452063ms","start":"2026-04-16T02:44:58.91273Z","end":"2026-04-16T02:44:59.102182Z","steps":["trace[1527076175] 'agreement among raft nodes before linearized reading' (duration: 188.612866ms)"],"step_count":1} {"level":"warn","ts":"2026-04-16T02:44:59.101985Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-04-16T02:44:58.695775Z","time spent":"405.924763ms","remote":"127.0.0.1:33314","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":673,"response count":0,"response size":39,"request content":"compare: success:> failure: >"}