Failed to prepare instance for machine anafi_ai

ANAFI Ai
1

Hello !

Ubuntu 20.04, Sphinx 2.15.1

1st console:

sudo systemctl start firmwared.service

sphinx "/opt/parrot-sphinx/usr/share/sphinx/drones/anafi_ai.drone"::firmware="https://firmware.parrot.com/Versions/anafi2/pc/%23latest/images/anafi2-pc.ext2.zip"

2nd console:

parrot-ue4-empty

3nd console:

sudo ulogcat -C -vlong

I got this error in 1st console:

[Msg] World params for 'default':
[Msg] 	spawn_points:
[Msg] 		- name: default
[Msg] 		  pose: -3.3 -0 0.4 0 -0 0
[Msg] connected to firmwared
[Msg] Preparation of firmware https://firmware.parrot.com/Versions/anafi2/pc/%23latest/images/anafi2-pc.ext2.zip
[Msg] firmware /usr/share/firmwared/firmwares//anafi2-pc.ext2.zip.9ba99fdf-4ddb-4023-b4e9-12f0c0e59938.firmware supported hardwares: 
[Msg] 	anafi2
[Msg] All firmwares prepared.
[Err] [PompPool.hh:143] Received an error from firmwared: mount.hook/init_extra failed. See ulog for details.
[Err] [AutomatonStartInst.cc:72] Failed to prepare instance for machine anafi_ai
[Msg] Firmware anafi_ai[189fd23dd0740ca01c44c5de463bee3a4938aff7] unprepared.
[Msg] All drones dropped. Let's shut down.

And logs:

