{"level":"warn","ts":"2026-10-16T00:01:59.12882Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-10-16T00:01:59.128923Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.148:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://162.253.55.148:2380","--initial-cluster=instance=https://162.253.55.148:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.148:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.148:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-10-16T00:01:59.129013Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-10-16T00:01:59.12903Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.148:2380"]} {"level":"info","ts":"2026-10-16T00:01:59.129053Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-10-16T00:01:59.129875Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.148:2379"]} {"level":"info","ts":"2026-10-16T00:01:59.129965Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://162.253.55.148:2380"],"listen-peer-urls":["https://162.253.55.148:2380"],"advertise-client-urls":["https://162.253.55.148:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.148:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.148:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-10-16T00:01:59.217552Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"69.137588ms"} {"level":"info","ts":"2026-10-16T00:01:59.254799Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"a6342599e225e01b","cluster-id":"8ad3da7aa894cc05"} {"level":"info","ts":"2026-10-16T00:01:59.254889Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b switched to configuration voters=()"} {"level":"info","ts":"2026-10-16T00:01:59.254912Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b became follower at term 0"} {"level":"info","ts":"2026-10-16T00:01:59.254921Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft a6342599e225e01b [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-10-16T00:01:59.254933Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b became follower at term 1"} {"level":"info","ts":"2026-10-16T00:01:59.254969Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b switched to configuration voters=(11976238651939348507)"} {"level":"warn","ts":"2026-10-16T00:01:59.283832Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-10-16T00:01:59.290339Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-10-16T00:01:59.292897Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-10-16T00:01:59.298394Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"a6342599e225e01b","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-10-16T00:01:59.30088Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-10-16T00:01:59.301056Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"a6342599e225e01b","initial-advertise-peer-urls":["https://162.253.55.148:2380"],"listen-peer-urls":["https://162.253.55.148:2380"],"advertise-client-urls":["https://162.253.55.148:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.148:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-10-16T00:01:59.301084Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-10-16T00:01:59.301216Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"a6342599e225e01b","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-10-16T00:01:59.30134Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-10-16T00:01:59.301374Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-10-16T00:01:59.301383Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-10-16T00:01:59.302227Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.148:2380"} {"level":"info","ts":"2026-10-16T00:01:59.302343Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.148:2380"} {"level":"info","ts":"2026-10-16T00:01:59.303167Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b switched to configuration voters=(11976238651939348507)"} {"level":"info","ts":"2026-10-16T00:01:59.30326Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"8ad3da7aa894cc05","local-member-id":"a6342599e225e01b","added-peer-id":"a6342599e225e01b","added-peer-peer-urls":["https://162.253.55.148:2380"]} {"level":"info","ts":"2026-10-16T00:01:59.655314Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b is starting a new election at term 1"} {"level":"info","ts":"2026-10-16T00:01:59.6554Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b became pre-candidate at term 1"} {"level":"info","ts":"2026-10-16T00:01:59.655437Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b received MsgPreVoteResp from a6342599e225e01b at term 1"} {"level":"info","ts":"2026-10-16T00:01:59.655483Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b became candidate at term 2"} {"level":"info","ts":"2026-10-16T00:01:59.655513Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b received MsgVoteResp from a6342599e225e01b at term 2"} {"level":"info","ts":"2026-10-16T00:01:59.655537Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"a6342599e225e01b became leader at term 2"} {"level":"info","ts":"2026-10-16T00:01:59.655561Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: a6342599e225e01b elected leader a6342599e225e01b at term 2"} {"level":"info","ts":"2026-10-16T00:01:59.666376Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-10-16T00:01:59.668002Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"8ad3da7aa894cc05","local-member-id":"a6342599e225e01b","cluster-version":"3.5"} {"level":"info","ts":"2026-10-16T00:01:59.668118Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-10-16T00:01:59.668164Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-10-16T00:01:59.668193Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-10-16T00:01:59.668203Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-10-16T00:01:59.668241Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"a6342599e225e01b","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.148:2379]}","request-path":"/0/members/a6342599e225e01b/attributes","cluster-id":"8ad3da7aa894cc05","publish-timeout":"7s"} {"level":"info","ts":"2026-10-16T00:01:59.668425Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-10-16T00:01:59.668468Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-10-16T00:01:59.670385Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.148:2379"} {"level":"info","ts":"2026-10-16T00:01:59.672166Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-10-16T00:02:05.227066Z","caller":"traceutil/trace.go:171","msg":"trace[1714082105] transaction","detail":"{read_only:false; response_revision:256; number_of_response:1; }","duration":"142.386176ms","start":"2026-10-16T00:02:05.084642Z","end":"2026-10-16T00:02:05.227028Z","steps":["trace[1714082105] 'process raft request' (duration: 58.284617ms)","trace[1714082105] 'compare' (duration: 83.718589ms)"],"step_count":2} {"level":"info","ts":"2026-10-16T00:02:05.231192Z","caller":"traceutil/trace.go:171","msg":"trace[869087757] transaction","detail":"{read_only:false; response_revision:257; number_of_response:1; }","duration":"145.019906ms","start":"2026-10-16T00:02:05.086129Z","end":"2026-10-16T00:02:05.231149Z","steps":["trace[869087757] 'process raft request' (duration: 144.788589ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:05.231333Z","caller":"traceutil/trace.go:171","msg":"trace[170488193] transaction","detail":"{read_only:false; number_of_response:0; response_revision:256; }","duration":"145.451397ms","start":"2026-10-16T00:02:05.08586Z","end":"2026-10-16T00:02:05.231311Z","steps":["trace[170488193] 'process raft request' (duration: 145.015325ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:05.231195Z","caller":"traceutil/trace.go:171","msg":"trace[455392605] linearizableReadLoop","detail":"{readStateIndex:264; appliedIndex:262; }","duration":"146.258188ms","start":"2026-10-16T00:02:05.084918Z","end":"2026-10-16T00:02:05.231176Z","steps":["trace[455392605] 'read index received' (duration: 58.02284ms)","trace[455392605] 'applied index is now lower than readState.Index' (duration: 88.234408ms)"],"step_count":2} {"level":"info","ts":"2026-10-16T00:02:05.231444Z","caller":"traceutil/trace.go:171","msg":"trace[1209010332] transaction","detail":"{read_only:false; number_of_response:0; response_revision:258; }","duration":"145.166309ms","start":"2026-10-16T00:02:05.086271Z","end":"2026-10-16T00:02:05.231437Z","steps":["trace[1209010332] 'process raft request' (duration: 144.80208ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:05.231602Z","caller":"traceutil/trace.go:171","msg":"trace[304027491] transaction","detail":"{read_only:false; response_revision:259; number_of_response:1; }","duration":"144.283466ms","start":"2026-10-16T00:02:05.087303Z","end":"2026-10-16T00:02:05.231586Z","steps":["trace[304027491] 'process raft request' (duration: 143.797323ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:05.231621Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.806986ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-10-16T00:02:05.23168Z","caller":"traceutil/trace.go:171","msg":"trace[1920585434] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:259; }","duration":"134.898659ms","start":"2026-10-16T00:02:05.096764Z","end":"2026-10-16T00:02:05.231662Z","steps":["trace[1920585434] 'agreement among raft nodes before linearized reading' (duration: 134.778556ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:05.231362Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.421032ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:1 size:4017"} {"level":"info","ts":"2026-10-16T00:02:05.231719Z","caller":"traceutil/trace.go:171","msg":"trace[562633079] transaction","detail":"{read_only:false; number_of_response:0; response_revision:256; }","duration":"146.290719ms","start":"2026-10-16T00:02:05.084696Z","end":"2026-10-16T00:02:05.230987Z","steps":["trace[562633079] 'process raft request' (duration: 146.082754ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:05.231783Z","caller":"traceutil/trace.go:171","msg":"trace[1019472096] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:1; response_revision:259; }","duration":"146.880985ms","start":"2026-10-16T00:02:05.084882Z","end":"2026-10-16T00:02:05.231763Z","steps":["trace[1019472096] 'agreement among raft nodes before linearized reading' (duration: 146.353011ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:05.23142Z","caller":"traceutil/trace.go:171","msg":"trace[875257628] transaction","detail":"{read_only:false; response_revision:258; number_of_response:1; }","duration":"145.2127ms","start":"2026-10-16T00:02:05.086197Z","end":"2026-10-16T00:02:05.23141Z","steps":["trace[875257628] 'process raft request' (duration: 144.837211ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:05.678992Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"304.291888ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-10-16T00:02:05.679329Z","caller":"traceutil/trace.go:171","msg":"trace[656318372] linearizableReadLoop","detail":"{readStateIndex:274; appliedIndex:269; }","duration":"219.877511ms","start":"2026-10-16T00:02:05.459432Z","end":"2026-10-16T00:02:05.67931Z","steps":["trace[656318372] 'read index received' (duration: 171.375301ms)","trace[656318372] 'applied index is now lower than readState.Index' (duration: 48.50116ms)"],"step_count":2} {"level":"info","ts":"2026-10-16T00:02:05.679412Z","caller":"traceutil/trace.go:171","msg":"trace[816376122] transaction","detail":"{read_only:false; response_revision:262; number_of_response:1; }","duration":"438.641642ms","start":"2026-10-16T00:02:05.240741Z","end":"2026-10-16T00:02:05.679383Z","steps":["trace[816376122] 'process raft request' (duration: 438.443387ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:05.679639Z","caller":"traceutil/trace.go:171","msg":"trace[1290870428] transaction","detail":"{read_only:false; response_revision:263; number_of_response:1; }","duration":"435.811407ms","start":"2026-10-16T00:02:05.243812Z","end":"2026-10-16T00:02:05.679623Z","steps":["trace[1290870428] 'process raft request' (duration: 435.406476ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:05.679797Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:05.240728Z","time spent":"438.789276ms","remote":"127.0.0.1:41966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":421,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-16T00:02:05.679945Z","caller":"traceutil/trace.go:171","msg":"trace[2000289509] transaction","detail":"{read_only:false; response_revision:264; number_of_response:1; }","duration":"411.985689ms","start":"2026-10-16T00:02:05.267941Z","end":"2026-10-16T00:02:05.679927Z","steps":["trace[2000289509] 'process raft request' (duration: 411.332622ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:05.679945Z","caller":"traceutil/trace.go:171","msg":"trace[1980392506] transaction","detail":"{read_only:false; response_revision:260; number_of_response:1; }","duration":"444.779084ms","start":"2026-10-16T00:02:05.235102Z","end":"2026-10-16T00:02:05.679881Z","steps":["trace[1980392506] 'process raft request' (duration: 139.008787ms)","trace[1980392506] 'compare' (duration: 303.59895ms)"],"step_count":2} {"level":"info","ts":"2026-10-16T00:02:05.680018Z","caller":"traceutil/trace.go:171","msg":"trace[1272207894] transaction","detail":"{read_only:false; response_revision:261; number_of_response:1; }","duration":"439.67908ms","start":"2026-10-16T00:02:05.240309Z","end":"2026-10-16T00:02:05.679988Z","steps":["trace[1272207894] 'process raft request' (duration: 438.794906ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:05.680078Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:05.267914Z","time spent":"412.093501ms","remote":"127.0.0.1:41914","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":170,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-16T00:02:05.680113Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:05.240282Z","time spent":"439.784822ms","remote":"127.0.0.1:41966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":417,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-16T00:02:05.679468Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"220.037025ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-10-16T00:02:05.680168Z","caller":"traceutil/trace.go:171","msg":"trace[1671640167] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:0; response_revision:264; }","duration":"220.780254ms","start":"2026-10-16T00:02:05.459375Z","end":"2026-10-16T00:02:05.680155Z","steps":["trace[1671640167] 'agreement among raft nodes before linearized reading' (duration: 219.990913ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:05.680013Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:05.243797Z","time spent":"435.877219ms","remote":"127.0.0.1:41886","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4183,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-10-16T00:02:05.680219Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:05.235082Z","time spent":"444.99501ms","remote":"127.0.0.1:41914","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":201,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-10-16T00:02:06.243287Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"228.080785ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-10-16T00:02:06.243435Z","caller":"traceutil/trace.go:171","msg":"trace[1833158827] transaction","detail":"{read_only:false; response_revision:265; number_of_response:1; }","duration":"558.116672ms","start":"2026-10-16T00:02:05.685287Z","end":"2026-10-16T00:02:06.243404Z","steps":["trace[1833158827] 'process raft request' (duration: 329.836552ms)","trace[1833158827] 'compare' (duration: 227.937701ms)"],"step_count":2} {"level":"warn","ts":"2026-10-16T00:02:06.24353Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:05.685256Z","time spent":"558.220465ms","remote":"127.0.0.1:42068","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":420,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-16T00:02:06.246548Z","caller":"traceutil/trace.go:171","msg":"trace[1854691353] transaction","detail":"{read_only:false; response_revision:266; number_of_response:1; }","duration":"559.56752ms","start":"2026-10-16T00:02:05.686908Z","end":"2026-10-16T00:02:06.246475Z","steps":["trace[1854691353] 'process raft request' (duration: 559.236941ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:06.246767Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:05.686807Z","time spent":"559.819317ms","remote":"127.0.0.1:41966","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-10-16T00:02:06.246828Z","caller":"traceutil/trace.go:171","msg":"trace[839381314] transaction","detail":"{read_only:false; number_of_response:0; response_revision:266; }","duration":"240.559705ms","start":"2026-10-16T00:02:06.006236Z","end":"2026-10-16T00:02:06.246796Z","steps":["trace[839381314] 'process raft request' (duration: 240.00047ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:06.247426Z","caller":"traceutil/trace.go:171","msg":"trace[1126331806] linearizableReadLoop","detail":"{readStateIndex:276; appliedIndex:274; }","duration":"559.998781ms","start":"2026-10-16T00:02:05.687397Z","end":"2026-10-16T00:02:06.247396Z","steps":["trace[1126331806] 'read index received' (duration: 327.829338ms)","trace[1126331806] 'applied index is now lower than readState.Index' (duration: 232.167583ms)"],"step_count":2} {"level":"info","ts":"2026-10-16T00:02:06.24747Z","caller":"traceutil/trace.go:171","msg":"trace[2043702666] transaction","detail":"{read_only:false; number_of_response:0; response_revision:266; }","duration":"238.421628ms","start":"2026-10-16T00:02:06.009032Z","end":"2026-10-16T00:02:06.247454Z","steps":["trace[2043702666] 'process raft request' (duration: 238.264194ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:06.247675Z","caller":"traceutil/trace.go:171","msg":"trace[1464000702] transaction","detail":"{read_only:false; number_of_response:0; response_revision:266; }","duration":"238.696315ms","start":"2026-10-16T00:02:06.008966Z","end":"2026-10-16T00:02:06.247663Z","steps":["trace[1464000702] 'process raft request' (duration: 237.458193ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:06.247729Z","caller":"traceutil/trace.go:171","msg":"trace[904202262] transaction","detail":"{read_only:false; number_of_response:0; response_revision:266; }","duration":"236.474657ms","start":"2026-10-16T00:02:06.011246Z","end":"2026-10-16T00:02:06.24772Z","steps":["trace[904202262] 'process raft request' (duration: 236.116048ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:06.24769Z","caller":"traceutil/trace.go:171","msg":"trace[639410188] transaction","detail":"{read_only:false; number_of_response:0; response_revision:266; }","duration":"238.016467ms","start":"2026-10-16T00:02:06.009657Z","end":"2026-10-16T00:02:06.247674Z","steps":["trace[639410188] 'process raft request' (duration: 237.677578ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:06.248094Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"560.686719ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/generic-garbage-collector\" ","response":"range_response_count:1 size:216"} {"level":"warn","ts":"2026-10-16T00:02:06.248364Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"239.515897ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-scheduler-instance\" ","response":"range_response_count:1 size:2918"} {"level":"info","ts":"2026-10-16T00:02:06.248422Z","caller":"traceutil/trace.go:171","msg":"trace[398756883] range","detail":"{range_begin:/registry/pods/kube-system/kube-scheduler-instance; range_end:; response_count:1; response_revision:266; }","duration":"239.64222ms","start":"2026-10-16T00:02:06.008766Z","end":"2026-10-16T00:02:06.248408Z","steps":["trace[398756883] 'agreement among raft nodes before linearized reading' (duration: 239.455875ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:06.248922Z","caller":"traceutil/trace.go:171","msg":"trace[2071111941] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/generic-garbage-collector; range_end:; response_count:1; response_revision:266; }","duration":"560.800433ms","start":"2026-10-16T00:02:05.687344Z","end":"2026-10-16T00:02:06.248144Z","steps":["trace[2071111941] 'agreement among raft nodes before linearized reading' (duration: 560.555047ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:06.248992Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:05.687326Z","time spent":"561.648695ms","remote":"127.0.0.1:41914","response type":"/etcdserverpb.KV/Range","request count":0,"request size":65,"response count":1,"response size":240,"request content":"key:\"/registry/serviceaccounts/kube-system/generic-garbage-collector\" "} {"level":"warn","ts":"2026-10-16T00:02:48.566824Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"195.540003ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-10-16T00:02:49.196079Z","caller":"traceutil/trace.go:171","msg":"trace[1332028654] transaction","detail":"{read_only:false; response_revision:544; number_of_response:1; }","duration":"108.630285ms","start":"2026-10-16T00:02:49.087418Z","end":"2026-10-16T00:02:49.196048Z","steps":["trace[1332028654] 'process raft request' (duration: 57.47309ms)","trace[1332028654] 'compare' (duration: 51.027551ms)"],"step_count":2} {"level":"info","ts":"2026-10-16T00:02:49.209781Z","caller":"traceutil/trace.go:171","msg":"trace[121102125] transaction","detail":"{read_only:false; response_revision:546; number_of_response:1; }","duration":"100.157764ms","start":"2026-10-16T00:02:49.109573Z","end":"2026-10-16T00:02:49.209731Z","steps":["trace[121102125] 'process raft request' (duration: 100.119863ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:49.210028Z","caller":"traceutil/trace.go:171","msg":"trace[2013639124] transaction","detail":"{read_only:false; response_revision:545; number_of_response:1; }","duration":"120.909345ms","start":"2026-10-16T00:02:49.089089Z","end":"2026-10-16T00:02:49.209999Z","steps":["trace[2013639124] 'process raft request' (duration: 120.474843ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:49.381712Z","caller":"traceutil/trace.go:171","msg":"trace[1103228952] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"165.302632ms","start":"2026-10-16T00:02:49.216357Z","end":"2026-10-16T00:02:49.381659Z","steps":["trace[1103228952] 'process raft request' (duration: 130.842922ms)","trace[1103228952] 'compare' (duration: 34.281835ms)"],"step_count":2} {"level":"info","ts":"2026-10-16T00:02:49.382039Z","caller":"traceutil/trace.go:171","msg":"trace[1710065589] transaction","detail":"{read_only:false; response_revision:549; number_of_response:1; }","duration":"108.508932ms","start":"2026-10-16T00:02:49.273499Z","end":"2026-10-16T00:02:49.382008Z","steps":["trace[1710065589] 'process raft request' (duration: 108.239665ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:49.382231Z","caller":"traceutil/trace.go:171","msg":"trace[553958428] transaction","detail":"{read_only:false; response_revision:550; number_of_response:1; }","duration":"100.43583ms","start":"2026-10-16T00:02:49.281704Z","end":"2026-10-16T00:02:49.38214Z","steps":["trace[553958428] 'process raft request' (duration: 100.161163ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:49.382383Z","caller":"traceutil/trace.go:171","msg":"trace[1720429585] transaction","detail":"{read_only:false; response_revision:551; number_of_response:1; }","duration":"100.055601ms","start":"2026-10-16T00:02:49.2823Z","end":"2026-10-16T00:02:49.382356Z","steps":["trace[1720429585] 'process raft request' (duration: 99.620459ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:49.578868Z","caller":"traceutil/trace.go:171","msg":"trace[1924628601] transaction","detail":"{read_only:false; response_revision:555; number_of_response:1; }","duration":"133.449652ms","start":"2026-10-16T00:02:49.445387Z","end":"2026-10-16T00:02:49.578837Z","steps":["trace[1924628601] 'process raft request' (duration: 81.367743ms)","trace[1924628601] 'compare' (duration: 51.969046ms)"],"step_count":2} {"level":"info","ts":"2026-10-16T00:02:49.591869Z","caller":"traceutil/trace.go:171","msg":"trace[985688315] transaction","detail":"{read_only:false; response_revision:556; number_of_response:1; }","duration":"112.823103ms","start":"2026-10-16T00:02:49.479012Z","end":"2026-10-16T00:02:49.591835Z","steps":["trace[985688315] 'process raft request' (duration: 112.588407ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:55.257866Z","caller":"traceutil/trace.go:171","msg":"trace[571937735] linearizableReadLoop","detail":"{readStateIndex:650; appliedIndex:649; }","duration":"133.858669ms","start":"2026-10-16T00:02:55.123982Z","end":"2026-10-16T00:02:55.257841Z","steps":["trace[571937735] 'read index received' (duration: 133.692745ms)","trace[571937735] 'applied index is now lower than readState.Index' (duration: 165.134µs)"],"step_count":2} {"level":"warn","ts":"2026-10-16T00:02:55.258085Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"134.086975ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-gtbkv\" ","response":"range_response_count:1 size:16965"} {"level":"info","ts":"2026-10-16T00:02:55.258116Z","caller":"traceutil/trace.go:171","msg":"trace[1170293905] range","detail":"{range_begin:/registry/pods/kube-system/cilium-gtbkv; range_end:; response_count:1; response_revision:620; }","duration":"134.170057ms","start":"2026-10-16T00:02:55.123934Z","end":"2026-10-16T00:02:55.258105Z","steps":["trace[1170293905] 'agreement among raft nodes before linearized reading' (duration: 133.999243ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:55.25824Z","caller":"traceutil/trace.go:171","msg":"trace[2142120463] transaction","detail":"{read_only:false; response_revision:620; number_of_response:1; }","duration":"270.995714ms","start":"2026-10-16T00:02:54.987206Z","end":"2026-10-16T00:02:55.258202Z","steps":["trace[2142120463] 'process raft request' (duration: 270.537422ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:56.283855Z","caller":"traceutil/trace.go:171","msg":"trace[140243846] linearizableReadLoop","detail":"{readStateIndex:652; appliedIndex:651; }","duration":"340.267808ms","start":"2026-10-16T00:02:55.943561Z","end":"2026-10-16T00:02:56.283828Z","steps":["trace[140243846] 'read index received' (duration: 339.126688ms)","trace[140243846] 'applied index is now lower than readState.Index' (duration: 1.14027ms)"],"step_count":2} {"level":"warn","ts":"2026-10-16T00:02:56.284103Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"229.517771ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-10-16T00:02:56.284138Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.412602ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-10-16T00:02:56.28418Z","caller":"traceutil/trace.go:171","msg":"trace[1138112434] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:622; }","duration":"340.648228ms","start":"2026-10-16T00:02:55.94352Z","end":"2026-10-16T00:02:56.284169Z","steps":["trace[1138112434] 'agreement among raft nodes before linearized reading' (duration: 340.416652ms)"],"step_count":1} {"level":"info","ts":"2026-10-16T00:02:56.284185Z","caller":"traceutil/trace.go:171","msg":"trace[1191567635] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:622; }","duration":"229.622795ms","start":"2026-10-16T00:02:56.054542Z","end":"2026-10-16T00:02:56.284165Z","steps":["trace[1191567635] 'agreement among raft nodes before linearized reading' (duration: 229.496451ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:56.284191Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"340.34513ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:432"} {"level":"info","ts":"2026-10-16T00:02:56.284243Z","caller":"traceutil/trace.go:171","msg":"trace[1032443011] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:622; }","duration":"340.416412ms","start":"2026-10-16T00:02:55.943812Z","end":"2026-10-16T00:02:56.284228Z","steps":["trace[1032443011] 'agreement among raft nodes before linearized reading' (duration: 340.154845ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:56.284284Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:55.943805Z","time spent":"340.468973ms","remote":"127.0.0.1:41966","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":"warn","ts":"2026-10-16T00:02:56.284389Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:55.943504Z","time spent":"340.808952ms","remote":"127.0.0.1:41966","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-10-16T00:02:56.284595Z","caller":"traceutil/trace.go:171","msg":"trace[478204432] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"560.097487ms","start":"2026-10-16T00:02:55.723794Z","end":"2026-10-16T00:02:56.283892Z","steps":["trace[478204432] 'process raft request' (duration: 559.198404ms)"],"step_count":1} {"level":"warn","ts":"2026-10-16T00:02:56.286162Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-16T00:02:55.723772Z","time spent":"560.897499ms","remote":"127.0.0.1:41808","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036285,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-10-16T00:03:12.414843Z","caller":"traceutil/trace.go:171","msg":"trace[863975895] transaction","detail":"{read_only:false; response_revision:782; number_of_response:1; }","duration":"179.027245ms","start":"2026-10-16T00:03:12.235785Z","end":"2026-10-16T00:03:12.414812Z","steps":["trace[863975895] 'process raft request' (duration: 178.84317ms)"],"step_count":1}