Attachment 1510002 Details for Bug 1654880 – File: anaconda.log

File: anaconda.log

anaconda.log (text/plain), 38.50 KB, created by Jan Gerrit Kootstra on 2018-11-29 22:57:47 UTC

(hide)

Description:

Filename:

MIME Type:

Creator: Jan Gerrit Kootstra

Created: 2018-11-29 22:57:47 UTC

Size: 38.50 KB

patch

obsolete

>22:29:14,052 INF main: /sbin/anaconda 29.19.0.25-1.el8
>22:29:14,259 INF isys: 2168348 kB (2117 MB) are available
>22:29:14,275 INF startup_utils: check_memory(): total:2117, needed:320, graphical:410
>22:29:14,288 INF main: anaconda called with cmdline = ['/sbin/anaconda']
>22:29:14,289 INF main: Default encoding = utf-8 
>22:29:14,311 INF dbus.connection: Connecting to a default bus at unix:abstract=/tmp/dbus-TCqqker6Nz,guid=7509abc67ce1df514d48535c5c00683a.
>22:29:14,696 INF startup_utils: Waiting 600 sec for modules to be started.
>22:29:15,699 INF startup_utils: Waiting 599 sec for modules to be started.
>22:29:16,702 INF startup_utils: Waiting 598 sec for modules to be started.
>22:29:17,704 INF startup_utils: Waiting 597 sec for modules to be started.
>22:29:18,708 INF startup_utils: Waiting 596 sec for modules to be started.
>22:29:19,783 INF startup_utils: Parsing kickstart: /run/install/ks.cfg
>22:29:20,169 WRN misc: /usr/lib/python3.6/site-packages/pykickstart/base.py:215: KickstartDeprecationWarning: Ignoring deprecated command on line 4:  The install command has been deprecated and no longer has any effect.  It may be removed from future releases, which will result in a fatal error from kickstart.  Please modify your kickstart file to remove this command.
>  warnings.warn(_("Ignoring deprecated command on line %(lineno)s:  The %(cmd)s command has been deprecated and no longer has any effect.  It may be removed from future releases, which will result in a fatal error from kickstart.  Please modify your kickstart file to remove this command.") % mapping, KickstartDeprecationWarning)
>
>22:29:20,171 WRN kickstart: Command lang will be parsed in DBus module.
>22:29:20,171 WRN kickstart: Command selinux will be parsed in DBus module.
>22:29:20,171 WRN kickstart: Command keyboard will be parsed in DBus module.
>22:29:20,172 WRN kickstart: Command skipx will be parsed in DBus module.
>22:29:20,173 WRN kickstart: Command rootpw will be parsed in DBus module.
>22:29:20,174 WRN kickstart: Command firewall will be parsed in DBus module.
>22:29:20,174 WRN kickstart: Command authconfig will be parsed in DBus module.
>22:29:20,175 WRN kickstart: Command timezone will be parsed in DBus module.
>22:29:20,175 WRN kickstart: Command services will be parsed in DBus module.
>22:29:20,175 WRN kickstart: Command bootloader will be parsed in DBus module.
>22:29:20,178 INF bootloader: bootloader GRUB2 on X86 platform
>22:29:20,180 WRN kickstart: Command zerombr will be parsed in DBus module.
>22:29:20,181 WRN kickstart: Command clearpart will be parsed in DBus module.
>22:29:20,181 WRN kickstart: Command autopart will be parsed in DBus module.
>22:29:20,458 DBG localization: setting locale to: en_US.UTF-8
>22:29:20,466 DBG network: devices found ['ens3']
>22:29:20,476 DBG network: ensure single initramfs connections
>22:29:20,518 DBG network: apply kickstart
>22:29:20,605 DBG network: ensure active ifcfg connection for ens3 (16bf4e89-4091-4fee-8061-40e7c66c0702 -> 16bf4e89-4091-4fee-8061-40e7c66c0702): not activating
>22:29:20,606 DBG network: create missing ifcfg files
>22:29:20,667 DBG network: set real ONBOOT value
>22:29:20,692 DBG network: setting ONBOOT value of ens3 to True
>22:29:20,739 DBG network: real kickstart ONBOOT value set for devices ['ens3']
>22:29:20,754 INF threading: Running Thread: AnaWaitForConnectingNMThread (140504224352000)
>22:29:20,755 DBG anaconda: setting display mode to TUI
>22:29:20,763 WRN stdout: Not asking for VNC because of an automated install
>22:29:20,764 WRN stdout: Not asking for VNC because text mode was explicitly asked for in kickstart
>22:29:20,766 INF anaconda: Display mode is set to 'interactive text mode'.
>22:29:20,768 INF isys: 2168348 kB (2117 MB) are available
>22:29:20,801 INF startup_utils: check_memory(): total:2117, needed:320, graphical:410
>22:29:20,806 INF network: got 0 NTP servers from DHCP
>22:29:20,821 INF threading: Thread Done: AnaWaitForConnectingNMThread (140504224352000)
>22:29:20,891 DBG installclass: Searching /usr/lib64/python3.6/site-packages/pyanaconda/installclasses.
>22:29:20,901 DBG installclass: Found Red Hat Enterprise Linux (RHELBaseInstallClass).
>22:29:20,902 DBG installclass: Found CentOS Linux (CentOSBaseInstallClass).
>22:29:20,902 DBG installclass: Found Scientific Linux (ScientificBaseInstallClass).
>22:29:20,902 DBG installclass: Found Atomic Host (AtomicHostInstallClass).
>22:29:20,903 DBG installclass: Found Fedora (FedoraBaseInstallClass).
>22:29:20,903 DBG installclass: Found Fedora Workstation (FedoraWorkstationInstallClass).
>22:29:20,903 DBG installclass: Found Fedora Server (FedoraServerInstallClass).
>22:29:20,903 DBG installclass: Found Red Hat Enterprise Linux (DefaultInstallClass).
>22:29:20,904 INF installclass: Using a visible install class Red Hat Enterprise Linux (RHELBaseInstallClass).
>22:29:21,060 DBG storage: trying to set new default luks version to 'luks2'
>22:29:21,638 DBG payload: getting release version from tree at None (8.0)
>22:29:21,639 DBG payload: using default release version of 8.0
>22:29:21,643 INF bootloader: bootloader GRUB2 on X86 platform
>22:29:21,644 INF autopart: Detected 2.07 GiB of memory
>22:29:21,645 INF autopart: Suggested swap size (2.07 GiB) exceeds 10 % of disk space, using 10 % of disk space (0.0) instead.
>22:29:21,645 INF autopart: Swap attempt of 0.0
>22:29:21,646 INF bootloader: bootloader GRUB2 on X86 platform
>22:29:21,715 DBG storage_utils: LABEL=OEMDRV matches [] for devicetree=None and disks_only=True
>22:29:21,717 INF threading: Running Thread: AnaStorageThread (140504224352000)
>22:29:21,723 INF threading: Running Thread: AnaTimeInitThread (140504140470016)
>22:29:21,786 DBG payload: Restarting payload thread
>22:29:21,788 INF threading: Running Thread: AnaPayloadRestartThread (140504132077312)
>22:29:21,789 INF geoloc: Geolocation is disabled due to automated kickstart based installation.
>22:29:21,798 INF threading: Running Thread: AnaPayloadThread (140504123684608)
>22:29:21,800 INF threading: Thread Done: AnaPayloadRestartThread (140504132077312)
>22:29:21,801 DBG payload: Updating payload thread state: 0
>22:29:21,803 DBG payload: Updating payload thread state: 1
>22:29:21,904 DBG simpleline: GLib event loop is used!
>22:29:22,041 INF core.util: Skipping detection of unsupported hardware.
>22:29:22,087 INF lifecycle: Adding controller: SummaryHub
>22:29:22,096 INF lifecycle: Module initialized: TimeSpoke
>22:29:22,457 INF lifecycle: Module initialized: LangSpoke
>22:29:22,465 INF threading: Running Thread: AnaSoftwareWatcher (140504132077312)
>22:29:22,469 INF threading: Running Thread: AnaSourceWatcher (140504115029760)
>22:29:22,488 INF threading: Running Thread: AnaStorageWatcher (140504106637056)
>22:29:23,001 INF threading: Thread Done: AnaTimeInitThread (140504140470016)
>22:29:23,128 INF lifecycle: Module initialized: NetworkSpoke
>22:29:23,137 INF lifecycle: Module initialized: PasswordSpoke
>22:29:23,146 WRN ui.tui.hubs: Spoke PasswordSpoke initialization failure!
>22:29:23,150 INF lifecycle: Module initialized: UserSpoke
>22:29:23,151 INF lifecycle: Initialization of all modules (8) has been started.
>22:29:27,617 DBG storage: blkid.tab devs: []
>22:29:27,617 DBG storage: parsing /mnt/sysimage/etc/crypttab
>22:29:27,618 DBG storage: crypttab maps: []
>22:29:27,618 DBG storage: parsing /mnt/sysimage/etc/fstab
>22:29:28,687 DBG storage: onlyuse is now: vda
>22:29:28,687 INF threading: Thread Done: AnaStorageThread (140504224352000)
>22:29:28,688 DBG payload: Updating payload thread state: 2
>22:29:28,688 DBG payload: Updating payload thread state: 4
>22:29:28,691 INF lifecycle: Module initialized: StorageSpoke
>22:29:28,693 INF threading: Thread Done: AnaStorageWatcher (140504106637056)
>22:29:28,696 DBG payload: retrieving treeinfo from http://satellite.internal.kootstra.co.uk/pulp/repos/Default_Organization/Pre-development/cv-RHEL8-beta/content/beta/rhel8/8/x86_64/baseos/kickstart/ (proxy:  ; sslverify: True)
>22:29:28,767 DBG payload: getting release version from tree at http://satellite.internal.kootstra.co.uk/pulp/repos/Default_Organization/Pre-development/cv-RHEL8-beta/content/beta/rhel8/8/x86_64/baseos/kickstart/ (8.0)
>22:29:28,767 DBG payload: using treeinfo release version of 8.0
>22:29:30,003 DBG payload: Updating payload thread state: 5
>22:29:30,787 INF payload: Refreshing environmentAddons
>22:29:30,814 DBG payload: Updating payload thread state: 6
>22:29:30,815 DBG ui.tui.spokes.software_selection: Payload restarted, set new info and clear the old one.
>22:29:30,815 INF threading: Thread Done: AnaPayloadThread (140504123684608)
>22:29:30,815 DBG ui.tui.spokes.software_selection: Apply called old env None, new env None and addons set()
>22:29:30,816 INF lifecycle: Module initialized: SoftwareSpoke
>22:29:30,817 INF threading: Thread Done: AnaSoftwareWatcher (140504132077312)
>22:29:30,817 INF lifecycle: Module initialized: SourceSpoke
>22:29:30,818 INF lifecycle: All modules have been initialized.
>22:29:30,818 INF threading: Thread Done: AnaSourceWatcher (140504115029760)
>22:29:30,975 DBG storage: clearpart: looking at vda2
>22:29:31,048 DBG storage: partitions: ['vda1']
>22:29:31,048 DBG storage: clearpart: looking at vda1
>22:29:31,066 DBG storage: partitions: []
>22:29:31,077 DBG storage: clearpart: initializing vda
>22:29:31,112 DBG kickstart.kickstart.bootloader: Execute the bootloader with dry run True.
>22:29:31,119 DBG kickstart.kickstart.bootloader: Applying bootloader arguments: ['nofb', 'quiet', 'splash=quiet']
>22:29:31,121 DBG kickstart.kickstart.bootloader: Applying bootloader location: MBR
>22:29:31,124 DBG kickstart.kickstart.bootloader: Applying drive order: []
>22:29:31,125 DBG bootloader: new disk order: []
>22:29:31,126 DBG kickstart.kickstart.bootloader: The /boot partition doesn't exist.
>22:29:31,126 DBG kickstart.kickstart.bootloader: Use the first usable drive.
>22:29:31,127 DBG kickstart.kickstart.bootloader: Using a boot drive: vda
>22:29:31,135 INF autopart: Detected 2.07 GiB of memory
>22:29:31,135 INF autopart: Swap attempt of 2.07 GiB
>22:29:31,137 DBG autopart: do_autopart: True
>22:29:31,138 DBG autopart: encrypted_autopart: False
>22:29:31,138 DBG autopart: autopart_type: 2
>22:29:31,138 DBG autopart: clear_part_type: 1
>22:29:31,139 DBG autopart: clear_part_disks: []
>22:29:31,139 DBG autopart: autopart_requests:
>PartSpec instance (0x7fc9afaa0dd8) -- 
>  mountpoint = /  lv = True  thin = True  btrfs = True
>  weight = 0  fstype = xfs  encrypted = True
>  size = 1024 MiB  max_size = 50 GiB  grow = True
>PartSpec instance (0x7fc9afaa0b00) -- 
>  mountpoint = /home  lv = True  thin = True  btrfs = True
>  weight = 0  fstype = xfs  encrypted = True
>  size = 500 MiB  max_size = None  grow = True
>PartSpec instance (0x7fc9afaa0c18) -- 
>  mountpoint = None  lv = False  thin = False  btrfs = False
>  weight = 0  fstype = biosboot  encrypted = False
>  size = 1024 KiB  max_size = None  grow = False
>PartSpec instance (0x7fc9afaa0cc0) -- 
>  mountpoint = /boot  lv = False  thin = False  btrfs = False
>  weight = 0  fstype = xfs  encrypted = False
>  size = 1024 MiB  max_size = None  grow = False
>PartSpec instance (0x7fc9afaa0fd0) -- 
>  mountpoint = None  lv = True  thin = False  btrfs = False
>  weight = 0  fstype = swap  encrypted = True
>  size = 2.07 GiB  max_size = None  grow = False
>
>22:29:31,139 DBG autopart: storage.disks: ['vda']
>22:29:31,140 DBG autopart: storage.partitioned: ['vda']
>22:29:31,140 DBG autopart: all names: ['/LiveOS/rootfs.img', '/overlay (deleted)', '/tmp/curl_fetch_url1/install.img (deleted)', 'live-base', 'live-rw', 'loop0', 'loop1', 'loop2', 'vda']
>22:29:31,140 DBG autopart: boot disk: vda
>22:29:31,154 DBG autopart: candidate disks: [DiskDevice instance (0x7fc9ab9611d0) --
>  name = vda  status = True  id = 4
>  children = []
>  parents = []
>  uuid = None  size = 50 GiB
>  format = non-existent msdos disklabel
>  major = 252  minor = 0  exists = True  protected = False
>  sysfs path = /sys/devices/pci0000:00/0000:00:04.0/virtio1/block/vda
>  target size = 50 GiB  path = /dev/vda
>  format args = []  original_format = disklabel  removable = False  wwn = None]
>22:29:31,156 DBG autopart: devs: [PartitionDevice instance (0x7fc9b061c1d0) --
>  name = req0  status = False  id = 141
>  children = []
>  parents = []
>  uuid = None  size = 500 MiB
>  format = non-existent lvmpv
>  major = 0  minor = 0  exists = False  protected = False
>  sysfs path = 
>  target size = 500 MiB  path = /dev/req0
>  format args = []  original_format = lvmpv  grow = True  max size = 0 B  bootable = None
>  part type = None  primary = False  start sector = None  end sector = None
>  parted_partition = None
>  disk = None
>]
>22:29:31,159 DBG bootloader: _is_valid_disklabel(vda) returning True
>22:29:31,160 DBG bootloader: _is_valid_size(vda) returning True
>22:29:31,160 DBG bootloader: _is_valid_location(vda) returning True
>22:29:31,160 DBG bootloader: _is_valid_format(vda) returning True
>22:29:31,160 DBG bootloader: is_valid_stage1_device(vda) returning True
>22:29:31,161 INF autopart: skipping unneeded stage1 biosboot request
>22:29:31,161 DBG autopart: PartSpec instance (0x7fc9afaa0c18) -- 
>  mountpoint = None  lv = False  thin = False  btrfs = False
>  weight = 0  fstype = biosboot  encrypted = False
>  size = 1024 KiB  max_size = None  grow = False
>
>22:29:31,162 DBG autopart: existing 50 GiB disk vda (4) with non-existent msdos disklabel
>22:29:31,358 DBG kickstart.kickstart.bootloader: Execute the bootloader with dry run False.
>22:29:31,365 DBG kickstart.kickstart.bootloader: Applying bootloader arguments: ['nofb', 'quiet', 'splash=quiet']
>22:29:31,366 DBG kickstart.kickstart.bootloader: Applying bootloader location: MBR
>22:29:31,369 DBG kickstart.kickstart.bootloader: Applying drive order: []
>22:29:31,370 DBG bootloader: new disk order: []
>22:29:31,372 DBG kickstart.kickstart.bootloader: Found a boot drive: vda
>22:29:31,372 DBG kickstart.kickstart.bootloader: Use a usable drive with a /boot partition.
>22:29:31,373 DBG kickstart.kickstart.bootloader: Using a boot drive: vda
>22:29:31,383 DBG bootloader: stage1 device cannot be of type lvmvg
>22:29:31,384 DBG bootloader: stage1 device cannot be of type lvmlv
>22:29:31,385 DBG bootloader: stage1 device cannot be of type lvmlv
>22:29:31,386 DBG bootloader: _is_valid_disklabel(vda) returning True
>22:29:31,386 DBG bootloader: _is_valid_size(vda) returning True
>22:29:31,387 DBG bootloader: _is_valid_location(vda) returning True
>22:29:31,387 DBG bootloader: _is_valid_format(vda) returning True
>22:29:31,387 DBG bootloader: is_valid_stage1_device(vda) returning True
>22:29:31,391 DBG bootloader: _is_valid_disklabel(vda) returning True
>22:29:31,391 DBG bootloader: _is_valid_size(vda) returning True
>22:29:31,392 DBG bootloader: _is_valid_location(vda) returning True
>22:29:31,392 DBG bootloader: _is_valid_format(vda) returning True
>22:29:31,392 DBG bootloader: is_valid_stage1_device(vda) returning True
>22:29:31,393 DBG bootloader: _is_valid_disklabel(vda1) returning True
>22:29:31,393 DBG bootloader: _is_valid_size(vda1) returning True
>22:29:31,394 DBG bootloader: _is_valid_partition(vda1) returning True
>22:29:31,394 DBG bootloader: _is_valid_format(vda1) returning True
>22:29:31,394 DBG bootloader: is_valid_stage2_device(vda1) returning True
>22:29:31,397 DBG storage_utils: Available memory: 843.23 MiB
>22:29:31,411 DBG kickstart.kickstart.autopart: Storage check started with constraints {'min_ram': 320, 'min_root': Size (250 MiB), 'min_partition_sizes': {'/usr': Size (250 MiB), '/tmp': Size (50 MiB), '/var': Size (384 MiB), '/home': Size (100 MiB), '/boot': Size (200 MiB)}, 'must_be_on_linuxfs': {'/', '/home', '/var', '/tmp', '/usr/lib', '/usr/share', '/usr'}, 'must_be_on_root': {'/etc', '/sbin', '/proc', '/root', '/bin', '/lib', '/dev', '/mnt', 'lost+found'}, 'swap_is_recommended': True, 'luks2_min_ram': Size (128 MiB)}.
>22:29:31,411 DBG kickstart.kickstart.autopart: Run sanity check verify_root.
>22:29:31,411 DBG kickstart.kickstart.autopart: Run sanity check verify_s390_constraints.
>22:29:31,411 DBG kickstart.kickstart.autopart: Run sanity check verify_partition_sizes.
>22:29:31,412 DBG kickstart.kickstart.autopart: Run sanity check verify_partition_format_sizes.
>22:29:31,412 DBG kickstart.kickstart.autopart: Run sanity check verify_bootloader.
>22:29:31,412 DBG kickstart.kickstart.autopart: Run sanity check verify_gpt_biosboot.
>22:29:31,412 DBG kickstart.kickstart.autopart: Run sanity check verify_swap.
>22:29:31,413 DBG kickstart.kickstart.autopart: Run sanity check verify_swap_uuid.
>22:29:31,413 DBG kickstart.kickstart.autopart: Run sanity check verify_mountpoints_on_linuxfs.
>22:29:31,413 DBG kickstart.kickstart.autopart: Run sanity check verify_mountpoints_on_root.
>22:29:31,413 DBG kickstart.kickstart.autopart: Run sanity check verify_luks_devices_have_key.
>22:29:31,414 DBG kickstart.kickstart.autopart: Run sanity check verify_luks2_memory_requirements.
>22:29:31,414 DBG kickstart.kickstart.autopart: Run sanity check verify_mounted_partitions.
>22:29:31,414 DBG kickstart.kickstart.autopart: Storage check finished with success.
>22:29:31,417 DBG kickstart.kickstart.bootloader: Execute the bootloader with dry run False.
>22:29:31,422 DBG kickstart.kickstart.bootloader: Applying bootloader arguments: ['nofb', 'quiet', 'splash=quiet']
>22:29:31,424 DBG kickstart.kickstart.bootloader: Applying bootloader location: MBR
>22:29:31,427 DBG kickstart.kickstart.bootloader: Applying drive order: []
>22:29:31,427 DBG bootloader: new disk order: []
>22:29:31,429 DBG kickstart.kickstart.bootloader: Use the requested boot drive.
>22:29:31,513 DBG storage_utils: vda matches ['vda'] for devicetree=existing 50 GiB disk vda (4) with non-existent msdos disklabel
>  non-existent 1024 MiB partition vda1 (148) with non-existent xfs filesystem mounted at /boot
>  non-existent 49 GiB partition vda2 (141) with non-existent lvmpv
>    non-existent 49 GiB lvmvg rhel_rhel8beta-dev (154)
>      non-existent 46.93 GiB lvmlv rhel_rhel8beta-dev-root (160) with non-existent xfs filesystem mounted at /
>      non-existent 2.07 GiB lvmlv rhel_rhel8beta-dev-swap (169) with non-existent swap
>existing 0 B file /tmp/curl_fetch_url1/install.img (deleted) (64)
>  existing 0 B loop loop0 (68)
>existing 0 B file /LiveOS/rootfs.img (78)
>  existing 0 B loop loop1 (82) with existing ext4 filesystem
>    existing 2 GiB dm live-rw (101) with existing ext4 filesystem
>    existing 2 GiB dm live-base (111) with existing ext4 filesystem
>existing 0 B file /overlay (deleted) (92)
>  existing 0 B loop loop2 (96)
> and disks_only=True
>22:29:31,519 DBG kickstart.kickstart.bootloader: Using a boot drive: vda
>22:29:31,530 DBG bootloader: stage1 device cannot be of type lvmvg
>22:29:31,531 DBG bootloader: stage1 device cannot be of type lvmlv
>22:29:31,532 DBG bootloader: stage1 device cannot be of type lvmlv
>22:29:31,534 DBG bootloader: _is_valid_disklabel(vda) returning True
>22:29:31,534 DBG bootloader: _is_valid_size(vda) returning True
>22:29:31,535 DBG bootloader: _is_valid_location(vda) returning True
>22:29:31,535 DBG bootloader: _is_valid_format(vda) returning True
>22:29:31,535 DBG bootloader: is_valid_stage1_device(vda) returning True
>22:29:31,542 DBG bootloader: _is_valid_disklabel(vda) returning True
>22:29:31,542 DBG bootloader: _is_valid_size(vda) returning True
>22:29:31,542 DBG bootloader: _is_valid_location(vda) returning True
>22:29:31,543 DBG bootloader: _is_valid_format(vda) returning True
>22:29:31,543 DBG bootloader: is_valid_stage1_device(vda) returning True
>22:29:31,544 DBG bootloader: _is_valid_disklabel(vda1) returning True
>22:29:31,545 DBG bootloader: _is_valid_size(vda1) returning True
>22:29:31,545 DBG bootloader: _is_valid_partition(vda1) returning True
>22:29:31,546 DBG bootloader: _is_valid_format(vda1) returning True
>22:29:31,546 DBG bootloader: is_valid_stage2_device(vda1) returning True
>22:29:31,549 DBG storage_utils: Available memory: 842.73 MiB
>22:29:31,567 DBG ui.tui.spokes.storage: Storage check started with constraints {'min_ram': 320, 'min_root': Size (250 MiB), 'min_partition_sizes': {'/usr': Size (250 MiB), '/tmp': Size (50 MiB), '/var': Size (384 MiB), '/home': Size (100 MiB), '/boot': Size (200 MiB)}, 'must_be_on_linuxfs': {'/', '/home', '/var', '/tmp', '/usr/lib', '/usr/share', '/usr'}, 'must_be_on_root': {'/etc', '/sbin', '/proc', '/root', '/bin', '/lib', '/dev', '/mnt', 'lost+found'}, 'swap_is_recommended': True, 'luks2_min_ram': Size (128 MiB)}.
>22:29:31,568 DBG ui.tui.spokes.storage: Run sanity check verify_root.
>22:29:31,568 DBG ui.tui.spokes.storage: Run sanity check verify_s390_constraints.
>22:29:31,568 DBG ui.tui.spokes.storage: Run sanity check verify_partition_sizes.
>22:29:31,569 DBG ui.tui.spokes.storage: Run sanity check verify_partition_format_sizes.
>22:29:31,569 DBG ui.tui.spokes.storage: Run sanity check verify_bootloader.
>22:29:31,569 DBG ui.tui.spokes.storage: Run sanity check verify_gpt_biosboot.
>22:29:31,569 DBG ui.tui.spokes.storage: Run sanity check verify_swap.
>22:29:31,570 DBG ui.tui.spokes.storage: Run sanity check verify_swap_uuid.
>22:29:31,570 DBG ui.tui.spokes.storage: Run sanity check verify_mountpoints_on_linuxfs.
>22:29:31,570 DBG ui.tui.spokes.storage: Run sanity check verify_mountpoints_on_root.
>22:29:31,571 DBG ui.tui.spokes.storage: Run sanity check verify_luks_devices_have_key.
>22:29:31,571 DBG ui.tui.spokes.storage: Run sanity check verify_luks2_memory_requirements.
>22:29:31,571 DBG ui.tui.spokes.storage: Run sanity check verify_mounted_partitions.
>22:29:31,571 DBG ui.tui.spokes.storage: Storage check finished with success.
>22:29:31,582 DBG simpleline: Scheduling screen SummaryHub
>22:29:31,584 DBG simpleline: New signal RenderScreenSignal enqueued with source ScreenScheduler
>22:29:31,585 DBG simpleline: Scheduling screen ProgressSpoke
>22:29:31,586 DBG simpleline: Starting main loop
>22:29:31,587 DBG simpleline: Processing screen ScreenData(SummaryHub,None,False)
>22:29:31,604 DBG payload: Source http://satellite.internal.kootstra.co.uk/pulp/repos/Default_Organization/Pre-development/cv-RHEL8-beta/content/beta/rhel8/8/x86_64/baseos/kickstart/ needs network for installation
>22:29:31,677 DBG simpleline: Input is required by ScreenData(SummaryHub,None,False) screen
>22:29:31,680 DBG payload: Source http://satellite.internal.kootstra.co.uk/pulp/repos/Default_Organization/Pre-development/cv-RHEL8-beta/content/beta/rhel8/8/x86_64/baseos/kickstart/ needs network for installation
>22:29:31,720 INF ui.lib.space: fs space: 45.52 GiB  needed: 2.79 GiB
>22:29:31,721 DBG simpleline: New signal CloseScreenSignal enqueued with source SummaryHub
>22:29:31,722 DBG simpleline: Closing screen ScreenData(SummaryHub,None,False) from SummaryHub
>22:29:31,722 DBG simpleline: New signal RenderScreenSignal enqueued with source ScreenScheduler
>22:29:31,723 DBG simpleline: Processing screen ScreenData(ProgressSpoke,None,False)
>22:29:31,736 INF threading: Running Thread: AnaInstallThread (140504123684608)
>22:29:31,751 INF installation: Top-level task queue: Installation queue
>Number of task queues: 9
>Number of tasks: 18
>Task & task group listing:
> Task: Save system time to HW clock
> Task queue: Installation environment setup
>  Task: Setup addons
> Task queue: Early storage configuration
>  Task: Insert custom storage to ksdata
>  Task: Run pre-storage tasks
>  Task: Activate filesystems
>  Task: Write early storage
> Task queue: Pre-install scripts
>  Task: Run %pre-install scripts
> Task queue: Realm discover
>  Task: Discover realm to join
> Task queue: Pre install tasks
>  Task: Setup authselect
>  Task: Setup firewall
>  Task: Setup network
>  Task: Setup timezone
>  Task: Copy /resolv.conf to sysroot
>  Task: Find additional packages & run preInstall()
> Task queue: Payload installation
>  Task: Install the payload
> Task queue: Late storage configuration
>  Task: Write late storage
> Task queue: Bootloader installation
>  Task: Install bootloader
> Task queue: Post-installation setup tasks
>  Task: Run post-installation setup tasks
>22:29:31,752 INF installation: Task started: Save system time to HW clock (1/18)
>22:29:32,503 DBG installation: Task completed: Save system time to HW clock (1/18) (0.8 s)
>22:29:32,503 INF progress: Save system time to HW clock
>22:29:32,504 INF installation: Queue started: Installation environment setup (1/9)
>22:29:32,505 INF progress: Setting up the installation environment
>22:29:32,506 INF installation: Task started: Setup addons (2/18)
>22:29:32,517 DBG installation: Task completed: Setup addons (2/18) (0.0 s)
>22:29:32,518 INF progress: Setup addons
>22:29:32,519 INF installation: Queue started: Early storage configuration (2/9)
>22:29:32,519 INF progress: Configuring storage
>22:29:32,520 INF installation: Task started: Insert custom storage to ksdata (3/18)
>22:29:32,542 DBG installation: Task completed: Insert custom storage to ksdata (3/18) (0.0 s)
>22:29:32,543 INF progress: Insert custom storage to ksdata
>22:29:32,544 INF installation: Task started: Run pre-storage tasks (4/18)
>22:29:32,544 DBG installation: Task completed: Run pre-storage tasks (4/18) (0.0 s)
>22:29:32,544 INF progress: Run pre-storage tasks
>22:29:32,545 INF installation: Task started: Activate filesystems (5/18)
>22:29:34,785 INF progress: Creating disklabel on /dev/vda
>22:29:35,123 INF progress: Creating xfs on /dev/vda1
>22:29:35,735 INF progress: Creating lvmpv on /dev/vda2
>22:29:36,311 INF progress: Creating swap on /dev/mapper/rhel_rhel8beta--dev-swap
>22:29:36,608 INF progress: Creating xfs on /dev/mapper/rhel_rhel8beta--dev-root
>22:29:36,879 INF storage: setting boot flag on vda1
>22:29:38,688 DBG installation: Task completed: Activate filesystems (5/18) (6.1 s)
>22:29:38,689 INF progress: Activate filesystems
>22:29:38,689 INF installation: Task started: Write early storage (6/18)
>22:29:38,694 INF storage: not writing out mpath configuration
>22:29:38,695 DBG installation: Task completed: Write early storage (6/18) (0.0 s)
>22:29:38,695 INF progress: Write early storage
>22:29:38,695 INF installation: Queue started: Pre-install scripts (3/9)
>22:29:38,696 INF progress: Running pre-installation scripts
>22:29:38,701 INF installation: Task started: Run %pre-install scripts (7/18)
>22:29:38,701 DBG installation: Task completed: Run %pre-install scripts (7/18) (0.0 s)
>22:29:38,702 INF progress: Run %pre-install scripts
>22:29:38,702 INF installation: Queue started: Realm discover (4/9)
>22:29:38,703 INF progress: Discovering realm to join
>22:29:38,706 INF installation: Task started: Discover realm to join (8/18)
>22:29:38,712 DBG installation: Task completed: Discover realm to join (8/18) (0.0 s)
>22:29:38,712 INF progress: Discover realm to join
>22:29:38,713 INF installation: Queue started: Pre install tasks (5/9)
>22:29:38,713 INF progress: Running pre-installation tasks
>22:29:38,716 INF installation: Task started: Setup authselect (9/18)
>22:29:38,721 DBG installation: Task completed: Setup authselect (9/18) (0.0 s)
>22:29:38,722 INF progress: Setup authselect
>22:29:38,722 INF installation: Task started: Setup firewall (10/18)
>22:29:38,726 DBG installation: Task completed: Setup firewall (10/18) (0.0 s)
>22:29:38,726 INF progress: Setup firewall
>22:29:38,727 INF installation: Task started: Setup network (11/18)
>22:29:38,740 DBG installation: Task completed: Setup network (11/18) (0.0 s)
>22:29:38,740 INF progress: Setup network
>22:29:38,741 INF installation: Task started: Setup timezone (12/18)
>22:29:38,777 DBG installation: Task completed: Setup timezone (12/18) (0.0 s)
>22:29:38,777 INF progress: Setup timezone
>22:29:38,778 INF installation: Task started: Copy /resolv.conf to sysroot (13/18)
>22:29:38,779 DBG installation: Task completed: Copy /resolv.conf to sysroot (13/18) (0.0 s)
>22:29:38,779 INF progress: Copy /resolv.conf to sysroot
>22:29:38,780 INF installation: Task started: Find additional packages & run preInstall() (14/18)
>22:29:38,782 DBG payload: added package requirement 'e2fsprogs' for storage, strong=True
>22:29:38,782 DBG payload: added package requirement 'xfsprogs' for storage, strong=True
>22:29:38,782 DBG payload: added package requirement 'lvm2' for storage, strong=True
>22:29:38,782 DBG payload: no package requirement added for realm
>22:29:38,783 DBG payload: added package requirement 'authselect-compat' for authselect, strong=True
>22:29:38,783 DBG payload: added package requirement 'firewalld' for firewall, strong=True
>22:29:38,783 DBG payload: no package requirement added for network
>22:29:38,784 DBG payload: added package requirement 'chrony' for ntp, strong=False
>22:29:38,784 DBG payload: added package requirement 'grub2' for bootloader, strong=True
>22:29:38,784 DBG payload: added package requirement 'grub2-tools' for bootloader, strong=True
>22:29:38,790 DBG payload: no group requirement added for language groups
>22:29:38,795 DBG payload: no package requirement added for langpacks
>22:29:38,812 WRN payload: Platform group platform-kvm not available.
>22:29:38,817 DBG installation: Task completed: Find additional packages & run preInstall() (14/18) (0.0 s)
>22:29:38,818 INF progress: Find additional packages & run preInstall()
>22:29:38,819 INF installation: Queue started: Payload installation (6/9)
>22:29:38,819 INF progress: Installing.
>22:29:38,823 INF installation: Task started: Install the payload (15/18)
>22:29:38,823 INF progress: Starting package installation process
>22:29:38,832 DBG payload: apply with result True called on requirements [('package', 'e2fsprogs', PayloadRequirement(id=e2fsprogs, reasons=[PayloadRequirementReason(reason='storage', strong=True)])), ('package', 'xfsprogs', PayloadRequirement(id=xfsprogs, reasons=[PayloadRequirementReason(reason='storage', strong=True)])), ('package', 'lvm2', PayloadRequirement(id=lvm2, reasons=[PayloadRequirementReason(reason='storage', strong=True)])), ('package', 'authselect-compat', PayloadRequirement(id=authselect-compat, reasons=[PayloadRequirementReason(reason='authselect', strong=True)])), ('package', 'firewalld', PayloadRequirement(id=firewalld, reasons=[PayloadRequirementReason(reason='firewall', strong=True)])), ('package', 'chrony', PayloadRequirement(id=chrony, reasons=[PayloadRequirementReason(reason='ntp', strong=False)])), ('package', 'grub2', PayloadRequirement(id=grub2, reasons=[PayloadRequirementReason(reason='bootloader', strong=True)])), ('package', 'grub2-tools', PayloadRequirement(id=grub2-tools, reasons=[PayloadRequirementReason(reason='bootloader', strong=True)]))]
>22:29:38,988 DBG simpleline: New signal SendMessageSignal enqueued with source TextUserInterface
>22:29:39,825 DBG simpleline: Pushing modal screen YesNoDialog to stack
>22:29:39,827 DBG simpleline: Executing inner loop
>22:29:39,827 DBG simpleline: New signal RenderScreenSignal enqueued with source ScreenScheduler
>22:29:39,827 DBG simpleline: Processing screen ScreenData(YesNoDialog,None,True)
>22:29:39,833 DBG simpleline: Input is required by ScreenData(YesNoDialog,None,True) screen
>22:49:20,691 DBG simpleline: New signal InputReceivedSignal enqueued with source InputHandlerRequest
>22:49:20,695 DBG simpleline: New signal InputReadySignal enqueued with source YesNoDialog
>22:49:20,698 DBG simpleline: Closing screen ScreenData(YesNoDialog,None,True) from None
>22:49:20,700 DBG simpleline: Closing inner loop
>22:49:30,924 INF progress: Preparing transaction from installation source
>22:54:11,870 DBG installation: Task completed: Install the payload (15/18) (1473.0 s)
>22:54:11,871 INF progress: Install the payload
>22:54:11,872 INF installation: Queue started: Late storage configuration (7/9)
>22:54:11,872 INF progress: Configuring storage
>22:54:11,875 INF installation: Task started: Write late storage (16/18)
>22:54:11,876 DBG installation: Task completed: Write late storage (16/18) (0.0 s)
>22:54:11,876 INF progress: Write late storage
>22:54:11,877 INF installation: Queue started: Bootloader installation (8/9)
>22:54:11,877 INF progress: Installing boot loader
>22:54:11,879 INF installation: Task started: Install bootloader (17/18)
>22:54:11,880 INF bootloader: boot loader stage1 target device is vda
>22:54:11,880 INF bootloader: boot loader stage2 target device is vda1
>22:54:11,929 DBG bootloader: new default image: <pyanaconda.bootloader.LinuxBootLoaderImage object at 0x7fc9b04ac828>
>22:54:12,081 INF bootloader: bootloader.py: mbr will be updated for grub2
>22:54:21,322 INF bootloader: bootloader.py: used boot args: nofb quiet splash=quiet crashkernel=auto resume=/dev/mapper/rhel_rhel8beta--dev-swap rd.lvm.lv=rhel_rhel8beta-dev/root rd.lvm.lv=rhel_rhel8beta-dev/swap 
>22:54:24,264 DBG installation: Task completed: Install bootloader (17/18) (12.4 s)
>22:54:24,265 INF progress: Install bootloader
>22:54:24,266 INF installation: Queue started: Post-installation setup tasks (9/9)
>22:54:24,266 INF progress: Performing post-installation setup tasks
>22:54:24,269 INF installation: Task started: Run post-installation setup tasks (18/18)
>22:54:24,290 DBG payload: The default target is already set.
>22:54:24,291 INF payload: Installation requirements: [('package', 'e2fsprogs', PayloadRequirement(id=e2fsprogs, reasons=[PayloadRequirementReason(reason='storage', strong=True)])), ('package', 'xfsprogs', PayloadRequirement(id=xfsprogs, reasons=[PayloadRequirementReason(reason='storage', strong=True)])), ('package', 'lvm2', PayloadRequirement(id=lvm2, reasons=[PayloadRequirementReason(reason='storage', strong=True)])), ('package', 'authselect-compat', PayloadRequirement(id=authselect-compat, reasons=[PayloadRequirementReason(reason='authselect', strong=True)])), ('package', 'firewalld', PayloadRequirement(id=firewalld, reasons=[PayloadRequirementReason(reason='firewall', strong=True)])), ('package', 'chrony', PayloadRequirement(id=chrony, reasons=[PayloadRequirementReason(reason='ntp', strong=False)])), ('package', 'grub2', PayloadRequirement(id=grub2, reasons=[PayloadRequirementReason(reason='bootloader', strong=True)])), ('package', 'grub2-tools', PayloadRequirement(id=grub2-tools, reasons=[PayloadRequirementReason(reason='bootloader', strong=True)]))]
>22:54:24,293 DBG installation: Task completed: Run post-installation setup tasks (18/18) (0.0 s)
>22:54:24,293 INF progress: Run post-installation setup tasks
>22:54:24,294 INF threading: Thread Done: AnaInstallThread (140504123684608)
>22:54:24,298 INF threading: Running Thread: AnaConfigurationThread (140504106637056)
>22:54:24,309 INF installation: Top-level task queue: Configuration queue
>Number of task queues: 7
>Number of tasks: 20
>Task & task group listing:
> Task queue: Installed system configuration
>  Task: Configure authselect
>  Task: Configure SELinux
>  Task: Configure first boot tasks
>  Task: Configure services
>  Task: Configure keyboard
>  Task: Configure timezone
>  Task: Configure language
>  Task: Configure firewall
>  Task: Configure X
>  Task: Configure system purpose
> Task queue: Network configuration
>  Task: Network configuration
> Task queue: User creation
>  Task: Configure root
>  Task: Configure user groups
>  Task: Configure user
>  Task: Configure SSH key
> Task queue: Anaconda addon configuration
>  Task: Configure Anaconda addons
> Task queue: Initramfs generation
>  Task: Generate initramfs
> Task queue: Post installation scripts
>  Task: Run post installation scripts
> Task queue: Write configs and kickstarts
>  Task: Store kickstarts
>  Task: Store user interaction config
>22:54:24,311 INF progress: Configuring installed system
>22:54:24,316 INF installation: Queue started: Installed system configuration (1/7)
>22:54:24,317 INF installation: Task started: Configure authselect (1/20)
>22:54:24,357 INF threading: Thread Failed: AnaConfigurationThread (140504106637056)
>22:54:24,358 DBG exception: running handleException
>22:54:24,364 CRT exception: Traceback (most recent call last):
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/threading.py", line 286, in run
>    threading.Thread.run(self)
>
>  File "/usr/lib64/python3.6/threading.py", line 864, in run
>    self._target(*self._args, **self._kwargs)
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation.py", line 205, in doConfiguration
>    configuration_queue.start()
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation_tasks.py", line 304, in start
>    item.start()
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation_tasks.py", line 304, in start
>    item.start()
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation_tasks.py", line 472, in start
>    self.run_task()
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation_tasks.py", line 438, in run_task
>    self._task(*self._task_args, **self._task_kwargs)
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/kickstart.py", line 373, in execute
>    ["--update", "--nostart"] + security_proxy.Authconfig
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/kickstart.py", line 380, in _run
>    raise KickstartError(msg)
>
>pykickstart.errors.KickstartError: /usr/sbin/authconfig is missing. Cannot setup authentication.
>
>22:54:25,228 DBG exception: Gtk cannot be initialized
>22:54:25,229 DBG exception: In a non-main thread, sending a message with exception data
>22:54:25,229 DBG simpleline: New signal ExceptionSignal enqueued with source ScreenScheduler
>22:54:25,230 INF threading: Thread Done: AnaConfigurationThread (140504106637056)
>22:54:25,316 DBG simpleline: Executing inner loop
>22:54:25,317 DBG simpleline: New signal ExceptionSignal enqueued with source ScreenScheduler
>22:54:25,317 ERR ui.tui: 
>======= Screen stack =======
>----------- TOP ------------
>ScreenData(ProgressSpoke,None,False)
>============================
>
>22:54:25,318 DBG exception: running handleException
>22:54:25,318 CRT exception: Traceback (most recent call last):
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/threading.py", line 286, in run
>    threading.Thread.run(self)
>
>  File "/usr/lib64/python3.6/threading.py", line 864, in run
>    self._target(*self._args, **self._kwargs)
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation.py", line 205, in doConfiguration
>    configuration_queue.start()
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation_tasks.py", line 304, in start
>    item.start()
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation_tasks.py", line 304, in start
>    item.start()
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation_tasks.py", line 472, in start
>    self.run_task()
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/installation_tasks.py", line 438, in run_task
>    self._task(*self._task_args, **self._task_kwargs)
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/kickstart.py", line 373, in execute
>    ["--update", "--nostart"] + security_proxy.Authconfig
>
>  File "/usr/lib64/python3.6/site-packages/pyanaconda/kickstart.py", line 380, in _run
>    raise KickstartError(msg)
>
>pykickstart.errors.KickstartError: /usr/sbin/authconfig is missing. Cannot setup authentication.
>
>22:54:25,319 DBG exception: Gtk cannot be initialized
>22:54:25,319 DBG exception: In the main thread, running exception handler
>22:55:03,042 INF core.util: Running kickstart %%onerror script(s)
>22:55:03,044 INF core.util: All kickstart %%onerror script(s) have been run
>22:55:03,044 INF kickstart.script: Running kickstart %%traceback script(s)
>22:55:03,044 INF kickstart.script: All kickstart %%traceback script(s) have been run
>22:55:36,672 DBG simpleline: New signal InputReceivedSignal enqueued with source InputHandlerRequest
>22:55:36,676 DBG simpleline: New signal InputReadySignal enqueued with source TextIntf

Actions: View

Attachments on bug 1654880: 1510001 | 1510002 | 1510003 | 1510004 | 1510005 | 1510006 | 1510007 | 1510008 | 1510009 | 1510010 | 1510011 | 1510012 | 1510013 | 1510014 | 1510015 | 1510016 | 1510017