01-01 04:33:25.580 I telemetryd  (telemetryd-199630)              : Loading plugins from '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins/'
01-01 04:33:25.583 I telemetryd  (telemetryd-199630)              : Loading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-gndctrl.so'
01-01 04:33:25.583 I telemetryd  (telemetryd-199630)              : Loading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-web-gndctrl.so'
01-01 04:33:25.586 I telemetryd  (telemetryd-199630)              : Loading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-blackbox.so'
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setEnabled 1
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setCompressed 1
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setCompressionLevel 6
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setCompressionMethod zlib
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setLogDir '.'
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setLogName 'log.tlmb'
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setLogCount 2
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setFilter *
01-01 04:33:25.586 I libtelemetry(telemetryd-199630)              : clear logger filter
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setFlushPeriod 0 ms
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : setMaxSize 2000000000 bytes
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : rotate logs: './sphinx-11345-log.tlmb.1' -> './sphinx-11345-log.tlmb.2'
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : rotate logs: './sphinx-11345-log.tlmb' -> './sphinx-11345-log.tlmb.1'
01-01 04:33:25.586 I tlmblackbox (telemetryd-199630)              : Creating file './sphinx-11345-log.tlmb'
01-01 04:33:25.587 I telemetryd  (telemetryd-199630)              : Entering loop
01-01 04:34:04.515 I perf        (firmwared-194370)               : CPU scaling governors all set to 'performance'.
01-01 04:34:04.516 I shd         (gzserver-199686/gz_world_update-199722): omniscient___UE4__magic_tile: created: generation=2 sample_count=4000 sample_size=200 sample_rate=1000 metadata_size=1165
01-01 04:34:04.537 I shd         (telemetryd-199630)              : omniscient___UE4__magic_tile: opened: sample_count=4000 sample_size=200 sample_rate=1000 metadata_size=1165
01-01 04:34:07.014 I firmwared_firmwares(firmwared-194370)        : firmware 9ba99fdf-4ddb-4023-b4e9-12f0c0e59938 already registered
01-01 04:34:07.066 I firmwared_instances(firmwared-194370)        : init_command_line: ro_boot_console = ro.boot.console=
01-01 04:34:07.121 I firmwared_instances(firmwared-194370)        : OUTER_PTS is /dev/pts/4
01-01 04:34:07.121 I firmwared_instances(firmwared-194370)        : INNER_PTS is /dev/pts/5
01-01 04:34:07.121 I apparmor_config(firmwared-194370)            : apparmor_load_profile(970c7e3c0609d4aa5b53f6ab88e4086172ebe09e)
01-01 04:34:07.229 W firmwared_log(firmwared-194370)              : mv: cannot remove '/var/cache/firmwared/mount_points/instances/970c7e3c0609d4aa5b53f6ab88e4086172ebe09e/union/simulator/sys/class/leds/led_vcam': Directory not empty
01-01 04:34:07.229 W firmwared_log(firmwared-194370)              : mv: cannot remove '/var/cache/firmwared/mount_points/instances/970c7e3c0609d4aa5b53f6ab88e4086172ebe09e/union/simulator/models/anafi2': Directory not empty
01-01 04:34:07.229 E firmwared_instances(firmwared-194370)        : invoke_mount_helper init_extra returned -125
01-01 04:34:07.246 W firmwared_log(firmwared-194370)              : umount: /var/cache/firmwared/mount_points/instances/970c7e3c0609d4aa5b53f6ab88e4086172ebe09e/union/simulator/x11: no mount point specified.
01-01 04:34:07.246 E firmwared_instances(firmwared-194370)        : invoke_mount_helper clean_extra returned -125
01-01 04:34:07.246 E firmwared_instances(firmwared-194370)        : install_extra_mount_points
01-01 04:34:07.246 I apparmor_config(firmwared-194370)            : apparmor_remove_profile(970c7e3c0609d4aa5b53f6ab88e4086172ebe09e)
01-01 04:34:07.265 W firmwared_log(firmwared-194370)              : umount: bad usage
01-01 04:34:07.266 W firmwared_log(firmwared-194370)              : Try 'umount --help' for more information.
01-01 04:34:07.266 E firmwared_instances(firmwared-194370)        : invoke_mount_helper clean_extra returned -125
01-01 04:34:07.292 E firmwared_instances(firmwared-194370)        : init_instance: mount.hook/init_extra failed. See ulog for details.
01-01 04:34:07.292 E firmwared_instances(firmwared-194370)        : instance_new(189fd23dd0740ca01c44c5de463bee3a4938aff7): Unknown error 1027
01-01 04:34:07.292 E firmwared_commands(firmwared-194370)         : command_process: mount.hook/init_extra failed. See ulog for details.
01-01 04:34:07.297 I shd         (gzserver-199686/gz_world_update-199722): omniscient___UE4__magic_tile: closed
01-01 04:34:07.329 E sphxpomp_worker(UnrealApp-199747)            : ExecAsync: Worker is not running.
01-01 04:34:07.329 E sphxpomp_worker(UnrealApp-199747)            : ExecAsync: Worker is not running.
01-01 04:34:07.329 E sphxpomp_worker(UnrealApp-199747)            : ExecAsync: Worker is not running.
01-01 04:34:07.333 I perf        (firmwared-194370)               : Resumed CPU scaling governors.
01-01 04:34:09.163 I telemetryd  (telemetryd-199630)              : sighandler: signo=15(Terminated)
01-01 04:34:09.163 I telemetryd  (telemetryd-199630)              : Exiting loop
01-01 04:34:09.164 I tlmblackbox (telemetryd-199630)              : Closing file './sphinx-11345-log.tlmb'
01-01 04:34:09.164 I telemetryd  (telemetryd-199630)              : Unloading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-blackbox.so'
01-01 04:34:09.164 I telemetryd  (telemetryd-199630)              : Unloading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-gndctrl.so'
01-01 04:34:09.628 I telemetryd  (telemetryd-199630)              : Unloading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-web-gndctrl.so'
01-01 04:34:09.628 E pomp        (telemetryd-199630)              : fd=13, cb=0x7f089eb21280 still in loop
01-01 04:34:09.628 E telemetryd  (telemetryd-199630)              : pomp_loop_destroy: err=-16(Device or resource busy)
01-01 04:34:09.628 I shd         (telemetryd-199630)              : omniscient___UE4__magic_tile: closed
01-01 04:39:53.624 E sphxpomp_worker(UnrealApp-199747)            : ExecAsync: Worker is not running.
01-01 04:39:53.624 E sphxpomp_worker(UnrealApp-199747)            : ExecAsync: Worker is not running.
01-01 04:39:53.625 E sphxpomp_worker(UnrealApp-199747)            : ExecAsync: Worker is not running.

