Using u-blox TOBY-R200, ModemManager not detecting already registered with network

Mon Feb 5 15:45:15 UTC 2018

> On Thu, 2018-02-01 at 22:09 +0000, Matthew Starr wrote:
> > I am using a TOBY-R200 which does not support USB Ethernet like TOBY-
> > L2 models, but only supports AT interface over USB serial.  When I use
> > a NetworkManager profile to start a 3G/4G connection using
> > ModemManager with the TOBY-R200, the registration step takes a long
> > time (~37 seconds).  The modem does eventually connect and everything
> > work, but it takes too long for my use case.  When I use a u-blox LISA
> > U230 modem with the same software configuration, hardware platform,
> > and SIM card, I get a connection quickly (~5 second).  When I put
> > ModemManager in debug mode there is a difference in the connection
> > between the two at the registration step as shown below. I have the
> > same issue on ModemManager versions 1.4.14, 1.6.4, and 1.6.12.
> 
> <snip>
> 
> > On the TOBY R200, instead of realizing that the modem is already
> > registered with the network, it runs AT+COPS=0 to reregister with the
> > network.  I confirmed that the modem registered with the network by
> > checking the AT+CREG?, AT+CEREG?, and AT+CGREG? commands.  Here is
> > what ModemManager is outputting when connecting to the network:
> 
> Do you see this line at all?
> 
> Modem XXX: 3GPP Registration state changed (XXX -> registering)
> 
> Basically, right after enabling the modem, ModemManager should be
> running initial registration checks.  That will run a sequence of
> AT+CREG?, AT+CGREG?, and AT+CEREG? requests which should report the
> operator ID (eg MCC/MNC).  This should all happen before the connect, but
> perhaps the NM connect request is happening to quickly.

I see that line and waited until that line was output to command Network Manager to bring up the GSM connection. See log below

> 
> Can you include a bit more of the ModemManager debug output from the
> time the modem is "enabling" until what you show below?
> 
> Dan
> 
> >
> > Does anyone know why both these devices are connecting using the same
> > AT interface, but ModemManager cannot detect that the TOBY R200 is
> > already registered with the network causing a long registration time?
> >
> > Any ideas how I could speed this up or make ModemManager realize the
> > modem is registered already?
> >
> > Best regards,
> >
> > Matthew Starr

