2026-02-02 09:42:09,051 main.py:<module> [INFO] Module search path: ['/usr/local/share/aliyun-assist/plugin/ecsgo-helper/0.48/src', '/usr/local/share/aliyun-assist/plugin/ecsgo-helper/0.48/lib/python/site-packages', '/usr/local/share/aliyun-assist/plugin/ecsgo-helper/0.48/lib/x86_64-linux-gnu/python2/site-packages', '/usr/local/share/aliyun-assist/plugin/ecsgo-helper/0.48/lib/x86_64-linux-gnu/python2.7/site-packages', '/usr/lib64/python27.zip', '/usr/lib64/python2.7', '/usr/lib64/python2.7/plat-linux2', '/usr/lib64/python2.7/lib-tk', '/usr/lib64/python2.7/lib-old', '/usr/lib64/python2.7/lib-dynload', '/usr/lib64/python2.7/site-packages', '/usr/lib/python2.7/site-packages', '/usr/lib/python2.7/site-packages/cloud_init-0.7.6-py2.7.egg', '/usr/lib/python2.7/site-packages']
2026-02-02 09:42:09,983 base.py:wrapper [INFO] [Collecting] get_system_info
2026-02-02 09:42:09,983 base.py:wrapper [INFO] [Collected] get_system_info
2026-02-02 09:42:09,983 base.py:wrapper [INFO] [Collecting] get_kernel_release
2026-02-02 09:42:09,986 base.py:wrapper [INFO] [Collected] get_kernel_release
2026-02-02 09:42:09,986 base.py:wrapper [INFO] [Collecting] get_architecture
2026-02-02 09:42:09,986 base.py:wrapper [INFO] [Collected] get_architecture
2026-02-02 09:42:09,987 system.py:check_system_supported [INFO] Current running OS ('centos', u'7.9.2009') matched supporting pattern ('centos', '7*')
2026-02-02 09:42:09,987 base.py:wrapper [INFO] [Collecting] get_auditd_service
2026-02-02 09:42:10,006 base.py:wrapper [INFO] [Collected] get_auditd_service
2026-02-02 09:42:10,006 base.py:wrapper [INFO] [Collecting] get_time_synchronization_service
2026-02-02 09:42:10,038 command.py:run_get_output [ERROR] Run command error, command: ['systemctl', 'is-enabled', 'ntpd.service'], error code: 1, output: disabled
2026-02-02 09:42:10,045 command.py:run_get_output [ERROR] Run command error, command: ['systemctl', 'is-active', 'ntpd.service'], error code: 3, output: inactive
2026-02-02 09:42:10,058 base.py:wrapper [INFO] [Collected] get_time_synchronization_service
2026-02-02 09:42:10,058 base.py:wrapper [INFO] [Collecting] get_auditd_config
2026-02-02 09:42:10,059 base.py:wrapper [INFO] [Collected] get_auditd_config
2026-02-02 09:42:10,059 base.py:wrapper [INFO] [Collecting] get_boot_file_info
2026-02-02 09:42:10,066 __init__.py:_find_in_early_cpios [INFO] /boot/initramfs-3.10.0-1160.41.1.el7.x86_64.img: at postition 31744 compressed content with magic number `\x1f\x8b\x08\x00\x37\xd2` seems to be encountered
2026-02-02 09:42:10,102 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.41.1.el7.x86_64.img: forwarding initramfs content started from position 31744
2026-02-02 09:42:11,422 __init__.py:_find_in_decompressed [DEBUG] /boot/initramfs-3.10.0-1160.41.1.el7.x86_64.img: compressed content of initramfs starts from position 31744
2026-02-02 09:42:11,476 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.41.1.el7.x86_64.img: forwarding initramfs content started from position 31744
2026-02-02 09:42:14,385 __init__.py:_find_in_early_cpios [INFO] /boot/initramfs-3.10.0-1160.76.1.el7.x86_64.img: at postition 38912 compressed content with magic number `\x1f\x8b\x08\x00\xdf\xe2` seems to be encountered
2026-02-02 09:42:14,414 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.76.1.el7.x86_64.img: forwarding initramfs content started from position 38912
2026-02-02 09:42:15,342 __init__.py:_find_in_decompressed [DEBUG] /boot/initramfs-3.10.0-1160.76.1.el7.x86_64.img: compressed content of initramfs starts from position 38912
2026-02-02 09:42:15,379 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.76.1.el7.x86_64.img: forwarding initramfs content started from position 38912
2026-02-02 09:42:17,772 __init__.py:_find_in_early_cpios [INFO] /boot/initramfs-3.10.0-1160.42.2.el7.x86_64.img: at postition 31744 compressed content with magic number `\x1f\x8b\x08\x00\xa5\x34` seems to be encountered
2026-02-02 09:42:17,804 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.42.2.el7.x86_64.img: forwarding initramfs content started from position 31744
2026-02-02 09:42:18,786 __init__.py:_find_in_decompressed [DEBUG] /boot/initramfs-3.10.0-1160.42.2.el7.x86_64.img: compressed content of initramfs starts from position 31744
2026-02-02 09:42:18,844 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.42.2.el7.x86_64.img: forwarding initramfs content started from position 31744
2026-02-02 09:42:20,840 __init__.py:_find_in_early_cpios [INFO] /boot/initramfs-3.10.0-1160.49.1.el7.x86_64.img: at postition 38912 compressed content with magic number `\x1f\x8b\x08\x00\xc3\xe2` seems to be encountered
2026-02-02 09:42:20,855 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.49.1.el7.x86_64.img: forwarding initramfs content started from position 38912
2026-02-02 09:42:21,447 __init__.py:_find_in_decompressed [DEBUG] /boot/initramfs-3.10.0-1160.49.1.el7.x86_64.img: compressed content of initramfs starts from position 38912
2026-02-02 09:42:21,464 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.49.1.el7.x86_64.img: forwarding initramfs content started from position 38912
2026-02-02 09:42:23,780 __init__.py:_find_in_early_cpios [INFO] /boot/initramfs-0-rescue-20191008171109952517774891784520.img: at postition 2572288 compressed content with magic number `\x1f\x8b\x08\x00\xb6\x53` seems to be encountered
2026-02-02 09:42:23,813 __init__.py:run [DEBUG] Forwarding /boot/initramfs-0-rescue-20191008171109952517774891784520.img: forwarding initramfs content started from position 2572288
2026-02-02 09:42:25,803 __init__.py:_find_in_decompressed [DEBUG] /boot/initramfs-0-rescue-20191008171109952517774891784520.img: compressed content of initramfs starts from position 2572288
2026-02-02 09:42:25,838 __init__.py:run [DEBUG] Forwarding /boot/initramfs-0-rescue-20191008171109952517774891784520.img: forwarding initramfs content started from position 2572288
2026-02-02 09:42:28,865 boot.py:get_boot_file_info [WARNING] Modules directory "/usr/lib/modules/0-rescue-20191008171109952517774891784520" of kernel release 0-rescue-20191008171109952517774891784520 is not a available directory
2026-02-02 09:42:28,868 __init__.py:_find_in_early_cpios [INFO] /boot/initramfs-3.10.0-1160.45.1.el7.x86_64.img: at postition 31744 compressed content with magic number `\x1f\x8b\x08\x00\x06\x63` seems to be encountered
2026-02-02 09:42:28,894 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.45.1.el7.x86_64.img: forwarding initramfs content started from position 31744
2026-02-02 09:42:29,675 __init__.py:_find_in_decompressed [DEBUG] /boot/initramfs-3.10.0-1160.45.1.el7.x86_64.img: compressed content of initramfs starts from position 31744
2026-02-02 09:42:29,708 __init__.py:run [DEBUG] Forwarding /boot/initramfs-3.10.0-1160.45.1.el7.x86_64.img: forwarding initramfs content started from position 31744
2026-02-02 09:42:31,817 base.py:wrapper [INFO] [Collected] get_boot_file_info
2026-02-02 09:42:31,818 base.py:wrapper [INFO] [Collecting] get_os_release_fileinfo
2026-02-02 09:42:31,818 base.py:wrapper [INFO] [Collected] get_os_release_fileinfo
2026-02-02 09:42:31,819 base.py:wrapper [INFO] [Collecting] get_boot_entries
2026-02-02 09:42:31,823 base.py:wrapper [INFO] [Collected] get_boot_entries
2026-02-02 09:42:31,823 base.py:wrapper [INFO] [Collecting] get_grub_version
2026-02-02 09:42:31,823 base.py:wrapper [INFO] [Collected] get_grub_version
2026-02-02 09:42:31,823 base.py:wrapper [INFO] [Collecting] get_critical_kerneloptions
2026-02-02 09:42:31,825 base.py:wrapper [INFO] [Collected] get_critical_kerneloptions
2026-02-02 09:42:31,825 base.py:wrapper [INFO] [Collecting] get_mounts
2026-02-02 09:42:31,826 base.py:wrapper [INFO] [Collected] get_mounts
2026-02-02 09:42:31,826 base.py:wrapper [INFO] [Collecting] get_fstab
2026-02-02 09:42:31,826 base.py:wrapper [INFO] [Collected] get_fstab
2026-02-02 09:42:31,826 base.py:wrapper [INFO] [Collecting] get_block_devices
2026-02-02 09:42:31,873 base.py:wrapper [INFO] [Collected] get_block_devices
2026-02-02 09:42:31,874 base.py:wrapper [INFO] [Collecting] get_partitions
2026-02-02 09:42:31,916 base.py:wrapper [INFO] [Collected] get_partitions
2026-02-02 09:42:31,916 base.py:wrapper [INFO] [Collecting] get_disk_usage
2026-02-02 09:42:31,943 disk.py:_nullable_parse_int [ERROR] Failed to parse `-` into value with unit
Traceback (most recent call last):
  File "/usr/local/share/aliyun-assist/plugin/ecsgo-helper/0.48/src/system_utils/disk.py", line 285, in _nullable_parse_int
    result = parser.parse_int(raw_value, expected_unit=parsing_unit)
  File "/usr/local/share/aliyun-assist/plugin/ecsgo-helper/0.48/src/ecsgo_utils/parser/__init__.py", line 11, in parse_int
    raise ParseDataUnitError("Unrecognized format of field with unit: {0}".format(raw_value))