I tried ls on ls -la /var/cache/firmwared/mount_points/instances it shows me root root. And by the way I also have this error on the 3th console:

LogUnixPlatformFile: Warning: create dir('/opt/parrot-ue4-empty/Empty/Saved/Config/CrashReportClient/UE4CC-Linux-EDAB671779244F8CA09FBDD777CB88A5/CrashReportClient.ini') failed: errno=13 (Permission denied)
LogUnixPlatformFile: Warning: create dir('/opt/parrot-ue4-empty/Empty/Saved/Config/CrashReportClient/UE4CC-Linux-EDAB671779244F8CA09FBDD777CB88A5/CrashReportClient.ini') failed: errno=13 (Permission denied)
2

Hello Lecrapouille,

The parrot-ue4-empty warnings can be ignored.
Can you please activate more logs for firmwared? See How to debug firmwares - 2.15.1
If firmwared has an issue with your wifi interface, you can try without it:

sphinx "/opt/parrot-sphinx/usr/share/sphinx/drones/anafi_ai.drone"::wifi_iface=::firmware="https://firmware.parrot.com/Versions/anafi2/pc/%23latest/images/anafi2-pc.ext2.zip"
3

Hi OCrave ! Sphinx is working on my other desktop with Debian 11. But for the 1st laptop, I tried what you asked me to do. It still does not work. Here are logs:

