{"level":"warn","ts":"2026-06-04T06:23:47.195837Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-04T06:23:47.196013Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.115: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.115:2380","--initial-cluster=instance=https://199.204.45.115:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.115:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.115: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-06-04T06:23:47.19629Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-04T06:23:47.196315Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.115:2380"]} {"level":"info","ts":"2026-06-04T06:23:47.196344Z","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-06-04T06:23:47.197522Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.115:2379"]} {"level":"info","ts":"2026-06-04T06:23:47.197771Z","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.115:2380"],"listen-peer-urls":["https://199.204.45.115:2380"],"advertise-client-urls":["https://199.204.45.115:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.115:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.115: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-06-04T06:23:47.202778Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.596384ms"} {"level":"info","ts":"2026-06-04T06:23:47.212551Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"e3aaa5c123e150e0","cluster-id":"61ec519698823541"} {"level":"info","ts":"2026-06-04T06:23:47.212678Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 switched to configuration voters=()"} {"level":"info","ts":"2026-06-04T06:23:47.212703Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 became follower at term 0"} {"level":"info","ts":"2026-06-04T06:23:47.212729Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft e3aaa5c123e150e0 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-06-04T06:23:47.212798Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 became follower at term 1"} {"level":"info","ts":"2026-06-04T06:23:47.212863Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 switched to configuration voters=(16405106841599693024)"} {"level":"warn","ts":"2026-06-04T06:23:47.2186Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-06-04T06:23:47.220121Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-06-04T06:23:47.221667Z","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-06-04T06:23:47.224591Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"e3aaa5c123e150e0","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-06-04T06:23:47.224725Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"e3aaa5c123e150e0","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-06-04T06:23:47.225077Z","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-06-04T06:23:47.225203Z","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-06-04T06:23:47.225296Z","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-06-04T06:23:47.230026Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 switched to configuration voters=(16405106841599693024)"} {"level":"info","ts":"2026-06-04T06:23:47.230147Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"61ec519698823541","local-member-id":"e3aaa5c123e150e0","added-peer-id":"e3aaa5c123e150e0","added-peer-peer-urls":["https://199.204.45.115:2380"]} {"level":"info","ts":"2026-06-04T06:23:47.231366Z","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-06-04T06:23:47.231618Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.115:2380"} {"level":"info","ts":"2026-06-04T06:23:47.231642Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.115:2380"} {"level":"info","ts":"2026-06-04T06:23:47.232094Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"e3aaa5c123e150e0","initial-advertise-peer-urls":["https://199.204.45.115:2380"],"listen-peer-urls":["https://199.204.45.115:2380"],"advertise-client-urls":["https://199.204.45.115:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.115:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-06-04T06:23:47.232123Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-06-04T06:23:47.51371Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 is starting a new election at term 1"} {"level":"info","ts":"2026-06-04T06:23:47.513775Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 became pre-candidate at term 1"} {"level":"info","ts":"2026-06-04T06:23:47.513812Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 received MsgPreVoteResp from e3aaa5c123e150e0 at term 1"} {"level":"info","ts":"2026-06-04T06:23:47.513826Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 became candidate at term 2"} {"level":"info","ts":"2026-06-04T06:23:47.513833Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 received MsgVoteResp from e3aaa5c123e150e0 at term 2"} {"level":"info","ts":"2026-06-04T06:23:47.513848Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"e3aaa5c123e150e0 became leader at term 2"} {"level":"info","ts":"2026-06-04T06:23:47.513861Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: e3aaa5c123e150e0 elected leader e3aaa5c123e150e0 at term 2"} {"level":"info","ts":"2026-06-04T06:23:47.521842Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-06-04T06:23:47.526662Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"e3aaa5c123e150e0","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.115:2379]}","request-path":"/0/members/e3aaa5c123e150e0/attributes","cluster-id":"61ec519698823541","publish-timeout":"7s"} {"level":"info","ts":"2026-06-04T06:23:47.52686Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-04T06:23:47.52691Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-04T06:23:47.527299Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-06-04T06:23:47.527354Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-06-04T06:23:47.528812Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-06-04T06:23:47.529407Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"61ec519698823541","local-member-id":"e3aaa5c123e150e0","cluster-version":"3.5"} {"level":"info","ts":"2026-06-04T06:23:47.531194Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-06-04T06:23:47.531607Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.115:2379"} {"level":"info","ts":"2026-06-04T06:23:47.532026Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"warn","ts":"2026-06-04T06:24:05.503268Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5827832264722878558,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-04T06:24:05.725023Z","caller":"traceutil/trace.go:171","msg":"trace[476862089] linearizableReadLoop","detail":"{readStateIndex:384; appliedIndex:383; }","duration":"722.688735ms","start":"2026-06-04T06:24:05.002307Z","end":"2026-06-04T06:24:05.724996Z","steps":["trace[476862089] 'read index received' (duration: 722.524239ms)","trace[476862089] 'applied index is now lower than readState.Index' (duration: 163.356µs)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:24:05.725097Z","caller":"traceutil/trace.go:171","msg":"trace[407580896] transaction","detail":"{read_only:false; response_revision:374; number_of_response:1; }","duration":"740.231777ms","start":"2026-06-04T06:24:04.984832Z","end":"2026-06-04T06:24:05.725064Z","steps":["trace[407580896] 'process raft request' (duration: 739.966848ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:05.725411Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"531.847375ms","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-06-04T06:24:05.725518Z","caller":"traceutil/trace.go:171","msg":"trace[1655336296] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:374; }","duration":"532.01415ms","start":"2026-06-04T06:24:05.193481Z","end":"2026-06-04T06:24:05.725495Z","steps":["trace[1655336296] 'agreement among raft nodes before linearized reading' (duration: 531.764183ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:05.725229Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"582.997029ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"warn","ts":"2026-06-04T06:24:05.725563Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:05.193458Z","time spent":"532.096553ms","remote":"127.0.0.1:58774","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":"info","ts":"2026-06-04T06:24:05.725665Z","caller":"traceutil/trace.go:171","msg":"trace[1465368331] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:374; }","duration":"583.426373ms","start":"2026-06-04T06:24:05.142149Z","end":"2026-06-04T06:24:05.725576Z","steps":["trace[1465368331] 'agreement among raft nodes before linearized reading' (duration: 583.01293ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:05.72577Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:05.14213Z","time spent":"583.607988ms","remote":"127.0.0.1:58774","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-06-04T06:24:05.725296Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"722.940442ms","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-06-04T06:24:05.725961Z","caller":"traceutil/trace.go:171","msg":"trace[2114496554] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:374; }","duration":"723.686066ms","start":"2026-06-04T06:24:05.002264Z","end":"2026-06-04T06:24:05.72595Z","steps":["trace[2114496554] 'agreement among raft nodes before linearized reading' (duration: 722.893401ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:05.725993Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:05.002249Z","time spent":"723.734968ms","remote":"127.0.0.1:58774","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"warn","ts":"2026-06-04T06:24:05.725293Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"405.649059ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-04T06:24:05.72608Z","caller":"traceutil/trace.go:171","msg":"trace[1336337845] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:374; }","duration":"406.503796ms","start":"2026-06-04T06:24:05.319547Z","end":"2026-06-04T06:24:05.726051Z","steps":["trace[1336337845] 'agreement among raft nodes before linearized reading' (duration: 405.632899ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:05.726099Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:04.984805Z","time spent":"740.631298ms","remote":"127.0.0.1:53132","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":7288,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-04T06:24:05.72614Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:05.319523Z","time spent":"406.600699ms","remote":"127.0.0.1:52954","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-04T06:24:06.55151Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"333.101103ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-04T06:24:06.551655Z","caller":"traceutil/trace.go:171","msg":"trace[1515150200] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:374; }","duration":"333.306279ms","start":"2026-06-04T06:24:06.218328Z","end":"2026-06-04T06:24:06.551635Z","steps":["trace[1515150200] 'range keys from in-memory index tree' (duration: 333.077601ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:06.553841Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"263.049288ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-04T06:24:06.554414Z","caller":"traceutil/trace.go:171","msg":"trace[75440873] transaction","detail":"{read_only:false; response_revision:375; number_of_response:1; }","duration":"822.829949ms","start":"2026-06-04T06:24:05.731534Z","end":"2026-06-04T06:24:06.554364Z","steps":["trace[75440873] 'process raft request' (duration: 557.007394ms)","trace[75440873] 'compare' (duration: 262.871542ms)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:24:06.554574Z","caller":"traceutil/trace.go:171","msg":"trace[837390461] transaction","detail":"{read_only:false; response_revision:376; number_of_response:1; }","duration":"822.901271ms","start":"2026-06-04T06:24:05.731639Z","end":"2026-06-04T06:24:06.55454Z","steps":["trace[837390461] 'process raft request' (duration: 822.310383ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:06.554585Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:05.731508Z","time spent":"822.971563ms","remote":"127.0.0.1:58774","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-04T06:24:06.554679Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:05.731616Z","time spent":"823.005205ms","remote":"127.0.0.1:58774","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":421,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-04T06:24:06.554881Z","caller":"traceutil/trace.go:171","msg":"trace[1425274628] transaction","detail":"{read_only:false; response_revision:377; number_of_response:1; }","duration":"822.780377ms","start":"2026-06-04T06:24:05.732045Z","end":"2026-06-04T06:24:06.554825Z","steps":["trace[1425274628] 'process raft request' (duration: 822.055114ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:06.555046Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:05.732031Z","time spent":"822.926922ms","remote":"127.0.0.1:58774","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":462,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-04T06:24:06.669392Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.177364ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:28"} {"level":"info","ts":"2026-06-04T06:24:06.670015Z","caller":"traceutil/trace.go:171","msg":"trace[1470120775] transaction","detail":"{read_only:false; response_revision:378; number_of_response:1; }","duration":"924.05613ms","start":"2026-06-04T06:24:05.745874Z","end":"2026-06-04T06:24:06.66993Z","steps":["trace[1470120775] 'process raft request' (duration: 923.729891ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:06.670223Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"349.990673ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-04T06:24:06.670245Z","caller":"traceutil/trace.go:171","msg":"trace[206500599] linearizableReadLoop","detail":"{readStateIndex:389; appliedIndex:384; }","duration":"349.693863ms","start":"2026-06-04T06:24:06.320134Z","end":"2026-06-04T06:24:06.669828Z","steps":["trace[206500599] 'read index received' (duration: 194.798299ms)","trace[206500599] 'applied index is now lower than readState.Index' (duration: 154.894434ms)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:24:06.670517Z","caller":"traceutil/trace.go:171","msg":"trace[1585891613] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:378; }","duration":"350.373425ms","start":"2026-06-04T06:24:06.320079Z","end":"2026-06-04T06:24:06.670452Z","steps":["trace[1585891613] 'agreement among raft nodes before linearized reading' (duration: 349.988873ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:06.670579Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"204.836865ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-06-04T06:24:06.670618Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:06.320057Z","time spent":"350.540732ms","remote":"127.0.0.1:52948","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-04T06:24:06.670631Z","caller":"traceutil/trace.go:171","msg":"trace[2121317448] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:378; }","duration":"204.924418ms","start":"2026-06-04T06:24:06.465689Z","end":"2026-06-04T06:24:06.670613Z","steps":["trace[2121317448] 'agreement among raft nodes before linearized reading' (duration: 204.826565ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:06.67101Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:05.74586Z","time spent":"924.464353ms","remote":"127.0.0.1:53132","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":6740,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-04T06:24:24.895079Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"103.379293ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-04T06:24:24.895258Z","caller":"traceutil/trace.go:171","msg":"trace[1073127859] linearizableReadLoop","detail":"{readStateIndex:499; appliedIndex:498; }","duration":"140.285465ms","start":"2026-06-04T06:24:24.75496Z","end":"2026-06-04T06:24:24.895245Z","steps":["trace[1073127859] 'read index received' (duration: 36.593963ms)","trace[1073127859] 'applied index is now lower than readState.Index' (duration: 103.690822ms)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:24:24.895303Z","caller":"traceutil/trace.go:171","msg":"trace[1684852255] transaction","detail":"{read_only:false; response_revision:484; number_of_response:1; }","duration":"218.128226ms","start":"2026-06-04T06:24:24.677143Z","end":"2026-06-04T06:24:24.895271Z","steps":["trace[1684852255] 'process raft request' (duration: 114.492306ms)","trace[1684852255] 'compare' (duration: 103.262ms)"],"step_count":2} {"level":"warn","ts":"2026-06-04T06:24:24.895531Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"140.566343ms","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-06-04T06:24:24.895574Z","caller":"traceutil/trace.go:171","msg":"trace[978595339] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:484; }","duration":"140.646114ms","start":"2026-06-04T06:24:24.75492Z","end":"2026-06-04T06:24:24.895566Z","steps":["trace[978595339] 'agreement among raft nodes before linearized reading' (duration: 140.354767ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.965111Z","caller":"traceutil/trace.go:171","msg":"trace[1816706459] transaction","detail":"{read_only:false; response_revision:485; number_of_response:1; }","duration":"117.540298ms","start":"2026-06-04T06:24:24.847548Z","end":"2026-06-04T06:24:24.965088Z","steps":["trace[1816706459] 'process raft request' (duration: 117.455715ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.973665Z","caller":"traceutil/trace.go:171","msg":"trace[1274883917] transaction","detail":"{read_only:false; response_revision:486; number_of_response:1; }","duration":"120.18907ms","start":"2026-06-04T06:24:24.853423Z","end":"2026-06-04T06:24:24.973612Z","steps":["trace[1274883917] 'process raft request' (duration: 119.902291ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.973993Z","caller":"traceutil/trace.go:171","msg":"trace[1908977422] transaction","detail":"{read_only:false; response_revision:487; number_of_response:1; }","duration":"120.307452ms","start":"2026-06-04T06:24:24.853674Z","end":"2026-06-04T06:24:24.973982Z","steps":["trace[1908977422] 'process raft request' (duration: 119.758767ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.974248Z","caller":"traceutil/trace.go:171","msg":"trace[585772474] transaction","detail":"{read_only:false; response_revision:490; number_of_response:1; }","duration":"109.652714ms","start":"2026-06-04T06:24:24.864561Z","end":"2026-06-04T06:24:24.974213Z","steps":["trace[585772474] 'process raft request' (duration: 109.382836ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.974382Z","caller":"traceutil/trace.go:171","msg":"trace[257204683] transaction","detail":"{read_only:false; response_revision:488; number_of_response:1; }","duration":"109.933051ms","start":"2026-06-04T06:24:24.864438Z","end":"2026-06-04T06:24:24.974371Z","steps":["trace[257204683] 'process raft request' (duration: 109.416147ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.974603Z","caller":"traceutil/trace.go:171","msg":"trace[1160517430] transaction","detail":"{read_only:false; response_revision:491; number_of_response:1; }","duration":"109.914021ms","start":"2026-06-04T06:24:24.864676Z","end":"2026-06-04T06:24:24.97459Z","steps":["trace[1160517430] 'process raft request' (duration: 109.343705ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.974637Z","caller":"traceutil/trace.go:171","msg":"trace[822537803] transaction","detail":"{read_only:false; response_revision:492; number_of_response:1; }","duration":"109.86189ms","start":"2026-06-04T06:24:24.864758Z","end":"2026-06-04T06:24:24.97462Z","steps":["trace[822537803] 'process raft request' (duration: 109.300384ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.974499Z","caller":"traceutil/trace.go:171","msg":"trace[709194858] transaction","detail":"{read_only:false; response_revision:489; number_of_response:1; }","duration":"109.976892ms","start":"2026-06-04T06:24:24.864512Z","end":"2026-06-04T06:24:24.974489Z","steps":["trace[709194858] 'process raft request' (duration: 109.391816ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:24.975015Z","caller":"traceutil/trace.go:171","msg":"trace[239902017] transaction","detail":"{read_only:false; response_revision:493; number_of_response:1; }","duration":"104.601618ms","start":"2026-06-04T06:24:24.870403Z","end":"2026-06-04T06:24:24.975005Z","steps":["trace[239902017] 'process raft request' (duration: 103.722973ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:31.233069Z","caller":"traceutil/trace.go:171","msg":"trace[322412823] linearizableReadLoop","detail":"{readStateIndex:611; appliedIndex:610; }","duration":"209.615875ms","start":"2026-06-04T06:24:31.023428Z","end":"2026-06-04T06:24:31.233043Z","steps":["trace[322412823] 'read index received' (duration: 208.848974ms)","trace[322412823] 'applied index is now lower than readState.Index' (duration: 765.821µs)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:24:31.233122Z","caller":"traceutil/trace.go:171","msg":"trace[1402652856] transaction","detail":"{read_only:false; response_revision:591; number_of_response:1; }","duration":"232.894544ms","start":"2026-06-04T06:24:31.000205Z","end":"2026-06-04T06:24:31.233099Z","steps":["trace[1402652856] 'process raft request' (duration: 232.331209ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:31.233287Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"209.84248ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-06-04T06:24:31.233346Z","caller":"traceutil/trace.go:171","msg":"trace[1012156795] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:591; }","duration":"209.947343ms","start":"2026-06-04T06:24:31.023383Z","end":"2026-06-04T06:24:31.23333Z","steps":["trace[1012156795] 'agreement among raft nodes before linearized reading' (duration: 209.764638ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:31.488567Z","caller":"traceutil/trace.go:171","msg":"trace[2114495929] linearizableReadLoop","detail":"{readStateIndex:613; appliedIndex:612; }","duration":"153.741677ms","start":"2026-06-04T06:24:31.334802Z","end":"2026-06-04T06:24:31.488544Z","steps":["trace[2114495929] 'read index received' (duration: 153.546731ms)","trace[2114495929] 'applied index is now lower than readState.Index' (duration: 193.806µs)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:24:31.488715Z","caller":"traceutil/trace.go:171","msg":"trace[1787840359] transaction","detail":"{read_only:false; response_revision:593; number_of_response:1; }","duration":"198.829497ms","start":"2026-06-04T06:24:31.289862Z","end":"2026-06-04T06:24:31.488691Z","steps":["trace[1787840359] 'process raft request' (duration: 198.548489ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:31.488742Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"153.926351ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-04T06:24:31.488944Z","caller":"traceutil/trace.go:171","msg":"trace[1176285822] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:593; }","duration":"154.190547ms","start":"2026-06-04T06:24:31.334743Z","end":"2026-06-04T06:24:31.488934Z","steps":["trace[1176285822] 'agreement among raft nodes before linearized reading' (duration: 153.924751ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:31.644979Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"146.275664ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-04T06:24:31.64508Z","caller":"traceutil/trace.go:171","msg":"trace[112283697] range","detail":"{range_begin:/registry/jobs/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:593; }","duration":"146.419478ms","start":"2026-06-04T06:24:31.498638Z","end":"2026-06-04T06:24:31.645057Z","steps":["trace[112283697] 'range keys from in-memory index tree' (duration: 146.153671ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:31.683782Z","caller":"traceutil/trace.go:171","msg":"trace[194062666] transaction","detail":"{read_only:false; response_revision:594; number_of_response:1; }","duration":"180.444232ms","start":"2026-06-04T06:24:31.503313Z","end":"2026-06-04T06:24:31.683757Z","steps":["trace[194062666] 'process raft request' (duration: 180.241347ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:32.820418Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":5827832264722879029,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-06-04T06:24:33.072804Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.037146017s","expected-duration":"1s"} {"level":"info","ts":"2026-06-04T06:24:33.073681Z","caller":"traceutil/trace.go:171","msg":"trace[622978022] linearizableReadLoop","detail":"{readStateIndex:615; appliedIndex:614; }","duration":"753.782697ms","start":"2026-06-04T06:24:32.319878Z","end":"2026-06-04T06:24:33.073661Z","steps":["trace[622978022] 'read index received' (duration: 753.254983ms)","trace[622978022] 'applied index is now lower than readState.Index' (duration: 527.074µs)"],"step_count":2} {"level":"warn","ts":"2026-06-04T06:24:33.07378Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"753.882519ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-04T06:24:33.073786Z","caller":"traceutil/trace.go:171","msg":"trace[1854202416] transaction","detail":"{read_only:false; response_revision:595; number_of_response:1; }","duration":"1.039687833s","start":"2026-06-04T06:24:32.034047Z","end":"2026-06-04T06:24:33.073735Z","steps":["trace[1854202416] 'process raft request' (duration: 1.03919984s)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:33.073808Z","caller":"traceutil/trace.go:171","msg":"trace[598889323] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:595; }","duration":"753.954461ms","start":"2026-06-04T06:24:32.319847Z","end":"2026-06-04T06:24:33.073801Z","steps":["trace[598889323] 'agreement among raft nodes before linearized reading' (duration: 753.88823ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:33.073834Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:32.31983Z","time spent":"753.998572ms","remote":"127.0.0.1:52954","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-04T06:24:33.073948Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:32.034012Z","time spent":"1.039816996s","remote":"127.0.0.1:53042","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036313,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-04T06:24:33.075303Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"385.152939ms","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-06-04T06:24:33.075368Z","caller":"traceutil/trace.go:171","msg":"trace[2135532528] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:596; }","duration":"385.257802ms","start":"2026-06-04T06:24:32.690094Z","end":"2026-06-04T06:24:33.075352Z","steps":["trace[2135532528] 'agreement among raft nodes before linearized reading' (duration: 385.075477ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:33.0754Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:32.690078Z","time spent":"385.315083ms","remote":"127.0.0.1:58774","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":502,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "} {"level":"info","ts":"2026-06-04T06:24:33.075647Z","caller":"traceutil/trace.go:171","msg":"trace[1892508120] transaction","detail":"{read_only:false; response_revision:596; number_of_response:1; }","duration":"135.392416ms","start":"2026-06-04T06:24:32.940244Z","end":"2026-06-04T06:24:33.075637Z","steps":["trace[1892508120] 'process raft request' (duration: 134.828172ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:33.075887Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"359.842252ms","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-06-04T06:24:33.075915Z","caller":"traceutil/trace.go:171","msg":"trace[101075361] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:596; }","duration":"359.907244ms","start":"2026-06-04T06:24:32.716001Z","end":"2026-06-04T06:24:33.075908Z","steps":["trace[101075361] 'agreement among raft nodes before linearized reading' (duration: 359.846062ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:33.075932Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:24:32.715981Z","time spent":"359.946944ms","remote":"127.0.0.1:58774","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-06-04T06:24:47.454542Z","caller":"traceutil/trace.go:171","msg":"trace[91980458] linearizableReadLoop","detail":"{readStateIndex:780; appliedIndex:778; }","duration":"134.7614ms","start":"2026-06-04T06:24:47.319766Z","end":"2026-06-04T06:24:47.454527Z","steps":["trace[91980458] 'read index received' (duration: 134.637377ms)","trace[91980458] 'applied index is now lower than readState.Index' (duration: 123.493µs)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:24:47.454678Z","caller":"traceutil/trace.go:171","msg":"trace[350625480] transaction","detail":"{read_only:false; response_revision:755; number_of_response:1; }","duration":"291.54014ms","start":"2026-06-04T06:24:47.16313Z","end":"2026-06-04T06:24:47.45467Z","steps":["trace[350625480] 'process raft request' (duration: 291.276424ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:24:47.454767Z","caller":"traceutil/trace.go:171","msg":"trace[1573372230] transaction","detail":"{read_only:false; response_revision:756; number_of_response:1; }","duration":"290.497496ms","start":"2026-06-04T06:24:47.164265Z","end":"2026-06-04T06:24:47.454763Z","steps":["trace[1573372230] 'process raft request' (duration: 290.239441ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:47.454854Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"135.085228ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-04T06:24:47.454884Z","caller":"traceutil/trace.go:171","msg":"trace[10406059] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:756; }","duration":"135.163502ms","start":"2026-06-04T06:24:47.319716Z","end":"2026-06-04T06:24:47.454879Z","steps":["trace[10406059] 'agreement among raft nodes before linearized reading' (duration: 135.110639ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:24:47.455051Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.62123ms","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-06-04T06:24:47.455086Z","caller":"traceutil/trace.go:171","msg":"trace[1406863671] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:756; }","duration":"125.678312ms","start":"2026-06-04T06:24:47.329403Z","end":"2026-06-04T06:24:47.455081Z","steps":["trace[1406863671] 'agreement among raft nodes before linearized reading' (duration: 125.59553ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.116863Z","caller":"traceutil/trace.go:171","msg":"trace[116869943] linearizableReadLoop","detail":"{readStateIndex:942; appliedIndex:941; }","duration":"121.440982ms","start":"2026-06-04T06:25:00.995398Z","end":"2026-06-04T06:25:01.116839Z","steps":["trace[116869943] 'read index received' (duration: 96.043932ms)","trace[116869943] 'applied index is now lower than readState.Index' (duration: 25.3961ms)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:25:01.1171Z","caller":"traceutil/trace.go:171","msg":"trace[1223450377] transaction","detail":"{read_only:false; response_revision:914; number_of_response:1; }","duration":"434.994746ms","start":"2026-06-04T06:25:00.682043Z","end":"2026-06-04T06:25:01.117038Z","steps":["trace[1223450377] 'process raft request' (duration: 409.475674ms)","trace[1223450377] 'compare' (duration: 25.189325ms)"],"step_count":2} {"level":"warn","ts":"2026-06-04T06:25:01.11721Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.803381ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-78446f96c9-njsdz\" ","response":"range_response_count:1 size:5674"} {"level":"info","ts":"2026-06-04T06:25:01.117257Z","caller":"traceutil/trace.go:171","msg":"trace[789898316] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-78446f96c9-njsdz; range_end:; response_count:1; response_revision:914; }","duration":"121.928164ms","start":"2026-06-04T06:25:00.995314Z","end":"2026-06-04T06:25:01.117242Z","steps":["trace[789898316] 'agreement among raft nodes before linearized reading' (duration: 121.619637ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:25:01.117435Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:25:00.682017Z","time spent":"435.218881ms","remote":"127.0.0.1:58946","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3297,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-04T06:25:01.361519Z","caller":"traceutil/trace.go:171","msg":"trace[395749088] transaction","detail":"{read_only:false; response_revision:915; number_of_response:1; }","duration":"238.805437ms","start":"2026-06-04T06:25:01.122668Z","end":"2026-06-04T06:25:01.361474Z","steps":["trace[395749088] 'process raft request' (duration: 238.611722ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.689407Z","caller":"traceutil/trace.go:171","msg":"trace[1376218683] linearizableReadLoop","detail":"{readStateIndex:944; appliedIndex:942; }","duration":"458.141469ms","start":"2026-06-04T06:25:01.231182Z","end":"2026-06-04T06:25:01.689323Z","steps":["trace[1376218683] 'read index received' (duration: 130.031284ms)","trace[1376218683] 'applied index is now lower than readState.Index' (duration: 328.109075ms)"],"step_count":2} {"level":"info","ts":"2026-06-04T06:25:01.689537Z","caller":"traceutil/trace.go:171","msg":"trace[1838871692] transaction","detail":"{read_only:false; response_revision:916; number_of_response:1; }","duration":"561.061176ms","start":"2026-06-04T06:25:01.128461Z","end":"2026-06-04T06:25:01.689523Z","steps":["trace[1838871692] 'process raft request' (duration: 529.834782ms)","trace[1838871692] 'compare' (duration: 30.932688ms)"],"step_count":2} {"level":"warn","ts":"2026-06-04T06:25:01.689661Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:25:01.128455Z","time spent":"561.110978ms","remote":"127.0.0.1:53132","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5469,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-04T06:25:01.689849Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"458.636961ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"warn","ts":"2026-06-04T06:25:01.689891Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"370.769272ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-04T06:25:01.689973Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.390912ms","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-06-04T06:25:01.69006Z","caller":"traceutil/trace.go:171","msg":"trace[892079990] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:916; }","duration":"370.953515ms","start":"2026-06-04T06:25:01.319091Z","end":"2026-06-04T06:25:01.690045Z","steps":["trace[892079990] 'agreement among raft nodes before linearized reading' (duration: 370.741321ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.690097Z","caller":"traceutil/trace.go:171","msg":"trace[1074626913] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:916; }","duration":"122.552455ms","start":"2026-06-04T06:25:01.567534Z","end":"2026-06-04T06:25:01.690086Z","steps":["trace[1074626913] 'agreement among raft nodes before linearized reading' (duration: 122.344421ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:25:01.690153Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.758665ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"warn","ts":"2026-06-04T06:25:01.690104Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:25:01.319046Z","time spent":"371.047467ms","remote":"127.0.0.1:52948","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-04T06:25:01.690259Z","caller":"traceutil/trace.go:171","msg":"trace[589344919] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:916; }","duration":"174.931108ms","start":"2026-06-04T06:25:01.515303Z","end":"2026-06-04T06:25:01.690234Z","steps":["trace[589344919] 'agreement among raft nodes before linearized reading' (duration: 174.581661ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.689964Z","caller":"traceutil/trace.go:171","msg":"trace[552205101] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:916; }","duration":"458.790303ms","start":"2026-06-04T06:25:01.231154Z","end":"2026-06-04T06:25:01.689944Z","steps":["trace[552205101] 'agreement among raft nodes before linearized reading' (duration: 458.466206ms)"],"step_count":1} {"level":"warn","ts":"2026-06-04T06:25:01.690402Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-04T06:25:01.23114Z","time spent":"459.242982ms","remote":"127.0.0.1:58774","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-06-04T06:25:01.690507Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"174.964388ms","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-06-04T06:25:01.690552Z","caller":"traceutil/trace.go:171","msg":"trace[2110575997] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:916; }","duration":"175.261576ms","start":"2026-06-04T06:25:01.51528Z","end":"2026-06-04T06:25:01.690541Z","steps":["trace[2110575997] 'agreement among raft nodes before linearized reading' (duration: 174.772016ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.917861Z","caller":"traceutil/trace.go:171","msg":"trace[673442519] transaction","detail":"{read_only:false; response_revision:920; number_of_response:1; }","duration":"220.536619ms","start":"2026-06-04T06:25:01.697303Z","end":"2026-06-04T06:25:01.917839Z","steps":["trace[673442519] 'process raft request' (duration: 220.473487ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.917935Z","caller":"traceutil/trace.go:171","msg":"trace[587841300] transaction","detail":"{read_only:false; response_revision:918; number_of_response:1; }","duration":"220.651821ms","start":"2026-06-04T06:25:01.697239Z","end":"2026-06-04T06:25:01.917891Z","steps":["trace[587841300] 'process raft request' (duration: 220.354415ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.917959Z","caller":"traceutil/trace.go:171","msg":"trace[1795040246] transaction","detail":"{read_only:false; response_revision:919; number_of_response:1; }","duration":"220.6534ms","start":"2026-06-04T06:25:01.697281Z","end":"2026-06-04T06:25:01.917934Z","steps":["trace[1795040246] 'process raft request' (duration: 220.456747ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.918241Z","caller":"traceutil/trace.go:171","msg":"trace[248875247] transaction","detail":"{read_only:false; response_revision:921; number_of_response:1; }","duration":"220.905246ms","start":"2026-06-04T06:25:01.697323Z","end":"2026-06-04T06:25:01.918228Z","steps":["trace[248875247] 'process raft request' (duration: 220.482727ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.919097Z","caller":"traceutil/trace.go:171","msg":"trace[294859698] transaction","detail":"{read_only:false; response_revision:924; number_of_response:1; }","duration":"191.149793ms","start":"2026-06-04T06:25:01.727916Z","end":"2026-06-04T06:25:01.919066Z","steps":["trace[294859698] 'process raft request' (duration: 191.066821ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.919203Z","caller":"traceutil/trace.go:171","msg":"trace[1218409116] transaction","detail":"{read_only:false; response_revision:922; number_of_response:1; }","duration":"221.59275ms","start":"2026-06-04T06:25:01.697591Z","end":"2026-06-04T06:25:01.919184Z","steps":["trace[1218409116] 'process raft request' (duration: 220.470117ms)"],"step_count":1} {"level":"info","ts":"2026-06-04T06:25:01.919354Z","caller":"traceutil/trace.go:171","msg":"trace[545347797] transaction","detail":"{read_only:false; response_revision:923; number_of_response:1; }","duration":"219.127449ms","start":"2026-06-04T06:25:01.700179Z","end":"2026-06-04T06:25:01.919307Z","steps":["trace[545347797] 'process raft request' (duration: 218.70856ms)"],"step_count":1}