ParseDataUnitError: ParseDataUnitFailure: Parse data failed: Unrecognized format of field with unit: -
2026-02-02 09:42:31,944 base.py:wrapper [INFO] [Collected] get_disk_usage
2026-02-02 09:42:31,944 base.py:wrapper [INFO] [Collecting] get_layouts
2026-02-02 09:42:31,965 base.py:wrapper [INFO] [Collected] get_layouts
2026-02-02 09:42:31,965 base.py:wrapper [INFO] [Collecting] get_mountpoints_in_fstab
2026-02-02 09:42:31,965 base.py:wrapper [INFO] [Collected] get_mountpoints_in_fstab
2026-02-02 09:42:31,965 base.py:wrapper [INFO] [Collecting] get_bad_geometry_errors
2026-02-02 09:42:31,993 _systemd_journal.py:parsed_grepped_journal [DEBUG] Initiate journalctl process with argv: ['journalctl', '--since', '2026-02-01 09:42:09', '--until', '2026-02-02 17:42:09', '--dmesg', '--output', 'json']
2026-02-02 09:42:32,001 _systemd_journal.py:parsed_grepped_journal [DEBUG] Piped from journalctl process, initiate grep process with argv: ['grep', '-E', 'bad geometry:']
2026-02-02 09:42:40,113 base.py:wrapper [INFO] [Collected] get_bad_geometry_errors
2026-02-02 09:42:40,114 base.py:wrapper [INFO] [Collecting] get_read_inode_bitmap_errors
2026-02-02 09:42:40,129 _systemd_journal.py:parsed_grepped_journal [DEBUG] Initiate journalctl process with argv: ['journalctl', '--since', '2026-02-01 09:42:09', '--until', '2026-02-02 17:42:09', '--dmesg', '--output', 'json']
2026-02-02 09:42:40,176 _systemd_journal.py:parsed_grepped_journal [DEBUG] Piped from journalctl process, initiate grep process with argv: ['grep', '-E', 'Cannot read inode bitmap']
2026-02-02 09:42:40,264 base.py:wrapper [INFO] [Collected] get_read_inode_bitmap_errors
2026-02-02 09:42:40,265 base.py:wrapper [INFO] [Collecting] get_cloudinit_status
2026-02-02 09:42:40,360 base.py:wrapper [INFO] [Collected] get_cloudinit_status
2026-02-02 09:42:40,360 base.py:wrapper [INFO] [Collecting] get_cloudinit_version_provider
2026-02-02 09:42:42,632 base.py:wrapper [INFO] [Collected] get_cloudinit_version_provider
2026-02-02 09:42:42,632 base.py:wrapper [INFO] [Collecting] get_cloudinit_fw_cfg
2026-02-02 09:42:42,633 base.py:wrapper [INFO] [Collected] get_cloudinit_fw_cfg
2026-02-02 09:42:42,633 base.py:wrapper [INFO] [Collecting] get_service_statuses
2026-02-02 09:42:43,441 base.py:wrapper [INFO] [Collected] get_service_statuses
2026-02-02 09:42:43,441 base.py:wrapper [INFO] [Collecting] get_user_data_exe_result
2026-02-02 09:42:43,669 _systemd_journal.py:parsed_grepped_journal [DEBUG] Initiate journalctl process with argv: ['journalctl', '--since', '2026-02-01 09:42:09', '--until', '2026-02-02 17:42:09', '--boot', '0', '--output', 'json', '--unit', 'cloud-final.service']
2026-02-02 09:42:43,708 _systemd_journal.py:parsed_grepped_journal [DEBUG] Piped from journalctl process, initiate grep process with argv: ['grep', '-E', 'Failed running /var/lib/cloud/instance/scripts/| Failed to run module scripts[-_]user \\(scripts in /var/lib/cloud/instance/scripts\\)']
2026-02-02 09:42:44,594 command.py:run_get_output [ERROR] Run command error, command: ['systemctl', 'is-enabled', 'cloud-init-main.service'], error code: 1, output: Failed to get unit file state for cloud-init-main.service: No such file or directory
2026-02-02 09:42:44,684 _systemd_journal.py:parsed_grepped_journal [DEBUG] Initiate journalctl process with argv: ['journalctl', '--since', '2026-02-01 09:42:09', '--until', '2026-02-02 17:42:09', '--boot', '0', '--output', 'json', '--unit', 'cloud-init.service']
2026-02-02 09:42:44,716 _systemd_journal.py:parsed_grepped_journal [DEBUG] Piped from journalctl process, initiate grep process with argv: ['grep', '-E', '.*\\[WARNING\\]: Unhandled non-multipart.*']
2026-02-02 09:42:46,817 command.py:run_get_output [ERROR] Run command error, command: ['systemctl', 'is-enabled', 'cloud-init-main.service'], error code: 1, output: Failed to get unit file state for cloud-init-main.service: No such file or directory
2026-02-02 09:42:46,817 base.py:wrapper [INFO] [Collected] get_user_data_exe_result
2026-02-02 09:42:46,818 base.py:wrapper [INFO] [Collecting] get_growpart_info
2026-02-02 09:42:46,818 base.py:wrapper [INFO] [Collected] get_growpart_info
2026-02-02 09:42:46,818 base.py:wrapper [INFO] [Collecting] get_installed_packages
2026-02-02 09:42:46,959 base.py:wrapper [INFO] [Collected] get_installed_packages
2026-02-02 09:42:46,960 base.py:wrapper [INFO] [Collecting] get_repository_info
2026-02-02 09:42:47,001 base.py:wrapper [INFO] [Collected] get_repository_info
2026-02-02 09:42:47,001 base.py:wrapper [INFO] [Collecting] get_network_category
2026-02-02 09:42:47,073 base.py:wrapper [INFO] [Collected] get_network_category
2026-02-02 09:42:47,074 base.py:wrapper [INFO] [Collecting] get_important_listen_ports
2026-02-02 09:42:47,746 base.py:wrapper [INFO] [Collected] get_important_listen_ports
2026-02-02 09:42:47,746 base.py:wrapper [INFO] [Collecting] get_dns_cfg
2026-02-02 09:42:47,747 base.py:wrapper [INFO] [Collected] get_dns_cfg
2026-02-02 09:42:47,747 base.py:wrapper [INFO] [Collecting] get_network_config
2026-02-02 09:42:48,596 base.py:wrapper [INFO] [Collected] get_network_config
2026-02-02 09:42:48,596 base.py:wrapper [INFO] [Collecting] get_dhclient_version
2026-02-02 09:42:48,622 base.py:wrapper [INFO] [Collected] get_dhclient_version
2026-02-02 09:42:48,622 base.py:wrapper [INFO] [Collecting] get_network_configuration_services
2026-02-02 09:42:48,854 command.py:run_get_output [ERROR] Run command error, command: ['systemctl', 'is-enabled', 'NetworkManager.service'], error code: 1, output: disabled
2026-02-02 09:42:48,949 command.py:run_get_output [ERROR] Run command error, command: ['systemctl', 'is-active', 'NetworkManager.service'], error code: 3, output: inactive
2026-02-02 09:42:48,973 base.py:wrapper [INFO] [Collected] get_network_configuration_services
2026-02-02 09:42:48,974 base.py:wrapper [INFO] [Collecting] get_firewall_info
2026-02-02 09:42:49,620 base.py:wrapper [INFO] [Collected] get_firewall_info
2026-02-02 09:42:49,620 base.py:wrapper [INFO] [Collecting] get_udev_naming
2026-02-02 09:42:49,621 base.py:wrapper [INFO] [Collected] get_udev_naming
2026-02-02 09:42:49,621 base.py:wrapper [INFO] [Collecting] get_networking_config
2026-02-02 09:42:49,621 network.py:get_networking_config [INFO] Mute exception about /etc/network/interfaces not found: FileNotExist: /etc/network/interfaces does not exist
2026-02-02 09:42:49,621 base.py:wrapper [INFO] [Collected] get_networking_config
2026-02-02 09:42:49,621 base.py:wrapper [INFO] [Collecting] get_ifcfgs
2026-02-02 09:42:49,621 base.py:wrapper [INFO] [Collected] get_ifcfgs
2026-02-02 09:42:49,621 base.py:wrapper [INFO] [Collecting] get_netstat_stats
2026-02-02 09:42:49,621 base.py:wrapper [INFO] [Collected] get_netstat_stats
2026-02-02 09:42:49,621 base.py:wrapper [INFO] [Collecting] get_softnet_stat_stats
2026-02-02 09:42:49,622 base.py:wrapper [INFO] [Collected] get_softnet_stat_stats
2026-02-02 09:42:49,622 base.py:wrapper [INFO] [Collecting] get_net_timewait
2026-02-02 09:42:49,706 base.py:wrapper [INFO] [Collected] get_net_timewait
2026-02-02 09:42:49,707 base.py:wrapper [INFO] [Collecting] get_nf_conntrack_max_info
2026-02-02 09:42:49,737 _systemd_journal.py:parsed_grepped_journal [DEBUG] Initiate journalctl process with argv: ['journalctl', '--since', '2026-02-01 09:42:09', '--until', '2026-02-02 17:42:09', '--dmesg', '--output', 'json']
2026-02-02 09:42:49,769 _systemd_journal.py:parsed_grepped_journal [DEBUG] Piped from journalctl process, initiate grep process with argv: ['grep', '-E', '(nf_conntrack(.*)table full, dropping packet)|(table full, dropping packet(.*)nf_conntrack)']
2026-02-02 09:42:49,805 base.py:wrapper [INFO] [Collected] get_nf_conntrack_max_info
2026-02-02 09:42:49,806 base.py:wrapper [INFO] [Collecting] get_tcp_max_timewait_buckets_info
2026-02-02 09:42:49,846 _systemd_journal.py:parsed_grepped_journal [DEBUG] Initiate journalctl process with argv: ['journalctl', '--since', '2026-02-01 09:42:09', '--until', '2026-02-02 17:42:09', '--dmesg', '--output', 'json']
2026-02-02 09:42:49,869 _systemd_journal.py:parsed_grepped_journal [DEBUG] Piped from journalctl process, initiate grep process with argv: ['grep', '-E', '(TCP(.*)time wait bucket table overflow)|(time wait bucket table overflow(.*)TCP)']
2026-02-02 09:42:49,910 base.py:wrapper [INFO] [Collected] get_tcp_max_timewait_buckets_info
2026-02-02 09:42:49,911 base.py:wrapper [INFO] [Collecting] get_cpu_top_5_processes
2026-02-02 09:42:49,981 base.py:wrapper [INFO] [Collected] get_cpu_top_5_processes
2026-02-02 09:42:49,981 base.py:wrapper [INFO] [Collecting] get_physical_memory_top_5_processes
2026-02-02 09:42:50,103 base.py:wrapper [INFO] [Collected] get_physical_memory_top_5_processes
2026-02-02 09:42:50,104 base.py:wrapper [INFO] [Collecting] get_disk_write_top_5_processes
2026-02-02 09:42:51,678 base.py:wrapper [INFO] [Collected] get_disk_write_top_5_processes
2026-02-02 09:42:51,679 base.py:wrapper [INFO] [Collecting] get_disk_read_top_5_processes
2026-02-02 09:42:53,363 base.py:wrapper [INFO] [Collected] get_disk_read_top_5_processes
2026-02-02 09:42:53,363 base.py:wrapper [INFO] [Collecting] get_process_count
2026-02-02 09:42:53,385 base.py:wrapper [INFO] [Collected] get_process_count
2026-02-02 09:42:53,385 base.py:wrapper [INFO] [Collecting] get_cpu_states
2026-02-02 09:42:53,687 base.py:wrapper [INFO] [Collected] get_cpu_states
2026-02-02 09:42:53,687 base.py:wrapper [INFO] [Collecting] get_cpu_numbers
2026-02-02 09:42:53,687 base.py:wrapper [INFO] [Collected] get_cpu_numbers
2026-02-02 09:42:53,687 base.py:wrapper [INFO] [Collecting] get_devfs_symbolic_links
2026-02-02 09:42:53,687 base.py:wrapper [INFO] [Collected] get_devfs_symbolic_links
2026-02-02 09:42:53,687 base.py:wrapper [INFO] [Collecting] get_critical_users
2026-02-02 09:42:53,688 base.py:wrapper [INFO] [Collected] get_critical_users
2026-02-02 09:42:53,689 base.py:wrapper [INFO] [Collecting] get_selinux_info
2026-02-02 09:42:53,769 base.py:wrapper [INFO] [Collected] get_selinux_info
2026-02-02 09:42:53,769 base.py:wrapper [INFO] [Collecting] get_cron
2026-02-02 09:42:53,805 command.py:run_get_output [ERROR] Run command error, command: ['crontab', '-l'], error code: 1, output: no crontab for root
2026-02-02 09:42:53,806 system.py:get_cron_job [ERROR] RunCommandFailure: Run command ['crontab', '-l'] failed with exitcode 1