=== RUN TestOffline
=== PAUSE TestOffline
=== CONT TestOffline
aab_offline_test.go:55: (dbg) Run: out/minikube-windows-amd64.exe start -p offline-docker-748400 --alsologtostderr -v=1 --memory=2048 --wait=true --driver=hyperv
aab_offline_test.go:55: (dbg) Non-zero exit: out/minikube-windows-amd64.exe start -p offline-docker-748400 --alsologtostderr -v=1 --memory=2048 --wait=true --driver=hyperv: exit status 90 (3m28.7702503s)
-- stdout --
* [offline-docker-748400] minikube v1.32.0 on Microsoft Windows 10 Enterprise N 10.0.19045.3930 Build 19045.3930
- KUBECONFIG=C:\Users\jenkins.minikube3\minikube-integration\kubeconfig
- MINIKUBE_FORCE_SYSTEMD=
- MINIKUBE_HOME=C:\Users\jenkins.minikube3\minikube-integration\.minikube
- MINIKUBE_LOCATION=17967
- MINIKUBE_SUPPRESS_DOCKER_PERFORMANCE=true
* Using the hyperv driver based on user configuration
* Starting control plane node offline-docker-748400 in cluster offline-docker-748400
* Creating hyperv VM (CPUs=2, Memory=2048MB, Disk=20000MB) ...
* Found network options:
- HTTP_PROXY=172.16.1.1:1
* Please see https://minikube.sigs.k8s.io/docs/handbook/vpn_and_proxy/ for more details
- HTTP_PROXY=172.16.1.1:1
-- /stdout --
** stderr **
W0116 03:30:13.083195 10356 main.go:291] Unable to resolve the current Docker CLI context "default": context "default": context not found: open C:\Users\jenkins.minikube3\.docker\contexts\meta\37a8eec1ce19687d132fe29051dca629d164e2c4958ba141d5f4133a33f0688f\meta.json: The system cannot find the path specified.
I0116 03:30:13.178191 10356 out.go:296] Setting OutFile to fd 736 ...
I0116 03:30:13.179193 10356 out.go:343] TERM=,COLORTERM=, which probably does not support color
I0116 03:30:13.179193 10356 out.go:309] Setting ErrFile to fd 840...
I0116 03:30:13.179193 10356 out.go:343] TERM=,COLORTERM=, which probably does not support color
I0116 03:30:13.203186 10356 out.go:303] Setting JSON to false
I0116 03:30:13.207180 10356 start.go:128] hostinfo: {"hostname":"minikube3","uptime":54204,"bootTime":1705321609,"procs":190,"os":"windows","platform":"Microsoft Windows 10 Enterprise N","platformFamily":"Standalone Workstation","platformVersion":"10.0.19045.3930 Build 19045.3930","kernelVersion":"10.0.19045.3930 Build 19045.3930","kernelArch":"x86_64","virtualizationSystem":"","virtualizationRole":"","hostId":"a0f355d5-8b6e-4346-9071-73232725d096"}
W0116 03:30:13.207180 10356 start.go:136] gopshost.Virtualization returned error: not implemented yet
I0116 03:30:13.209183 10356 out.go:177] * [offline-docker-748400] minikube v1.32.0 on Microsoft Windows 10 Enterprise N 10.0.19045.3930 Build 19045.3930
I0116 03:30:13.210180 10356 out.go:177] - KUBECONFIG=C:\Users\jenkins.minikube3\minikube-integration\kubeconfig
I0116 03:30:13.210180 10356 notify.go:220] Checking for updates...
I0116 03:30:13.211179 10356 out.go:177] - MINIKUBE_FORCE_SYSTEMD=
I0116 03:30:13.212181 10356 out.go:177] - MINIKUBE_HOME=C:\Users\jenkins.minikube3\minikube-integration\.minikube
I0116 03:30:13.213197 10356 out.go:177] - MINIKUBE_LOCATION=17967
I0116 03:30:13.215194 10356 out.go:177] - MINIKUBE_SUPPRESS_DOCKER_PERFORMANCE=true
I0116 03:30:13.217200 10356 driver.go:392] Setting default libvirt URI to qemu:///system
I0116 03:30:19.607643 10356 out.go:177] * Using the hyperv driver based on user configuration
I0116 03:30:19.608420 10356 start.go:298] selected driver: hyperv
I0116 03:30:19.608420 10356 start.go:902] validating driver "hyperv" against <nil>
I0116 03:30:19.608703 10356 start.go:913] status for hyperv: {Installed:true Healthy:true Running:false NeedsImprovement:false Error:<nil> Reason: Fix: Doc: Version:}
I0116 03:30:19.662108 10356 start_flags.go:307] no existing cluster config was found, will generate one from the flags
I0116 03:30:19.665223 10356 start_flags.go:927] Waiting for all components: map[apiserver:true apps_running:true default_sa:true extra:true kubelet:true node_ready:true system_pods:true]
I0116 03:30:19.665223 10356 cni.go:84] Creating CNI manager for ""
I0116 03:30:19.665223 10356 cni.go:158] "hyperv" driver + "docker" container runtime found on kubernetes v1.24+, recommending bridge
I0116 03:30:19.665223 10356 start_flags.go:316] Found "bridge CNI" CNI - setting NetworkPlugin=cni
I0116 03:30:19.665223 10356 start_flags.go:321] config:
{Name:offline-docker-748400 KeepContext:false EmbedCerts:false MinikubeISO: KicBaseImage:gcr.io/k8s-minikube/kicbase-builds:v0.0.42-1704759386-17866@sha256:8c3c33047f9bc285e1f5f2a5aa14744a2fe04c58478f02f77b06169dea8dd3f0 Memory:2048 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:offline-docker-748400 Namespace:default APIServerName:minikubeCA APIServerNames:[] APIServerIPs:[] DNSDomain:cluster.local Container
Runtime:docker CRISocket: NetworkPlugin:cni FeatureGates: ServiceCIDR:10.96.0.0/12 ImageRepository: LoadBalancerStartIP: LoadBalancerEndIP: CustomIngressCert: RegistryAliases: ExtraOptions:[] ShouldLoadCachedImages:true EnableDefaultCNI:false CNI: 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:6m0s ScheduledStop:<nil> ExposedPorts:[] ListenAddress: Network: Subnet: MultiNodeRequested:false ExtraDisks:0 CertExpiration:26280h0m0s Mount:false MountString:C:\Users\jenkins.minikube3:/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 GPUs:}
I0116 03:30:19.666080 10356 iso.go:125] acquiring lock: {Name:mk2c0b62d272a573835231fdc54419c800e07e34 Clock:{} Delay:500ms Timeout:10m0s Cancel:<nil>}
I0116 03:30:19.667146 10356 out.go:177] * Starting control plane node offline-docker-748400 in cluster offline-docker-748400
I0116 03:30:19.668081 10356 preload.go:132] Checking if preload exists for k8s version v1.28.4 and runtime docker
I0116 03:30:19.668081 10356 preload.go:148] Found local preload: C:\Users\jenkins.minikube3\minikube-integration\.minikube\cache\preloaded-tarball\preloaded-images-k8s-v18-v1.28.4-docker-overlay2-amd64.tar.lz4
I0116 03:30:19.668081 10356 cache.go:56] Caching tarball of preloaded images
I0116 03:30:19.669068 10356 preload.go:174] Found C:\Users\jenkins.minikube3\minikube-integration\.minikube\cache\preloaded-tarball\preloaded-images-k8s-v18-v1.28.4-docker-overlay2-amd64.tar.lz4 in cache, skipping download
I0116 03:30:19.669068 10356 cache.go:59] Finished verifying existence of preloaded tar for v1.28.4 on docker
I0116 03:30:19.669068 10356 profile.go:148] Saving config to C:\Users\jenkins.minikube3\minikube-integration\.minikube\profiles\offline-docker-748400\config.json ...
I0116 03:30:19.669068 10356 lock.go:35] WriteFile acquiring C:\Users\jenkins.minikube3\minikube-integration\.minikube\profiles\offline-docker-748400\config.json: {Name:mkc954fce93a43120c8305ea80afd83bd2d8c0bc Clock:{} Delay:500ms Timeout:1m0s Cancel:<nil>}
I0116 03:30:19.671081 10356 start.go:365] acquiring machines lock for offline-docker-748400: {Name:mk88ace50ad3bf72786f3a589a5328076247f3a1 Clock:{} Delay:500ms Timeout:13m0s Cancel:<nil>}
I0116 03:30:19.671081 10356 start.go:369] acquired machines lock for "offline-docker-748400" in 0s
I0116 03:30:19.671081 10356 start.go:93] Provisioning new machine with config: &{Name:offline-docker-748400 KeepContext:false EmbedCerts:false MinikubeISO:https://storage.googleapis.com/minikube-builds/iso/17866/minikube-v1.32.1-1703784139-17866-amd64.iso KicBaseImage:gcr.io/k8s-minikube/kicbase-builds:v0.0.42-1704759386-17866@sha256:8c3c33047f9bc285e1f5f2a5aa14744a2fe04c58478f02f77b06169dea8dd3f0 Memory:2048 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 Kubern
etesConfig:{KubernetesVersion:v1.28.4 ClusterName:offline-docker-748400 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: 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:6m0s ScheduledStop:<nil> ExposedPorts:[] ListenAddress: Network: Subnet: MultiNodeRequested:false ExtraDisks:0 CertExpiration:26280h0m0s Mount:false MountString:C:\Users\jenkins.minikube3:/minikube-host Mount9PVersion:9p2000.L MountGID:docke
r MountIP: MountMSize:262144 MountOptions:[] MountPort:0 MountType:9p MountUID:docker BinaryMirror: DisableOptimizations:false DisableMetrics:false CustomQemuFirmwarePath: SocketVMnetClientPath: SocketVMnetPath: StaticIP: SSHAuthSock: SSHAgentPID:0 GPUs:} &{Name: IP: Port:8443 KubernetesVersion:v1.28.4 ContainerRuntime:docker ControlPlane:true Worker:true}
I0116 03:30:19.671081 10356 start.go:125] createHost starting for "" (driver="hyperv")
I0116 03:30:19.672080 10356 out.go:204] * Creating hyperv VM (CPUs=2, Memory=2048MB, Disk=20000MB) ...
I0116 03:30:19.672080 10356 start.go:159] libmachine.API.Create for "offline-docker-748400" (driver="hyperv")
I0116 03:30:19.672080 10356 client.go:168] LocalClient.Create starting
I0116 03:30:19.673076 10356 main.go:141] libmachine: Reading certificate data from C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\ca.pem
I0116 03:30:19.673076 10356 main.go:141] libmachine: Decoding PEM data...
I0116 03:30:19.673076 10356 main.go:141] libmachine: Parsing certificate...
I0116 03:30:19.673076 10356 main.go:141] libmachine: Reading certificate data from C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\cert.pem
I0116 03:30:19.674079 10356 main.go:141] libmachine: Decoding PEM data...
I0116 03:30:19.674079 10356 main.go:141] libmachine: Parsing certificate...
I0116 03:30:19.674079 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive @(Get-Module -ListAvailable hyper-v).Name | Get-Unique
I0116 03:30:21.935618 10356 main.go:141] libmachine: [stdout =====>] : Hyper-V
I0116 03:30:21.935618 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:21.935618 10356 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")))
I0116 03:30:24.286600 10356 main.go:141] libmachine: [stdout =====>] : False
I0116 03:30:24.286600 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:24.286600 10356 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")
I0116 03:30:25.774323 10356 main.go:141] libmachine: [stdout =====>] : True
I0116 03:30:25.774377 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:25.774377 10356 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)
I0116 03:30:29.759193 10356 main.go:141] libmachine: [stdout =====>] : [
{
"Id": "c08cb7b8-9b3c-408e-8e30-5e16a3aeb444",
"Name": "Default Switch",
"SwitchType": 1
}
]
I0116 03:30:29.759193 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:29.761865 10356 main.go:141] libmachine: Downloading C:\Users\jenkins.minikube3\minikube-integration\.minikube\cache\boot2docker.iso from file://C:/Users/jenkins.minikube3/minikube-integration/.minikube/cache/iso/amd64/minikube-v1.32.1-1703784139-17866-amd64.iso...
I0116 03:30:30.167497 10356 main.go:141] libmachine: Creating SSH key...
I0116 03:30:30.292973 10356 main.go:141] libmachine: Creating VM...
I0116 03:30:30.292973 10356 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)
I0116 03:30:33.124528 10356 main.go:141] libmachine: [stdout =====>] : [
{
"Id": "c08cb7b8-9b3c-408e-8e30-5e16a3aeb444",
"Name": "Default Switch",
"SwitchType": 1
}
]
I0116 03:30:33.124528 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:33.125061 10356 main.go:141] libmachine: Using switch "Default Switch"
I0116 03:30:33.125061 10356 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")
I0116 03:30:34.965417 10356 main.go:141] libmachine: [stdout =====>] : True
I0116 03:30:34.965417 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:34.965501 10356 main.go:141] libmachine: Creating VHD
I0116 03:30:34.965501 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\New-VHD -Path 'C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\fixed.vhd' -SizeBytes 10MB -Fixed
I0116 03:30:38.804860 10356 main.go:141] libmachine: [stdout =====>] :
ComputerName : minikube3
Path : C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\fixe
d.vhd
VhdFormat : VHD
VhdType : Fixed
FileSize : 10486272
Size : 10485760
MinimumSize :
LogicalSectorSize : 512
PhysicalSectorSize : 512
BlockSize : 0
ParentPath :
DiskIdentifier : 8CCAD214-7584-40F7-86BA-E201B471850E
FragmentationPercentage : 0
Alignment : 1
Attached : False
DiskNumber :
IsPMEMCompatible : False
AddressAbstractionType : None
Number :
I0116 03:30:38.804947 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:38.804947 10356 main.go:141] libmachine: Writing magic tar header
I0116 03:30:38.805025 10356 main.go:141] libmachine: Writing SSH key tar header
I0116 03:30:38.814371 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Convert-VHD -Path 'C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\fixed.vhd' -DestinationPath 'C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\disk.vhd' -VHDType Dynamic -DeleteSource
I0116 03:30:41.997294 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:30:41.997294 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:41.997450 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Resize-VHD -Path 'C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\disk.vhd' -SizeBytes 20000MB
I0116 03:30:44.454198 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:30:44.454419 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:44.454473 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\New-VM offline-docker-748400 -Path 'C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400' -SwitchName 'Default Switch' -MemoryStartupBytes 2048MB
I0116 03:30:47.929916 10356 main.go:141] libmachine: [stdout =====>] :
Name State CPUUsage(%) MemoryAssigned(M) Uptime Status Version
---- ----- ----------- ----------------- ------ ------ -------
offline-docker-748400 Off 0 0 00:00:00 Operating normally 9.0
I0116 03:30:47.930089 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:47.930089 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Set-VMMemory -VMName offline-docker-748400 -DynamicMemoryEnabled $false
I0116 03:30:50.154252 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:30:50.154252 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:50.154370 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Set-VMProcessor offline-docker-748400 -Count 2
I0116 03:30:52.314398 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:30:52.314398 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:52.314398 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Set-VMDvdDrive -VMName offline-docker-748400 -Path 'C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\boot2docker.iso'
I0116 03:30:54.871225 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:30:54.871513 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:54.871597 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Add-VMHardDiskDrive -VMName offline-docker-748400 -Path 'C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\disk.vhd'
I0116 03:30:57.447174 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:30:57.447174 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:30:57.447278 10356 main.go:141] libmachine: Starting VM...
I0116 03:30:57.447278 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive Hyper-V\Start-VM offline-docker-748400
I0116 03:31:00.299313 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:31:00.299313 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:00.299313 10356 main.go:141] libmachine: Waiting for host to start...
I0116 03:31:00.299313 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:02.636198 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:02.636198 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:02.636443 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:05.138902 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:31:05.138902 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:06.139268 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:08.330601 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:08.330601 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:08.330601 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:10.849444 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:31:10.849536 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:11.850712 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:14.029313 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:14.029313 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:14.029313 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:16.606672 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:31:16.606672 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:17.610964 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:19.838599 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:19.838599 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:19.838664 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:22.316908 10356 main.go:141] libmachine: [stdout =====>] :
I0116 03:31:22.317066 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:23.330076 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:25.525184 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:25.525281 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:25.525395 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:28.123866 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:31:28.123943 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:28.123943 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:30.256768 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:30.256768 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:30.256959 10356 machine.go:88] provisioning docker machine ...
I0116 03:31:30.256959 10356 buildroot.go:166] provisioning hostname "offline-docker-748400"
I0116 03:31:30.256959 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:32.434608 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:32.434608 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:32.434691 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:34.958915 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:31:34.958915 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:34.965615 10356 main.go:141] libmachine: Using SSH client type: native
I0116 03:31:34.978524 10356 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0x1326120] 0x1328c60 <nil> [] 0s} 172.27.115.126 22 <nil> <nil>}
I0116 03:31:34.978524 10356 main.go:141] libmachine: About to run SSH command:
sudo hostname offline-docker-748400 && echo "offline-docker-748400" | sudo tee /etc/hostname
I0116 03:31:35.141446 10356 main.go:141] libmachine: SSH cmd err, output: <nil>: offline-docker-748400
I0116 03:31:35.141550 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:37.264272 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:37.264272 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:37.264272 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:39.774207 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:31:39.774207 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:39.780948 10356 main.go:141] libmachine: Using SSH client type: native
I0116 03:31:39.781674 10356 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0x1326120] 0x1328c60 <nil> [] 0s} 172.27.115.126 22 <nil> <nil>}
I0116 03:31:39.781674 10356 main.go:141] libmachine: About to run SSH command:
if ! grep -xq '.*\soffline-docker-748400' /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 offline-docker-748400/g' /etc/hosts;
else
echo '127.0.1.1 offline-docker-748400' | sudo tee -a /etc/hosts;
fi
fi
I0116 03:31:39.949877 10356 main.go:141] libmachine: SSH cmd err, output: <nil>:
I0116 03:31:39.949877 10356 buildroot.go:172] set auth options {CertDir:C:\Users\jenkins.minikube3\minikube-integration\.minikube CaCertPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\ca.pem CaPrivateKeyPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\ca-key.pem CaCertRemotePath:/etc/docker/ca.pem ServerCertPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\server.pem ServerKeyPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\server-key.pem ClientKeyPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\key.pem ServerCertRemotePath:/etc/docker/server.pem ServerKeyRemotePath:/etc/docker/server-key.pem ClientCertPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\cert.pem ServerCertSANs:[] StorePath:C:\Users\jenkins.minikube3\minikube-integration\.minikube}
I0116 03:31:39.949877 10356 buildroot.go:174] setting up certificates
I0116 03:31:39.949877 10356 provision.go:83] configureAuth start
I0116 03:31:39.949877 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:42.048946 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:42.048946 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:42.048946 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:44.525758 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:31:44.525876 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:44.525876 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:46.611506 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:46.611506 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:46.611650 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:49.137882 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:31:49.138051 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:49.138051 10356 provision.go:138] copyHostCerts
I0116 03:31:49.138132 10356 exec_runner.go:144] found C:\Users\jenkins.minikube3\minikube-integration\.minikube/ca.pem, removing ...
I0116 03:31:49.138132 10356 exec_runner.go:203] rm: C:\Users\jenkins.minikube3\minikube-integration\.minikube\ca.pem
I0116 03:31:49.139031 10356 exec_runner.go:151] cp: C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\ca.pem --> C:\Users\jenkins.minikube3\minikube-integration\.minikube/ca.pem (1082 bytes)
I0116 03:31:49.140273 10356 exec_runner.go:144] found C:\Users\jenkins.minikube3\minikube-integration\.minikube/cert.pem, removing ...
I0116 03:31:49.140273 10356 exec_runner.go:203] rm: C:\Users\jenkins.minikube3\minikube-integration\.minikube\cert.pem
I0116 03:31:49.140846 10356 exec_runner.go:151] cp: C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\cert.pem --> C:\Users\jenkins.minikube3\minikube-integration\.minikube/cert.pem (1123 bytes)
I0116 03:31:49.142497 10356 exec_runner.go:144] found C:\Users\jenkins.minikube3\minikube-integration\.minikube/key.pem, removing ...
I0116 03:31:49.142497 10356 exec_runner.go:203] rm: C:\Users\jenkins.minikube3\minikube-integration\.minikube\key.pem
I0116 03:31:49.142979 10356 exec_runner.go:151] cp: C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\key.pem --> C:\Users\jenkins.minikube3\minikube-integration\.minikube/key.pem (1675 bytes)
I0116 03:31:49.144142 10356 provision.go:112] generating server cert: C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\server.pem ca-key=C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\ca.pem private-key=C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\ca-key.pem org=jenkins.offline-docker-748400 san=[172.27.115.126 172.27.115.126 localhost 127.0.0.1 minikube offline-docker-748400]
I0116 03:31:49.334572 10356 provision.go:172] copyRemoteCerts
I0116 03:31:49.346734 10356 ssh_runner.go:195] Run: sudo mkdir -p /etc/docker /etc/docker /etc/docker
I0116 03:31:49.347742 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:51.470458 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:51.470638 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:51.470638 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:54.102110 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:31:54.102110 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:54.102549 10356 sshutil.go:53] new ssh client: &{IP:172.27.115.126 Port:22 SSHKeyPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\id_rsa Username:docker}
I0116 03:31:54.212105 10356 ssh_runner.go:235] Completed: sudo mkdir -p /etc/docker /etc/docker /etc/docker: (4.865339s)
I0116 03:31:54.212998 10356 ssh_runner.go:362] scp C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\server-key.pem --> /etc/docker/server-key.pem (1675 bytes)
I0116 03:31:54.253550 10356 ssh_runner.go:362] scp C:\Users\jenkins.minikube3\minikube-integration\.minikube\certs\ca.pem --> /etc/docker/ca.pem (1082 bytes)
I0116 03:31:54.289427 10356 ssh_runner.go:362] scp C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\server.pem --> /etc/docker/server.pem (1241 bytes)
I0116 03:31:54.327383 10356 provision.go:86] duration metric: configureAuth took 14.3774117s
I0116 03:31:54.327523 10356 buildroot.go:189] setting minikube options for container-runtime
I0116 03:31:54.328258 10356 config.go:182] Loaded profile config "offline-docker-748400": Driver=hyperv, ContainerRuntime=docker, KubernetesVersion=v1.28.4
I0116 03:31:54.328348 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:31:56.448947 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:31:56.449122 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:56.449217 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:31:58.988643 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:31:58.988643 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:31:58.996177 10356 main.go:141] libmachine: Using SSH client type: native
I0116 03:31:58.996324 10356 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0x1326120] 0x1328c60 <nil> [] 0s} 172.27.115.126 22 <nil> <nil>}
I0116 03:31:58.996324 10356 main.go:141] libmachine: About to run SSH command:
df --output=fstype / | tail -n 1
I0116 03:31:59.151570 10356 main.go:141] libmachine: SSH cmd err, output: <nil>: tmpfs
I0116 03:31:59.151570 10356 buildroot.go:70] root file system type: tmpfs
I0116 03:31:59.151830 10356 provision.go:309] Updating docker unit: /lib/systemd/system/docker.service ...
I0116 03:31:59.151933 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:01.277896 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:01.277954 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:01.277954 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:03.892508 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:03.892701 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:03.898817 10356 main.go:141] libmachine: Using SSH client type: native
I0116 03:32:03.899565 10356 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0x1326120] 0x1328c60 <nil> [] 0s} 172.27.115.126 22 <nil> <nil>}
I0116 03:32:03.899565 10356 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
Environment="HTTP_PROXY=172.16.1.1:1"
# 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
I0116 03:32:04.061347 10356 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
Environment=HTTP_PROXY=172.16.1.1:1
# 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
I0116 03:32:04.061587 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:06.196857 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:06.196857 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:06.196857 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:08.754472 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:08.754647 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:08.760933 10356 main.go:141] libmachine: Using SSH client type: native
I0116 03:32:08.761096 10356 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0x1326120] 0x1328c60 <nil> [] 0s} 172.27.115.126 22 <nil> <nil>}
I0116 03:32:08.761096 10356 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; }
I0116 03:32:09.728871 10356 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.
I0116 03:32:09.728871 10356 machine.go:91] provisioned docker machine in 39.4716514s
I0116 03:32:09.728871 10356 client.go:171] LocalClient.Create took 1m50.0560654s
I0116 03:32:09.728871 10356 start.go:167] duration metric: libmachine.API.Create for "offline-docker-748400" took 1m50.0560654s
I0116 03:32:09.728871 10356 start.go:300] post-start starting for "offline-docker-748400" (driver="hyperv")
I0116 03:32:09.728871 10356 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]
I0116 03:32:09.752543 10356 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
I0116 03:32:09.752543 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:11.835940 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:11.835940 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:11.835940 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:14.313953 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:14.313953 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:14.313953 10356 sshutil.go:53] new ssh client: &{IP:172.27.115.126 Port:22 SSHKeyPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\id_rsa Username:docker}
I0116 03:32:14.422478 10356 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: (4.6699037s)
I0116 03:32:14.436630 10356 ssh_runner.go:195] Run: cat /etc/os-release
I0116 03:32:14.443233 10356 info.go:137] Remote host: Buildroot 2021.02.12
I0116 03:32:14.443233 10356 filesync.go:126] Scanning C:\Users\jenkins.minikube3\minikube-integration\.minikube\addons for local assets ...
I0116 03:32:14.443817 10356 filesync.go:126] Scanning C:\Users\jenkins.minikube3\minikube-integration\.minikube\files for local assets ...
I0116 03:32:14.444874 10356 filesync.go:149] local asset: C:\Users\jenkins.minikube3\minikube-integration\.minikube\files\etc\ssl\certs\135082.pem -> 135082.pem in /etc/ssl/certs
I0116 03:32:14.459136 10356 ssh_runner.go:195] Run: sudo mkdir -p /etc/ssl/certs
I0116 03:32:14.475984 10356 ssh_runner.go:362] scp C:\Users\jenkins.minikube3\minikube-integration\.minikube\files\etc\ssl\certs\135082.pem --> /etc/ssl/certs/135082.pem (1708 bytes)
I0116 03:32:14.516353 10356 start.go:303] post-start completed in 4.7874504s
I0116 03:32:14.519972 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:16.606378 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:16.606378 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:16.606378 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:19.079805 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:19.079805 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:19.079805 10356 profile.go:148] Saving config to C:\Users\jenkins.minikube3\minikube-integration\.minikube\profiles\offline-docker-748400\config.json ...
I0116 03:32:19.083500 10356 start.go:128] duration metric: createHost completed in 1m59.4116312s
I0116 03:32:19.083595 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:21.218488 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:21.218488 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:21.218588 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:23.783670 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:23.783670 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:23.790139 10356 main.go:141] libmachine: Using SSH client type: native
I0116 03:32:23.790848 10356 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0x1326120] 0x1328c60 <nil> [] 0s} 172.27.115.126 22 <nil> <nil>}
I0116 03:32:23.790848 10356 main.go:141] libmachine: About to run SSH command:
date +%s.%N
I0116 03:32:23.948137 10356 main.go:141] libmachine: SSH cmd err, output: <nil>: 1705375943.948590998
I0116 03:32:23.948137 10356 fix.go:206] guest clock: 1705375943.948590998
I0116 03:32:23.948137 10356 fix.go:219] Guest: 2024-01-16 03:32:23.948590998 +0000 UTC Remote: 2024-01-16 03:32:19.0835004 +0000 UTC m=+126.117582901 (delta=4.865090598s)
I0116 03:32:23.948137 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:26.072088 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:26.072292 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:26.072369 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:28.601553 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:28.601553 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:28.608960 10356 main.go:141] libmachine: Using SSH client type: native
I0116 03:32:28.609939 10356 main.go:141] libmachine: &{{{<nil> 0 [] [] []} docker [0x1326120] 0x1328c60 <nil> [] 0s} 172.27.115.126 22 <nil> <nil>}
I0116 03:32:28.609939 10356 main.go:141] libmachine: About to run SSH command:
sudo date -s @1705375943
I0116 03:32:28.759167 10356 main.go:141] libmachine: SSH cmd err, output: <nil>: Tue Jan 16 03:32:23 UTC 2024
I0116 03:32:28.759232 10356 fix.go:226] clock set: Tue Jan 16 03:32:23 UTC 2024
(err=<nil>)
I0116 03:32:28.759232 10356 start.go:83] releasing machines lock for "offline-docker-748400", held for 2m9.0872993s
I0116 03:32:28.759553 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:30.925068 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:30.925068 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:30.925068 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:33.569898 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:33.569898 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:33.571106 10356 out.go:177] * Found network options:
I0116 03:32:33.576002 10356 out.go:177] - HTTP_PROXY=172.16.1.1:1
W0116 03:32:33.576718 10356 out.go:239] ! You appear to be using a proxy, but your NO_PROXY environment does not include the minikube IP (172.27.115.126).
! You appear to be using a proxy, but your NO_PROXY environment does not include the minikube IP (172.27.115.126).
I0116 03:32:33.577567 10356 out.go:177] * Please see https://minikube.sigs.k8s.io/docs/handbook/vpn_and_proxy/ for more details
I0116 03:32:33.577567 10356 out.go:177] - HTTP_PROXY=172.16.1.1:1
I0116 03:32:33.582880 10356 ssh_runner.go:195] Run: curl -sS -m 2 https://registry.k8s.io/
I0116 03:32:33.582880 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:33.595937 10356 ssh_runner.go:195] Run: cat /version.json
I0116 03:32:33.595937 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive ( Hyper-V\Get-VM offline-docker-748400 ).state
I0116 03:32:35.875310 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:35.875310 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:35.875310 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:35.893072 10356 main.go:141] libmachine: [stdout =====>] : Running
I0116 03:32:35.893256 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:35.893365 10356 main.go:141] libmachine: [executing ==>] : C:\WINDOWS\System32\WindowsPowerShell\v1.0\powershell.exe -NoProfile -NonInteractive (( Hyper-V\Get-VM offline-docker-748400 ).networkadapters[0]).ipaddresses[0]
I0116 03:32:38.601376 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:38.601376 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:38.601376 10356 sshutil.go:53] new ssh client: &{IP:172.27.115.126 Port:22 SSHKeyPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\id_rsa Username:docker}
I0116 03:32:38.620679 10356 main.go:141] libmachine: [stdout =====>] : 172.27.115.126
I0116 03:32:38.620679 10356 main.go:141] libmachine: [stderr =====>] :
I0116 03:32:38.620953 10356 sshutil.go:53] new ssh client: &{IP:172.27.115.126 Port:22 SSHKeyPath:C:\Users\jenkins.minikube3\minikube-integration\.minikube\machines\offline-docker-748400\id_rsa Username:docker}
I0116 03:32:38.829993 10356 ssh_runner.go:235] Completed: cat /version.json: (5.2340222s)
I0116 03:32:38.829993 10356 ssh_runner.go:235] Completed: curl -sS -m 2 https://registry.k8s.io/: (5.2470788s)
I0116 03:32:38.844341 10356 ssh_runner.go:195] Run: systemctl --version
I0116 03:32:38.867903 10356 ssh_runner.go:195] Run: sh -c "stat /etc/cni/net.d/*loopback.conf*"
W0116 03:32:38.875982 10356 cni.go:209] loopback cni configuration skipped: "/etc/cni/net.d/*loopback.conf*" not found
I0116 03:32:38.892338 10356 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" ;
I0116 03:32:38.915604 10356 cni.go:262] disabled [/etc/cni/net.d/87-podman-bridge.conflist] bridge cni config(s)
I0116 03:32:38.915604 10356 start.go:475] detecting cgroup driver to use...
I0116 03:32:38.915604 10356 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"
I0116 03:32:38.965559 10356 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"
I0116 03:32:39.001369 10356 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"
I0116 03:32:39.018975 10356 containerd.go:146] configuring containerd to use "cgroupfs" as cgroup driver...
I0116 03:32:39.036008 10356 ssh_runner.go:195] Run: sh -c "sudo sed -i -r 's|^( *)SystemdCgroup = .*$|\1SystemdCgroup = false|g' /etc/containerd/config.toml"
I0116 03:32:39.073967 10356 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"
I0116 03:32:39.122902 10356 ssh_runner.go:195] Run: sh -c "sudo sed -i '/systemd_cgroup/d' /etc/containerd/config.toml"
I0116 03:32:39.154522 10356 ssh_runner.go:195] Run: sh -c "sudo sed -i 's|"io.containerd.runc.v1"|"io.containerd.runc.v2"|g' /etc/containerd/config.toml"
I0116 03:32:39.187419 10356 ssh_runner.go:195] Run: sh -c "sudo rm -rf /etc/cni/net.mk"
I0116 03:32:39.222342 10356 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"
I0116 03:32:39.256838 10356 ssh_runner.go:195] Run: sudo sysctl net.bridge.bridge-nf-call-iptables
I0116 03:32:39.283977 10356 ssh_runner.go:195] Run: sudo sh -c "echo 1 > /proc/sys/net/ipv4/ip_forward"
I0116 03:32:39.317144 10356 ssh_runner.go:195] Run: sudo systemctl daemon-reload
I0116 03:32:39.493575 10356 ssh_runner.go:195] Run: sudo systemctl restart containerd
I0116 03:32:39.523727 10356 start.go:475] detecting cgroup driver to use...
I0116 03:32:39.538300 10356 ssh_runner.go:195] Run: sudo systemctl cat docker.service
I0116 03:32:39.570962 10356 ssh_runner.go:195] Run: sudo systemctl is-active --quiet service containerd
I0116 03:32:39.601955 10356 ssh_runner.go:195] Run: sudo systemctl stop -f containerd
I0116 03:32:39.650520 10356 ssh_runner.go:195] Run: sudo systemctl is-active --quiet service containerd
I0116 03:32:39.686599 10356 ssh_runner.go:195] Run: sudo systemctl is-active --quiet service crio
I0116 03:32:39.723471 10356 ssh_runner.go:195] Run: sudo systemctl stop -f crio
I0116 03:32:39.777049 10356 ssh_runner.go:195] Run: sudo systemctl is-active --quiet service crio
I0116 03:32:39.799239 10356 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"
I0116 03:32:39.848735 10356 ssh_runner.go:195] Run: which cri-dockerd
I0116 03:32:39.870788 10356 ssh_runner.go:195] Run: sudo mkdir -p /etc/systemd/system/cri-docker.service.d
I0116 03:32:39.887104 10356 ssh_runner.go:362] scp memory --> /etc/systemd/system/cri-docker.service.d/10-cni.conf (189 bytes)
I0116 03:32:39.932027 10356 ssh_runner.go:195] Run: sudo systemctl unmask docker.service
I0116 03:32:40.115981 10356 ssh_runner.go:195] Run: sudo systemctl enable docker.socket
I0116 03:32:40.278623 10356 docker.go:574] configuring docker to use "cgroupfs" as cgroup driver...
I0116 03:32:40.278623 10356 ssh_runner.go:362] scp memory --> /etc/docker/daemon.json (130 bytes)
I0116 03:32:40.323256 10356 ssh_runner.go:195] Run: sudo systemctl daemon-reload
I0116 03:32:40.490347 10356 ssh_runner.go:195] Run: sudo systemctl restart docker
I0116 03:33:41.603316 10356 ssh_runner.go:235] Completed: sudo systemctl restart docker: (1m1.1125083s)
I0116 03:33:41.619152 10356 ssh_runner.go:195] Run: sudo journalctl --no-pager -u docker
I0116 03:33:41.652082 10356 out.go:177]
W0116 03:33:41.652082 10356 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 Tue 2024-01-16 03:31:19 UTC, ends at Tue 2024-01-16 03:33:41 UTC. --
Jan 16 03:32:09 offline-docker-748400 systemd[1]: Starting Docker Application Container Engine...
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.288653596Z" level=info msg="Starting up"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.289650210Z" level=info msg="containerd not running, starting managed containerd"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.290852728Z" level=info msg="started new containerd process" address=/var/run/docker/containerd/containerd.sock module=libcontainerd pid=679
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.323964718Z" level=info msg="starting containerd" revision=64b8a811b07ba6288238eefc14d898ee0b5b99ba version=v1.7.11
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.348417281Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.348572083Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.350748315Z" 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
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.350841316Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351051920Z" 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
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351138921Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351376724Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351555227Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351674829Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351810231Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352152736Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352281638Z" level=warning msg="failed to load plugin io.containerd.snapshotter.v1.devmapper" error="devmapper not configured"
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352298138Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352436740Z" 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
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352555742Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352621643Z" level=warning msg="could not use snapshotter devmapper in metadata plugin" error="devmapper not configured"
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352710744Z" level=info msg="metadata content store policy set" policy=shared
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.362884995Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363004197Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363025397Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363080198Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363102498Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363169299Z" level=info msg="NRI interface is disabled by configuration."
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363190199Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363346302Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363449903Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363470803Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363486104Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363501004Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363517904Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363531504Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363544605Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363558305Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363572505Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363585605Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363598105Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363756308Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365013826Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365175529Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365206529Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365283830Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365377132Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365508734Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365532634Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365549534Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365567634Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365585335Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365602635Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365618835Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365637536Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365755237Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365852139Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365874939Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365896839Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365915540Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365935040Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365952340Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365968140Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365987941Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="no OpenTelemetry endpoint: skip plugin" type=io.containerd.tracing.processor.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.366004341Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.366060142Z" level=info msg="skipping tracing processor initialization (no tracing plugin)" error="no OpenTelemetry endpoint: skip plugin"
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.367189058Z" level=info msg=serving... address=/var/run/docker/containerd/containerd-debug.sock
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.367371161Z" level=info msg=serving... address=/var/run/docker/containerd/containerd.sock.ttrpc
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.367502763Z" level=info msg=serving... address=/var/run/docker/containerd/containerd.sock
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.367533864Z" level=info msg="containerd successfully booted in 0.045047s"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.403502396Z" level=info msg="[graphdriver] trying configured driver: overlay2"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.419097327Z" level=info msg="Loading containers: start."
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.645884185Z" level=info msg="Loading containers: done."
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.666962697Z" level=warning msg="WARNING: No blkio throttle.read_bps_device support"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667313402Z" level=warning msg="WARNING: No blkio throttle.write_bps_device support"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667443004Z" level=warning msg="WARNING: No blkio throttle.read_iops_device support"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667573406Z" level=warning msg="WARNING: No blkio throttle.write_iops_device support"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667698508Z" level=info msg="Docker daemon" commit=311b9ff graphdriver=overlay2 version=24.0.7
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667940212Z" level=info msg="Daemon has completed initialization"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.725809569Z" level=info msg="API listen on [::]:2376"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.725951571Z" level=info msg="API listen on /var/run/docker.sock"
Jan 16 03:32:09 offline-docker-748400 systemd[1]: Started Docker Application Container Engine.
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.511776212Z" level=info msg="Processing signal 'terminated'"
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.513513712Z" level=info msg="stopping event stream following graceful shutdown" error="<nil>" module=libcontainerd namespace=moby
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.513545712Z" level=info msg="Daemon shutdown complete"
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.513710712Z" level=info msg="stopping healthcheck following graceful shutdown" module=libcontainerd
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.513956512Z" level=info msg="stopping event stream following graceful shutdown" error="context canceled" module=libcontainerd namespace=plugins.moby
Jan 16 03:32:40 offline-docker-748400 systemd[1]: Stopping Docker Application Container Engine...
Jan 16 03:32:41 offline-docker-748400 systemd[1]: docker.service: Succeeded.
Jan 16 03:32:41 offline-docker-748400 systemd[1]: Stopped Docker Application Container Engine.
Jan 16 03:32:41 offline-docker-748400 systemd[1]: Starting Docker Application Container Engine...
Jan 16 03:32:41 offline-docker-748400 dockerd[1006]: time="2024-01-16T03:32:41.590477312Z" level=info msg="Starting up"
Jan 16 03:33:41 offline-docker-748400 dockerd[1006]: failed to start daemon: failed to dial "/run/containerd/containerd.sock": failed to dial "/run/containerd/containerd.sock": context deadline exceeded
Jan 16 03:33:41 offline-docker-748400 systemd[1]: docker.service: Main process exited, code=exited, status=1/FAILURE
Jan 16 03:33:41 offline-docker-748400 systemd[1]: docker.service: Failed with result 'exit-code'.
Jan 16 03:33:41 offline-docker-748400 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 Tue 2024-01-16 03:31:19 UTC, ends at Tue 2024-01-16 03:33:41 UTC. --
Jan 16 03:32:09 offline-docker-748400 systemd[1]: Starting Docker Application Container Engine...
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.288653596Z" level=info msg="Starting up"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.289650210Z" level=info msg="containerd not running, starting managed containerd"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.290852728Z" level=info msg="started new containerd process" address=/var/run/docker/containerd/containerd.sock module=libcontainerd pid=679
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.323964718Z" level=info msg="starting containerd" revision=64b8a811b07ba6288238eefc14d898ee0b5b99ba version=v1.7.11
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.348417281Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.348572083Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.350748315Z" 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
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.350841316Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351051920Z" 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
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351138921Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351376724Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351555227Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351674829Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.351810231Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352152736Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352281638Z" level=warning msg="failed to load plugin io.containerd.snapshotter.v1.devmapper" error="devmapper not configured"
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352298138Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352436740Z" 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
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352555742Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352621643Z" level=warning msg="could not use snapshotter devmapper in metadata plugin" error="devmapper not configured"
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.352710744Z" level=info msg="metadata content store policy set" policy=shared
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.362884995Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363004197Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363025397Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363080198Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363102498Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363169299Z" level=info msg="NRI interface is disabled by configuration."
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363190199Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363346302Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363449903Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363470803Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363486104Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363501004Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363517904Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363531504Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363544605Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363558305Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363572505Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363585605Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363598105Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.363756308Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365013826Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365175529Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365206529Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365283830Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365377132Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365508734Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365532634Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365549534Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365567634Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365585335Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365602635Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365618835Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365637536Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365755237Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365852139Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365874939Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365896839Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365915540Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365935040Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365952340Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365968140Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.365987941Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="no OpenTelemetry endpoint: skip plugin" type=io.containerd.tracing.processor.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.366004341Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.366060142Z" level=info msg="skipping tracing processor initialization (no tracing plugin)" error="no OpenTelemetry endpoint: skip plugin"
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.367189058Z" level=info msg=serving... address=/var/run/docker/containerd/containerd-debug.sock
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.367371161Z" level=info msg=serving... address=/var/run/docker/containerd/containerd.sock.ttrpc
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.367502763Z" level=info msg=serving... address=/var/run/docker/containerd/containerd.sock
Jan 16 03:32:09 offline-docker-748400 dockerd[679]: time="2024-01-16T03:32:09.367533864Z" level=info msg="containerd successfully booted in 0.045047s"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.403502396Z" level=info msg="[graphdriver] trying configured driver: overlay2"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.419097327Z" level=info msg="Loading containers: start."
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.645884185Z" level=info msg="Loading containers: done."
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.666962697Z" level=warning msg="WARNING: No blkio throttle.read_bps_device support"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667313402Z" level=warning msg="WARNING: No blkio throttle.write_bps_device support"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667443004Z" level=warning msg="WARNING: No blkio throttle.read_iops_device support"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667573406Z" level=warning msg="WARNING: No blkio throttle.write_iops_device support"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667698508Z" level=info msg="Docker daemon" commit=311b9ff graphdriver=overlay2 version=24.0.7
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.667940212Z" level=info msg="Daemon has completed initialization"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.725809569Z" level=info msg="API listen on [::]:2376"
Jan 16 03:32:09 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:09.725951571Z" level=info msg="API listen on /var/run/docker.sock"
Jan 16 03:32:09 offline-docker-748400 systemd[1]: Started Docker Application Container Engine.
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.511776212Z" level=info msg="Processing signal 'terminated'"
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.513513712Z" level=info msg="stopping event stream following graceful shutdown" error="<nil>" module=libcontainerd namespace=moby
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.513545712Z" level=info msg="Daemon shutdown complete"
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.513710712Z" level=info msg="stopping healthcheck following graceful shutdown" module=libcontainerd
Jan 16 03:32:40 offline-docker-748400 dockerd[673]: time="2024-01-16T03:32:40.513956512Z" level=info msg="stopping event stream following graceful shutdown" error="context canceled" module=libcontainerd namespace=plugins.moby
Jan 16 03:32:40 offline-docker-748400 systemd[1]: Stopping Docker Application Container Engine...
Jan 16 03:32:41 offline-docker-748400 systemd[1]: docker.service: Succeeded.
Jan 16 03:32:41 offline-docker-748400 systemd[1]: Stopped Docker Application Container Engine.
Jan 16 03:32:41 offline-docker-748400 systemd[1]: Starting Docker Application Container Engine...
Jan 16 03:32:41 offline-docker-748400 dockerd[1006]: time="2024-01-16T03:32:41.590477312Z" level=info msg="Starting up"
Jan 16 03:33:41 offline-docker-748400 dockerd[1006]: failed to start daemon: failed to dial "/run/containerd/containerd.sock": failed to dial "/run/containerd/containerd.sock": context deadline exceeded
Jan 16 03:33:41 offline-docker-748400 systemd[1]: docker.service: Main process exited, code=exited, status=1/FAILURE
Jan 16 03:33:41 offline-docker-748400 systemd[1]: docker.service: Failed with result 'exit-code'.
Jan 16 03:33:41 offline-docker-748400 systemd[1]: Failed to start Docker Application Container Engine.
-- /stdout --
W0116 03:33:41.653532 10356 out.go:239] *
*
W0116 03:33:41.655162 10356 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. │
│ │
╰─────────────────────────────────────────────────────────────────────────────────────────────╯
I0116 03:33:41.656128 10356 out.go:177]
** /stderr **
aab_offline_test.go:58: out/minikube-windows-amd64.exe start -p offline-docker-748400 --alsologtostderr -v=1 --memory=2048 --wait=true --driver=hyperv failed: exit status 90
panic.go:523: *** TestOffline FAILED at 2024-01-16 03:33:41.9162854 +0000 UTC m=+7035.855646601
helpers_test.go:222: -----------------------post-mortem--------------------------------
helpers_test.go:239: (dbg) Run: out/minikube-windows-amd64.exe status --format={{.Host}} -p offline-docker-748400 -n offline-docker-748400
E0116 03:33:46.620552 13508 cert_rotation.go:168] key failed with : open C:\Users\jenkins.minikube3\minikube-integration\.minikube\profiles\addons-179200\client.crt: The system cannot find the path specified.
helpers_test.go:239: (dbg) Non-zero exit: out/minikube-windows-amd64.exe status --format={{.Host}} -p offline-docker-748400 -n offline-docker-748400: exit status 6 (12.3589214s)
-- stdout --
Running
WARNING: Your kubectl is pointing to stale minikube-vm.
To fix the kubectl context, run `minikube update-context`
-- /stdout --
** stderr **
W0116 03:33:42.058038 8460 main.go:291] Unable to resolve the current Docker CLI context "default": context "default": context not found: open C:\Users\jenkins.minikube3\.docker\contexts\meta\37a8eec1ce19687d132fe29051dca629d164e2c4958ba141d5f4133a33f0688f\meta.json: The system cannot find the path specified.
E0116 03:33:54.199396 8460 status.go:415] kubeconfig endpoint: extract IP: "offline-docker-748400" does not appear in C:\Users\jenkins.minikube3\minikube-integration\kubeconfig
** /stderr **
helpers_test.go:239: status error: exit status 6 (may be ok)
helpers_test.go:241: "offline-docker-748400" host is not running, skipping log retrieval (state="Running\nWARNING: Your kubectl is pointing to stale minikube-vm.\nTo fix the kubectl context, run `minikube update-context`")
helpers_test.go:175: Cleaning up "offline-docker-748400" profile ...
helpers_test.go:178: (dbg) Run: out/minikube-windows-amd64.exe delete -p offline-docker-748400
helpers_test.go:178: (dbg) Done: out/minikube-windows-amd64.exe delete -p offline-docker-748400: (1m2.9673339s)
--- FAIL: TestOffline (284.30s)