01-01 01:00:05.626 I firmwared_main(firmwared-848)                : firmwared[848] starting
01-01 01:00:05.626 I firmwared_config(firmwared-848)              : loading configuration from "/etc/firmwared.conf"
01-01 01:00:05.646 I firmwared_firmwares(firmwared-848)           : indexing firmwares from folder '/usr/share/firmwared/firmwares/'
01-01 01:00:05.653 I firmwared_firmwares(firmwared-848)           : done indexing firmwares
01-01 01:10:16.283 I firmwared   (firmwared-848)                  : Caught signal 15, exiting
01-01 01:10:16.283 I firmwared_main(firmwared-848)                : firmwared[848] exiting
01-01 01:10:16.305 I firmwared_main(firmwared-6817)               : firmwared[6817] starting
01-01 01:10:16.305 I firmwared_config(firmwared-6817)             : loading configuration from "/etc/firmwared.conf"
01-01 01:10:16.307 I firmwared_firmwares(firmwared-6817)          : indexing firmwares from folder '/usr/share/firmwared/firmwares/'
01-01 01:10:16.307 I firmwared_firmwares(firmwared-6817)          : done indexing firmwares
01-01 01:10:43.776 I telemetryd  (telemetryd-7203)                : Creating daemon with rate 50 ms
01-01 01:10:43.776 I libtelemetry(telemetryd-7203)                : clear logger filter
01-01 01:10:43.776 I telemetryd  (telemetryd-7203)                : Loading plugins from '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins/'
01-01 01:10:43.776 I telemetryd  (telemetryd-7203)                : Loading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-gndctrl.so'
01-01 01:10:43.777 I telemetryd  (telemetryd-7203)                : Loading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-web-gndctrl.so'
01-01 01:10:43.779 I telemetryd  (telemetryd-7203)                : Loading '/opt/parrot-sphinx/usr/bin/../lib/tlm-plugins//tlm-blackbox.so'
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setEnabled 1
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setCompressed 1
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setCompressionLevel 6
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setCompressionMethod zlib
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setLogDir '.'
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setLogName 'log.tlmb'
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setLogCount 2
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setFilter *
01-01 01:10:43.780 I libtelemetry(telemetryd-7203)                : clear logger filter
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setFlushPeriod 0 ms
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : setMaxSize 2000000000 bytes
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : rotate logs: './sphinx-11345-log.tlmb.1' -> './sphinx-11345-log.tlmb.2'
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : rotate logs: './sphinx-11345-log.tlmb' -> './sphinx-11345-log.tlmb.1'
01-01 01:10:43.780 I tlmblackbox (telemetryd-7203)                : Creating file './sphinx-11345-log.tlmb'
01-01 01:10:43.780 I telemetryd  (telemetryd-7203)                : Entering loop
01-01 01:11:15.084 I shd         (gzserver-7259/gz_world_update-7295): omniscient___UE4__magic_tile: created: generation=2 sample_count=4000 sample_size=200 sample_rate=1000 metadata_size=1165
01-01 01:11:15.085 I perf        (firmwared-6817)                 : CPU scaling governors all set to 'performance'.
01-01 01:11:15.663 I firmwared_firmwares(firmwared-6817)          : firmware 9ba99fdf-4ddb-4023-b4e9-12f0c0e59938 already registered
01-01 01:11:15.682 I shd         (telemetryd-7203)                : omniscient___UE4__magic_tile: opened: sample_count=4000 sample_size=200 sample_rate=1000 metadata_size=1165
01-01 01:11:15.714 I firmwared_instances(firmwared-6817)          : init_command_line: ro_boot_console = ro.boot.console=
01-01 01:11:15.718 W firmwared_log(firmwared-6817)                : + stdcpplibpath=usr/lib/x86_64-linux-gnu/libstdc++.so.6
01-01 01:11:15.718 W firmwared_log(firmwared-6817)                : + '[' '!' -z /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union ']'
01-01 01:11:15.719 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.723 W firmwared_log(firmwared-6817)                : + union_mount_point=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.723 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:15.725 W firmwared_log(firmwared-6817)                : + host_system_root_full_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:15.725 W firmwared_log(firmwared-6817)                : + simulator_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator
01-01 01:11:15.725 W firmwared_log(firmwared-6817)                : + simulator_bak_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator.bak
01-01 01:11:15.726 W firmwared_log(firmwared-6817)                : + '[' '!' -z /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11 ']'
01-01 01:11:15.726 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11
01-01 01:11:15.728 W firmwared_log(firmwared-6817)                : + x11_mount_point=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11
01-01 01:11:15.728 W firmwared_log(firmwared-6817)                : + '[' '!' -z '' ']'
01-01 01:11:15.728 W firmwared_log(firmwared-6817)                : ++ readlink -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.730 W firmwared_log(firmwared-6817)                : + canonicalized=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.730 W firmwared_log(firmwared-6817)                : + [[ 0 != 0 ]]
01-01 01:11:15.730 W firmwared_log(firmwared-6817)                : + [[ /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union == / ]]
01-01 01:11:15.730 W firmwared_log(firmwared-6817)                : + unset canonicalized
01-01 01:11:15.730 W firmwared_log(firmwared-6817)                : + workdir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/workdir
01-01 01:11:15.730 W firmwared_log(firmwared-6817)                : + rw_dir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/rw
01-01 01:11:15.731 W firmwared_log(firmwared-6817)                : + ldconfig_sphinx=/opt/parrot-sphinx/usr/bin/ldconfig_sphinx
01-01 01:11:15.731 W firmwared_log(firmwared-6817)                : + [[ ! -x /opt/parrot-sphinx/usr/bin/ldconfig_sphinx ]]
01-01 01:11:15.733 W firmwared_log(firmwared-6817)                : + '[' init = init ']'
01-01 01:11:15.733 W firmwared_log(firmwared-6817)                : + mkdir -p /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs
01-01 01:11:15.736 W firmwared_log(firmwared-6817)                : + '[' unlimited '!=' unlimited ']'
01-01 01:11:15.736 W firmwared_log(firmwared-6817)                : + mkdir -p /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/ro /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/rw /var/cache/firmwared/mount_points/instances/60887434b7db2c183dc
01-01 01:11:15.736 W firmwared_log(firmwared-6817)                : ae829a4e64cf02be62b3/union /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/workdir
01-01 01:11:15.739 W firmwared_log(firmwared-6817)                : + '[' -d /usr/share/firmwared/firmwares//anafi2-pc.ext2.zip.9ba99fdf-4ddb-4023-b4e9-12f0c0e59938.firmware ']'
01-01 01:11:15.739 W firmwared_log(firmwared-6817)                : + touch /usr/share/firmwared/firmwares//anafi2-pc.ext2.zip.9ba99fdf-4ddb-4023-b4e9-12f0c0e59938.firmware
01-01 01:11:15.740 W firmwared_log(firmwared-6817)                : + mount -o ro,loop /usr/share/firmwared/firmwares//anafi2-pc.ext2.zip.9ba99fdf-4ddb-4023-b4e9-12f0c0e59938.firmware /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/ro
01-01 01:11:15.749 W firmwared_log(firmwared-6817)                : ++ uname -r
01-01 01:11:15.750 W firmwared_log(firmwared-6817)                : ++ sed -e 's/-.*$//'
01-01 01:11:15.755 W firmwared_log(firmwared-6817)                : + kernel_version=5.15.0
01-01 01:11:15.756 W firmwared_log(firmwared-6817)                : ++ version_same_or_greater 5.15.0 5.13
01-01 01:11:15.757 W firmwared_log(firmwared-6817)                : ++ printf '5.15.0\n5.13\n'
01-01 01:11:15.757 W firmwared_log(firmwared-6817)                : ++ sort --reverse --version-sort --check=silent
01-01 01:11:15.762 W firmwared_log(firmwared-6817)                : ++ printf 1
01-01 01:11:15.763 W firmwared_log(firmwared-6817)                : + '[' 1 = 1 ']'
01-01 01:11:15.763 W firmwared_log(firmwared-6817)                : + extra_opts=,volatile
01-01 01:11:15.763 W firmwared_log(firmwared-6817)                : + mount -t overlay -o lowerdir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/ro,upperdir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/rw,workdir=/var/cache/firmwared/mount
01-01 01:11:15.763 W firmwared_log(firmwared-6817)                : points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/workdir,volatile firmwared_60887434b7db2c183dcdae829a4e64cf02be62b3 /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.787 I firmwared_instances(firmwared-6817)          : OUTER_PTS is /dev/pts/3
01-01 01:11:15.787 I firmwared_instances(firmwared-6817)          : INNER_PTS is /dev/pts/4
01-01 01:11:15.787 I apparmor_config(firmwared-6817)              : apparmor_load_profile(60887434b7db2c183dcdae829a4e64cf02be62b3)
01-01 01:11:15.951 W firmwared_log(firmwared-6817)                : + stdcpplibpath=usr/lib/x86_64-linux-gnu/libstdc++.so.6
01-01 01:11:15.951 W firmwared_log(firmwared-6817)                : + '[' '!' -z /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union ']'
01-01 01:11:15.951 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.953 W firmwared_log(firmwared-6817)                : + union_mount_point=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.954 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:15.956 W firmwared_log(firmwared-6817)                : + host_system_root_full_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:15.956 W firmwared_log(firmwared-6817)                : + simulator_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator
01-01 01:11:15.956 W firmwared_log(firmwared-6817)                : + simulator_bak_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator.bak
01-01 01:11:15.956 W firmwared_log(firmwared-6817)                : + '[' '!' -z /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11 ']'
01-01 01:11:15.956 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11
01-01 01:11:15.958 W firmwared_log(firmwared-6817)                : + x11_mount_point=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11
01-01 01:11:15.958 W firmwared_log(firmwared-6817)                : + '[' '!' -z '' ']'
01-01 01:11:15.959 W firmwared_log(firmwared-6817)                : ++ readlink -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.961 W firmwared_log(firmwared-6817)                : + canonicalized=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.961 W firmwared_log(firmwared-6817)                : + [[ 0 != 0 ]]
01-01 01:11:15.961 W firmwared_log(firmwared-6817)                : + [[ /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union == / ]]
01-01 01:11:15.961 W firmwared_log(firmwared-6817)                : + unset canonicalized
01-01 01:11:15.961 W firmwared_log(firmwared-6817)                : + workdir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/workdir
01-01 01:11:15.961 W firmwared_log(firmwared-6817)                : + rw_dir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/rw
01-01 01:11:15.961 W firmwared_log(firmwared-6817)                : + ldconfig_sphinx=/opt/parrot-sphinx/usr/bin/ldconfig_sphinx
01-01 01:11:15.961 W firmwared_log(firmwared-6817)                : + [[ ! -x /opt/parrot-sphinx/usr/bin/ldconfig_sphinx ]]
01-01 01:11:15.962 W firmwared_log(firmwared-6817)                : + '[' init_extra = init ']'
01-01 01:11:15.962 W firmwared_log(firmwared-6817)                : + '[' init_extra = init_extra ']'
01-01 01:11:15.962 W firmwared_log(firmwared-6817)                : + mount_simulator_space
01-01 01:11:15.962 W firmwared_log(firmwared-6817)                : + '[' -d /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator ']'
01-01 01:11:15.962 W firmwared_log(firmwared-6817)                : + mv /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator.bak
01-01 01:11:15.967 W firmwared_log(firmwared-6817)                : mv: cannot remove '/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/sys/class/leds/led_vcam': Directory not empty
01-01 01:11:15.967 W firmwared_log(firmwared-6817)                : mv: cannot remove '/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/models/anafi2': Directory not empty
01-01 01:11:15.968 E firmwared_instances(firmwared-6817)          : invoke_mount_helper init_extra returned -125
01-01 01:11:15.973 W firmwared_log(firmwared-6817)                : + stdcpplibpath=usr/lib/x86_64-linux-gnu/libstdc++.so.6
01-01 01:11:15.973 W firmwared_log(firmwared-6817)                : + '[' '!' -z /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union ']'
01-01 01:11:15.973 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.975 W firmwared_log(firmwared-6817)                : + union_mount_point=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.976 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:15.978 W firmwared_log(firmwared-6817)                : + host_system_root_full_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:15.978 W firmwared_log(firmwared-6817)                : + simulator_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator
01-01 01:11:15.978 W firmwared_log(firmwared-6817)                : + simulator_bak_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator.bak
01-01 01:11:15.978 W firmwared_log(firmwared-6817)                : + '[' '!' -z /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11 ']'
01-01 01:11:15.978 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11
01-01 01:11:15.980 W firmwared_log(firmwared-6817)                : + x11_mount_point=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11
01-01 01:11:15.980 W firmwared_log(firmwared-6817)                : + '[' '!' -z '' ']'
01-01 01:11:15.981 W firmwared_log(firmwared-6817)                : ++ readlink -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.982 W firmwared_log(firmwared-6817)                : + canonicalized=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:15.983 W firmwared_log(firmwared-6817)                : + [[ 0 != 0 ]]
01-01 01:11:15.983 W firmwared_log(firmwared-6817)                : + [[ /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union == / ]]
01-01 01:11:15.983 W firmwared_log(firmwared-6817)                : + unset canonicalized
01-01 01:11:15.983 W firmwared_log(firmwared-6817)                : + workdir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/workdir
01-01 01:11:15.983 W firmwared_log(firmwared-6817)                : + rw_dir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/rw
01-01 01:11:15.983 W firmwared_log(firmwared-6817)                : + ldconfig_sphinx=/opt/parrot-sphinx/usr/bin/ldconfig_sphinx
01-01 01:11:15.983 W firmwared_log(firmwared-6817)                : + [[ ! -x /opt/parrot-sphinx/usr/bin/ldconfig_sphinx ]]
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' clean_extra = init ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' clean_extra = init_extra ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' clean_extra = remount ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' clean_extra = umount_children ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' clean_extra = clean ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' clean_extra = clean_extra ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + destroy_loopback_dev ext_storage
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + local storage=ext_storage
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' '!' -f /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/ext_storage_path ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + return
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + destroy_loopback_dev int_storage
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + local storage=int_storage
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' '!' -f /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/int_storage_path ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + return
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' -n '' ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + '[' -d /tmp/.X11-unix/ ']'
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + umount_lazy /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11
01-01 01:11:15.985 W firmwared_log(firmwared-6817)                : + umount -l /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11
01-01 01:11:15.994 W firmwared_log(firmwared-6817)                : umount: /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/x11: no mount point specified.
01-01 01:11:15.994 E firmwared_instances(firmwared-6817)          : invoke_mount_helper clean_extra returned -125
01-01 01:11:15.994 E firmwared_instances(firmwared-6817)          : install_extra_mount_points
01-01 01:11:15.994 I apparmor_config(firmwared-6817)              : apparmor_remove_profile(60887434b7db2c183dcdae829a4e64cf02be62b3)
01-01 01:11:16.004 W firmwared_log(firmwared-6817)                : + stdcpplibpath=usr/lib/x86_64-linux-gnu/libstdc++.so.6
01-01 01:11:16.004 W firmwared_log(firmwared-6817)                : + '[' '!' -z /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union ']'
01-01 01:11:16.005 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:16.007 W firmwared_log(firmwared-6817)                : + union_mount_point=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:16.007 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:16.009 W firmwared_log(firmwared-6817)                : + host_system_root_full_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:16.009 W firmwared_log(firmwared-6817)                : + simulator_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator
01-01 01:11:16.009 W firmwared_log(firmwared-6817)                : + simulator_bak_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator.bak
01-01 01:11:16.009 W firmwared_log(firmwared-6817)                : + '[' '!' -z '' ']'
01-01 01:11:16.009 W firmwared_log(firmwared-6817)                : + '[' '!' -z '' ']'
01-01 01:11:16.010 W firmwared_log(firmwared-6817)                : ++ readlink -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:16.012 W firmwared_log(firmwared-6817)                : + canonicalized=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:16.012 W firmwared_log(firmwared-6817)                : + [[ 0 != 0 ]]
01-01 01:11:16.012 W firmwared_log(firmwared-6817)                : + [[ /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union == / ]]
01-01 01:11:16.012 W firmwared_log(firmwared-6817)                : + unset canonicalized
01-01 01:11:16.012 W firmwared_log(firmwared-6817)                : + workdir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/workdir
01-01 01:11:16.012 W firmwared_log(firmwared-6817)                : + rw_dir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/rw
01-01 01:11:16.013 W firmwared_log(firmwared-6817)                : + ldconfig_sphinx=/opt/parrot-sphinx/usr/bin/ldconfig_sphinx
01-01 01:11:16.013 W firmwared_log(firmwared-6817)                : + [[ ! -x /opt/parrot-sphinx/usr/bin/ldconfig_sphinx ]]
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' clean_extra = init ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' clean_extra = init_extra ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' clean_extra = remount ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' clean_extra = umount_children ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' clean_extra = clean ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' clean_extra = clean_extra ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + destroy_loopback_dev ext_storage
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + local storage=ext_storage
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' '!' -f /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/ext_storage_path ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + return
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + destroy_loopback_dev int_storage
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + local storage=int_storage
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' '!' -f /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/int_storage_path ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + return
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' -n '' ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + '[' -d /tmp/.X11-unix/ ']'
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + umount_lazy
01-01 01:11:16.014 W firmwared_log(firmwared-6817)                : + umount -l
01-01 01:11:16.019 W firmwared_log(firmwared-6817)                : umount: bad usage
01-01 01:11:16.019 W firmwared_log(firmwared-6817)                : Try 'umount --help' for more information.
01-01 01:11:16.020 E firmwared_instances(firmwared-6817)          : invoke_mount_helper clean_extra returned -125
01-01 01:11:16.023 W firmwared_log(firmwared-6817)                : + stdcpplibpath=usr/lib/x86_64-linux-gnu/libstdc++.so.6
01-01 01:11:16.023 W firmwared_log(firmwared-6817)                : + '[' '!' -z /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union ']'
01-01 01:11:16.024 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:16.026 W firmwared_log(firmwared-6817)                : + union_mount_point=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:16.026 W firmwared_log(firmwared-6817)                : ++ realpath -s -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:16.028 W firmwared_log(firmwared-6817)                : + host_system_root_full_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator/host
01-01 01:11:16.028 W firmwared_log(firmwared-6817)                : + simulator_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator
01-01 01:11:16.028 W firmwared_log(firmwared-6817)                : + simulator_bak_path=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union/simulator.bak
01-01 01:11:16.028 W firmwared_log(firmwared-6817)                : + '[' '!' -z '' ']'
01-01 01:11:16.028 W firmwared_log(firmwared-6817)                : + '[' '!' -z '' ']'
01-01 01:11:16.028 W firmwared_log(firmwared-6817)                : ++ readlink -m /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:16.030 W firmwared_log(firmwared-6817)                : + canonicalized=/var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union
01-01 01:11:16.030 W firmwared_log(firmwared-6817)                : + [[ 0 != 0 ]]
01-01 01:11:16.031 W firmwared_log(firmwared-6817)                : + [[ /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union == / ]]
01-01 01:11:16.031 W firmwared_log(firmwared-6817)                : + unset canonicalized
01-01 01:11:16.031 W firmwared_log(firmwared-6817)                : + workdir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/workdir
01-01 01:11:16.031 W firmwared_log(firmwared-6817)                : + rw_dir=/var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/fs/rw
01-01 01:11:16.031 W firmwared_log(firmwared-6817)                : + ldconfig_sphinx=/opt/parrot-sphinx/usr/bin/ldconfig_sphinx
01-01 01:11:16.031 W firmwared_log(firmwared-6817)                : + [[ ! -x /opt/parrot-sphinx/usr/bin/ldconfig_sphinx ]]
01-01 01:11:16.032 W firmwared_log(firmwared-6817)                : + '[' clean = init ']'
01-01 01:11:16.032 W firmwared_log(firmwared-6817)                : + '[' clean = init_extra ']'
01-01 01:11:16.032 W firmwared_log(firmwared-6817)                : + '[' clean = remount ']'
01-01 01:11:16.032 W firmwared_log(firmwared-6817)                : + '[' clean = umount_children ']'
01-01 01:11:16.032 W firmwared_log(firmwared-6817)                : + '[' clean = clean ']'
01-01 01:11:16.032 W firmwared_log(firmwared-6817)                : + umount_lazy /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/ro
01-01 01:11:16.033 W firmwared_log(firmwared-6817)                : + umount -l /var/cache/firmwared/mount_points/instances/60887434b7db2c183dcdae829a4e64cf02be62b3/union /var/cache/firmwared/mount_points//instances/60887434b7db2c183dcdae829a4e64cf02be62b3/ro
01-01 01:11:16.043 W firmwared_log(firmwared-6817)                : + '[' unlimited '!=' unlimited ']'
01-01 01:11:16.043 W firmwared_log(firmwared-6817)                : + '[' '!' n = y ']'
01-01 01:11:16.043 W firmwared_log(firmwared-6817)                : + '[' false = false ']'
01-01 01:11:16.048 E firmwared_instances(firmwared-6817)          : init_instance: mount.hook/init_extra failed. See ulog for details.
01-01 01:11:16.048 E firmwared_instances(firmwared-6817)          : instance_new(189fd23dd0740ca01c44c5de463bee3a4938aff7): Unknown error 1027
01-01 01:11:16.048 E firmwared_commands(firmwared-6817)           : command_process: mount.hook/init_extra failed. See ulog for details.
01-01 01:11:16.050 I shd         (gzserver-7259/gz_world_update-7295): omniscient___UE4__magic_tile: closed
4

I am not sure how to solve this issue, but I can give you some commands to try. First, you can make sure that your cache is cleared:

fdc drop_all instances
fdc drop_all firmwares

/var/cache/firmwared/mount_points/instances/ should now be empty. Then you can download the firmware on your disk:

wget https://firmware.parrot.com/Versions/anafi2/pc/%23latest/images/anafi2-pc.ext2.zip

And use this command to start sphinx with the downloaded archive to make sure that there is no network issue:

sphinx "/opt/parrot-sphinx/usr/share/sphinx/drones/anafi_ai.drone"::firmware="/path/to/anafi2-pc.ext2.zip
5

Hello @Lecrapouille,

Are you running sphinx from a partition with ext4? If not, it could be the cause of your issue.
We also don’t really handle partitions with encryption schemes.

Could you show us the output of lsblk -o name,fstype,mountpoint?

6

Thank! Sorry for the long delay!

@d.belopopsky yes ext4 and no encryption.
@ocrave I followed your steps. It did not help. The /var folder is empty. The issue is at runtime. I may have an outdated lib version. But do not worry since its working on one architecture.

7

This topic was automatically closed 3 days after the last reply. New replies are no longer allowed.