Here is the output of ModemManager as well as the relevant output from Network Manager.  The "3GPP Registration state changed (XXX -> registering)" message occurred at timestamp "Feb 22 10:41:30".  The command to bring up the GSM connection through Network Manager was done at timestamp "Feb 22 10:42:16".  The registration didn't finish until 30 seconds later at timestamp "Feb 22 10:42:46", after not detecting the modem is already registered causing a "AT+COPS=0".

Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <info>  [-184857548.546566] [main.c:158] main(): ModemManager (version 1.6.12) starting in system bus...
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.656253] [main.c:83] bus_acquired_cb(): Bus acquired, creating manager...
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.667504] [mm-plugin-manager.c:1565] load_plugins(): [plugin manager] looking for plugins in '/usr/lib/ModemManager'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.684936] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Sierra'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.687967] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Motorola'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.690865] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Linktop'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.699894] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Longcheer'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.705172] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'AnyDATA'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.715731] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Wavecom'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.723389] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Samsung'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.728202] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Iridium'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.753131] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Dell'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.762651] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Huawei'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.771138] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Sierra (legacy)'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.783211] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Option'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.786183] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Haier'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.795960] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Thuraya'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.805673] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'SimTech'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.810853] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Nokia'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.816912] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Generic'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.825702] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'X22X'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.838527] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'ZTE'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.849987] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Novatel'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.860686] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Altair LTE'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.873804] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Pantech'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.891399] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Option High-Speed'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.909901] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'MTK'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.928723] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Telit'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.939192] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Novatel LTE'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.946408] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Via CBP7'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.958486] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Cinterion'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.980264] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Ericsson MBM'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.989407] [mm-plugin-manager.c:1590] load_plugins(): [plugin manager] loaded plugin 'Nokia (Icera)'
Feb 22 10:40:52 canect2 daemon.info ModemManager[301]: <debug> [-184857548.993118] [mm-plugin-manager.c:1615] load_plugins(): [plugin manager] successfully loaded 30 plugins
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.006183] [main.c:105] name_acquired_cb(): Service name 'org.freedesktop.ModemManager1' was acquired
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.006656] [mm-base-manager.c:502] mm_base_manager_start(): Starting automatic device scan...
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.061517] [mm-base-manager.c:541] mm_base_manager_start(): Finished device scan...
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.076913] [mm-base-manager.c:392] device_added(): (tty/ttymxc0): port's parent platform driver is not whitelisted
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.090301] [mm-base-manager.c:392] device_added(): (tty/ttymxc3): port's parent platform driver is not whitelisted
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.102354] [mm-base-manager.c:392] device_added(): (net/can0): port's parent platform driver is not whitelisted
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.124794] [mm-base-manager.c:392] device_added(): (net/can1): port's parent platform driver is not whitelisted
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.132624] [mm-base-manager.c:392] device_added(): (net/eth0): port's parent platform driver is not whitelisted
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.140056] [mm-plugin-manager.c:1448] mm_plugin_manager_device_support_check(): [plugin manager] task 0: new support task for device: /sys/devices/platform/soc/2100000.aips-bus/2190000.usdhc/mmc_host
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.144612] [mm-device.c:328] mm_device_grab_port(): (/sys/devices/platform/soc/2100000.aips-bus/2190000.usdhc/mmc_host/mmc0/mmc0:0001/mmc0:0001:1) could not get vendor/product ID
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.147098] [mm-plugin-manager.c:1173] device_context_port_grabbed(): [plugin manager] task 0: port grabbed: mlan0
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.150334] [mm-plugin-manager.c:1198] device_context_port_grabbed(): [plugin manager] task 0,mlan0: new support task for port
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.150640] [mm-plugin-manager.c:1203] device_context_port_grabbed(): [plugin manager) task 0,mlan0: deferred until min wait time elapsed
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.152178] [mm-device.c:328] mm_device_grab_port(): (/sys/devices/platform/soc/2100000.aips-bus/2190000.usdhc/mmc_host/mmc0/mmc0:0001/mmc0:0001:1) could not get vendor/product ID
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.158110] [mm-plugin-manager.c:1173] device_context_port_grabbed(): [plugin manager] task 0: port grabbed: uap0
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.158547] [mm-plugin-manager.c:1198] device_context_port_grabbed(): [plugin manager] task 0,uap0: new support task for port
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.158761] [mm-plugin-manager.c:1203] device_context_port_grabbed(): [plugin manager) task 0,uap0: deferred until min wait time elapsed
Feb 22 10:40:53 canect2 daemon.info ModemManager[301]: <debug> [-184857547.160450] [mm-base-manager.c:368] device_added(): (net/sit0): could not get port's parent device
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.646996] [mm-plugin-manager.c:1116] device_context_min_wait_time_elapsed(): [plugin manager] task 0: min wait time elapsed
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647204] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra) [uap0] filtered by drivers
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647301] [mm-plugin.c:212] apply_pre_probing_filters(): (Motorola) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647372] [mm-plugin.c:212] apply_pre_probing_filters(): (Linktop) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647443] [mm-plugin.c:212] apply_pre_probing_filters(): (Longcheer) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647513] [mm-plugin.c:376] apply_pre_probing_filters(): (AnyDATA) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647581] [mm-plugin.c:212] apply_pre_probing_filters(): (Wavecom) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647646] [mm-plugin.c:376] apply_pre_probing_filters(): (Samsung) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647720] [mm-plugin.c:212] apply_pre_probing_filters(): (Iridium) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647785] [mm-plugin.c:376] apply_pre_probing_filters(): (Dell) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647846] [mm-plugin.c:376] apply_pre_probing_filters(): (Huawei) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.647907] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra (legacy)) [uap0] filtered by drivers
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.648506] [mm-plugin.c:212] apply_pre_probing_filters(): (Option) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.648623] [mm-plugin.c:212] apply_pre_probing_filters(): (Haier) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.648699] [mm-plugin.c:212] apply_pre_probing_filters(): (Thuraya) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.648770] [mm-plugin.c:376] apply_pre_probing_filters(): (SimTech) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.648831] [mm-plugin.c:212] apply_pre_probing_filters(): (Nokia) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.648895] [mm-plugin.c:376] apply_pre_probing_filters(): (X22X) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.648959] [mm-plugin.c:376] apply_pre_probing_filters(): (ZTE) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.649026] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.649089] [mm-plugin.c:376] apply_pre_probing_filters(): (Altair LTE) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.649152] [mm-plugin.c:376] apply_pre_probing_filters(): (Pantech) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.649215] [mm-plugin.c:264] apply_pre_probing_filters(): (Option High-Speed) [uap0] filtered by drivers
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.649709] [mm-plugin.c:212] apply_pre_probing_filters(): (MTK) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.649877] [mm-plugin.c:212] apply_pre_probing_filters(): (Telit) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.650030] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel LTE) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.650173] [mm-plugin.c:212] apply_pre_probing_filters(): (Via CBP7) [uap0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.650315] [mm-plugin.c:376] apply_pre_probing_filters(): (Cinterion) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.650469] [mm-plugin.c:430] apply_pre_probing_filters(): (Ericsson MBM) [uap0] filtered by udev tags
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.650614] [mm-plugin.c:376] apply_pre_probing_filters(): (Nokia (Icera)) [uap0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.650823] [mm-plugin-manager.c:605] port_context_run(): [plugin manager] task 0,uap0: found '1' plugins to try
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.650996] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 0,uap0: will try with plugin 'Generic'
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.651215] [mm-plugin-manager.c:641] port_context_run(): [plugin manager) task 0,uap0: started
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.651417] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 0,uap0: checking with plugin 'Generic'
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.661181] [mm-plugin.c:730] mm_plugin_supports_port(): (Generic) [uap0] probing deferred until result suggested
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.661620] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra) [mlan0] filtered by drivers
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.661864] [mm-plugin.c:212] apply_pre_probing_filters(): (Motorola) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.662049] [mm-plugin.c:212] apply_pre_probing_filters(): (Linktop) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.662212] [mm-plugin.c:212] apply_pre_probing_filters(): (Longcheer) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.662366] [mm-plugin.c:376] apply_pre_probing_filters(): (AnyDATA) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.662508] [mm-plugin.c:212] apply_pre_probing_filters(): (Wavecom) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.662655] [mm-plugin.c:376] apply_pre_probing_filters(): (Samsung) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.662797] [mm-plugin.c:212] apply_pre_probing_filters(): (Iridium) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.662938] [mm-plugin.c:376] apply_pre_probing_filters(): (Dell) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.663076] [mm-plugin.c:376] apply_pre_probing_filters(): (Huawei) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.663218] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra (legacy)) [mlan0] filtered by drivers
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.663358] [mm-plugin.c:212] apply_pre_probing_filters(): (Option) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.663572] [mm-plugin.c:212] apply_pre_probing_filters(): (Haier) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.663741] [mm-plugin.c:212] apply_pre_probing_filters(): (Thuraya) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.663898] [mm-plugin.c:376] apply_pre_probing_filters(): (SimTech) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.664046] [mm-plugin.c:212] apply_pre_probing_filters(): (Nokia) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.664190] [mm-plugin.c:376] apply_pre_probing_filters(): (X22X) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.664326] [mm-plugin.c:376] apply_pre_probing_filters(): (ZTE) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.664461] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.664599] [mm-plugin.c:376] apply_pre_probing_filters(): (Altair LTE) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.664732] [mm-plugin.c:376] apply_pre_probing_filters(): (Pantech) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.664874] [mm-plugin.c:264] apply_pre_probing_filters(): (Option High-Speed) [mlan0] filtered by drivers
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.665050] [mm-plugin.c:212] apply_pre_probing_filters(): (MTK) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.665201] [mm-plugin.c:212] apply_pre_probing_filters(): (Telit) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.665347] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel LTE) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.665484] [mm-plugin.c:212] apply_pre_probing_filters(): (Via CBP7) [mlan0] filtered by subsystem
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.665621] [mm-plugin.c:376] apply_pre_probing_filters(): (Cinterion) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.665769] [mm-plugin.c:430] apply_pre_probing_filters(): (Ericsson MBM) [mlan0] filtered by udev tags
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.665916] [mm-plugin.c:376] apply_pre_probing_filters(): (Nokia (Icera)) [mlan0] filtered by vendor/product IDs
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.666066] [mm-plugin-manager.c:605] port_context_run(): [plugin manager] task 0,mlan0: found '1' plugins to try
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.666210] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 0,mlan0: will try with plugin 'Generic'
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.666397] [mm-plugin-manager.c:641] port_context_run(): [plugin manager) task 0,mlan0: started
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.666562] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 0,mlan0: checking with plugin 'Generic'
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.666777] [mm-plugin.c:730] mm_plugin_supports_port(): (Generic) [mlan0] probing deferred until result suggested
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.667115] [mm-plugin-manager.c:456] port_context_defer_until_suggested(): [plugin manager] task 0,uap0: deferring support check until result suggested
Feb 22 10:40:54 canect2 daemon.info ModemManager[301]: <debug> [-184857546.667418] [mm-plugin-manager.c:456] port_context_defer_until_suggested(): [plugin manager] task 0,mlan0: deferring support check until result suggested
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.645604] [mm-plugin-manager.c:1064] device_context_min_probing_time_elapsed(): [plugin manager] task 0: min probing time elapsed
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.645886] [mm-plugin-manager.c:1011] device_context_continue(): [plugin Manager] task 0: still 2 running probes (0 active): uap0, mlan0
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.646026] [mm-plugin-manager.c:1015] device_context_continue(): [plugin manager] task 0: no active tasks to probe
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.646137] [mm-plugin-manager.c:340] port_context_set_suggestion(): [plugin manager] task 0,uap0: deferred task completed, no suggested plugin
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.646248] [mm-plugin-manager.c:268] port_context_complete(): [plugin manager] task 0,uap0: finished in '2.487717' seconds
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.646620] [mm-plugin-manager.c:898] device_context_set_best_plugin(): [plugin manager] task 0,uap0: not supported by any plugin
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.646749] [mm-device.c:374] mm_device_ignore_port(): Fully ignoring port 'net/uap0' from now on
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.646872] [mm-plugin-manager.c:340] port_context_set_suggestion(): [plugin manager] task 0,mlan0: deferred task completed, no suggested plugin
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.646963] [mm-plugin-manager.c:268] port_context_complete(): [plugin manager] task 0,mlan0: finished in '2.496665' seconds
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.647079] [mm-plugin-manager.c:898] device_context_set_best_plugin(): [plugin manager] task 0,mlan0: not supported by any plugin
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.647162] [mm-device.c:374] mm_device_ignore_port(): Fully ignoring port 'net/mlan0' from now on
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.647306] [mm-plugin-manager.c:1011] device_context_continue(): [plugin Manager] task 0: still 1 running probes (1 active): uap0
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.648091] [mm-plugin-manager.c:985] device_context_continue(): [plugin manager] task 0: no more ports to probe
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <debug> [-184857545.648337] [mm-plugin-manager.c:819] device_context_complete(): [plugin manager] task 0: finished in '2.508361' seconds
Feb 22 10:40:55 canect2 daemon.info ModemManager[301]: <info>  [-184857545.648664] [mm-base-manager.c:155] device_support_check_ready(): Couldn't check support for device at '/sys/devices/platform/soc/2100000.aips-bus/2190000.usdhc/mmc_host/mmc0/mmc0:0001/mmc0:0001:1': n
Feb 22 10:40:55 canect2 user.info kernel: [   13.876350] cdc_acm 1-1:1.0: ttyACM0: USB ACM device
Feb 22 10:40:55 canect2 user.info kernel: [   13.904704] cdc_acm 1-1:1.2: ttyACM1: USB ACM device
Feb 22 10:40:55 canect2 user.info kernel: [   13.933409] cdc_acm 1-1:1.4: ttyACM2: USB ACM device
Feb 22 10:40:55 canect2 user.info kernel: [   13.964120] cdc_acm 1-1:1.6: ttyACM3: USB ACM device
Feb 22 10:40:55 canect2 user.info kernel: [   13.999589] cdc_acm 1-1:1.8: ttyACM4: USB ACM device
Feb 22 10:40:55 canect2 user.info kernel: [   14.023424] cdc_acm 1-1:1.10: ttyACM5: USB ACM device
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.115267] [mm-plugin-manager.c:1448] mm_plugin_manager_device_support_check(): [plugin manager] task 1: new support task for device: /sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.116244] [mm-plugin-manager.c:1173] device_context_port_grabbed(): [plugin manager] task 1: port grabbed: ttyACM0
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.116623] [mm-plugin-manager.c:1198] device_context_port_grabbed(): [plugin manager] task 1,ttyACM0: new support task for port
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.116828] [mm-plugin-manager.c:1203] device_context_port_grabbed(): [plugin manager) task 1,ttyACM0: deferred until min wait time elapsed
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.162648] [mm-plugin-manager.c:1173] device_context_port_grabbed(): [plugin manager] task 1: port grabbed: ttyACM1
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.163035] [mm-plugin-manager.c:1198] device_context_port_grabbed(): [plugin manager] task 1,ttyACM1: new support task for port
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.163243] [mm-plugin-manager.c:1203] device_context_port_grabbed(): [plugin manager) task 1,ttyACM1: deferred until min wait time elapsed
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.171016] [mm-plugin-manager.c:1173] device_context_port_grabbed(): [plugin manager] task 1: port grabbed: ttyACM2
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.193626] [mm-plugin-manager.c:1198] device_context_port_grabbed(): [plugin manager] task 1,ttyACM2: new support task for port
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.193933] [mm-plugin-manager.c:1203] device_context_port_grabbed(): [plugin manager) task 1,ttyACM2: deferred until min wait time elapsed
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.196572] [mm-plugin-manager.c:1173] device_context_port_grabbed(): [plugin manager] task 1: port grabbed: ttyACM4
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.206772] [mm-plugin-manager.c:1198] device_context_port_grabbed(): [plugin manager] task 1,ttyACM4: new support task for port
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.207062] [mm-plugin-manager.c:1203] device_context_port_grabbed(): [plugin manager) task 1,ttyACM4: deferred until min wait time elapsed
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.209715] [mm-plugin-manager.c:1173] device_context_port_grabbed(): [plugin manager] task 1: port grabbed: ttyACM5
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.210580] [mm-plugin-manager.c:1198] device_context_port_grabbed(): [plugin manager] task 1,ttyACM5: new support task for port
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.210832] [mm-plugin-manager.c:1203] device_context_port_grabbed(): [plugin manager) task 1,ttyACM5: deferred until min wait time elapsed
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.213083] [mm-plugin-manager.c:1173] device_context_port_grabbed(): [plugin manager] task 1: port grabbed: ttyACM3
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.213462] [mm-plugin-manager.c:1198] device_context_port_grabbed(): [plugin manager] task 1,ttyACM3: new support task for port
Feb 22 10:40:56 canect2 daemon.info ModemManager[301]: <debug> [-184857544.213747] [mm-plugin-manager.c:1203] device_context_port_grabbed(): [plugin manager) task 1,ttyACM3: deferred until min wait time elapsed
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.617506] [mm-plugin-manager.c:1116] device_context_min_wait_time_elapsed(): [plugin manager] task 1: min wait time elapsed
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.617707] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra) [ttyACM3] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.617804] [mm-plugin.c:376] apply_pre_probing_filters(): (Motorola) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.617882] [mm-plugin.c:376] apply_pre_probing_filters(): (Linktop) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.617951] [mm-plugin.c:376] apply_pre_probing_filters(): (Longcheer) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.618023] [mm-plugin.c:376] apply_pre_probing_filters(): (AnyDATA) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.618093] [mm-plugin.c:376] apply_pre_probing_filters(): (Wavecom) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.618162] [mm-plugin.c:376] apply_pre_probing_filters(): (Samsung) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.618238] [mm-plugin.c:376] apply_pre_probing_filters(): (Dell) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.618312] [mm-plugin.c:376] apply_pre_probing_filters(): (Huawei) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.618379] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra (legacy)) [ttyACM3] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.618442] [mm-plugin.c:264] apply_pre_probing_filters(): (Option) [ttyACM3] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.618989] [mm-plugin.c:376] apply_pre_probing_filters(): (Haier) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619099] [mm-plugin.c:376] apply_pre_probing_filters(): (Thuraya) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619173] [mm-plugin.c:376] apply_pre_probing_filters(): (SimTech) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619255] [mm-plugin.c:376] apply_pre_probing_filters(): (X22X) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619328] [mm-plugin.c:376] apply_pre_probing_filters(): (ZTE) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619399] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619468] [mm-plugin.c:376] apply_pre_probing_filters(): (Altair LTE) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619535] [mm-plugin.c:376] apply_pre_probing_filters(): (Pantech) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619598] [mm-plugin.c:264] apply_pre_probing_filters(): (Option High-Speed) [ttyACM3] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619673] [mm-plugin.c:430] apply_pre_probing_filters(): (MTK) [ttyACM3] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.619747] [mm-plugin.c:376] apply_pre_probing_filters(): (Telit) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.620319] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel LTE) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.620534] [mm-plugin.c:430] apply_pre_probing_filters(): (Ericsson MBM) [ttyACM3] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.620714] [mm-plugin.c:376] apply_pre_probing_filters(): (Nokia (Icera)) [ttyACM3] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.620885] [mm-plugin-manager.c:605] port_context_run(): [plugin manager] task 1,ttyACM3: found '5' plugins to try
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.621039] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM3: will try with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.621178] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM3: will try with plugin 'Nokia'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.621315] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM3: will try with plugin 'Via CBP7'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.621454] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM3: will try with plugin 'Cinterion'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.621587] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM3: will try with plugin 'Generic'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.621778] [mm-plugin-manager.c:641] port_context_run(): [plugin manager) task 1,ttyACM3: started
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.621928] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM3: checking with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.634618] [mm-plugin.c:804] mm_plugin_supports_port(): (Iridium) [ttyACM3] probe required: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.635030] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM3) launching port probing: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.635387] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra) [ttyACM5] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.635624] [mm-plugin.c:376] apply_pre_probing_filters(): (Motorola) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.635806] [mm-plugin.c:376] apply_pre_probing_filters(): (Linktop) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.635971] [mm-plugin.c:376] apply_pre_probing_filters(): (Longcheer) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.636126] [mm-plugin.c:376] apply_pre_probing_filters(): (AnyDATA) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.636274] [mm-plugin.c:376] apply_pre_probing_filters(): (Wavecom) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.636426] [mm-plugin.c:376] apply_pre_probing_filters(): (Samsung) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.636586] [mm-plugin.c:376] apply_pre_probing_filters(): (Dell) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.636739] [mm-plugin.c:376] apply_pre_probing_filters(): (Huawei) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.636883] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra (legacy)) [ttyACM5] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.637024] [mm-plugin.c:264] apply_pre_probing_filters(): (Option) [ttyACM5] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.637161] [mm-plugin.c:376] apply_pre_probing_filters(): (Haier) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.637303] [mm-plugin.c:376] apply_pre_probing_filters(): (Thuraya) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.637442] [mm-plugin.c:376] apply_pre_probing_filters(): (SimTech) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.637591] [mm-plugin.c:376] apply_pre_probing_filters(): (X22X) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.637736] [mm-plugin.c:376] apply_pre_probing_filters(): (ZTE) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.637876] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.638025] [mm-plugin.c:376] apply_pre_probing_filters(): (Altair LTE) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.638166] [mm-plugin.c:376] apply_pre_probing_filters(): (Pantech) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.638301] [mm-plugin.c:264] apply_pre_probing_filters(): (Option High-Speed) [ttyACM5] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.638450] [mm-plugin.c:430] apply_pre_probing_filters(): (MTK) [ttyACM5] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.638625] [mm-plugin.c:376] apply_pre_probing_filters(): (Telit) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.638786] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel LTE) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.638953] [mm-plugin.c:430] apply_pre_probing_filters(): (Ericsson MBM) [ttyACM5] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.639108] [mm-plugin.c:376] apply_pre_probing_filters(): (Nokia (Icera)) [ttyACM5] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.639266] [mm-plugin-manager.c:605] port_context_run(): [plugin manager] task 1,ttyACM5: found '5' plugins to try
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.639409] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM5: will try with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.639550] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM5: will try with plugin 'Nokia'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.639686] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM5: will try with plugin 'Via CBP7'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.639815] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM5: will try with plugin 'Cinterion'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.639948] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM5: will try with plugin 'Generic'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.640127] [mm-plugin-manager.c:641] port_context_run(): [plugin manager) task 1,ttyACM5: started
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.640283] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM5: checking with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.640535] [mm-plugin.c:804] mm_plugin_supports_port(): (Iridium) [ttyACM5] probe required: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.640771] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM5) launching port probing: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.641040] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra) [ttyACM4] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.641240] [mm-plugin.c:376] apply_pre_probing_filters(): (Motorola) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.641411] [mm-plugin.c:376] apply_pre_probing_filters(): (Linktop) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.641566] [mm-plugin.c:376] apply_pre_probing_filters(): (Longcheer) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.641714] [mm-plugin.c:376] apply_pre_probing_filters(): (AnyDATA) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.641865] [mm-plugin.c:376] apply_pre_probing_filters(): (Wavecom) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.642006] [mm-plugin.c:376] apply_pre_probing_filters(): (Samsung) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.642158] [mm-plugin.c:376] apply_pre_probing_filters(): (Dell) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.642339] [mm-plugin.c:376] apply_pre_probing_filters(): (Huawei) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.642497] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra (legacy)) [ttyACM4] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.642649] [mm-plugin.c:264] apply_pre_probing_filters(): (Option) [ttyACM4] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.642790] [mm-plugin.c:376] apply_pre_probing_filters(): (Haier) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.642930] [mm-plugin.c:376] apply_pre_probing_filters(): (Thuraya) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.643062] [mm-plugin.c:376] apply_pre_probing_filters(): (SimTech) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.643210] [mm-plugin.c:376] apply_pre_probing_filters(): (X22X) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.643353] [mm-plugin.c:376] apply_pre_probing_filters(): (ZTE) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.643578] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.643749] [mm-plugin.c:376] apply_pre_probing_filters(): (Altair LTE) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.643904] [mm-plugin.c:376] apply_pre_probing_filters(): (Pantech) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.644052] [mm-plugin.c:264] apply_pre_probing_filters(): (Option High-Speed) [ttyACM4] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.644209] [mm-plugin.c:430] apply_pre_probing_filters(): (MTK) [ttyACM4] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.644361] [mm-plugin.c:376] apply_pre_probing_filters(): (Telit) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.644509] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel LTE) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.644671] [mm-plugin.c:430] apply_pre_probing_filters(): (Ericsson MBM) [ttyACM4] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.644824] [mm-plugin.c:376] apply_pre_probing_filters(): (Nokia (Icera)) [ttyACM4] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.644978] [mm-plugin-manager.c:605] port_context_run(): [plugin manager] task 1,ttyACM4: found '5' plugins to try
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.645122] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM4: will try with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.645264] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM4: will try with plugin 'Nokia'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.645396] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM4: will try with plugin 'Via CBP7'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.645527] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM4: will try with plugin 'Cinterion'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.645687] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM4: will try with plugin 'Generic'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.645886] [mm-plugin-manager.c:641] port_context_run(): [plugin manager) task 1,ttyACM4: started
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.646056] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM4: checking with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.646308] [mm-plugin.c:804] mm_plugin_supports_port(): (Iridium) [ttyACM4] probe required: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.646547] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM4) launching port probing: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.646809] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra) [ttyACM2] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.647010] [mm-plugin.c:376] apply_pre_probing_filters(): (Motorola) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.647172] [mm-plugin.c:376] apply_pre_probing_filters(): (Linktop) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.647321] [mm-plugin.c:376] apply_pre_probing_filters(): (Longcheer) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.647470] [mm-plugin.c:376] apply_pre_probing_filters(): (AnyDATA) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.647616] [mm-plugin.c:376] apply_pre_probing_filters(): (Wavecom) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.647758] [mm-plugin.c:376] apply_pre_probing_filters(): (Samsung) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.647907] [mm-plugin.c:376] apply_pre_probing_filters(): (Dell) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.648049] [mm-plugin.c:376] apply_pre_probing_filters(): (Huawei) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.648189] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra (legacy)) [ttyACM2] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.648325] [mm-plugin.c:264] apply_pre_probing_filters(): (Option) [ttyACM2] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.648463] [mm-plugin.c:376] apply_pre_probing_filters(): (Haier) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.648603] [mm-plugin.c:376] apply_pre_probing_filters(): (Thuraya) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.648738] [mm-plugin.c:376] apply_pre_probing_filters(): (SimTech) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.648888] [mm-plugin.c:376] apply_pre_probing_filters(): (X22X) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.649026] [mm-plugin.c:376] apply_pre_probing_filters(): (ZTE) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.649170] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.649306] [mm-plugin.c:376] apply_pre_probing_filters(): (Altair LTE) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.649474] [mm-plugin.c:376] apply_pre_probing_filters(): (Pantech) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.649632] [mm-plugin.c:264] apply_pre_probing_filters(): (Option High-Speed) [ttyACM2] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.649785] [mm-plugin.c:430] apply_pre_probing_filters(): (MTK) [ttyACM2] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.649935] [mm-plugin.c:376] apply_pre_probing_filters(): (Telit) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.650076] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel LTE) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.650236] [mm-plugin.c:430] apply_pre_probing_filters(): (Ericsson MBM) [ttyACM2] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.650388] [mm-plugin.c:376] apply_pre_probing_filters(): (Nokia (Icera)) [ttyACM2] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.650542] [mm-plugin-manager.c:605] port_context_run(): [plugin manager] task 1,ttyACM2: found '5' plugins to try
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.650681] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM2: will try with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.650817] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM2: will try with plugin 'Nokia'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.650953] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM2: will try with plugin 'Via CBP7'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.651094] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM2: will try with plugin 'Cinterion'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.651229] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM2: will try with plugin 'Generic'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.651408] [mm-plugin-manager.c:641] port_context_run(): [plugin manager) task 1,ttyACM2: started
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.651564] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM2: checking with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.651824] [mm-plugin.c:804] mm_plugin_supports_port(): (Iridium) [ttyACM2] probe required: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.652067] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM2) launching port probing: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.652319] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra) [ttyACM1] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.652513] [mm-plugin.c:376] apply_pre_probing_filters(): (Motorola) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.652683] [mm-plugin.c:376] apply_pre_probing_filters(): (Linktop) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.652833] [mm-plugin.c:376] apply_pre_probing_filters(): (Longcheer) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.652985] [mm-plugin.c:376] apply_pre_probing_filters(): (AnyDATA) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.653160] [mm-plugin.c:376] apply_pre_probing_filters(): (Wavecom) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.653316] [mm-plugin.c:376] apply_pre_probing_filters(): (Samsung) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.653533] [mm-plugin.c:376] apply_pre_probing_filters(): (Dell) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.653724] [mm-plugin.c:376] apply_pre_probing_filters(): (Huawei) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.653880] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra (legacy)) [ttyACM1] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.654026] [mm-plugin.c:264] apply_pre_probing_filters(): (Option) [ttyACM1] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.654167] [mm-plugin.c:376] apply_pre_probing_filters(): (Haier) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.654310] [mm-plugin.c:376] apply_pre_probing_filters(): (Thuraya) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.654455] [mm-plugin.c:376] apply_pre_probing_filters(): (SimTech) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.654605] [mm-plugin.c:376] apply_pre_probing_filters(): (X22X) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.654752] [mm-plugin.c:376] apply_pre_probing_filters(): (ZTE) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.654892] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.655028] [mm-plugin.c:376] apply_pre_probing_filters(): (Altair LTE) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.655166] [mm-plugin.c:376] apply_pre_probing_filters(): (Pantech) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.655301] [mm-plugin.c:264] apply_pre_probing_filters(): (Option High-Speed) [ttyACM1] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.655446] [mm-plugin.c:430] apply_pre_probing_filters(): (MTK) [ttyACM1] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.655587] [mm-plugin.c:376] apply_pre_probing_filters(): (Telit) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.655728] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel LTE) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.655884] [mm-plugin.c:430] apply_pre_probing_filters(): (Ericsson MBM) [ttyACM1] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.656031] [mm-plugin.c:376] apply_pre_probing_filters(): (Nokia (Icera)) [ttyACM1] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.656185] [mm-plugin-manager.c:605] port_context_run(): [plugin manager] task 1,ttyACM1: found '5' plugins to try
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.656331] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM1: will try with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.656468] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM1: will try with plugin 'Nokia'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.656625] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM1: will try with plugin 'Via CBP7'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.656773] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM1: will try with plugin 'Cinterion'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.656906] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM1: will try with plugin 'Generic'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.657090] [mm-plugin-manager.c:641] port_context_run(): [plugin manager) task 1,ttyACM1: started
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.657257] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM1: checking with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.657519] [mm-plugin.c:804] mm_plugin_supports_port(): (Iridium) [ttyACM1] probe required: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.657764] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM1) launching port probing: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.658019] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra) [ttyACM0] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.658216] [mm-plugin.c:376] apply_pre_probing_filters(): (Motorola) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.658381] [mm-plugin.c:376] apply_pre_probing_filters(): (Linktop) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.658532] [mm-plugin.c:376] apply_pre_probing_filters(): (Longcheer) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.658680] [mm-plugin.c:376] apply_pre_probing_filters(): (AnyDATA) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.658829] [mm-plugin.c:376] apply_pre_probing_filters(): (Wavecom) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.658966] [mm-plugin.c:376] apply_pre_probing_filters(): (Samsung) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.659108] [mm-plugin.c:376] apply_pre_probing_filters(): (Dell) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.659252] [mm-plugin.c:376] apply_pre_probing_filters(): (Huawei) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.659400] [mm-plugin.c:264] apply_pre_probing_filters(): (Sierra (legacy)) [ttyACM0] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.659533] [mm-plugin.c:264] apply_pre_probing_filters(): (Option) [ttyACM0] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.659674] [mm-plugin.c:376] apply_pre_probing_filters(): (Haier) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.659811] [mm-plugin.c:376] apply_pre_probing_filters(): (Thuraya) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.659948] [mm-plugin.c:376] apply_pre_probing_filters(): (SimTech) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.660092] [mm-plugin.c:376] apply_pre_probing_filters(): (X22X) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.660260] [mm-plugin.c:376] apply_pre_probing_filters(): (ZTE) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.660418] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.660564] [mm-plugin.c:376] apply_pre_probing_filters(): (Altair LTE) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.660705] [mm-plugin.c:376] apply_pre_probing_filters(): (Pantech) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.660847] [mm-plugin.c:264] apply_pre_probing_filters(): (Option High-Speed) [ttyACM0] filtered by drivers
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.660994] [mm-plugin.c:430] apply_pre_probing_filters(): (MTK) [ttyACM0] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.661137] [mm-plugin.c:376] apply_pre_probing_filters(): (Telit) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.661276] [mm-plugin.c:376] apply_pre_probing_filters(): (Novatel LTE) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.661426] [mm-plugin.c:430] apply_pre_probing_filters(): (Ericsson MBM) [ttyACM0] filtered by udev tags
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.661572] [mm-plugin.c:376] apply_pre_probing_filters(): (Nokia (Icera)) [ttyACM0] filtered by vendor/product IDs
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.661718] [mm-plugin-manager.c:605] port_context_run(): [plugin manager] task 1,ttyACM0: found '5' plugins to try
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.661854] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM0: will try with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.661987] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM0: will try with plugin 'Nokia'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.662121] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM0: will try with plugin 'Via CBP7'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.662246] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM0: will try with plugin 'Cinterion'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.662375] [mm-plugin-manager.c:628] port_context_run(): [plugin manager] task 1,ttyACM0: will try with plugin 'Generic'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.662573] [mm-plugin-manager.c:641] port_context_run(): [plugin manager) task 1,ttyACM0: started
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.662730] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM0: checking with plugin 'Iridium'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.662997] [mm-plugin.c:804] mm_plugin_supports_port(): (Iridium) [ttyACM0] probe required: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.663252] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM0) launching port probing: 'at, at-vendor, at-product'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.665803] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM3) opening serial port...
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.669023] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM3) device open count is 1 (open)
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.671124] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM5) opening serial port...
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.673809] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM5) device open count is 1 (open)
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.675838] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM4) opening serial port...
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.678345] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM4) device open count is 1 (open)
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.680106] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM2) opening serial port...
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.682977] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM2) device open count is 1 (open)
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.684975] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM1) opening serial port...
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.687755] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 1 (open)
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.689847] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM0) opening serial port...
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.692655] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 1 (open)
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.772773] [mm-port-serial-at.c:460] debug_log(): (ttyACM3): --> 'AT<CR>'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.776452] [mm-port-serial-at.c:460] debug_log(): (ttyACM5): --> 'AT<CR>'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.781087] [mm-port-serial-at.c:460] debug_log(): (ttyACM4): --> 'AT<CR>'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.785820] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): --> 'AT<CR>'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.986550] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- '<CR><LF>+PACSP0<CR><LF>AT'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.987440] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT<CR>'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.987921] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT<CR>'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.988592] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- '<CR><CR><LF>OK<CR><LF>'
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.989447] [mm-port-probe.c:155] mm_port_probe_set_result_at(): (tty/ttyACM2) port is AT-capable
Feb 22 10:40:57 canect2 daemon.info ModemManager[301]: <debug> [-184857543.990275] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): --> 'AT+CGMI<CR>'
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.188311] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>+PACSP0<CR><LF>AT'
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.189301] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+PACSP0<CR><LF>AT'
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.198484] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><CR><LF>OK<CR><LF>'
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.198977] [mm-port-probe.c:155] mm_port_probe_set_result_at(): (tty/ttyACM1) port is AT-capable
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.199647] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><CR><LF>OK<CR><LF>'
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.200206] [mm-port-probe.c:155] mm_port_probe_set_result_at(): (tty/ttyACM0) port is AT-capable
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.627177] [mm-plugin-manager.c:1064] device_context_min_probing_time_elapsed(): [plugin manager] task 1: min probing time elapsed
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.627552] [mm-plugin-manager.c:1011] device_context_continue(): [plugin Manager] task 1: still 6 running probes (6 active): ttyACM3, ttyACM5, ttyACM4, ttyACM2, ttyACM1, ttyACM0
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.693193] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- 'AT+CGMI'
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.695243] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- '<CR><CR><LF>u-blox<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.695930] [mm-port-probe.c:182] mm_port_probe_set_result_at_vendor(): (tty/ttyACM2) vendor probing finished
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.698194] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT+CGMI<CR>'
Feb 22 10:40:58 canect2 daemon.info ModemManager[301]: <debug> [-184857542.698785] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGMI<CR>'
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.446078] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- 'AT+CGMI'
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.449767] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><CR><LF>u-blox<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.450378] [mm-port-probe.c:182] mm_port_probe_set_result_at_vendor(): (tty/ttyACM1) vendor probing finished
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.451249] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- 'AT+CGMI'
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.451837] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): --> 'AT+CGMM<CR>'
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.452547] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT+CGMM<CR>'
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.454506] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><CR><LF>u-blox<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.455114] [mm-port-probe.c:182] mm_port_probe_set_result_at_vendor(): (tty/ttyACM0) vendor probing finished
Feb 22 10:40:59 canect2 daemon.info ModemManager[301]: <debug> [-184857541.455810] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGMM<CR>'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.154470] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- 'AT+CGMM'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.155485] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- 'AT+CGMM'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.156884] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- '<CR><CR><LF>TOBY-R200<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.157478] [mm-port-probe.c:202] mm_port_probe_set_result_at_product(): (tty/ttyACM2) product probing finished
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.169768] [mm-plugin.c:527] apply_post_probing_filters(): (Iridium) [ttyACM2] filtered by vendor/product strings
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.170225] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM2: checking with plugin 'Nokia'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.170684] [mm-plugin.c:804] mm_plugin_supports_port(): (Nokia) [ttyACM2] probe required: 'at, at-vendor, at-icera'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.171047] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM2) launching port probing: 'at-icera'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.171493] [mm-port-serial.c:1353] _close_internal(): (ttyACM2) device open count is 0 (close)
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.171864] [mm-port-serial.c:1369] _close_internal(): (ttyACM2) closing serial port...
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.177924] [mm-port-serial.c:1417] _close_internal(): (ttyACM2) serial port closed
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.178587] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM2) forced to close port
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.179217] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><CR><LF>TOBY-R200<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.179816] [mm-port-probe.c:202] mm_port_probe_set_result_at_product(): (tty/ttyACM1) product probing finished
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.180323] [mm-plugin.c:527] apply_post_probing_filters(): (Iridium) [ttyACM1] filtered by vendor/product strings
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.180663] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM1: checking with plugin 'Nokia'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.181085] [mm-plugin.c:804] mm_plugin_supports_port(): (Nokia) [ttyACM1] probe required: 'at, at-vendor, at-icera'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.181424] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM1) launching port probing: 'at-icera'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.181867] [mm-port-serial.c:1353] _close_internal(): (ttyACM1) device open count is 0 (close)
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.182207] [mm-port-serial.c:1369] _close_internal(): (ttyACM1) closing serial port...
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.187032] [mm-port-serial.c:1417] _close_internal(): (ttyACM1) serial port closed
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.187549] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM1) forced to close port
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.188266] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- 'AT+CGMM'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.189467] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM2) opening serial port...
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.193443] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM2) device open count is 1 (open)
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.195665] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM1) opening serial port...
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.197471] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 1 (open)
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.198940] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><CR><LF>TOBY-R200<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.199557] [mm-port-probe.c:202] mm_port_probe_set_result_at_product(): (tty/ttyACM0) product probing finished
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.200072] [mm-plugin.c:527] apply_post_probing_filters(): (Iridium) [ttyACM0] filtered by vendor/product strings
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.200402] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM0: checking with plugin 'Nokia'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.200821] [mm-plugin.c:804] mm_plugin_supports_port(): (Nokia) [ttyACM0] probe required: 'at, at-vendor, at-icera'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.201161] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM0) launching port probing: 'at-icera'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.201634] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 0 (close)
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.201991] [mm-port-serial.c:1369] _close_internal(): (ttyACM0) closing serial port...
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.207485] [mm-port-serial.c:1417] _close_internal(): (ttyACM0) serial port closed
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.208002] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM0) forced to close port
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.209095] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM0) opening serial port...
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.210843] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 1 (open)
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.296515] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.843873] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.844491] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:00 canect2 daemon.info ModemManager[301]: <debug> [-184857540.846739] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.214474] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- 'AT%IPSYS?'
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.215494] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.216035] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.216643] [mm-port-serial-at.c:460] debug_log(): (ttyACM3): --> 'AT<CR>'
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.217137] [mm-port-serial-at.c:460] debug_log(): (ttyACM5): --> 'AT<CR>'
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.217648] [mm-port-serial-at.c:460] debug_log(): (ttyACM4): --> 'AT<CR>'
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.218341] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.219248] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:01 canect2 daemon.info ModemManager[301]: <debug> [-184857539.219807] [mm-port-probe.c:947] serial_probe_at_parse_response(): (tty/ttyACM2) re-scheduling next command in probing group in 2 seconds...
Feb 22 10:41:02 canect2 daemon.info ModemManager[301]: <debug> [-184857538.116882] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- 'AT%IPSYS?'
Feb 22 10:41:02 canect2 daemon.info ModemManager[301]: <debug> [-184857538.117965] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- 'AT%IPSYS?'
Feb 22 10:41:02 canect2 daemon.info ModemManager[301]: <debug> [-184857538.119893] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:02 canect2 daemon.info ModemManager[301]: <debug> [-184857538.120387] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:02 canect2 daemon.info ModemManager[301]: <debug> [-184857538.120795] [mm-port-probe.c:947] serial_probe_at_parse_response(): (tty/ttyACM1) re-scheduling next command in probing group in 2 seconds...
Feb 22 10:41:02 canect2 daemon.info ModemManager[301]: <debug> [-184857538.122282] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:02 canect2 daemon.info ModemManager[301]: <debug> [-184857538.122794] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:02 canect2 daemon.info ModemManager[301]: <debug> [-184857538.123213] [mm-port-probe.c:947] serial_probe_at_parse_response(): (tty/ttyACM0) re-scheduling next command in probing group in 2 seconds...
Feb 22 10:41:03 canect2 daemon.info ModemManager[301]: <debug> [-184857537.845770] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.747051] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- 'AT%IPSYS?'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.749798] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.750306] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.750726] [mm-port-probe.c:947] serial_probe_at_parse_response(): (tty/ttyACM2) re-scheduling next command in probing group in 2 seconds...
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.844417] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.844983] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.845459] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.846178] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.846655] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.847357] [mm-port-serial-at.c:460] debug_log(): (ttyACM3): --> 'AT<CR>'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.847892] [mm-port-serial-at.c:460] debug_log(): (ttyACM5): --> 'AT<CR>'
Feb 22 10:41:04 canect2 daemon.info ModemManager[301]: <debug> [-184857536.848396] [mm-port-serial-at.c:460] debug_log(): (ttyACM4): --> 'AT<CR>'
Feb 22 10:41:05 canect2 daemon.info ModemManager[301]: <debug> [-184857535.747606] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- 'AT%IPSYS?'
Feb 22 10:41:05 canect2 daemon.info ModemManager[301]: <debug> [-184857535.748673] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- 'AT%IPSYS?'
Feb 22 10:41:05 canect2 daemon.info ModemManager[301]: <debug> [-184857535.750523] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:05 canect2 daemon.info ModemManager[301]: <debug> [-184857535.751017] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:05 canect2 daemon.info ModemManager[301]: <debug> [-184857535.751424] [mm-port-probe.c:947] serial_probe_at_parse_response(): (tty/ttyACM1) re-scheduling next command in probing group in 2 seconds...
Feb 22 10:41:05 canect2 daemon.info ModemManager[301]: <debug> [-184857535.753156] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:05 canect2 daemon.info ModemManager[301]: <debug> [-184857535.753780] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:05 canect2 daemon.info ModemManager[301]: <debug> [-184857535.754220] [mm-port-probe.c:947] serial_probe_at_parse_response(): (tty/ttyACM0) re-scheduling next command in probing group in 2 seconds...
Feb 22 10:41:06 canect2 daemon.info ModemManager[301]: <debug> [-184857534.845211] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.746658] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- 'AT%IPSYS?'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.749522] [mm-port-serial-at.c:460] debug_log(): (ttyACM2): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.750034] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.750444] [mm-port-probe.c:227] mm_port_probe_set_result_at_icera(): (tty/ttyACM2) Modem is probably not Icera-based
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.750820] [mm-plugin.c:479] apply_post_probing_filters(): (Nokia) [ttyACM2] filtered by vendor strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.751137] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM2: checking with plugin 'Via CBP7'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.751545] [mm-plugin.c:804] mm_plugin_supports_port(): (Via CBP7) [ttyACM2] probe required: 'at, at-vendor, at-product'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.751876] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM2) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.752289] [mm-port-serial.c:1353] _close_internal(): (ttyACM2) device open count is 0 (close)
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.752619] [mm-port-serial.c:1369] _close_internal(): (ttyACM2) closing serial port...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.758478] [mm-port-serial.c:1417] _close_internal(): (ttyACM2) serial port closed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.758993] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM2) forced to close port
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.759538] [mm-plugin.c:527] apply_post_probing_filters(): (Via CBP7) [ttyACM2] filtered by vendor/product strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.759916] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM2: checking with plugin 'Cinterion'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.760351] [mm-plugin.c:804] mm_plugin_supports_port(): (Cinterion) [ttyACM2] probe required: 'at, at-vendor'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.760710] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM2) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.761308] [mm-plugin.c:479] apply_post_probing_filters(): (Cinterion) [ttyACM2] filtered by vendor strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.761694] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM2: checking with plugin 'Generic'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.762112] [mm-plugin.c:804] mm_plugin_supports_port(): (Generic) [ttyACM2] probe required: 'at, qcdm'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.762447] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM2) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.762981] [mm-plugin-manager.c:286] port_context_supported(): [plugin manager] task 1,ttyACM2: found best plugin for port (Generic)
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.763346] [mm-plugin-manager.c:268] port_context_complete(): [plugin manager] task 1,ttyACM2: finished in '11.569745' seconds
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.763894] [mm-plugin-manager.c:1011] device_context_continue(): [plugin Manager] task 1: still 5 running probes (5 active): ttyACM3, ttyACM5, ttyACM4, ttyACM1, ttyACM0
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.845064] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.845512] [mm-port-probe.c:165] mm_port_probe_set_result_at(): (tty/ttyACM3) port is not AT-capable
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.845861] [mm-plugin.c:504] apply_post_probing_filters(): (Iridium) [ttyACM3] filtered as no vendor/product strings given
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.846175] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM3: checking with plugin 'Nokia'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.846529] [mm-plugin.c:783] mm_plugin_supports_port(): (Nokia) [ttyACM3] not setting up AT probing tasks: modem already has the expected single AT port
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.846827] [mm-port-probe.c:165] mm_port_probe_set_result_at(): (tty/ttyACM3) port is not AT-capable
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.847142] [mm-plugin.c:804] mm_plugin_supports_port(): (Nokia) [ttyACM3] probe required: 'at, at-vendor, at-icera'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.847441] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM3) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.847855] [mm-port-serial.c:1353] _close_internal(): (ttyACM3) device open count is 0 (close)
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.848184] [mm-port-serial.c:1369] _close_internal(): (ttyACM3) closing serial port...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.852668] [mm-port-serial.c:1417] _close_internal(): (ttyACM3) serial port closed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.853193] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM3) forced to close port
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.853706] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.854057] [mm-port-probe.c:165] mm_port_probe_set_result_at(): (tty/ttyACM5) port is not AT-capable
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.854381] [mm-plugin.c:504] apply_post_probing_filters(): (Iridium) [ttyACM5] filtered as no vendor/product strings given
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.854680] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM5: checking with plugin 'Nokia'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.855031] [mm-plugin.c:783] mm_plugin_supports_port(): (Nokia) [ttyACM5] not setting up AT probing tasks: modem already has the expected single AT port
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.855321] [mm-port-probe.c:165] mm_port_probe_set_result_at(): (tty/ttyACM5) port is not AT-capable
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.855627] [mm-plugin.c:804] mm_plugin_supports_port(): (Nokia) [ttyACM5] probe required: 'at, at-vendor, at-icera'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.855956] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM5) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.856438] [mm-port-serial.c:1353] _close_internal(): (ttyACM5) device open count is 0 (close)
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.856792] [mm-port-serial.c:1369] _close_internal(): (ttyACM5) closing serial port...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.861520] [mm-port-serial.c:1417] _close_internal(): (ttyACM5) serial port closed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.862020] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM5) forced to close port
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.862458] [mm-port-probe-at.c:43] mm_port_probe_response_processor_is_at(): Parsing AT got: 'Serial command timed out'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.862789] [mm-port-probe.c:165] mm_port_probe_set_result_at(): (tty/ttyACM4) port is not AT-capable
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.863106] [mm-plugin.c:504] apply_post_probing_filters(): (Iridium) [ttyACM4] filtered as no vendor/product strings given
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.863409] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM4: checking with plugin 'Nokia'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.863852] [mm-plugin.c:783] mm_plugin_supports_port(): (Nokia) [ttyACM4] not setting up AT probing tasks: modem already has the expected single AT port
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.864166] [mm-port-probe.c:165] mm_port_probe_set_result_at(): (tty/ttyACM4) port is not AT-capable
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.864471] [mm-plugin.c:804] mm_plugin_supports_port(): (Nokia) [ttyACM4] probe required: 'at, at-vendor, at-icera'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.864779] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM4) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.865255] [mm-port-serial.c:1353] _close_internal(): (ttyACM4) device open count is 0 (close)
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.865623] [mm-port-serial.c:1369] _close_internal(): (ttyACM4) closing serial port...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.869706] [mm-port-serial.c:1417] _close_internal(): (ttyACM4) serial port closed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.870215] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM4) forced to close port
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.870820] [mm-plugin.c:479] apply_post_probing_filters(): (Nokia) [ttyACM3] filtered by vendor strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.871228] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM3: checking with plugin 'Via CBP7'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.871659] [mm-plugin.c:804] mm_plugin_supports_port(): (Via CBP7) [ttyACM3] probe required: 'at, at-vendor, at-product'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.871997] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM3) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.872426] [mm-plugin.c:479] apply_post_probing_filters(): (Nokia) [ttyACM5] filtered by vendor strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.872764] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM5: checking with plugin 'Via CBP7'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.873195] [mm-plugin.c:804] mm_plugin_supports_port(): (Via CBP7) [ttyACM5] probe required: 'at, at-vendor, at-product'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.873657] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM5) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.874105] [mm-plugin.c:479] apply_post_probing_filters(): (Nokia) [ttyACM4] filtered by vendor strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.874445] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM4: checking with plugin 'Via CBP7'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.874844] [mm-plugin.c:804] mm_plugin_supports_port(): (Via CBP7) [ttyACM4] probe required: 'at, at-vendor, at-product'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.875173] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM4) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.875653] [mm-plugin.c:504] apply_post_probing_filters(): (Via CBP7) [ttyACM3] filtered as no vendor/product strings given
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.876022] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM3: checking with plugin 'Cinterion'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.876428] [mm-plugin.c:804] mm_plugin_supports_port(): (Cinterion) [ttyACM3] probe required: 'at, at-vendor'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.876755] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM3) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.877178] [mm-plugin.c:504] apply_post_probing_filters(): (Via CBP7) [ttyACM5] filtered as no vendor/product strings given
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.877514] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM5: checking with plugin 'Cinterion'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.877904] [mm-plugin.c:804] mm_plugin_supports_port(): (Cinterion) [ttyACM5] probe required: 'at, at-vendor'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.878227] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM5) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.878645] [mm-plugin.c:504] apply_post_probing_filters(): (Via CBP7) [ttyACM4] filtered as no vendor/product strings given
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.878983] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM4: checking with plugin 'Cinterion'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.879375] [mm-plugin.c:804] mm_plugin_supports_port(): (Cinterion) [ttyACM4] probe required: 'at, at-vendor'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.879729] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM4) port probing finished: no more probings needed
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.880199] [mm-plugin.c:479] apply_post_probing_filters(): (Cinterion) [ttyACM3] filtered by vendor strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.880558] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM3: checking with plugin 'Generic'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.880958] [mm-plugin.c:804] mm_plugin_supports_port(): (Generic) [ttyACM3] probe required: 'at, qcdm'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.881317] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM3) launching port probing: 'qcdm'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.881748] [mm-plugin.c:479] apply_post_probing_filters(): (Cinterion) [ttyACM5] filtered by vendor strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.882092] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM5: checking with plugin 'Generic'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.882481] [mm-plugin.c:804] mm_plugin_supports_port(): (Generic) [ttyACM5] probe required: 'at, qcdm'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.882810] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM5) launching port probing: 'qcdm'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.883208] [mm-plugin.c:479] apply_post_probing_filters(): (Cinterion) [ttyACM4] filtered by vendor strings
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.883616] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM4: checking with plugin 'Generic'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.884047] [mm-plugin.c:804] mm_plugin_supports_port(): (Generic) [ttyACM4] probe required: 'at, qcdm'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.884392] [mm-port-probe.c:1388] mm_port_probe_run(): (tty/ttyACM4) launching port probing: 'qcdm'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.884859] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.885306] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT%IPSYS?<CR>'
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.885906] [mm-port-probe.c:691] serial_probe_qcdm(): (tty/ttyACM3) probing QCDM...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.886500] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM3) opening serial port...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.889464] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM3) device open count is 1 (open)
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.890082] [mm-port-probe.c:691] serial_probe_qcdm(): (tty/ttyACM5) probing QCDM...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.890604] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM5) opening serial port...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.893465] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM5) device open count is 1 (open)
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.894130] [mm-port-probe.c:691] serial_probe_qcdm(): (tty/ttyACM4) probing QCDM...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.894686] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM4) opening serial port...
Feb 22 10:41:07 canect2 daemon.info ModemManager[301]: <debug> [-184857533.896970] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM4) device open count is 1 (open)
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.786197] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- 'AT%IPSYS?'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.787232] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- 'AT%IPSYS?'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.787876] [mm-port-serial-qcdm.c:199] debug_log(): (ttyACM3): --> 7e 00 78 f0 7e
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.788446] [mm-port-serial-qcdm.c:199] debug_log(): (ttyACM5): --> 7e 00 78 f0 7e
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.788912] [mm-port-serial-qcdm.c:199] debug_log(): (ttyACM4): --> 7e 00 78 f0 7e
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.789724] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.790220] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.790633] [mm-port-probe.c:227] mm_port_probe_set_result_at_icera(): (tty/ttyACM1) Modem is probably not Icera-based
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.791009] [mm-plugin.c:479] apply_post_probing_filters(): (Nokia) [ttyACM1] filtered by vendor strings
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.791331] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM1: checking with plugin 'Via CBP7'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.791743] [mm-plugin.c:804] mm_plugin_supports_port(): (Via CBP7) [ttyACM1] probe required: 'at, at-vendor, at-product'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.792085] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM1) port probing finished: no more probings needed
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.792508] [mm-port-serial.c:1353] _close_internal(): (ttyACM1) device open count is 0 (close)
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.792996] [mm-port-serial.c:1369] _close_internal(): (ttyACM1) closing serial port...
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.798860] [mm-port-serial.c:1417] _close_internal(): (ttyACM1) serial port closed
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.799359] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM1) forced to close port
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.799864] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><CR><LF>ERROR<CR><LF>'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.800384] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.800792] [mm-port-probe.c:227] mm_port_probe_set_result_at_icera(): (tty/ttyACM0) Modem is probably not Icera-based
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.801168] [mm-plugin.c:479] apply_post_probing_filters(): (Nokia) [ttyACM0] filtered by vendor strings
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.801480] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM0: checking with plugin 'Via CBP7'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.801891] [mm-plugin.c:804] mm_plugin_supports_port(): (Via CBP7) [ttyACM0] probe required: 'at, at-vendor, at-product'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.802228] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM0) port probing finished: no more probings needed
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.802634] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 0 (close)
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.802967] [mm-port-serial.c:1369] _close_internal(): (ttyACM0) closing serial port...
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.807714] [mm-port-serial.c:1417] _close_internal(): (ttyACM0) serial port closed
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.808238] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM0) forced to close port
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.808685] [mm-plugin.c:527] apply_post_probing_filters(): (Via CBP7) [ttyACM1] filtered by vendor/product strings
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.809063] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM1: checking with plugin 'Cinterion'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.809491] [mm-plugin.c:804] mm_plugin_supports_port(): (Cinterion) [ttyACM1] probe required: 'at, at-vendor'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.809834] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM1) port probing finished: no more probings needed
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.810370] [mm-plugin.c:527] apply_post_probing_filters(): (Via CBP7) [ttyACM0] filtered by vendor/product strings
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.810747] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM0: checking with plugin 'Cinterion'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.811172] [mm-plugin.c:804] mm_plugin_supports_port(): (Cinterion) [ttyACM0] probe required: 'at, at-vendor'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.811514] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM0) port probing finished: no more probings needed
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.811951] [mm-plugin.c:479] apply_post_probing_filters(): (Cinterion) [ttyACM1] filtered by vendor strings
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.812289] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM1: checking with plugin 'Generic'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.812688] [mm-plugin.c:804] mm_plugin_supports_port(): (Generic) [ttyACM1] probe required: 'at, qcdm'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.813025] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM1) port probing finished: no more probings needed
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.813646] [mm-plugin.c:479] apply_post_probing_filters(): (Cinterion) [ttyACM0] filtered by vendor strings
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.814043] [mm-plugin-manager.c:522] port_context_next(): [plugin manager] task 1,ttyACM0: checking with plugin 'Generic'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.814467] [mm-plugin.c:804] mm_plugin_supports_port(): (Generic) [ttyACM0] probe required: 'at, qcdm'
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.814804] [mm-port-probe.c:1378] mm_port_probe_run(): (tty/ttyACM0) port probing finished: no more probings needed
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.815227] [mm-plugin-manager.c:286] port_context_supported(): [plugin manager] task 1,ttyACM1: found best plugin for port (Generic)
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.815554] [mm-plugin-manager.c:268] port_context_complete(): [plugin manager] task 1,ttyACM1: finished in '12.652533' seconds
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.815902] [mm-plugin-manager.c:972] device_context_set_best_plugin(): [plugin manager] task 1,ttyACM1: best plugin matches device reported one: Generic
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.816219] [mm-plugin-manager.c:1011] device_context_continue(): [plugin Manager] task 1: still 4 running probes (4 active): ttyACM3, ttyACM5, ttyACM4, ttyACM0
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.816692] [mm-plugin-manager.c:286] port_context_supported(): [plugin manager] task 1,ttyACM0: found best plugin for port (Generic)
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.817049] [mm-plugin-manager.c:268] port_context_complete(): [plugin manager] task 1,ttyACM0: finished in '12.700445' seconds
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.817736] [mm-plugin-manager.c:972] device_context_set_best_plugin(): [plugin manager] task 1,ttyACM0: best plugin matches device reported one: Generic
Feb 22 10:41:08 canect2 daemon.info ModemManager[301]: <debug> [-184857532.818200] [mm-plugin-manager.c:1011] device_context_continue(): [plugin Manager] task 1: still 3 running probes (3 active): ttyACM3, ttyACM5, ttyACM4
Feb 22 10:41:11 canect2 daemon.info ModemManager[301]: <debug> [-184857529.847309] [mm-port-serial-qcdm.c:199] debug_log(): (ttyACM3): --> 7e 00 78 f0 7e
Feb 22 10:41:11 canect2 daemon.info ModemManager[301]: <debug> [-184857529.847680] [mm-port-serial-qcdm.c:199] debug_log(): (ttyACM5): --> 7e 00 78 f0 7e
Feb 22 10:41:11 canect2 daemon.info ModemManager[301]: <debug> [-184857529.847887] [mm-port-serial-qcdm.c:199] debug_log(): (ttyACM4): --> 7e 00 78 f0 7e
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.847274] [mm-port-probe.c:261] mm_port_probe_set_result_qcdm(): (tty/ttyACM3) port is not QCDM-capable
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.847492] [mm-plugin-manager.c:286] port_context_supported(): [plugin manager] task 1,ttyACM3: found best plugin for port (Generic)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.847602] [mm-plugin-manager.c:268] port_context_complete(): [plugin manager] task 1,ttyACM3: finished in '18.634155' seconds
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.847736] [mm-plugin-manager.c:972] device_context_set_best_plugin(): [plugin manager] task 1,ttyACM3: best plugin matches device reported one: Generic
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.847836] [mm-plugin-manager.c:1011] device_context_continue(): [plugin Manager] task 1: still 2 running probes (2 active): ttyACM5, ttyACM4
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.848013] [mm-port-serial.c:1353] _close_internal(): (ttyACM3) device open count is 0 (close)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.848120] [mm-port-serial.c:1369] _close_internal(): (ttyACM3) closing serial port...
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.852714] [mm-port-serial.c:1417] _close_internal(): (ttyACM3) serial port closed
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.852976] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM3) forced to close port
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.853187] [mm-port-probe.c:261] mm_port_probe_set_result_qcdm(): (tty/ttyACM5) port is not QCDM-capable
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.853319] [mm-plugin-manager.c:286] port_context_supported(): [plugin manager] task 1,ttyACM5: found best plugin for port (Generic)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.853413] [mm-plugin-manager.c:268] port_context_complete(): [plugin manager] task 1,ttyACM5: finished in '18.642860' seconds
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.854388] [mm-plugin-manager.c:972] device_context_set_best_plugin(): [plugin manager] task 1,ttyACM5: best plugin matches device reported one: Generic
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.854684] [mm-plugin-manager.c:1011] device_context_continue(): [plugin Manager] task 1: still 1 running probes (1 active): ttyACM4
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.855057] [mm-port-serial.c:1353] _close_internal(): (ttyACM5) device open count is 0 (close)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.855379] [mm-port-serial.c:1369] _close_internal(): (ttyACM5) closing serial port...
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.859836] [mm-port-serial.c:1417] _close_internal(): (ttyACM5) serial port closed
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.860335] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM5) forced to close port
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.860798] [mm-port-probe.c:261] mm_port_probe_set_result_qcdm(): (tty/ttyACM4) port is not QCDM-capable
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.861176] [mm-plugin-manager.c:286] port_context_supported(): [plugin manager] task 1,ttyACM4: found best plugin for port (Generic)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.861492] [mm-plugin-manager.c:268] port_context_complete(): [plugin manager] task 1,ttyACM4: finished in '18.654750' seconds
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.861839] [mm-plugin-manager.c:972] device_context_set_best_plugin(): [plugin manager] task 1,ttyACM4: best plugin matches device reported one: Generic
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.862116] [mm-plugin-manager.c:985] device_context_continue(): [plugin manager] task 1: no more ports to probe
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.862376] [mm-plugin-manager.c:819] device_context_complete(): [plugin manager] task 1: finished in '18.747130' seconds
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <info>  [-184857526.862806] [mm-device.c:538] mm_device_create_modem(): Creating modem with plugin 'Generic' and '6' ports
Feb 22 10:41:14 canect2 daemon.warn ModemManager[301]: <warn>  [-184857526.880564] [mm-plugin.c:957] mm_plugin_create_modem(): Could not grab port (tty/ttyACM3): 'Cannot add port 'tty/ttyACM3', unhandled serial type'
Feb 22 10:41:14 canect2 daemon.warn ModemManager[301]: <warn>  [-184857526.881104] [mm-plugin.c:957] mm_plugin_create_modem(): Could not grab port (tty/ttyACM5): 'Cannot add port 'tty/ttyACM5', unhandled serial type'
Feb 22 10:41:14 canect2 daemon.warn ModemManager[301]: <warn>  [-184857526.881471] [mm-plugin.c:957] mm_plugin_create_modem(): Could not grab port (tty/ttyACM4): 'Cannot add port 'tty/ttyACM4', unhandled serial type'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.882379] [mm-base-modem.c:280] mm_base_modem_grab_port(): (ttyACM2) type 'at' claimed by /sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/usb1/1-1
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.883416] [mm-base-modem.c:280] mm_base_modem_grab_port(): (ttyACM1) type 'at' claimed by /sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/usb1/1-1
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.884584] [mm-base-modem.c:280] mm_base_modem_grab_port(): (ttyACM0) type 'at' claimed by /sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/usb1/1-1
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.885113] [mm-base-modem.c:875] log_port(): (/sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/usb1/1-1) tty/ttyACM0 at (primary)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.885445] [mm-base-modem.c:875] log_port(): (/sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/usb1/1-1) tty/ttyACM1 at (secondary)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.885721] [mm-base-modem.c:875] log_port(): (/sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/usb1/1-1) tty/ttyACM0 data (primary)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.887897] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM0) opening serial port...
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.889974] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 1 (open)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.890369] [mm-port-serial-at.c:496] mm_port_serial_at_run_init_sequence(): (ttyACM0): running init sequence...
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.891012] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.892119] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <info>  [-184857526.892671] [mm-base-manager.c:175] device_support_check_ready(): Modem for device at '/sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/usb1/1-1' successfully created
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.893158] [mm-port-serial.c:1353] _close_internal(): (ttyACM4) device open count is 0 (close)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.893585] [mm-port-serial.c:1369] _close_internal(): (ttyACM4) closing serial port...
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.897697] [mm-port-serial.c:1417] _close_internal(): (ttyACM4) serial port closed
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.898168] [mm-port-serial.c:1479] port_serial_close_force(): (ttyACM4) forced to close port
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.904784] [mm-broadband-modem.c:736] modem_load_current_capabilities(): loading current capabilities...
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.905408] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 4 (open)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.905985] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATE0<CR>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.910924] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- 'ATE0'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.913861] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><CR><LF>OK<CR><LF>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.914566] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATV1<CR>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.921913] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.922627] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMEE=1<CR>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.935802] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.936732] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATX4<CR>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.944182] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.944908] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT&C1<CR>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.953412] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.954180] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATE0<CR>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.961672] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.962304] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 3 (close)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.962798] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMEE=1<CR>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.976051] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.976711] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.977257] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+GCAP<CR>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.988305] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+GCAP: +CGSM<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.989203] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.989773] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:14 canect2 daemon.info ModemManager[301]: <debug> [-184857526.990250] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+WS46=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.003698] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+WS46: (12,22,25,28,29,30,31)<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.005211] [mm-broadband-modem.c:364] modem_load_current_capabilities_finish(): loaded current capabilities: gsm-umts, lte
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.005639] [mm-iface-modem.c:3902] load_current_capabilities_ready(): Setting EPS network as supported
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.006624] [mm-iface-modem.c:4360] interface_initialization_step(): Modem allows up to 1 bearers
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.007074] [mm-bearer-list.c:270] mm_bearer_list_new(): Creating bearer list (max: 1, max active: 1)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.016961] [mm-broadband-modem.c:796] modem_load_manufacturer(): loading manufacturer...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.017490] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.018012] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.018483] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGMI<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.029186] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>u-blox<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.029901] [mm-broadband-modem.c:780] modem_load_manufacturer_finish(): loaded manufacturer: u-blox
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.030445] [mm-broadband-modem.c:836] modem_load_model(): loading model...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.030878] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.031361] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.031814] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGMM<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.042426] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>TOBY-R200<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.043135] [mm-broadband-modem.c:820] modem_load_model_finish(): loaded model: TOBY-R200
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.043724] [mm-broadband-modem.c:876] modem_load_revision(): loading revision...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.044175] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.044661] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.045147] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGMR<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.055677] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>30.31<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.056379] [mm-broadband-modem.c:860] modem_load_revision_finish(): loaded revision: 30.31
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.056912] [mm-broadband-modem.c:937] modem_load_equipment_identifier(): loading equipment identifier...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.057369] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.057866] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.058344] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGSN<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.079063] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>XXXXXXXXXXXXXXX<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.079915] [mm-broadband-modem.c:919] modem_load_equipment_identifier_finish(): loaded equipment identifier: XXXXXXXXXXXXXXX
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.080478] [mm-broadband-modem.c:1025] modem_load_device_identifier(): loading device identifier...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.080927] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.081413] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.081864] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATI<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.091689] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>TOBY-R200-02B-01<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.092714] [mm-modem-helpers.c:310] mm_create_device_identifier(): Device ID source '0000154600001107TOBY-R200-02B-01XXXXXXXXXXXXXXX30.31TOBY-R200u-blox'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.093156] [mm-modem-helpers.c:311] mm_create_device_identifier(): Device ID 'XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.093513] [mm-broadband-modem.c:988] modem_load_device_identifier_finish(): loaded device identifier: XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.094034] [mm-broadband-modem.c:1601] modem_load_supported_modes(): loading supported modes...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.094524] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.095024] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.095477] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT*CNTI=2<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.108924] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CME ERROR: 100<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.109661] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 100: Unknown error
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.110190] [mm-broadband-modem.c:1535] supported_modes_cnti_ready(): Generic query of supported 3GPP networks with *CNTI failed: 'Unknown error'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.110879] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.111407] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.112197] [mm-broadband-modem.c:1480] supported_modes_ws46_test_ready(): Device allows (3GPP) mode combination: 2g
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.112600] [mm-broadband-modem.c:1480] supported_modes_ws46_test_ready(): Device allows (3GPP) mode combination: 3g
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.112933] [mm-broadband-modem.c:1480] supported_modes_ws46_test_ready(): Device allows (3GPP) mode combination: 2g, 3g, 4g
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.113198] [mm-broadband-modem.c:1480] supported_modes_ws46_test_ready(): Device allows (3GPP) mode combination: 4g
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.113517] [mm-broadband-modem.c:1480] supported_modes_ws46_test_ready(): Device allows (3GPP) mode combination: 2g, 3g
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.113811] [mm-broadband-modem.c:1480] supported_modes_ws46_test_ready(): Device allows (3GPP) mode combination: 2g, 4g
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.114077] [mm-broadband-modem.c:1480] supported_modes_ws46_test_ready(): Device allows (3GPP) mode combination: 3g, 4g
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.114863] [mm-broadband-modem.c:1675] modem_load_supported_ip_families(): loading supported IP families...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.115371] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.115873] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.116336] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGDCONT=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.133328] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CGDCONT: (1-11),"IP",,,0,(0-4),(0,1),(0,1),(0,1),(0,1)<CR><LF><CR><LF>+CGDCONT: (1-11),"IPV6",,,0,(0-4),(0,1),(0,1),(0,1),(0
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.134780] [mm-broadband-modem.c:3139] load_power_state(): loading power state...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.135310] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.135820] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.136280] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CFUN?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.148422] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CFUN: 1,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.warn ModemManager[301]: <warn>  [-184857525.149291] [mm-iface-modem.c:4047] load_power_state_ready(): couldn't load Power State: 'Failed to parse +CFUN? response '1,0''
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.149795] [mm-broadband-modem.c:1328] modem_load_unlock_required(): checking if unlock required...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.150215] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.150768] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.151244] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CPIN?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.163689] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CPIN: READY<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.164449] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.165018] [mm-iface-modem.c:3106] update_lock_info_context_step(): SIM is ready, and no need for the after SIM unlock step...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.166897] [mm-base-sim.c:1004] load_sim_identifier(): loading SIM identifier...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.167453] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.168039] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CRSM=176,12258,0,0,10<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.213583] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CRSM: 144,0,"XXXXXXXXXXXXXXXXXXXX"<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.214500] [mm-base-sim.c:993] load_sim_identifier_finish(): loaded SIM identifier: XXXXXXXXXXXXXXXXXXXX
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.215061] [mm-base-sim.c:1074] load_imsi(): loading IMSI...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.215511] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.215997] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.216488] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CIMI<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.227803] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>XXXXXXXXXXXXXXX<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.228489] [mm-base-sim.c:1063] load_imsi_finish(): loaded IMSI: XXXXXXXXXXXXXXX
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.229012] [mm-base-sim.c:1194] load_operator_identifier(): loading Operator ID...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.229464] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.229960] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.230411] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CRSM=176,28589,0,0,4<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.273058] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CRSM: 144,0,"00000003"<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.274251] [mm-base-sim.c:1289] load_operator_name(): loading Operator Name...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.274779] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.275295] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.275800] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CRSM=176,28486,0,0,17<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.318443] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CRSM: 106,130<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.warn ModemManager[301]: <warn>  [-184857525.319481] [mm-base-sim.c:1425] load_operator_name_ready(): couldn't load Operator name: 'Failed to parse CRSM query result '+CRSM: 106,130''
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.319962] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.320931] [mm-broadband-modem.c:1206] modem_load_own_numbers(): loading own numbers...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.321416] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.321989] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CNUM<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.369436] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.371143] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.373780] [mm-broadband-modem.c:3242] modem_3gpp_load_imei(): loading IMEI...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.374314] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.374899] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGSN<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.396059] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>XXXXXXXXXXXXXXX<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.396815] [mm-broadband-modem.c:3233] modem_3gpp_load_imei_finish(): loaded IMEI: XXXXXXXXXXXXXXX
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.397336] [mm-broadband-modem.c:3401] modem_3gpp_load_enabled_facility_locks(): loading enabled facility locks...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.397771] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.398214] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.398657] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLCK=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.412317] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CLCK: ("AO","OI","AI","IR","OX","AB","AG","AC","PS","PN","PU","PP","PC","SC","FD")<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.413419] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.414041] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.414522] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLCK="SC",2<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.433316] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CLCK: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.434335] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.434937] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.435422] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLCK="FD",2<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.454329] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CLCK: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.455244] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.455796] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.456268] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLCK="PS",2<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.475074] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CLCK: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.475988] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.476539] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.477008] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLCK="PN",2<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.498690] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CLCK: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.499374] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.499634] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.499842] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLCK="PU",2<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.518671] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CLCK: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.519589] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.521244] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.521790] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLCK="PP",2<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.540546] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CLCK: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.541465] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.542022] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.542496] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLCK="PC",2<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.561422] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CLCK: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.562686] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.564918] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.565630] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CUSD=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.578799] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CUSD: (0-2)<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.579908] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.583230] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.584068] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CNMI=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.597196] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CNMI: (0-2),(0-3),(0-3),(0-2),(0-1)<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.598076] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.598671] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.599151] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CPMS=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.612426] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CPMS: ("BM","ME","SM","SR"),("ME","SM"),("BM","ME","SM","SR")<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.613765] [mm-iface-modem-messaging.c:1149] load_supported_storages_ready(): Supported storages loaded:
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.614157] [mm-iface-modem-messaging.c:1150] load_supported_storages_ready():   mem1 (list/read/delete) storages: 'bm, me, sm, sr'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.614450] [mm-iface-modem-messaging.c:1151] load_supported_storages_ready():   mem2 (write/send) storages:       'me, sm'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.614697] [mm-iface-modem-messaging.c:1152] load_supported_storages_ready():   mem3 (reception) storages:        'bm, me, sm, sr'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.615238] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.615780] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.616250] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CPMS?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.628053] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CPMS: "SR",0,10,"ME",1,100,"ME",1,100<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.629178] [mm-broadband-modem.c:5280] cpms_query_ready(): Current storages initialized:
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.629621] [mm-broadband-modem.c:5283] cpms_query_ready():   mem1 (list/read/delete) storages: 'sr'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.629968] [mm-broadband-modem.c:5287] cpms_query_ready():   mem2 (write/send) storages:       'me'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.630263] [mm-iface-modem-messaging.c:1232] init_current_storages_ready(): Current storages initialized
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.630955] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.632163] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.632838] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATH<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.639423] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.640461] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.641573] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.642249] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CTZU=1<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.655438] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.656245] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CCLK?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.668682] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CCLK: "04/01/01,00:00:27-24"<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.669754] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.671038] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.671748] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CESQ=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.685448] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CESQ: (0-63,99),(0-7,99),(0-96,255),(0-49,255),(0-34,255),(0-97,255)<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.686560] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.688228] [mm-broadband-modem.c:9715] iface_modem_oma_initialize_ready(): Couldn't initialize interface: 'OMA not supported'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.689562] [mm-broadband-modem.c:9716] iface_modem_firmware_initialize_ready(): Couldn't initialize interface: 'Firmware interface not available'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <info>  [-184857525.690855] [mm-iface-modem.c:1433] __iface_modem_update_state_internal(): Modem: state changed (unknown -> disabled)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.691882] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 0 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.692313] [mm-port-serial.c:1369] _close_internal(): (ttyACM0) closing serial port...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.696745] [mm-port-serial.c:1417] _close_internal(): (ttyACM0) serial port closed
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.697249] [mm-base-modem.c:844] initialize_ready(): modem properly initialized
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.714250] [mm-device.c:453] export_modem(): Exported modem '/sys/devices/platform/soc/2100000.aips-bus/2184200.usb/ci_hdrc.1/usb1/1-1' at path '/org/freedesktop/ModemManager1/Modem/0'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.714815] [mm-device.c:463] export_modem(): (/org/freedesktop/ModemManager1/Modem/0): 'Generic' modem, VID 0x1546 PID 0x1107 (usb)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <info>  [-184857525.742793] [mm-iface-modem.c:1433] __iface_modem_update_state_internal(): Modem /org/freedesktop/ModemManager1/Modem/0: state changed (disabled -> enabling)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.749175] [mm-broadband-modem.c:8617] enabling_started(): Skipping modem initialization: device hotplugged
Feb 22 10:41:15 canect2 daemon.info NetworkManager[308]: <info>  [-184857525.7497] (ttyACM0): modem state changed, 'disabled' --> 'enabling' (reason: user preference)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.750100] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM0) opening serial port...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.760446] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 1 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.760897] [mm-port-serial-at.c:496] mm_port_serial_at_run_init_sequence(): (ttyACM0): running init sequence...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.761370] [mm-port-serial.c:1166] mm_port_serial_open(): (ttyACM1) opening serial port...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.763407] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 1 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.763714] [mm-port-serial-at.c:496] mm_port_serial_at_run_init_sequence(): (ttyACM1): running init sequence...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.763898] [mm-broadband-modem.c:8633] enabling_started(): Flashing primary AT port before enabling...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.764909] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATE0<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.765169] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'ATE0<CR>'
Feb 22 10:41:15 canect2 daemon.info NetworkManager[308]: <info>  [-184857525.7662] manager: (ttyACM0): new Broadband device (/org/freedesktop/NetworkManager/Devices/8)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.770917] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- 'AT'
Feb 22 10:41:15 canect2 daemon.info NetworkManager[308]: <info>  [-184857525.7745] device (ttyACM0): state change: unmanaged -> unavailable (reason 'managed') [10 20 2]
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.776746] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- 'E0<CR><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.777710] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.778176] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATV1<CR>'
Feb 22 10:41:15 canect2 daemon.info NetworkManager[308]: <info>  [-184857525.7815] device (ttyACM0): modem state 'enabling'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.786598] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.787947] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMEE=1<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.804922] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.805447] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATX4<CR>'
Feb 22 10:41:15 canect2 daemon.info NetworkManager[308]: <info>  [-184857525.8065] device (ttyACM0): state change: unavailable -> disconnected (reason 'none') [20 30 0]
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.813910] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.814429] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT&C1<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.824076] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.866785] [mm-broadband-modem.c:3139] load_power_state(): loading power state...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.867306] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.867961] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CFUN?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.880302] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CFUN: 1,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.881021] [mm-iface-modem.c:3370] set_power_state_load_ready(): Couldn't reload current power state: Failed to parse +CFUN? response '1,0'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.881502] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.882019] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.882481] [mm-iface-modem.c:3221] modem_power_up_ready(): Modem set in full-power mode...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.886505] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.887393] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 4 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.888001] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CFUN=1<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.902439] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.903091] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 3 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.903669] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+IFC=1,1<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.918182] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CME ERROR: 3<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.918804] [mm-serial-parsers.c:364] mm_serial_parser_v1_parse(): Got failure code 3: Operation not allowed
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.919228] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.919760] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CSCS=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.933188] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CSCS: ("IRA","GSM","PCCP437","8859-1","UCS2","HEX")<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.934431] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.935054] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.935589] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CSCS="UCS2"<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.954437] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.955197] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.955752] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.956221] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CSCS?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.968434] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CSCS: "UCS2"<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.969205] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.969714] [mm-broadband-modem.c:9278] enabling_step(): Modem has 3GPP capabilities, enabling the Modem 3GPP interface...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.970126] [mm-broadband-modem.c:2601] modem_3gpp_setup_unsolicited_events(): Checking indicator support...
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.970553] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.971126] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CIND=?<CR>'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.984608] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CIND: ("battchg",(0-5)),("signal",(0-5)),("service",(0-1)),("sounder",(0-1)),("message",(0-1)),("call",(0-1)),("roam",(0-1))
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.985842] [mm-broadband-modem.c:2554] cind_format_check_ready(): Modem supports signal quality indications via CIND at index '2'(min: 0, max: 5)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.986263] [mm-broadband-modem.c:2563] cind_format_check_ready(): Modem supports roaming indications via CIND at index '7'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.986571] [mm-broadband-modem.c:2572] cind_format_check_ready(): Modem supports service indications via CIND at index '3'
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.986952] [mm-broadband-modem.c:2505] set_unsolicited_events_handlers(): (ttyACM0) Setting 3GPP unsolicited events handlers
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.987268] [mm-broadband-modem.c:2505] set_unsolicited_events_handlers(): (ttyACM1) Setting 3GPP unsolicited events handlers
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.987699] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.988188] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:15 canect2 daemon.info ModemManager[301]: <debug> [-184857525.988650] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMER=3,0,0,1<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.008934] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.009792] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.010354] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.010874] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT+CMER=3,0,0,1<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.032557] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.034457] [mm-broadband-modem.c:3601] modem_3gpp_setup_unsolicited_registration_events(): (ttyACM0) setting up 3GPP unsolicited registration messages handlers
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.034953] [mm-broadband-modem.c:3601] modem_3gpp_setup_unsolicited_registration_events(): (ttyACM1) setting up 3GPP unsolicited registration messages handlers
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.035421] [mm-port-serial.c:1353] _close_internal(): (ttyACM1) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.036016] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.036618] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CREG=2<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.051309] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.052069] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.052655] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.053130] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT+CREG=2<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.066056] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.066813] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.067350] [mm-port-serial.c:1353] _close_internal(): (ttyACM1) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.067824] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGREG=2<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.081953] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.082716] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.083269] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.083813] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT+CGREG=2<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.097807] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.098542] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.099072] [mm-port-serial.c:1353] _close_internal(): (ttyACM1) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.099534] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CEREG=2<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.113687] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.114473] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.115055] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.115543] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT+CEREG=2<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.129563] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.130254] [mm-port-serial.c:1353] _close_internal(): (ttyACM1) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.130832] [mm-broadband-modem.c:9291] enabling_step(): Modem has 3GPP/USSD capabilities, enabling the Modem 3GPP/USSD interface...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.131348] [mm-broadband-modem.c:4915] set_unsolicited_result_code_handlers(): (ttyACM0) Setting unsolicited result code handlers
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.131701] [mm-broadband-modem.c:4915] set_unsolicited_result_code_handlers(): (ttyACM1) Setting unsolicited result code handlers
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.132238] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.132820] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CUSD=1<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.146063] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.146966] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.150841] [mm-broadband-modem.c:9319] enabling_step(): Modem has location capabilities, enabling the Location interface...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.151440] [mm-iface-modem-location.c:762] setup_gathering(): Need to enable the following location sources: '3gpp-lac-ci'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.152171] [mm-iface-modem-3gpp.c:761] mm_iface_modem_3gpp_run_registration_checks(): Running registration checks (CS: 'yes', PS: 'yes', EPS: 'yes')
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.152673] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.156855] [mm-broadband-modem.c:9332] enabling_step(): Modem has messaging capabilities, enabling the Messaging interface...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.157774] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.158404] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CREG?<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.170432] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CREG: 2,3<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <info>  [-184857524.171092] [mm-iface-modem-3gpp.c:1186] update_registration_state(): Modem /org/freedesktop/ModemManager1/Modem/0: 3GPP Registration state changed (unknown -> denied)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.172024] [mm-iface-modem.c:1602] get_updated_consolidated_state(): Will start keeping track of state for subsystem '3gpp'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.172922] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 4 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.173560] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 3 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.177426] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMGF=?<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.190431] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CMGF: (0-1)<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.191452] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 4 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.191988] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 3 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.192486] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGREG?<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.205318] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CGREG: 2,3<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.206243] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 4 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.206781] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 3 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.207320] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMGF=0<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.220178] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.220861] [mm-broadband-modem.c:5601] cmgf_set_ready(): Successfully set preferred SMS mode: 'PDU'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.221672] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 4 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.222212] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 3 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.226085] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CEREG?<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.239313] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CEREG: 2,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.240233] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.240840] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CPMS="SR","ME","ME"<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.268693] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CPMS: 0,10,1,100,1,100<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.269437] [mm-broadband-modem.c:6373] modem_messaging_load_initial_sms_parts(): Listing SMS parts in storage 'bm'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.269839] [mm-broadband-modem.c:5483] mm_broadband_modem_lock_sms_storages(): Locking SMS storages to: mem1 (BM), mem2 (none)...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.270242] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.270715] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.271163] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CPMS="BM"<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.287810] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CPMS: 0,10,1,100,1,100<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.288557] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.289170] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.289774] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMGL=4<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.302803] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.303749] [mm-broadband-modem.c:6373] modem_messaging_load_initial_sms_parts(): Listing SMS parts in storage 'me'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.304181] [mm-broadband-modem.c:5483] mm_broadband_modem_lock_sms_storages(): Locking SMS storages to: mem1 (ME), mem2 (none)...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.304598] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.305076] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.305531] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CPMS="ME"<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.322313] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CPMS: 1,100,1,100,1,100<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.323039] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.323699] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.324309] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMGL=4<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.337448] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CMGL: 1,1,,44<CR><LF>XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.347214] [mm-sms-part-3gpp.c:368] mm_sms_part_3gpp_new_from_binary_pdu(): Parsing PDU (1)...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.347663] [mm-sms-part-3gpp.c:397] mm_sms_part_3gpp_new_from_binary_pdu():   SMSC address parsed: '+XXXXXXXXXXX'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.347962] [mm-sms-part-3gpp.c:410] mm_sms_part_3gpp_new_from_binary_pdu():   Deliver type PDU detected
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.348219] [mm-sms-part-3gpp.c:471] mm_sms_part_3gpp_new_from_binary_pdu():   Number parsed: '+XXXXX'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.348460] [mm-sms-part-3gpp.c:575] mm_sms_part_3gpp_new_from_binary_pdu():   PID: 0
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.348686] [mm-sms-part-3gpp.c:586] mm_sms_part_3gpp_new_from_binary_pdu():   user data encoding is GSM7
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.348916] [mm-sms-part-3gpp.c:614] mm_sms_part_3gpp_new_from_binary_pdu():   user data length: 32 elements
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.349135] [mm-sms-part-3gpp.c:620] mm_sms_part_3gpp_new_from_binary_pdu():   user data length: 28 bytes
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.349379] [mm-sms-part-3gpp.c:695] mm_sms_part_3gpp_new_from_binary_pdu(): Decoding SMS text with '32' elements
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.349619] [mm-sms-part-3gpp.c:244] sms_decode_text(): Converting SMS part text from GSM7 to UTF8...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.349945] [mm-sms-part-3gpp.c:247] sms_decode_text():    Got UTF-8 text: 'This is a test of the LTE modem.'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.350230] [mm-broadband-modem.c:6306] sms_pdu_part_list_ready(): Correctly parsed PDU (1)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.350576] [mm-sms-list.c:384] mm_sms_list_take_part(): SMS part at 'me/1' is from a singlepart SMS
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.353260] [mm-iface-modem-messaging.c:511] sms_added(): Added received SMS at '/org/freedesktop/ModemManager1/SMS/0'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.357033] [mm-broadband-modem.c:6373] modem_messaging_load_initial_sms_parts(): Listing SMS parts in storage 'sm'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.357574] [mm-broadband-modem.c:5483] mm_broadband_modem_lock_sms_storages(): Locking SMS storages to: mem1 (SM), mem2 (none)...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.358015] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.358505] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.362343] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CPMS="SM"<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.379813] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CPMS: 0,3,1,100,1,100<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.380548] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.381131] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.381721] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMGL=4<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.396065] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.396951] [mm-broadband-modem.c:6373] modem_messaging_load_initial_sms_parts(): Listing SMS parts in storage 'sr'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.397403] [mm-broadband-modem.c:5483] mm_broadband_modem_lock_sms_storages(): Locking SMS storages to: mem1 (SR), mem2 (none)...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.397819] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.398298] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.398762] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CPMS="SR"<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.415694] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CPMS: 0,10,1,100,1,100<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.416429] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.416999] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.417623] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CMGL=4<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.430553] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.431560] [mm-broadband-modem.c:5904] set_messaging_unsolicited_events_handlers(): (ttyACM0) Setting messaging unsolicited events handlers
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.431988] [mm-broadband-modem.c:5904] set_messaging_unsolicited_events_handlers(): (ttyACM1) Setting messaging unsolicited events handlers
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.432400] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.432861] [mm-broadband-modem.c:6077] modem_messaging_enable_unsolicited_events(): (ttyACM0) Enabling messaging unsolicited events on primary port
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.433285] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.433891] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CNMI=2,1,2,1,0<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.456058] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.456728] [mm-broadband-modem.c:6038] modem_messaging_enable_unsolicited_events_primary_ready(): (ttyACM0) Messaging unsolicited events enabled on primary
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.457096] [mm-broadband-modem.c:6043] modem_messaging_enable_unsolicited_events_primary_ready(): (ttyACM1) Enabling messaging unsolicited events on secondary port
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.457476] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.457937] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.458416] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT+CNMI=2,1,2,1,0<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.480306] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.480974] [mm-broadband-modem.c:6011] modem_messaging_enable_unsolicited_events_secondary_ready(): (ttyACM1) Messaging unsolicited events enabled on secondary
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.481428] [mm-port-serial.c:1353] _close_internal(): (ttyACM1) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.481869] [mm-broadband-modem.c:9345] enabling_step(): Modem has voice capabilities, enabling the Voice interface...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.482808] [mm-broadband-modem.c:6541] set_voice_unsolicited_events_handlers(): (ttyACM0) Setting voice unsolicited events handlers
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.483243] [mm-broadband-modem.c:6541] set_voice_unsolicited_events_handlers(): (ttyACM1) Setting voice unsolicited events handlers
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.483882] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.484481] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CLIP=1<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.497691] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.498536] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CRC=1<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.510553] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.511289] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.511793] [mm-broadband-modem.c:9358] enabling_step(): Modem has time capabilities, enabling the Time interface...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.512455] [mm-broadband-modem.c:9371] enabling_step(): Modem has extended signal reporting capabilities, enabling the Signal interface...
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.512910] [mm-iface-modem-signal.c:206] setup_refresh_context(): Extended signal information reporting disabled (rate: 0 seconds)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <info>  [-184857524.513822] [mm-iface-modem.c:1433] __iface_modem_update_state_internal(): Modem /org/freedesktop/ModemManager1/Modem/0: state changed (enabling -> enabled)
Feb 22 10:41:16 canect2 daemon.info NetworkManager[308]: <info>  [-184857524.5204] (ttyACM0): modem state changed, 'enabling' --> 'enabled' (reason: user-requested)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.524644] [mm-iface-modem-3gpp.c:761] mm_iface_modem_3gpp_run_registration_checks(): Running registration checks (CS: 'yes', PS: 'yes', EPS: 'yes')
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.525231] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.525830] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CREG?<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.537688] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CREG: 2,3<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.538629] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.539184] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.539668] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGREG?<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.552806] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CGREG: 2,3<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.553814] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.554410] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.554904] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CEREG?<CR>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.567936] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CEREG: 2,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.568845] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:16 canect2 daemon.info ModemManager[301]: <debug> [-184857524.569381] [mm-broadband-modem.c:8655] modem_3gpp_run_registration_checks_ready(): Initial 3GPP registration checks finished
Feb 22 10:41:26 canect2 daemon.info ModemManager[301]: <debug> [-184857514.978645] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CEREG: 3<CR><LF>'
Feb 22 10:41:26 canect2 daemon.info ModemManager[301]: <debug> [-184857514.979803] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>+CEREG: 3<CR><LF>'
Feb 22 10:41:29 canect2 daemon.info ModemManager[301]: <debug> [-184857511.205532] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CIEV: 9,1<CR><LF><CR><LF>+CEREG: 3<CR><LF>'
Feb 22 10:41:29 canect2 daemon.info ModemManager[301]: <debug> [-184857511.206700] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>+CIEV: 9,1<CR><LF><CR><LF>+CEREG: 3<CR><LF>'
Feb 22 10:41:29 canect2 daemon.info ModemManager[301]: <debug> [-184857511.382090] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CIEV: 2,3<CR><LF>'
Feb 22 10:41:29 canect2 daemon.info ModemManager[301]: <debug> [-184857511.382969] [mm-iface-modem.c:1206] update_signal_quality(): Modem /org/freedesktop/ModemManager1/Modem/0: signal quality updated (60)
Feb 22 10:41:29 canect2 daemon.info ModemManager[301]: <debug> [-184857511.387299] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>+CIEV: 2,3<CR><LF>'
Feb 22 10:41:29 canect2 daemon.info ModemManager[301]: <debug> [-184857511.388252] [mm-iface-modem.c:1206] update_signal_quality(): Modem /org/freedesktop/ModemManager1/Modem/0: signal quality updated (60)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.808791] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CGREG: 1,"7910","051C085F",6,"6C"<CR><LF><CR><LF>+CIEV: 9,2<CR><LF><CR><LF>+CEREG: 4<CR><LF>'
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <info>  [-184857510.809553] [mm-iface-modem-3gpp.c:1171] update_registration_state(): Modem /org/freedesktop/ModemManager1/Modem/0: 3GPP Registration state changed (denied -> registering)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.809737] [mm-broadband-modem.c:3437] modem_3gpp_load_operator_code(): loading Operator Code...
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.809905] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.810327] [mm-iface-modem.c:935] mm_iface_modem_update_access_technologies(): Modem /org/freedesktop/ModemManager1/Modem/0: access technology changed (unknown -> hspa)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.810545] [mm-iface-modem-location.c:297] notify_3gpp_location_update(): Modem /org/freedesktop/ModemManager1/Modem/0: 3GPP location updated (MCC: '0', MNC: '0', Location area code: '7910', Cell ID:
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.815321] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>+CGREG: 1,"7910","051C085F",6,"6C"<CR><LF><CR><LF>+CIEV: 9,2<CR><LF><CR><LF>+CEREG: 4<CR><LF>'
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.816519] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+COPS=3,2;+COPS?<CR>'
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.842579] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+COPS: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.843666] [mm-broadband-modem.c:3473] modem_3gpp_load_operator_name(): loading Operator Name...
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.844168] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.844651] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.845343] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+COPS=3,0;+COPS?<CR>'
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.869684] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+COPS: 0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.870742] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <info>  [-184857510.871564] [mm-iface-modem-3gpp.c:1096] update_registration_reload_current_registration_info_ready(): Modem /org/freedesktop/ModemManager1/Modem/0: 3GPP Registration state changed (registering -> hom
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <info>  [-184857510.872313] [mm-iface-modem.c:1433] __iface_modem_update_state_internal(): Modem /org/freedesktop/ModemManager1/Modem/0: state changed (enabled -> registered)
Feb 22 10:41:30 canect2 daemon.info NetworkManager[308]: <info>  [-184857510.8789] (ttyACM0): modem state changed, 'enabled' --> 'registered' (reason: unknown)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.880518] [mm-iface-modem.c:1357] periodic_signal_quality_check_enable(): Periodic signal quality checks enabled (interval = 3s)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.880985] [mm-broadband-modem.c:1991] modem_load_signal_quality(): loading signal quality...
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.881416] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.881889] [mm-iface-modem.c:1077] periodic_access_technologies_check_enable(): Periodic access technology checks enabled
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.885902] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CIND?<CR>'
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.898571] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CIND: 5,3,0,0,0,0,0,0,2,0,0,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.899547] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.900388] [mm-iface-modem.c:1206] update_signal_quality(): Modem /org/freedesktop/ModemManager1/Modem/0: signal quality updated (60)
Feb 22 10:41:30 canect2 daemon.info ModemManager[301]: <debug> [-184857510.900904] [mm-iface-modem.c:1276] signal_quality_check_ready(): Periodic signal quality checks rescheduled (interval = 30s)
Feb 22 10:41:35 canect2 daemon.info ModemManager[301]: <debug> [-184857505.846935] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:41:35 canect2 daemon.info ModemManager[301]: <debug> [-184857505.847346] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CCLK?<CR>'
Feb 22 10:41:35 canect2 daemon.info ModemManager[301]: <debug> [-184857505.861196] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CCLK: "18/02/05,09:04:27-24"<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:41:35 canect2 daemon.info ModemManager[301]: <debug> [-184857505.862712] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:42:00 canect2 daemon.info ModemManager[301]: <debug> [-184857480.853729] [mm-broadband-modem.c:1991] modem_load_signal_quality(): loading signal quality...
Feb 22 10:42:00 canect2 daemon.info ModemManager[301]: <debug> [-184857480.854021] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:42:00 canect2 daemon.info ModemManager[301]: <debug> [-184857480.854393] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CIND?<CR>'
Feb 22 10:42:00 canect2 daemon.info ModemManager[301]: <debug> [-184857480.866819] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CIND: 5,3,0,0,0,0,0,0,2,0,0,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:42:00 canect2 daemon.info ModemManager[301]: <debug> [-184857480.867781] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:42:00 canect2 daemon.info ModemManager[301]: <debug> [-184857480.868657] [mm-iface-modem.c:1206] update_signal_quality(): Modem /org/freedesktop/ModemManager1/Modem/0: signal quality updated (60)
Feb 22 10:42:04 canect2 daemon.info ModemManager[301]: <debug> [-184857476.600520] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CREG: 1,"XXXX","XXXXXXXX",6<CR><LF><CR><LF>+CIEV: 3,1<CR><LF>'
Feb 22 10:42:04 canect2 daemon.info ModemManager[301]: <debug> [-184857476.601811] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>+CREG: 1,"XXXX","XXXXXXXX",6<CR><LF><CR><LF>+CIEV: 3,1<CR><LF>'
Feb 22 10:42:16 canect2 daemon.info NetworkManager[308]: <info>  [-184857464.7534] device (ttyACM0): Activation: starting connection 'Aeris' (83187ceb-ad3a-4af8-92d8-7a255d9c5e3f)
Feb 22 10:42:16 canect2 daemon.info NetworkManager[308]: <info>  [-184857464.7573] audit: op="connection-activate" uuid="83187ceb-ad3a-4af8-92d8-7a255d9c5e3f" name="Aeris" pid=478 uid=0 result="success"
Feb 22 10:42:16 canect2 daemon.info NetworkManager[308]: <info>  [-184857464.7650] device (ttyACM0): state change: disconnected -> prepare (reason 'none') [30 40 0]
Feb 22 10:42:16 canect2 daemon.info NetworkManager[308]: <info>  [-184857464.7732] manager: NetworkManager state is now CONNECTING
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <info>  [-184857464.781480] [mm-iface-modem-simple.c:641] connect_auth_ready(): Simple connect started...
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.781954] [mm-iface-modem-simple.c:651] connect_auth_ready():    PIN: unspecified
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.782101] [mm-iface-modem-simple.c:653] connect_auth_ready():    Operator ID: unspecified
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.782195] [mm-iface-modem-simple.c:655] connect_auth_ready():    Allowed roaming: yes
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.782281] [mm-iface-modem-simple.c:657] connect_auth_ready():    APN: iot.aer.net
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.782379] [mm-iface-modem-simple.c:662] connect_auth_ready():    IP family: ipv4v6
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.782459] [mm-iface-modem-simple.c:673] connect_auth_ready():    Allowed authentication: unspecified
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.782538] [mm-iface-modem-simple.c:675] connect_auth_ready():    User: unspecified
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.782618] [mm-iface-modem-simple.c:677] connect_auth_ready():    Password: unspecified
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.782690] [mm-iface-modem-simple.c:679] connect_auth_ready():    Number: *99#
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <info>  [-184857464.782753] [mm-iface-modem-simple.c:469] connection_step(): Simple connect state (4/8): Wait to get fully enabled
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <info>  [-184857464.783032] [mm-iface-modem-simple.c:478] connection_step(): Simple connect state (5/8): Register
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.783255] [mm-iface-modem-3gpp.c:407] mm_iface_modem_3gpp_register_in_network(): Launching automatic network registration...
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.784679] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:42:16 canect2 daemon.info ModemManager[301]: <debug> [-184857464.785323] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+COPS=0<CR>'
Feb 22 10:42:30 canect2 daemon.info ModemManager[301]: <debug> [-184857450.846031] [mm-broadband-modem.c:1991] modem_load_signal_quality(): loading signal quality...
Feb 22 10:42:30 canect2 daemon.info ModemManager[301]: <debug> [-184857450.846306] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.777022] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>OK<CR><LF>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.777512] [mm-iface-modem-3gpp.c:761] mm_iface_modem_3gpp_run_registration_checks(): Running registration checks (CS: 'yes', PS: 'yes', EPS: 'yes')
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.777741] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 4 (open)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.777931] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 3 (close)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.778182] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CIND?<CR>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.789935] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CIND: 5,3,1,0,0,0,0,0,2,0,0,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.790904] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.791762] [mm-iface-modem.c:1206] update_signal_quality(): Modem /org/freedesktop/ModemManager1/Modem/0: signal quality updated (60)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.792327] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CREG?<CR>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.804457] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CREG: 2,1,"XXXX","XXXXXXXX",6<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.805523] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.806126] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.806621] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGREG?<CR>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.820115] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CGREG: 2,1,"XXXX","XXXXXXXX",6,"6C"<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.821243] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.821857] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.822359] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CEREG?<CR>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.835573] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CEREG: 2,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.836425] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.837100] [mm-iface-modem-3gpp.c:275] run_registration_checks_ready(): Modem is currently registered in a 3GPP network
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <info>  [-184857434.837720] [mm-iface-modem-simple.c:501] connection_step(): Simple connect state (6/8): Bearer
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.838137] [mm-iface-modem-simple.c:521] connection_step(): Creating new bearer...
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.838500] [mm-broadband-modem.c:297] modem_create_bearer(): Creating Broadband bearer in broadband modem
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.841021] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.841561] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 1 (close)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.842355] [mm-broadband-modem.c:258] modem_create_bearer_finish(): New bearer created at DBus path '/org/freedesktop/ModemManager1/Bearer/0'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <info>  [-184857434.846711] [mm-iface-modem-simple.c:583] connection_step(): Simple connect state (7/8): Connect
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.847248] [mm-base-bearer.c:703] mm_base_bearer_connect(): Connecting bearer '/org/freedesktop/ModemManager1/Bearer/0'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <info>  [-184857434.847951] [mm-iface-modem.c:1433] __iface_modem_update_state_internal(): Modem /org/freedesktop/ModemManager1/Modem/0: state changed (registered -> connecting)
Feb 22 10:42:46 canect2 daemon.info NetworkManager[308]: <info>  [-184857434.8545] (ttyACM0): modem state changed, 'registered' --> 'connecting' (reason: user-requested)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.856012] [mm-broadband-bearer.c:1263] connect(): Launching 3GPP connection attempt with APN 'iot.aer.net'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.856500] [mm-broadband-bearer.c:1052] connect_3gpp(): Looking for best CID...
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.856910] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 2 (open)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.857517] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'AT+CGDCONT?<CR>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.874738] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>+CGDCONT: 1,"IPV4V6","nxtgenphone","0.0.0.0 0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0",0,0,0,0,0,0<CR><LF><CR><LF>+CGDCONT: 2,"IPV4V6",
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.876091] [mm-broadband-bearer.c:969] parse_pdp_list(): Found '4' PDP contexts
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.876507] [mm-broadband-bearer.c:978] parse_pdp_list():   PDP context [cid=1] [type='ipv4v6'] [apn='nxtgenphone']
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.876810] [mm-broadband-bearer.c:978] parse_pdp_list():   PDP context [cid=2] [type='ipv4v6'] [apn='iot.aer.net']
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.877102] [mm-broadband-bearer.c:978] parse_pdp_list():   PDP context [cid=3] [type='ipv4v6'] [apn='iot.aer.net']
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.877360] [mm-broadband-bearer.c:978] parse_pdp_list():   PDP context [cid=4] [type='ipv4'] [apn='iot.aer.net']
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.877667] [mm-broadband-bearer.c:1002] parse_pdp_list(): Found PDP context with CID 2 and PDP type ipv4v6 for APN 'iot.aer.net'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.878037] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 3 (open)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.878347] [mm-broadband-bearer.c:214] common_get_at_data_port(): Connection through a plain serial AT port (ttyACM0)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.878722] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM0) device open count is 4 (open)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.879229] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 3 (close)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.879707] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): --> 'ATD*99***2#<CR>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.900584] [mm-port-serial-at.c:460] debug_log(): (ttyACM0): <-- '<CR><LF>CONNECT<CR><LF>'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.901395] [mm-port.c:95] mm_port_set_connected(): (ttyACM0): port now connected
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.902106] [mm-port-serial.c:1353] _close_internal(): (ttyACM0) device open count is 2 (close)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <debug> [-184857434.902789] [mm-base-bearer.c:601] connect_ready(): Connected bearer '/org/freedesktop/ModemManager1/Bearer/0'
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <info>  [-184857434.904417] [mm-iface-modem.c:1433] __iface_modem_update_state_internal(): Modem /org/freedesktop/ModemManager1/Modem/0: state changed (connecting -> connected)
Feb 22 10:42:46 canect2 daemon.info NetworkManager[308]: <info>  [-184857434.9114] (ttyACM0): modem state changed, 'connecting' --> 'connected' (reason: user-requested)
Feb 22 10:42:46 canect2 daemon.info ModemManager[301]: <info>  [-184857434.912604] [mm-iface-modem-simple.c:602] connection_step(): Simple connect state (8/8): All done
Feb 22 10:42:46 canect2 daemon.warn NetworkManager[308]: <warn>  [-184857434.9671] device (ttyACM0): ip-ifname: set ifname 'ttyACM0', unknown ifindex
Feb 22 10:42:46 canect2 daemon.info NetworkManager[308]: <info>  [-184857434.9713] device (ttyACM0): state change: prepare -> config (reason 'none') [40 50 0]
Feb 22 10:42:46 canect2 daemon.info NetworkManager[308]: <info>  [-184857434.9825] device (ttyACM0): state change: config -> ip-config (reason 'none') [50 70 0]
Feb 22 10:42:46 canect2 daemon.warn NetworkManager[308]: <warn>  [-184857434.9866] device (ttyACM0): interface ttyACM0 not up for IP configuration
Feb 22 10:42:46 canect2 daemon.info NetworkManager[308]: <info>  [-184857434.9871] (ttyACM0): using modem-specified IP timeout: 20 seconds
Feb 22 10:42:47 canect2 daemon.info NetworkManager[308]: <info>  [-184857433.0018] loaded PPP plugin /usr/lib/NetworkManager/libnm-ppp-plugin.so
Feb 22 10:42:47 canect2 daemon.info NetworkManager[308]: <info>  [-184857433.0090] ppp-manager: starting PPP connection
Feb 22 10:42:47 canect2 daemon.info NetworkManager[308]: <info>  [-184857433.0194] ppp-manager: pppd started with pid 491
Feb 22 10:42:47 canect2 daemon.info pppd[491]: Plugin /usr/lib/pppd/2.4.5/nm-pppd-plugin.so loaded.
Feb 22 10:42:47 canect2 daemon.notice pppd[491]: pppd 2.4.7 started by root, uid 0
Feb 22 10:42:47 canect2 daemon.info pppd[491]: Using interface ppp0
Feb 22 10:42:47 canect2 daemon.notice pppd[491]: Connect: ppp0 <--> /dev/ttyACM0
Feb 22 10:42:47 canect2 daemon.info NetworkManager[308]: <info>  [-184857433.1739] manager: (ppp0): new Generic device (/org/freedesktop/NetworkManager/Devices/9)
Feb 22 10:42:47 canect2 daemon.info ModemManager[301]: <debug> [-184857433.184588] [mm-base-manager.c:368] device_added(): (net/ppp0): could not get port's parent device
Feb 22 10:42:53 canect2 daemon.notice pppd[491]: local  IP address XXX.XXX.XXX.XXX
Feb 22 10:42:53 canect2 daemon.notice pppd[491]: remote IP address XXX.XXX.XXX.XXX
Feb 22 10:42:53 canect2 daemon.notice pppd[491]: primary   DNS address XXX.XXX.XXX.XXX
Feb 22 10:42:53 canect2 daemon.notice pppd[491]: secondary DNS address XXX.XXX.XXX.XXX
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.2224] ppp-manager: (IPv4 Config Get) reply received.
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.2762] device (ttyACM0): state change: ip-config -> ip-check (reason 'none') [70 80 0]
Feb 22 10:42:53 canect2 daemon.notice dbus[235]: [system] Activating service name='org.freedesktop.nm_dispatcher' (using servicehelper)
Feb 22 10:42:53 canect2 daemon.notice dbus[235]: [system] Successfully activated service 'org.freedesktop.nm_dispatcher'
Feb 22 10:42:53 canect2 daemon.info nm-dispatcher: req:1 'pre-up' [ppp0]: new request (1 scripts)
Feb 22 10:42:53 canect2 daemon.info nm-dispatcher: req:1 'pre-up' [ppp0]: start running ordered scripts...
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.4143] device (ttyACM0): state change: ip-check -> secondaries (reason 'none') [80 90 0]
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.4180] device (ttyACM0): state change: secondaries -> activated (reason 'none') [90 100 0]
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.4199] manager: NetworkManager state is now CONNECTED_LOCAL
Feb 22 10:42:53 canect2 daemon.warn NetworkManager[308]: <warn>  [-184857427.4210] settings-connection[0x20fcf68,83187ceb-ad3a-4af8-92d8-7a255d9c5e3f]: error saving timestamp to file '/var/lib/NetworkManager/timestamps': Failed to create file “/var/lib/NetworkManager/t
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.4457] manager: NetworkManager state is now CONNECTED_SITE
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.4499] policy: set 'Aeris' (ppp0) as default for IPv4 routing and DNS
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.4526] device (ttyACM0): Activation: successful, device activated.
Feb 22 10:42:53 canect2 daemon.info nm-dispatcher: req:2 'up' [ppp0]: new request (1 scripts)
Feb 22 10:42:53 canect2 daemon.info nm-dispatcher: req:2 'up' [ppp0]: start running ordered scripts...
Feb 22 10:42:53 canect2 daemon.info NetworkManager[308]: <info>  [-184857427.4989] manager: NetworkManager state is now CONNECTED_GLOBAL
Feb 22 10:42:53 canect2 daemon.info nm-dispatcher: req:3 'connectivity-change': new request (1 scripts)
Feb 22 10:42:53 canect2 daemon.info nm-dispatcher: req:3 'connectivity-change': start running ordered scripts...
Feb 22 10:42:57 canect2 daemon.info NetworkManager[308]: <info>  [-184857423.9205] audit: op="connection-add-activate" pid=558 uid=0 result="fail" reason="A 'wireless' setting is required if no AP path was given."
Feb 22 10:43:00 canect2 daemon.info ModemManager[301]: <debug> [-184857420.849357] [mm-broadband-modem.c:1991] modem_load_signal_quality(): loading signal quality...
Feb 22 10:43:00 canect2 daemon.info ModemManager[301]: <debug> [-184857420.849678] [mm-port-serial.c:1296] mm_port_serial_open(): (ttyACM1) device open count is 2 (open)
Feb 22 10:43:00 canect2 daemon.info ModemManager[301]: <debug> [-184857420.849977] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): --> 'AT+CIND?<CR>'
Feb 22 10:43:00 canect2 daemon.info ModemManager[301]: <debug> [-184857420.862434] [mm-port-serial-at.c:460] debug_log(): (ttyACM1): <-- '<CR><LF>+CIND: 5,3,1,0,0,0,0,0,2,0,0,0<CR><LF><CR><LF>OK<CR><LF>'
Feb 22 10:43:00 canect2 daemon.info ModemManager[301]: <debug> [-184857420.863409] [mm-port-serial.c:1353] _close_internal(): (ttyACM1) device open count is 1 (close)
Feb 22 10:43:00 canect2 daemon.info ModemManager[301]: <debug> [-184857420.864318] [mm-iface-modem.c:1206] update_signal_quality(): Modem /org/freedesktop/ModemManager1/Modem/0: signal quality updated (60)

Matt Starr