=== RUN TestNetworkPlugins/group/bridge/Start
net_test.go:112: (dbg) Run: out/minikube-windows-amd64.exe start -p bridge-353700 --memory=3072 --alsologtostderr --wait=true --wait-timeout=15m --cni=bridge --driver=hyperv
E1218 14:13:08.612525 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\kindnet-353700\client.crt: The system cannot find the path specified.
E1218 14:13:25.553834 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\calico-353700\client.crt: The system cannot find the path specified.
E1218 14:13:42.394357 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\functional-806500\client.crt: The system cannot find the path specified.
E1218 14:13:56.572811 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\ingress-addon-legacy-134100\client.crt: The system cannot find the path specified.
E1218 14:14:02.431753 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\addons-922300\client.crt: The system cannot find the path specified.
E1218 14:14:26.036240 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:26.051902 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:26.067585 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:26.098881 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:26.145539 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:26.237908 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:26.409398 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:26.743235 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:27.393324 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:28.677681 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:31.246104 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:36.369157 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:46.625276 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\custom-flannel-353700\client.crt: The system cannot find the path specified.
E1218 14:14:47.487635 14928 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\calico-353700\client.crt: The system cannot find the path specified.
net_test.go:112: (dbg) Non-zero exit: out/minikube-windows-amd64.exe start -p bridge-353700 --memory=3072 --alsologtostderr --wait=true --wait-timeout=15m --cni=bridge --driver=hyperv: exit status 90 (4m36.0057619s)
-- stdout --
* [bridge-353700] minikube v1.32.0 on Microsoft Windows 10 Enterprise N 10.0.19045.3803 Build 19045.3803
- KUBECONFIG=C:\Users\jenkins.minikube7\minikube-integration\kubeconfig
- MINIKUBE_FORCE_SYSTEMD=
- MINIKUBE_HOME=C:\Users\jenkins.minikube7\minikube-integration\.minikube
- MINIKUBE_LOCATION=17824
- MINIKUBE_SUPPRESS_DOCKER_PERFORMANCE=true
* Using the hyperv driver based on user configuration
* Starting control plane node bridge-353700 in cluster bridge-353700
* Creating hyperv VM (CPUs=2, Memory=3072MB, Disk=20000MB) ...
-- /stdout --
** stderr **
W1218 14:12:56.041295 4856 main.go:291] Unable to resolve the current Docker CLI context "default": context "default": context not found: open C:\Users\jenkins.minikube7\.docker\contexts\meta\37a8eec1ce19687d132fe29051dca629d164e2c4958ba141d5f4133a33f0688f\meta.json: The system cannot find the path specified.
I1218 14:12:56.135491 4856 out.go:296] Setting OutFile to fd 1408 ...
I1218 14:12:56.135491 4856 out.go:343] TERM=,COLORTERM=, which probably does not support color
I1218 14:12:56.135491 4856 out.go:309] Setting ErrFile to fd 2020...
I1218 14:12:56.135491 4856 out.go:343] TERM=,COLORTERM=, which probably does not support color
I1218 14:12:56.160480 4856 out.go:303] Setting JSON to false
I1218 14:12:56.166485 4856 start.go:128] hostinfo: {"hostname":"minikube7","uptime":9250,"bootTime":1702899525,"procs":207,"os":"windows","platform":"Microsoft Windows 10 Enterprise N","platformFamily":"Standalone Workstation","platformVersion":"10.0.19045.3803 Build 19045.3803","kernelVersion":"10.0.19045.3803 Build 19045.3803","kernelArch":"x86_64","virtualizationSystem":"","virtualizationRole":"","hostId":"f66ed2ea-6c04-4a6b-8eea-b2fb0953e990"}
W1218 14:12:56.166485 4856 start.go:136] gopshost.Virtualization returned error: not implemented yet
I1218 14:12:56.168489 4856 out.go:177] * [bridge-353700] minikube v1.32.0 on Microsoft Windows 10 Enterprise N 10.0.19045.3803 Build 19045.3803
I1218 14:12:56.169550 4856 out.go:177] - KUBECONFIG=C:\Users\jenkins.minikube7\minikube-integration\kubeconfig
I1218 14:12:56.169550 4856 notify.go:220] Checking for updates...
I1218 14:12:56.170483 4856 out.go:177] - MINIKUBE_FORCE_SYSTEMD=
I1218 14:12:56.170483 4856 out.go:177] - MINIKUBE_HOME=C:\Users\jenkins.minikube7\minikube-integration\.minikube
I1218 14:12:56.171486 4856 out.go:177] - MINIKUBE_LOCATION=17824
I1218 14:12:56.172485 4856 out.go:177] - MINIKUBE_SUPPRESS_DOCKER_PERFORMANCE=true
I1218 14:12:56.175484 4856 config.go:182] Loaded profile config "enable-default-cni-353700": Driver=hyperv, ContainerRuntime=docker, KubernetesVersion=v1.28.4
I1218 14:12:56.176476 4856 config.go:182] Loaded profile config "false-353700": Driver=hyperv, ContainerRuntime=docker, KubernetesVersion=v1.28.4
I1218 14:12:56.176476 4856 config.go:182] Loaded profile config "flannel-353700": Driver=hyperv, ContainerRuntime=docker, KubernetesVersion=v1.28.4
I1218 14:12:56.176476 4856 config.go:182] Loaded profile config "multinode-015900-m01": Driver=hyperv, ContainerRuntime=docker, KubernetesVersion=v1.28.4
I1218 14:12:56.177494 4856 driver.go:392] Setting default libvirt URI to qemu:///system
I1218 14:13:03.007629 4856 out.go:177] * Using the hyperv driver based on user configuration
I1218 14:13:03.008410 4856 start.go:298] selected driver: hyperv
I1218 14:13:03.008578 4856 start.go:902] validating driver "hyperv" against <nil>
I1218 14:13:03.008578 4856 start.go:913] status for hyperv: {Installed:true Healthy:true Running:false NeedsImprovement:false Error:<nil> Reason: Fix: Doc: Version:}
I1218 14:13:03.078554 4856 start_flags.go:309] no existing cluster config was found, will generate one from the flags
I1218 14:13:03.079553 4856 start_flags.go:931] Waiting for all components: map[apiserver:true apps_running:true default_sa:true extra:true kubelet:true node_ready:true system_pods:true]
I1218 14:13:03.080555 4856 cni.go:84] Creating CNI manager for "bridge"
I1218 14:13:03.080555 4856 start_flags.go:318] Found "bridge CNI" CNI - setting NetworkPlugin=cni
I1218 14:13:03.080555 4856 start_flags.go:323] config:
{Name:bridge-353700 KeepContext:false EmbedCerts:false MinikubeISO: KicBaseImage:gcr.io/k8s-minikube/kicbase-builds:v0.0.42-1702585004-17765@sha256:ba2fbb9efd5b81a443834ba0800f3bc13feea942ce199df74b0054a9bdb32bbd Memory:3072 CPUs:2 DiskSize:20000 VMDriver: Driver:hyperv HyperkitVpnKitSock: HyperkitVSockPorts:[] DockerEnv:[] ContainerVolumeMounts:[] InsecureRegistry:[] RegistryMirror:[] HostOnlyCIDR:192.168.59.1/24 HypervVirtualSwitch: HypervUseExternalSwitch:false HypervExternalAdapter: KVMNetwork:default KVMQemuURI:qemu:///system KVMGPU:false KVMHidden:false KVMNUMACount:1 APIServerPort:0 DockerOpt:[] DisableDriverMounts:false NFSShare:[] NFSSharesRoot:/nfsshares UUID: NoVTXCheck:false DNSProxy:false HostDNSResolver:true HostOnlyNicType:virtio NatNicType:virtio SSHIPAddress: SSHUser:root SSHKey: SSHPort:22 KubernetesConfig:{KubernetesVersion:v1.28.4 ClusterName:bridge-353700 Namespace:default APIServerName:minikubeCA APIServerNames:[] APIServerIPs:[] DNSDomain:cluster.local ContainerRuntime:docker C
RISocket: NetworkPlugin:cni FeatureGates: ServiceCIDR:10.96.0.0/12 ImageRepository: LoadBalancerStartIP: LoadBalancerEndIP: CustomIngressCert: RegistryAliases: ExtraOptions:[] ShouldLoadCachedImages:true EnableDefaultCNI:false CNI:bridge NodeIP: NodePort:8443 NodeName:} Nodes:[] Addons:map[] CustomAddonImages:map[] CustomAddonRegistries:map[] VerifyComponents:map[apiserver:true apps_running:true default_sa:true extra:true kubelet:true node_ready:true system_pods:true] StartHostTimeout:15m0s ScheduledStop:<nil> ExposedPorts:[] ListenAddress: Network: Subnet: MultiNodeRequested:false ExtraDisks:0 CertExpiration:26280h0m0s Mount:false MountString:C:\Users\jenkins.minikube7:/minikube-host Mount9PVersion:9p2000.L MountGID:docker MountIP: MountMSize:262144 MountOptions:[] MountPort:0 MountType:9p MountUID:docker BinaryMirror: DisableOptimizations:false DisableMetrics:false CustomQemuFirmwarePath: SocketVMnetClientPath: SocketVMnetPath: StaticIP: SSHAuthSock: SSHAgentPID:0 AutoPauseInterval:1m0s GPUs:}
I1218 14:13:03.080555 4856 iso.go:125] acquiring lock: {Name:mka7fdf4332632f41b99a369cc525e40499a0030 Clock:{} Delay:500ms Timeout:10m0s Cancel:<nil>}
I1218 14:13:03.082546 4856 out.go:177] * Starting control plane node bridge-353700 in cluster bridge-353700
I1218 14:13:03.083565 4856 preload.go:132] Checking if preload exists for k8s version v1.28.4 and runtime docker
I1218 14:13:03.083565 4856 preload.go:148] Found local preload: C:\Users\jenkins.minikube7\minikube-integration\.minikube\cache\preloaded-tarball\preloaded-images-k8s-v18-v1.28.4-docker-overlay2-amd64.tar.lz4
I1218 14:13:03.083565 4856 cache.go:56] Caching tarball of preloaded images
I1218 14:13:03.083565 4856 preload.go:174] Found C:\Users\jenkins.minikube7\minikube-integration\.minikube\cache\preloaded-tarball\preloaded-images-k8s-v18-v1.28.4-docker-overlay2-amd64.tar.lz4 in cache, skipping download
I1218 14:13:03.084554 4856 cache.go:59] Finished verifying existence of preloaded tar for v1.28.4 on docker
I1218 14:13:03.084554 4856 profile.go:148] Saving config to C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\bridge-353700\config.json ...
I1218 14:13:03.084554 4856 lock.go:35] WriteFile acquiring C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\bridge-353700\config.json: {Name:mk3fadda15f697339c7301294a606d80c128a077 Clock:{} Delay:500ms Timeout:1m0s Cancel:<nil>}
I1218 14:13:03.086555 4856 start.go:365] acquiring machines lock for bridge-353700: {Name:mk814f158b6187cc9297257c36fdbe0d2871c950 Clock:{} Delay:500ms Timeout:13m0s Cancel:<nil>}
I1218 14:13:32.189984 4856 start.go:369] acquired machines lock for "bridge-353700" in 29.1032983s
I1218 14:13:32.190985 4856 start.go:93] Provisioning new machine with config: &{Name:bridge-353700 KeepContext:false EmbedCerts:false MinikubeISO:https://storage.googleapis.com/minikube-builds/iso/17765/minikube-v1.32.1-1702490427-17765-amd64.iso KicBaseImage:gcr.io/k8s-minikube/kicbase-builds:v0.0.42-1702585004-17765@sha256:ba2fbb9efd5b81a443834ba0800f3bc13feea942ce199df74b0054a9bdb32bbd Memory:3072 CPUs:2 DiskSize:20000 VMDriver: Driver:hyperv HyperkitVpnKitSock: HyperkitVSockPorts:[] DockerEnv:[] ContainerVolumeMounts:[] InsecureRegistry:[] RegistryMirror:[] HostOnlyCIDR:192.168.59.1/24 HypervVirtualSwitch: HypervUseExternalSwitch:false HypervExternalAdapter: KVMNetwork:default KVMQemuURI:qemu:///system KVMGPU:false KVMHidden:false KVMNUMACount:1 APIServerPort:0 DockerOpt:[] DisableDriverMounts:false NFSShare:[] NFSSharesRoot:/nfsshares UUID: NoVTXCheck:false DNSProxy:false HostDNSResolver:true HostOnlyNicType:virtio NatNicType:virtio SSHIPAddress: SSHUser:root SSHKey: SSHPort:22 KubernetesConf
ig:{KubernetesVersion:v1.28.4 ClusterName:bridge-353700 Namespace:default APIServerName:minikubeCA APIServerNames:[] APIServerIPs:[] DNSDomain:cluster.local ContainerRuntime:docker CRISocket: NetworkPlugin:cni FeatureGates: ServiceCIDR:10.96.0.0/12 ImageRepository: LoadBalancerStartIP: LoadBalancerEndIP: CustomIngressCert: RegistryAliases: ExtraOptions:[] ShouldLoadCachedImages:true EnableDefaultCNI:false CNI:bridge NodeIP: NodePort:8443 NodeName:} Nodes:[{Name: IP: Port:8443 KubernetesVersion:v1.28.4 ContainerRuntime:docker ControlPlane:true Worker:true}] Addons:map[] CustomAddonImages:map[] CustomAddonRegistries:map[] VerifyComponents:map[apiserver:true apps_running:true default_sa:true extra:true kubelet:true node_ready:true system_pods:true] StartHostTimeout:15m0s ScheduledStop:<nil> ExposedPorts:[] ListenAddress: Network: Subnet: MultiNodeRequested:false ExtraDisks:0 CertExpiration:26280h0m0s Mount:false MountString:C:\Users\jenkins.minikube7:/minikube-host Mount9PVersion:9p2000.L MountGID:docker MountIP
: MountMSize:262144 MountOptions:[] MountPort:0 MountType:9p MountUID:docker BinaryMirror: DisableOptimizations:false DisableMetrics:false CustomQemuFirmwarePath: SocketVMnetClientPath: SocketVMnetPath: StaticIP: SSHAuthSock: SSHAgentPID:0 AutoPauseInterval:1m0s GPUs:} &{Name: IP: Port:8443 KubernetesVersion:v1.28.4 ContainerRuntime:docker ControlPlane:true Worker:true}
I1218 14:13:32.190985 4856 start.go:125] createHost starting for "" (driver="hyperv")
I1218 14:13:32.191984 4856 out.go:204] * Creating hyperv VM (CPUs=2, Memory=3072MB, Disk=20000MB) ...
I1218 14:13:32.193004 4856 start.go:159] libmachine.API.Create for "bridge-353700" (driver="hyperv")
I1218 14:13:32.193004 4856 client.go:168] LocalClient.Create starting
I1218 14:13:32.193004 4856 main.go:141] libmachine: Reading certificate data from C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\ca.pem
I1218 14:13:32.194000 4856 main.go:141] libmachine: Decoding PEM data...
I1218 14:13:32.194000 4856 main.go:141] libmachine: Parsing certificate...
I1218 14:13:32.194000 4856 main.go:141] libmachine: Reading certificate data from C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\cert.pem
I1218 14:13:32.194000 4856 main.go:141] libmachine: Decoding PEM data...
I1218 14:13:32.194000 4856 main.go:141] libmachine: Parsing certificate...
I1218 14:13:32.194000 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive @(Get-Module -ListAvailable hyper-v).Name | Get-Unique
I1218 14:13:34.541554 4856 main.go:141] libmachine: [stdout =====>] : Hyper-V
I1218 14:13:34.541629 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:13:34.541771 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive @([Security.Principal.WindowsPrincipal][Security.Principal.WindowsIdentity]::GetCurrent()).IsInRole(([System.Security.Principal.SecurityIdentifier]::new("S-1-5-32-578")))
I1218 14:13:36.802369 4856 main.go:141] libmachine: [stdout =====>] : False
I1218 14:13:36.802497 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:13:36.802725 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive @([Security.Principal.WindowsPrincipal][Security.Principal.WindowsIdentity]::GetCurrent()).IsInRole([Security.Principal.WindowsBuiltInRole] "Administrator")
I1218 14:13:38.757306 4856 main.go:141] libmachine: [stdout =====>] : True
I1218 14:13:38.757640 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:13:38.757712 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive [Console]::OutputEncoding = [Text.Encoding]::UTF8; ConvertTo-Json @(Hyper-V\Get-VMSwitch|Select Id, Name, SwitchType|Where-Object {($_.SwitchType -eq 'External') -or ($_.Id -eq 'c08cb7b8-9b3c-408e-8e30-5e16a3aeb444')}|Sort-Object -Property SwitchType)
I1218 14:13:43.841088 4856 main.go:141] libmachine: [stdout =====>] : [
{
"Id": "c08cb7b8-9b3c-408e-8e30-5e16a3aeb444",
"Name": "Default Switch",
"SwitchType": 1
}
]
I1218 14:13:43.841181 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:13:43.844175 4856 main.go:141] libmachine: Downloading C:\Users\jenkins.minikube7\minikube-integration\.minikube\cache\boot2docker.iso from file://C:/Users/jenkins.minikube7/minikube-integration/.minikube/cache/iso/amd64/minikube-v1.32.1-1702490427-17765-amd64.iso...
I1218 14:13:44.324799 4856 main.go:141] libmachine: Creating SSH key...
I1218 14:13:44.480441 4856 main.go:141] libmachine: Creating VM...
I1218 14:13:44.480441 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive [Console]::OutputEncoding = [Text.Encoding]::UTF8; ConvertTo-Json @(Hyper-V\Get-VMSwitch|Select Id, Name, SwitchType|Where-Object {($_.SwitchType -eq 'External') -or ($_.Id -eq 'c08cb7b8-9b3c-408e-8e30-5e16a3aeb444')}|Sort-Object -Property SwitchType)
I1218 14:13:48.347819 4856 main.go:141] libmachine: [stdout =====>] : [
{
"Id": "c08cb7b8-9b3c-408e-8e30-5e16a3aeb444",
"Name": "Default Switch",
"SwitchType": 1
}
]
I1218 14:13:48.348083 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:13:48.348190 4856 main.go:141] libmachine: Using switch "Default Switch"
I1218 14:13:48.348261 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive @([Security.Principal.WindowsPrincipal][Security.Principal.WindowsIdentity]::GetCurrent()).IsInRole([Security.Principal.WindowsBuiltInRole] "Administrator")
I1218 14:13:50.491668 4856 main.go:141] libmachine: [stdout =====>] : True
I1218 14:13:50.491668 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:13:50.491668 4856 main.go:141] libmachine: Creating VHD
I1218 14:13:50.491668 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\New-VHD -Path 'C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\fixed.vhd' -SizeBytes 10MB -Fixed
I1218 14:13:55.323443 4856 main.go:141] libmachine: [stdout =====>] :
ComputerName : minikube7
Path : C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\fixed.vhd
VhdFormat : VHD
VhdType : Fixed
FileSize : 10486272
Size : 10485760
MinimumSize :
LogicalSectorSize : 512
PhysicalSectorSize : 512
BlockSize : 0
ParentPath :
DiskIdentifier : 7A98D34D-CC12-4C4B-9EA5-7CA55DF66CDD
FragmentationPercentage : 0
Alignment : 1
Attached : False
DiskNumber :
IsPMEMCompatible : False
AddressAbstractionType : None
Number :
I1218 14:13:55.323521 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:13:55.323521 4856 main.go:141] libmachine: Writing magic tar header
I1218 14:13:55.323682 4856 main.go:141] libmachine: Writing SSH key tar header
I1218 14:13:55.338862 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Convert-VHD -Path 'C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\fixed.vhd' -DestinationPath 'C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\disk.vhd' -VHDType Dynamic -DeleteSource
I1218 14:13:59.153947 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:13:59.154136 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:13:59.154231 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Resize-VHD -Path 'C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\disk.vhd' -SizeBytes 20000MB
I1218 14:14:02.177477 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:02.177704 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:02.177799 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\New-VM bridge-353700 -Path 'C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700' -SwitchName 'Default Switch' -MemoryStartupBytes 3072MB
I1218 14:14:07.298735 4856 main.go:141] libmachine: [stdout =====>] :
Name State CPUUsage(%) MemoryAssigned(M) Uptime Status Version
---- ----- ----------- ----------------- ------ ------ -------
bridge-353700 Off 0 0 00:00:00 Operating normally 9.0
I1218 14:14:07.298807 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:07.298807 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Set-VMMemory -VMName bridge-353700 -DynamicMemoryEnabled $false
I1218 14:14:10.189994 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:10.190268 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:10.190268 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Set-VMProcessor bridge-353700 -Count 2
I1218 14:14:12.787907 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:12.788182 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:12.788244 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Set-VMDvdDrive -VMName bridge-353700 -Path 'C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\boot2docker.iso'
I1218 14:14:15.912612 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:15.912612 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:15.912612 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Add-VMHardDiskDrive -VMName bridge-353700 -Path 'C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\disk.vhd'
I1218 14:14:19.286010 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:19.286182 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:19.286263 4856 main.go:141] libmachine: Starting VM...
I1218 14:14:19.286263 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Start-VM bridge-353700
I1218 14:14:22.887876 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:22.888010 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:22.888010 4856 main.go:141] libmachine: Waiting for host to start...
I1218 14:14:22.888253 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:14:25.720442 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:14:25.720548 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:25.720548 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:14:28.898463 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:28.898914 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:29.907100 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:14:32.632775 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:14:32.632775 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:32.632775 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:14:35.846748 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:35.846748 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:36.862350 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:14:39.919542 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:14:39.919542 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:39.919542 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:14:43.939455 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:43.939455 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:44.949766 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:14:48.356747 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:14:48.356747 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:48.356747 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:14:52.202615 4856 main.go:141] libmachine: [stdout =====>] :
I1218 14:14:52.202685 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:53.209152 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:14:56.074655 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:14:56.074745 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:56.074745 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:14:59.406600 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:14:59.406600 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:14:59.406600 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:02.198255 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:02.198255 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:02.198255 4856 machine.go:88] provisioning docker machine ...
I1218 14:15:02.198478 4856 buildroot.go:166] provisioning hostname "bridge-353700"
I1218 14:15:02.198557 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:04.695533 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:04.695533 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:04.695533 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:08.022746 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:08.022847 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:08.032565 4856 main.go:141] libmachine: Using SSH client type: native
I1218 14:15:08.034549 4856 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0xdb4f40] 0xdb7a80 <nil> [] 0s} 192.168.224.53 22 <nil> <nil>}
I1218 14:15:08.034549 4856 main.go:141] libmachine: About to run SSH command:
sudo hostname bridge-353700 && echo "bridge-353700" | sudo tee /etc/hostname
I1218 14:15:08.246234 4856 main.go:141] libmachine: SSH cmd err, output: <nil>: bridge-353700
I1218 14:15:08.246394 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:11.317056 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:11.317056 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:11.317056 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:14.637561 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:14.637812 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:14.649526 4856 main.go:141] libmachine: Using SSH client type: native
I1218 14:15:14.650838 4856 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0xdb4f40] 0xdb7a80 <nil> [] 0s} 192.168.224.53 22 <nil> <nil>}
I1218 14:15:14.650838 4856 main.go:141] libmachine: About to run SSH command:
if ! grep -xq '.*\sbridge-353700' /etc/hosts; then
if grep -xq '127.0.1.1\s.*' /etc/hosts; then
sudo sed -i 's/^127.0.1.1\s.*/127.0.1.1 bridge-353700/g' /etc/hosts;
else
echo '127.0.1.1 bridge-353700' | sudo tee -a /etc/hosts;
fi
fi
I1218 14:15:14.831448 4856 main.go:141] libmachine: SSH cmd err, output: <nil>:
I1218 14:15:14.831695 4856 buildroot.go:172] set auth options {CertDir:C:\Users\jenkins.minikube7\minikube-integration\.minikube CaCertPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\ca.pem CaPrivateKeyPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\ca-key.pem CaCertRemotePath:/etc/docker/ca.pem ServerCertPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\server.pem ServerKeyPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\server-key.pem ClientKeyPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\key.pem ServerCertRemotePath:/etc/docker/server.pem ServerKeyRemotePath:/etc/docker/server-key.pem ClientCertPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\cert.pem ServerCertSANs:[] StorePath:C:\Users\jenkins.minikube7\minikube-integration\.minikube}
I1218 14:15:14.831695 4856 buildroot.go:174] setting up certificates
I1218 14:15:14.831805 4856 provision.go:83] configureAuth start
I1218 14:15:14.831887 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:17.534354 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:17.534445 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:17.534533 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:20.708825 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:20.708915 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:20.708915 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:23.333011 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:23.333011 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:23.333288 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:26.483804 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:26.483866 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:26.483866 4856 provision.go:138] copyHostCerts
I1218 14:15:26.484068 4856 exec_runner.go:144] found C:\Users\jenkins.minikube7\minikube-integration\.minikube/ca.pem, removing ...
I1218 14:15:26.484068 4856 exec_runner.go:203] rm: C:\Users\jenkins.minikube7\minikube-integration\.minikube\ca.pem
I1218 14:15:26.484809 4856 exec_runner.go:151] cp: C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\ca.pem --> C:\Users\jenkins.minikube7\minikube-integration\.minikube/ca.pem (1078 bytes)
I1218 14:15:26.485801 4856 exec_runner.go:144] found C:\Users\jenkins.minikube7\minikube-integration\.minikube/cert.pem, removing ...
I1218 14:15:26.485801 4856 exec_runner.go:203] rm: C:\Users\jenkins.minikube7\minikube-integration\.minikube\cert.pem
I1218 14:15:26.486727 4856 exec_runner.go:151] cp: C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\cert.pem --> C:\Users\jenkins.minikube7\minikube-integration\.minikube/cert.pem (1123 bytes)
I1218 14:15:26.488174 4856 exec_runner.go:144] found C:\Users\jenkins.minikube7\minikube-integration\.minikube/key.pem, removing ...
I1218 14:15:26.488174 4856 exec_runner.go:203] rm: C:\Users\jenkins.minikube7\minikube-integration\.minikube\key.pem
I1218 14:15:26.488679 4856 exec_runner.go:151] cp: C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\key.pem --> C:\Users\jenkins.minikube7\minikube-integration\.minikube/key.pem (1679 bytes)
I1218 14:15:26.489881 4856 provision.go:112] generating server cert: C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\server.pem ca-key=C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\ca.pem private-key=C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\ca-key.pem org=jenkins.bridge-353700 san=[192.168.224.53 192.168.224.53 localhost 127.0.0.1 minikube bridge-353700]
I1218 14:15:26.597940 4856 provision.go:172] copyRemoteCerts
I1218 14:15:26.614041 4856 ssh_runner.go:195] Run: sudo mkdir -p /etc/docker /etc/docker /etc/docker
I1218 14:15:26.614041 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:29.096220 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:29.096266 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:29.096388 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:31.932100 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:31.932179 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:31.933010 4856 sshutil.go:53] new ssh client: &{IP:192.168.224.53 Port:22 SSHKeyPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\id_rsa Username:docker}
I1218 14:15:32.043129 4856 ssh_runner.go:235] Completed: sudo mkdir -p /etc/docker /etc/docker /etc/docker: (5.4289951s)
I1218 14:15:32.043616 4856 ssh_runner.go:362] scp C:\Users\jenkins.minikube7\minikube-integration\.minikube\certs\ca.pem --> /etc/docker/ca.pem (1078 bytes)
I1218 14:15:32.094274 4856 ssh_runner.go:362] scp C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\server.pem --> /etc/docker/server.pem (1216 bytes)
I1218 14:15:32.141667 4856 ssh_runner.go:362] scp C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\server-key.pem --> /etc/docker/server-key.pem (1675 bytes)
I1218 14:15:32.191218 4856 provision.go:86] duration metric: configureAuth took 17.3592658s
I1218 14:15:32.191282 4856 buildroot.go:189] setting minikube options for container-runtime
I1218 14:15:32.191701 4856 config.go:182] Loaded profile config "bridge-353700": Driver=hyperv, ContainerRuntime=docker, KubernetesVersion=v1.28.4
I1218 14:15:32.191701 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:34.502098 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:34.502383 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:34.502496 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:37.428409 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:37.428409 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:37.433408 4856 main.go:141] libmachine: Using SSH client type: native
I1218 14:15:37.434412 4856 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0xdb4f40] 0xdb7a80 <nil> [] 0s} 192.168.224.53 22 <nil> <nil>}
I1218 14:15:37.434412 4856 main.go:141] libmachine: About to run SSH command:
df --output=fstype / | tail -n 1
I1218 14:15:37.578975 4856 main.go:141] libmachine: SSH cmd err, output: <nil>: tmpfs
I1218 14:15:37.579033 4856 buildroot.go:70] root file system type: tmpfs
I1218 14:15:37.579359 4856 provision.go:309] Updating docker unit: /lib/systemd/system/docker.service ...
I1218 14:15:37.579479 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:39.910622 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:39.910966 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:39.911045 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:42.857712 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:42.858025 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:42.867400 4856 main.go:141] libmachine: Using SSH client type: native
I1218 14:15:42.868383 4856 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0xdb4f40] 0xdb7a80 <nil> [] 0s} 192.168.224.53 22 <nil> <nil>}
I1218 14:15:42.868383 4856 main.go:141] libmachine: About to run SSH command:
sudo mkdir -p /lib/systemd/system && printf %s "[Unit]
Description=Docker Application Container Engine
Documentation=https://docs.docker.com
After=network.target minikube-automount.service docker.socket
Requires= minikube-automount.service docker.socket
StartLimitBurst=3
StartLimitIntervalSec=60
[Service]
Type=notify
Restart=on-failure
# This file is a systemd drop-in unit that inherits from the base dockerd configuration.
# The base configuration already specifies an 'ExecStart=...' command. The first directive
# here is to clear out that command inherited from the base configuration. Without this,
# the command from the base configuration and the command specified here are treated as
# a sequence of commands, which is not the desired behavior, nor is it valid -- systemd
# will catch this invalid input and refuse to start the service with an error like:
# Service has more than one ExecStart= setting, which is only allowed for Type=oneshot services.
# NOTE: default-ulimit=nofile is set to an arbitrary number for consistency with other
# container runtimes. If left unlimited, it may result in OOM issues with MySQL.
ExecStart=
ExecStart=/usr/bin/dockerd -H tcp://0.0.0.0:2376 -H unix:///var/run/docker.sock --default-ulimit=nofile=1048576:1048576 --tlsverify --tlscacert /etc/docker/ca.pem --tlscert /etc/docker/server.pem --tlskey /etc/docker/server-key.pem --label provider=hyperv --insecure-registry 10.96.0.0/12
ExecReload=/bin/kill -s HUP \$MAINPID
# Having non-zero Limit*s causes performance problems due to accounting overhead
# in the kernel. We recommend using cgroups to do container-local accounting.
LimitNOFILE=infinity
LimitNPROC=infinity
LimitCORE=infinity
# Uncomment TasksMax if your systemd version supports it.
# Only systemd 226 and above support this version.
TasksMax=infinity
TimeoutStartSec=0
# set delegate yes so that systemd does not reset the cgroups of docker containers
Delegate=yes
# kill only the docker process, not all processes in the cgroup
KillMode=process
[Install]
WantedBy=multi-user.target
" | sudo tee /lib/systemd/system/docker.service.new
I1218 14:15:43.040905 4856 main.go:141] libmachine: SSH cmd err, output: <nil>: [Unit]
Description=Docker Application Container Engine
Documentation=https://docs.docker.com
After=network.target minikube-automount.service docker.socket
Requires= minikube-automount.service docker.socket
StartLimitBurst=3
StartLimitIntervalSec=60
[Service]
Type=notify
Restart=on-failure
# This file is a systemd drop-in unit that inherits from the base dockerd configuration.
# The base configuration already specifies an 'ExecStart=...' command. The first directive
# here is to clear out that command inherited from the base configuration. Without this,
# the command from the base configuration and the command specified here are treated as
# a sequence of commands, which is not the desired behavior, nor is it valid -- systemd
# will catch this invalid input and refuse to start the service with an error like:
# Service has more than one ExecStart= setting, which is only allowed for Type=oneshot services.
# NOTE: default-ulimit=nofile is set to an arbitrary number for consistency with other
# container runtimes. If left unlimited, it may result in OOM issues with MySQL.
ExecStart=
ExecStart=/usr/bin/dockerd -H tcp://0.0.0.0:2376 -H unix:///var/run/docker.sock --default-ulimit=nofile=1048576:1048576 --tlsverify --tlscacert /etc/docker/ca.pem --tlscert /etc/docker/server.pem --tlskey /etc/docker/server-key.pem --label provider=hyperv --insecure-registry 10.96.0.0/12
ExecReload=/bin/kill -s HUP $MAINPID
# Having non-zero Limit*s causes performance problems due to accounting overhead
# in the kernel. We recommend using cgroups to do container-local accounting.
LimitNOFILE=infinity
LimitNPROC=infinity
LimitCORE=infinity
# Uncomment TasksMax if your systemd version supports it.
# Only systemd 226 and above support this version.
TasksMax=infinity
TimeoutStartSec=0
# set delegate yes so that systemd does not reset the cgroups of docker containers
Delegate=yes
# kill only the docker process, not all processes in the cgroup
KillMode=process
[Install]
WantedBy=multi-user.target
I1218 14:15:43.041923 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:45.837659 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:45.837857 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:45.837857 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:48.987868 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:48.987924 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:48.993966 4856 main.go:141] libmachine: Using SSH client type: native
I1218 14:15:48.994662 4856 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0xdb4f40] 0xdb7a80 <nil> [] 0s} 192.168.224.53 22 <nil> <nil>}
I1218 14:15:48.994662 4856 main.go:141] libmachine: About to run SSH command:
sudo diff -u /lib/systemd/system/docker.service /lib/systemd/system/docker.service.new || { sudo mv /lib/systemd/system/docker.service.new /lib/systemd/system/docker.service; sudo systemctl -f daemon-reload && sudo systemctl -f enable docker && sudo systemctl -f restart docker; }
I1218 14:15:52.979789 4856 main.go:141] libmachine: SSH cmd err, output: <nil>: diff: can't stat '/lib/systemd/system/docker.service': No such file or directory
Created symlink /etc/systemd/system/multi-user.target.wants/docker.service → /usr/lib/systemd/system/docker.service.
I1218 14:15:52.980340 4856 machine.go:91] provisioned docker machine in 50.781301s
I1218 14:15:52.980449 4856 client.go:171] LocalClient.Create took 2m20.7867977s
I1218 14:15:52.980449 4856 start.go:167] duration metric: libmachine.API.Create for "bridge-353700" took 2m20.7867977s
I1218 14:15:52.980449 4856 start.go:300] post-start starting for "bridge-353700" (driver="hyperv")
I1218 14:15:52.980449 4856 start.go:329] creating required directories: [/etc/kubernetes/addons /etc/kubernetes/manifests /var/tmp/minikube /var/lib/minikube /var/lib/minikube/certs /var/lib/minikube/images /var/lib/minikube/binaries /tmp/gvisor /usr/share/ca-certificates /etc/ssl/certs]
I1218 14:15:53.001188 4856 ssh_runner.go:195] Run: sudo mkdir -p /etc/kubernetes/addons /etc/kubernetes/manifests /var/tmp/minikube /var/lib/minikube /var/lib/minikube/certs /var/lib/minikube/images /var/lib/minikube/binaries /tmp/gvisor /usr/share/ca-certificates /etc/ssl/certs
I1218 14:15:53.001188 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:15:55.629925 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:15:55.629925 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:55.629925 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:15:58.618567 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:15:58.618839 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:15:58.619094 4856 sshutil.go:53] new ssh client: &{IP:192.168.224.53 Port:22 SSHKeyPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\id_rsa Username:docker}
I1218 14:15:58.755419 4856 ssh_runner.go:235] Completed: sudo mkdir -p /etc/kubernetes/addons /etc/kubernetes/manifests /var/tmp/minikube /var/lib/minikube /var/lib/minikube/certs /var/lib/minikube/images /var/lib/minikube/binaries /tmp/gvisor /usr/share/ca-certificates /etc/ssl/certs: (5.7542048s)
I1218 14:15:58.777847 4856 ssh_runner.go:195] Run: cat /etc/os-release
I1218 14:15:58.788104 4856 info.go:137] Remote host: Buildroot 2021.02.12
I1218 14:15:58.788316 4856 filesync.go:126] Scanning C:\Users\jenkins.minikube7\minikube-integration\.minikube\addons for local assets ...
I1218 14:15:58.788952 4856 filesync.go:126] Scanning C:\Users\jenkins.minikube7\minikube-integration\.minikube\files for local assets ...
I1218 14:15:58.790766 4856 filesync.go:149] local asset: C:\Users\jenkins.minikube7\minikube-integration\.minikube\files\etc\ssl\certs\149282.pem -> 149282.pem in /etc/ssl/certs
I1218 14:15:58.821355 4856 ssh_runner.go:195] Run: sudo mkdir -p /etc/ssl/certs
I1218 14:15:58.844458 4856 ssh_runner.go:362] scp C:\Users\jenkins.minikube7\minikube-integration\.minikube\files\etc\ssl\certs\149282.pem --> /etc/ssl/certs/149282.pem (1708 bytes)
I1218 14:15:58.896354 4856 start.go:303] post-start completed in 5.9158776s
I1218 14:15:58.901317 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:16:01.720437 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:16:01.720437 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:01.720437 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:16:04.951317 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:16:04.951844 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:04.951844 4856 profile.go:148] Saving config to C:\Users\jenkins.minikube7\minikube-integration\.minikube\profiles\bridge-353700\config.json ...
I1218 14:16:04.957001 4856 start.go:128] duration metric: createHost completed in 2m32.7653134s
I1218 14:16:04.957154 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:16:07.536671 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:16:07.536873 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:07.536873 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:16:10.457264 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:16:10.457441 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:10.465260 4856 main.go:141] libmachine: Using SSH client type: native
I1218 14:16:10.465937 4856 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0xdb4f40] 0xdb7a80 <nil> [] 0s} 192.168.224.53 22 <nil> <nil>}
I1218 14:16:10.465937 4856 main.go:141] libmachine: About to run SSH command:
date +%s.%N
I1218 14:16:10.606949 4856 main.go:141] libmachine: SSH cmd err, output: <nil>: 1702908970.619134553
I1218 14:16:10.606949 4856 fix.go:206] guest clock: 1702908970.619134553
I1218 14:16:10.606949 4856 fix.go:219] Guest: 2023-12-18 14:16:10.619134553 +0000 UTC Remote: 2023-12-18 14:16:04.9570016 +0000 UTC m=+189.040801001 (delta=5.662132953s)
I1218 14:16:10.606949 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:16:13.058580 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:16:13.058732 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:13.058732 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:16:15.977744 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:16:15.977744 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:15.985132 4856 main.go:141] libmachine: Using SSH client type: native
I1218 14:16:15.985902 4856 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0xdb4f40] 0xdb7a80 <nil> [] 0s} 192.168.224.53 22 <nil> <nil>}
I1218 14:16:15.985902 4856 main.go:141] libmachine: About to run SSH command:
sudo date -s @1702908970
I1218 14:16:16.137893 4856 main.go:141] libmachine: SSH cmd err, output: <nil>: Mon Dec 18 14:16:10 UTC 2023
I1218 14:16:16.138587 4856 fix.go:226] clock set: Mon Dec 18 14:16:10 UTC 2023
(err=<nil>)
I1218 14:16:16.138665 4856 start.go:83] releasing machines lock for "bridge-353700", held for 2m43.9479269s
I1218 14:16:16.138761 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:16:18.800205 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:16:18.800388 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:18.800388 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:16:22.074466 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:16:22.074722 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:22.080397 4856 ssh_runner.go:195] Run: curl -sS -m 2 https://registry.k8s.io/
I1218 14:16:22.080965 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:16:22.104152 4856 ssh_runner.go:195] Run: cat /version.json
I1218 14:16:22.105146 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM bridge-353700 ).state
I1218 14:16:25.010108 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:16:25.010306 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:25.010539 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:16:25.015560 4856 main.go:141] libmachine: [stdout =====>] : Running
I1218 14:16:25.015854 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:25.015909 4856 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM bridge-353700 ).networkadapters[0]).ipaddresses[0]
I1218 14:16:28.437861 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:16:28.437940 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:28.438743 4856 sshutil.go:53] new ssh client: &{IP:192.168.224.53 Port:22 SSHKeyPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\id_rsa Username:docker}
I1218 14:16:28.499401 4856 main.go:141] libmachine: [stdout =====>] : 192.168.224.53
I1218 14:16:28.499401 4856 main.go:141] libmachine: [stderr =====>] :
I1218 14:16:28.499401 4856 sshutil.go:53] new ssh client: &{IP:192.168.224.53 Port:22 SSHKeyPath:C:\Users\jenkins.minikube7\minikube-integration\.minikube\machines\bridge-353700\id_rsa Username:docker}
I1218 14:16:28.555336 4856 ssh_runner.go:235] Completed: cat /version.json: (6.4501609s)
I1218 14:16:28.578700 4856 ssh_runner.go:195] Run: systemctl --version
I1218 14:16:28.660709 4856 ssh_runner.go:235] Completed: curl -sS -m 2 https://registry.k8s.io/: (6.5802819s)
I1218 14:16:28.687522 4856 ssh_runner.go:195] Run: sh -c "stat /etc/cni/net.d/*loopback.conf*"
W1218 14:16:28.699934 4856 cni.go:209] loopback cni configuration skipped: "/etc/cni/net.d/*loopback.conf*" not found
I1218 14:16:28.715609 4856 ssh_runner.go:195] Run: sudo find /etc/cni/net.d -maxdepth 1 -type f ( ( -name *bridge* -or -name *podman* ) -and -not -name *.mk_disabled ) -printf "%p, " -exec sh -c "sudo mv {} {}.mk_disabled" ;
I1218 14:16:28.750949 4856 cni.go:262] disabled [/etc/cni/net.d/87-podman-bridge.conflist] bridge cni config(s)
I1218 14:16:28.751022 4856 start.go:475] detecting cgroup driver to use...
I1218 14:16:28.751426 4856 ssh_runner.go:195] Run: /bin/bash -c "sudo mkdir -p /etc && printf %s "runtime-endpoint: unix:///run/containerd/containerd.sock
" | sudo tee /etc/crictl.yaml"
I1218 14:16:28.805607 4856 ssh_runner.go:195] Run: sh -c "sudo sed -i -r 's|^( *)sandbox_image = .*$|\1sandbox_image = "registry.k8s.io/pause:3.9"|' /etc/containerd/config.toml"
I1218 14:16:28.838579 4856 ssh_runner.go:195] Run: sh -c "sudo sed -i -r 's|^( *)restrict_oom_score_adj = .*$|\1restrict_oom_score_adj = false|' /etc/containerd/config.toml"
I1218 14:16:28.858302 4856 containerd.go:145] configuring containerd to use "cgroupfs" as cgroup driver...
I1218 14:16:28.872574 4856 ssh_runner.go:195] Run: sh -c "sudo sed -i -r 's|^( *)SystemdCgroup = .*$|\1SystemdCgroup = false|g' /etc/containerd/config.toml"
I1218 14:16:28.910582 4856 ssh_runner.go:195] Run: sh -c "sudo sed -i 's|"io.containerd.runtime.v1.linux"|"io.containerd.runc.v2"|g' /etc/containerd/config.toml"
I1218 14:16:28.947584 4856 ssh_runner.go:195] Run: sh -c "sudo sed -i '/systemd_cgroup/d' /etc/containerd/config.toml"
I1218 14:16:28.992160 4856 ssh_runner.go:195] Run: sh -c "sudo sed -i 's|"io.containerd.runc.v1"|"io.containerd.runc.v2"|g' /etc/containerd/config.toml"
I1218 14:16:29.035752 4856 ssh_runner.go:195] Run: sh -c "sudo rm -rf /etc/cni/net.mk"
I1218 14:16:29.079678 4856 ssh_runner.go:195] Run: sh -c "sudo sed -i -r 's|^( *)conf_dir = .*$|\1conf_dir = "/etc/cni/net.d"|g' /etc/containerd/config.toml"
I1218 14:16:29.125679 4856 ssh_runner.go:195] Run: sudo sysctl net.bridge.bridge-nf-call-iptables
I1218 14:16:29.167212 4856 ssh_runner.go:195] Run: sudo sh -c "echo 1 > /proc/sys/net/ipv4/ip_forward"
I1218 14:16:29.202231 4856 ssh_runner.go:195] Run: sudo systemctl daemon-reload
I1218 14:16:29.419998 4856 ssh_runner.go:195] Run: sudo systemctl restart containerd
I1218 14:16:29.460382 4856 start.go:475] detecting cgroup driver to use...
I1218 14:16:29.477489 4856 ssh_runner.go:195] Run: sudo systemctl cat docker.service
I1218 14:16:29.531502 4856 ssh_runner.go:195] Run: sudo systemctl is-active --quiet service containerd
I1218 14:16:29.573489 4856 ssh_runner.go:195] Run: sudo systemctl stop -f containerd
I1218 14:16:29.628485 4856 ssh_runner.go:195] Run: sudo systemctl is-active --quiet service containerd
I1218 14:16:29.681488 4856 ssh_runner.go:195] Run: sudo systemctl is-active --quiet service crio
I1218 14:16:29.724423 4856 ssh_runner.go:195] Run: sudo systemctl stop -f crio
I1218 14:16:29.801401 4856 ssh_runner.go:195] Run: sudo systemctl is-active --quiet service crio
I1218 14:16:29.826032 4856 ssh_runner.go:195] Run: /bin/bash -c "sudo mkdir -p /etc && printf %s "runtime-endpoint: unix:///var/run/cri-dockerd.sock
" | sudo tee /etc/crictl.yaml"
I1218 14:16:29.885936 4856 ssh_runner.go:195] Run: which cri-dockerd
I1218 14:16:29.907471 4856 ssh_runner.go:195] Run: sudo mkdir -p /etc/systemd/system/cri-docker.service.d
I1218 14:16:29.928269 4856 ssh_runner.go:362] scp memory --> /etc/systemd/system/cri-docker.service.d/10-cni.conf (189 bytes)
I1218 14:16:29.974393 4856 ssh_runner.go:195] Run: sudo systemctl unmask docker.service
I1218 14:16:30.176218 4856 ssh_runner.go:195] Run: sudo systemctl enable docker.socket
I1218 14:16:30.352839 4856 docker.go:560] configuring docker to use "cgroupfs" as cgroup driver...
I1218 14:16:30.353062 4856 ssh_runner.go:362] scp memory --> /etc/docker/daemon.json (130 bytes)
I1218 14:16:30.405250 4856 ssh_runner.go:195] Run: sudo systemctl daemon-reload
I1218 14:16:30.593271 4856 ssh_runner.go:195] Run: sudo systemctl restart docker
I1218 14:17:31.759150 4856 ssh_runner.go:235] Completed: sudo systemctl restart docker: (1m1.1655972s)
I1218 14:17:31.793267 4856 ssh_runner.go:195] Run: sudo journalctl --no-pager -u docker
I1218 14:17:31.828578 4856 out.go:177]
W1218 14:17:31.829572 4856 out.go:239] X Exiting due to RUNTIME_ENABLE: Failed to enable container runtime: sudo systemctl restart docker: Process exited with status 1
stdout:
stderr:
Job for docker.service failed because the control process exited with error code.
See "systemctl status docker.service" and "journalctl -xe" for details.
sudo journalctl --no-pager -u docker:
-- stdout --
-- Journal begins at Mon 2023-12-18 14:14:48 UTC, ends at Mon 2023-12-18 14:17:31 UTC. --
Dec 18 14:15:49 bridge-353700 systemd[1]: Starting Docker Application Container Engine...
Dec 18 14:15:49 bridge-353700 dockerd[676]: time="2023-12-18T14:15:49.640424915Z" level=info msg="Starting up"
Dec 18 14:15:49 bridge-353700 dockerd[676]: time="2023-12-18T14:15:49.641484774Z" level=info msg="containerd not running, starting managed containerd"
Dec 18 14:15:49 bridge-353700 dockerd[676]: time="2023-12-18T14:15:49.643105366Z" level=info msg="started new containerd process" address=/var/run/docker/containerd/containerd.sock module=libcontainerd pid=682
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.691825106Z" level=info msg="starting containerd" revision=64b8a811b07ba6288238eefc14d898ee0b5b99ba version=v1.7.11
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.744951995Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.745369419Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.749853871Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.aufs\"..." error="aufs is not supported (modprobe aufs failed: exit status 1 \"modprobe: FATAL: Module aufs not found in directory /lib/modules/5.10.57\\n\"): skip plugin" type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.750048882Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.750997235Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." error="path /var/lib/docker/containerd/daemon/io.containerd.snapshotter.v1.btrfs (ext4) must be a btrfs filesystem to be used with the btrfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751168745Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751377757Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751632071Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751795080Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751981691Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.752642228Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.752835439Z" level=warning msg="failed to load plugin io.containerd.snapshotter.v1.devmapper" error="devmapper not configured"
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.752926744Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.753302465Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.zfs\"..." error="path /var/lib/docker/containerd/daemon/io.containerd.snapshotter.v1.zfs must be a zfs filesystem to be used with the zfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.753366769Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.753487075Z" level=warning msg="could not use snapshotter devmapper in metadata plugin" error="devmapper not configured"
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.753657885Z" level=info msg="metadata content store policy set" policy=shared
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803046364Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803191772Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803217873Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803310378Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803335080Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803349681Z" level=info msg="NRI interface is disabled by configuration."
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803378982Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803711201Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803835708Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803876510Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803910012Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803945514Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803997517Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804068121Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804101223Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804134525Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804168727Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804207729Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804309335Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804497845Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804956171Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805015674Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805038176Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805065477Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805145182Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805184284Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805218786Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805233187Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805316291Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805334492Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805352493Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805368194Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805384595Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805524403Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805570806Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805590307Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805606808Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805632109Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805656710Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805673211Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805687612Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805705813Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="no OpenTelemetry endpoint: skip plugin" type=io.containerd.tracing.processor.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805723514Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805736515Z" level=info msg="skipping tracing processor initialization (no tracing plugin)" error="no OpenTelemetry endpoint: skip plugin"
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.806095535Z" level=info msg=serving... address=/var/run/docker/containerd/containerd-debug.sock
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.806296246Z" level=info msg=serving... address=/var/run/docker/containerd/containerd.sock.ttrpc
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.806521959Z" level=info msg=serving... address=/var/run/docker/containerd/containerd.sock
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.806730871Z" level=info msg="containerd successfully booted in 0.117085s"
Dec 18 14:15:50 bridge-353700 dockerd[676]: time="2023-12-18T14:15:50.497180496Z" level=info msg="[graphdriver] trying configured driver: overlay2"
Dec 18 14:15:50 bridge-353700 dockerd[676]: time="2023-12-18T14:15:50.796205967Z" level=info msg="Loading containers: start."
Dec 18 14:15:51 bridge-353700 dockerd[676]: time="2023-12-18T14:15:51.902596103Z" level=info msg="Loading containers: done."
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090676401Z" level=warning msg="WARNING: No blkio throttle.read_bps_device support"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090806407Z" level=warning msg="WARNING: No blkio throttle.write_bps_device support"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090821508Z" level=warning msg="WARNING: No blkio throttle.read_iops_device support"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090832308Z" level=warning msg="WARNING: No blkio throttle.write_iops_device support"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090874810Z" level=info msg="Docker daemon" commit=311b9ff graphdriver=overlay2 version=24.0.7
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.091061919Z" level=info msg="Daemon has completed initialization"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.987596478Z" level=info msg="API listen on /var/run/docker.sock"
Dec 18 14:15:52 bridge-353700 systemd[1]: Started Docker Application Container Engine.
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.989555569Z" level=info msg="API listen on [::]:2376"
Dec 18 14:16:30 bridge-353700 systemd[1]: Stopping Docker Application Container Engine...
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.635089169Z" level=info msg="Processing signal 'terminated'"
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.637560174Z" level=info msg="stopping event stream following graceful shutdown" error="<nil>" module=libcontainerd namespace=moby
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.638447476Z" level=info msg="Daemon shutdown complete"
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.638636176Z" level=info msg="stopping healthcheck following graceful shutdown" module=libcontainerd
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.638659776Z" level=info msg="stopping event stream following graceful shutdown" error="context canceled" module=libcontainerd namespace=plugins.moby
Dec 18 14:16:31 bridge-353700 systemd[1]: docker.service: Succeeded.
Dec 18 14:16:31 bridge-353700 systemd[1]: Stopped Docker Application Container Engine.
Dec 18 14:16:31 bridge-353700 systemd[1]: Starting Docker Application Container Engine...
Dec 18 14:16:31 bridge-353700 dockerd[1013]: time="2023-12-18T14:16:31.758033887Z" level=info msg="Starting up"
Dec 18 14:17:31 bridge-353700 dockerd[1013]: failed to start daemon: failed to dial "/run/containerd/containerd.sock": failed to dial "/run/containerd/containerd.sock": context deadline exceeded
Dec 18 14:17:31 bridge-353700 systemd[1]: docker.service: Main process exited, code=exited, status=1/FAILURE
Dec 18 14:17:31 bridge-353700 systemd[1]: docker.service: Failed with result 'exit-code'.
Dec 18 14:17:31 bridge-353700 systemd[1]: Failed to start Docker Application Container Engine.
-- /stdout --
X Exiting due to RUNTIME_ENABLE: Failed to enable container runtime: sudo systemctl restart docker: Process exited with status 1
stdout:
stderr:
Job for docker.service failed because the control process exited with error code.
See "systemctl status docker.service" and "journalctl -xe" for details.
sudo journalctl --no-pager -u docker:
-- stdout --
-- Journal begins at Mon 2023-12-18 14:14:48 UTC, ends at Mon 2023-12-18 14:17:31 UTC. --
Dec 18 14:15:49 bridge-353700 systemd[1]: Starting Docker Application Container Engine...
Dec 18 14:15:49 bridge-353700 dockerd[676]: time="2023-12-18T14:15:49.640424915Z" level=info msg="Starting up"
Dec 18 14:15:49 bridge-353700 dockerd[676]: time="2023-12-18T14:15:49.641484774Z" level=info msg="containerd not running, starting managed containerd"
Dec 18 14:15:49 bridge-353700 dockerd[676]: time="2023-12-18T14:15:49.643105366Z" level=info msg="started new containerd process" address=/var/run/docker/containerd/containerd.sock module=libcontainerd pid=682
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.691825106Z" level=info msg="starting containerd" revision=64b8a811b07ba6288238eefc14d898ee0b5b99ba version=v1.7.11
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.744951995Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.745369419Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.749853871Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.aufs\"..." error="aufs is not supported (modprobe aufs failed: exit status 1 \"modprobe: FATAL: Module aufs not found in directory /lib/modules/5.10.57\\n\"): skip plugin" type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.750048882Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.750997235Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." error="path /var/lib/docker/containerd/daemon/io.containerd.snapshotter.v1.btrfs (ext4) must be a btrfs filesystem to be used with the btrfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751168745Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751377757Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751632071Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751795080Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.751981691Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.752642228Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.752835439Z" level=warning msg="failed to load plugin io.containerd.snapshotter.v1.devmapper" error="devmapper not configured"
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.752926744Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.753302465Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.zfs\"..." error="path /var/lib/docker/containerd/daemon/io.containerd.snapshotter.v1.zfs must be a zfs filesystem to be used with the zfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.753366769Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.753487075Z" level=warning msg="could not use snapshotter devmapper in metadata plugin" error="devmapper not configured"
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.753657885Z" level=info msg="metadata content store policy set" policy=shared
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803046364Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803191772Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803217873Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803310378Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803335080Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803349681Z" level=info msg="NRI interface is disabled by configuration."
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803378982Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803711201Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803835708Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803876510Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803910012Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803945514Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.803997517Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804068121Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804101223Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804134525Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804168727Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804207729Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804309335Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804497845Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.804956171Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805015674Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805038176Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805065477Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805145182Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805184284Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805218786Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805233187Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805316291Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805334492Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805352493Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805368194Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805384595Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805524403Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805570806Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805590307Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805606808Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805632109Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805656710Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805673211Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805687612Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805705813Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="no OpenTelemetry endpoint: skip plugin" type=io.containerd.tracing.processor.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805723514Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.805736515Z" level=info msg="skipping tracing processor initialization (no tracing plugin)" error="no OpenTelemetry endpoint: skip plugin"
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.806095535Z" level=info msg=serving... address=/var/run/docker/containerd/containerd-debug.sock
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.806296246Z" level=info msg=serving... address=/var/run/docker/containerd/containerd.sock.ttrpc
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.806521959Z" level=info msg=serving... address=/var/run/docker/containerd/containerd.sock
Dec 18 14:15:49 bridge-353700 dockerd[682]: time="2023-12-18T14:15:49.806730871Z" level=info msg="containerd successfully booted in 0.117085s"
Dec 18 14:15:50 bridge-353700 dockerd[676]: time="2023-12-18T14:15:50.497180496Z" level=info msg="[graphdriver] trying configured driver: overlay2"
Dec 18 14:15:50 bridge-353700 dockerd[676]: time="2023-12-18T14:15:50.796205967Z" level=info msg="Loading containers: start."
Dec 18 14:15:51 bridge-353700 dockerd[676]: time="2023-12-18T14:15:51.902596103Z" level=info msg="Loading containers: done."
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090676401Z" level=warning msg="WARNING: No blkio throttle.read_bps_device support"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090806407Z" level=warning msg="WARNING: No blkio throttle.write_bps_device support"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090821508Z" level=warning msg="WARNING: No blkio throttle.read_iops_device support"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090832308Z" level=warning msg="WARNING: No blkio throttle.write_iops_device support"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.090874810Z" level=info msg="Docker daemon" commit=311b9ff graphdriver=overlay2 version=24.0.7
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.091061919Z" level=info msg="Daemon has completed initialization"
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.987596478Z" level=info msg="API listen on /var/run/docker.sock"
Dec 18 14:15:52 bridge-353700 systemd[1]: Started Docker Application Container Engine.
Dec 18 14:15:52 bridge-353700 dockerd[676]: time="2023-12-18T14:15:52.989555569Z" level=info msg="API listen on [::]:2376"
Dec 18 14:16:30 bridge-353700 systemd[1]: Stopping Docker Application Container Engine...
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.635089169Z" level=info msg="Processing signal 'terminated'"
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.637560174Z" level=info msg="stopping event stream following graceful shutdown" error="<nil>" module=libcontainerd namespace=moby
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.638447476Z" level=info msg="Daemon shutdown complete"
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.638636176Z" level=info msg="stopping healthcheck following graceful shutdown" module=libcontainerd
Dec 18 14:16:30 bridge-353700 dockerd[676]: time="2023-12-18T14:16:30.638659776Z" level=info msg="stopping event stream following graceful shutdown" error="context canceled" module=libcontainerd namespace=plugins.moby
Dec 18 14:16:31 bridge-353700 systemd[1]: docker.service: Succeeded.
Dec 18 14:16:31 bridge-353700 systemd[1]: Stopped Docker Application Container Engine.
Dec 18 14:16:31 bridge-353700 systemd[1]: Starting Docker Application Container Engine...
Dec 18 14:16:31 bridge-353700 dockerd[1013]: time="2023-12-18T14:16:31.758033887Z" level=info msg="Starting up"
Dec 18 14:17:31 bridge-353700 dockerd[1013]: failed to start daemon: failed to dial "/run/containerd/containerd.sock": failed to dial "/run/containerd/containerd.sock": context deadline exceeded
Dec 18 14:17:31 bridge-353700 systemd[1]: docker.service: Main process exited, code=exited, status=1/FAILURE
Dec 18 14:17:31 bridge-353700 systemd[1]: docker.service: Failed with result 'exit-code'.
Dec 18 14:17:31 bridge-353700 systemd[1]: Failed to start Docker Application Container Engine.
-- /stdout --
W1218 14:17:31.829572 4856 out.go:239] *
*
W1218 14:17:31.830561 4856 out.go:239] ╭─────────────────────────────────────────────────────────────────────────────────────────────╮
│ │
│ * If the above advice does not help, please let us know: │
│ https://github.com/kubernetes/minikube/issues/new/choose │
│ │
│ * Please run `minikube logs --file=logs.txt` and attach logs.txt to the GitHub issue. │
│ │
╰─────────────────────────────────────────────────────────────────────────────────────────────╯
╭─────────────────────────────────────────────────────────────────────────────────────────────╮
│ │
│ * If the above advice does not help, please let us know: │
│ https://github.com/kubernetes/minikube/issues/new/choose │
│ │
│ * Please run `minikube logs --file=logs.txt` and attach logs.txt to the GitHub issue. │
│ │
╰─────────────────────────────────────────────────────────────────────────────────────────────╯
I1218 14:17:31.831574 4856 out.go:177]
** /stderr **
net_test.go:114: failed start: exit status 90
--- FAIL: TestNetworkPlugins/group/bridge/Start (276.20s)