Arlo : l'API ne répond plus, le démon est indiqué démarré mais n'est pas opérationnel

guipom · Décembre 5, 2022, 10:10

Bonjour !

C’est à la fois autant pour partager mon expérience, voir si d’autres personnes observent la même chose, et voir si mips a des idées en réserve.
Ce soir en arrivant dans le garage je me rends compte que ma floodlight ne réagit pas. Première chose que je me dis c’est que la batterie est déchargée, ou que j’ai un problème de réseau … bref j’ai remis en cause plein de choses avant de voir côté Jeedom tellement c’est fiable.
Et le problème est dans Jeedom, dans le plugin Arlo, tous les statuts sont au vert mais en fait la communication ne semble plus « opérante » .

Un petit coup sur le démarrer de Arlo et hoplà, tout remarche.

Faut il avec le plugin Arlo selectionner un heartbeat de log, avec quel réglage et avec redémarrage démon, ou c’est anormal de faire ça ?

une fois le démon démarré c’est reparti !

Version : 4.3.11
Source : default
Branche : V4-stable
Système : Atlas

market / plugin : arlo stable 2022-11-12 01:18:22 2022-11-12 01:18:22 2022-11-12 21:51:49

cddu33 · Décembre 5, 2022, 10:15

slt , sans log ça va être compliqué d’avancer.

Post les log au moment où ça se produit

guipom · Décembre 5, 2022, 10:18

Il n’y a pas de log, c’est le principe de mes captures d’écran de le montrer. Le démon est comme mort, il n’écrit rien, il n’y a rien.
Pour la raison pour laquelle il n’y a rien, c’est de ma faute, il y a 4 jours j’ai vidé tous les logs avec des erreurs nuki en pagaille, les erreurs autour de la migration openzwave vers zwave, bref, ménage pour avoir des vraies alertes quand il se passe quelque chose.

cddu33 · Décembre 5, 2022, 10:19

met toi en debug et relance le demon ça devrait re créer les log

guipom · Décembre 5, 2022, 10:21

J’ai pourtant mis les captures d’écran une fois le démon relancé, on voit le fichier de log qui apparait, on voit le démon fonctionnel. Ce n’est pas un problème de recréer le fichier, c’est plutôt ce qui peut déclencher le fait d’arriver dans cet état.

Par contre évidemment c’est trop tard, tout est redevenu fonctionnel, puisque j’ai forcé le démarrage du démon à la main.

cddu33 · Décembre 5, 2022, 10:24

ta capture d’écran montre que tu n’es pas en mode debug… donc le plugin n’envoie pas tous dans le log…
Mais si tu ne veux pas la passer en debug pour les prochains problème …

guipom · Décembre 5, 2022, 10:26

C’est trop verbeux debug sur une installation en production, c’est ma vidéosurveillance, ce n’est pas un jouet
Et on est bien d’accord que ca bloque une fois tous les 2/3 mois, ca ne va pas arriver demain, et je ne sais meme pas ce qui fait que ca bloque, d’ailleurs !

Mips · Décembre 6, 2022, 2:50

Salut,
Je pense que ça m’est déjà arrivé mais effectivement on ne sait pas le reproduire et c’est « trop » rare pour « espérer » tomber sur le problème avec des logs utiles.

Je vais voir si je peux mieux détecter ce genre d’anomalies dans le démon.

En tout cas, non il ne faut pas configurer un heartbeat via le core (zone logs et surveillance), ça pose trop de problème, uniquement la case dans la config plugin ce qui est déjà le cas chez toi donc c’est bon de ce côté.

guipom · Décembre 6, 2022, 6:49

Ok, je ne touche à rien de mon côté. J’espère que la prochaine fois j’aurais accès à quelques infos pour essayer d’en savoir plus, ou que je ne serai pas dans l’urgence de rétablir la situation!

stepharma · Juillet 1, 2023, 9:05

Bonjour

Je pense que j’ai un souci similaire
Démon noté OK et Rien de fonctionnel depuis le 21 juin
Je ne reçois meme plus les mails (je n’ai rien changé dans le plugin ni dans le mail, qui est dédié à ca!!)
Voici les Logs depuis la relance des dépendances et du daemon…

Je suis à jour sur Jeedom et le plugin

0000|[2023-07-01 22:45:41]DEBUG : Update active modes...
0001|[2023-07-01 22:45:41]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0002|[2023-07-01 22:45:41]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0003|[2023-07-01 22:45:41]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0004|[2023-07-01 22:45:44]DEBUG : calling ResourceEventHandlerForbasestation
0005|[2023-07-01 22:45:44]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_basestation: connected:1 |
0006|[2023-07-01 22:45:44]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_siren: connected:1 |
0007|[2023-07-01 22:49:55]INFO : Lancement démon
0008|[2023-07-01 22:49:56]DEBUG : test from daemon
0009|[2023-07-01 22:49:57]DEBUG : Create EqLogics...
0010|[2023-07-01 22:49:57]INFO : Checking commands of 'Arlo Steph_Gwen' - deviceType/modelId:'siren/VMB4000-siren'
0011|[2023-07-01 22:49:57]DEBUG : check special model for VMB4000-siren
0012|[2023-07-01 22:49:57]DEBUG : next device...
0013|[2023-07-01 22:49:57]INFO : Checking commands of 'Garage' - deviceType/modelId:'camera/VMC4030P'
0014|[2023-07-01 22:49:57]DEBUG : check special model for VMC4030P
0015|[2023-07-01 22:49:57]DEBUG : isCamera...
0016|[2023-07-01 22:49:57]DEBUG : setLastImage
0017|[2023-07-01 22:49:57]DEBUG : new local image:plugins/arlo/data/records/52M18374A5333/20230623100035839419.jpg
0018|[2023-07-01 22:49:57]DEBUG : lastLocal:/var/www/html/plugins/arlo/data/records/52M18374A5333.jpg from: /var/www/html/plugins/arlo/data/records/52M18374A5333/20230623100035839419.jpg
0019|[2023-07-01 22:49:57]DEBUG : next device...
0020|[2023-07-01 22:49:57]INFO : Checking commands of 'Terrasse' - deviceType/modelId:'camera/VMC4030P'
0021|[2023-07-01 22:49:57]DEBUG : check special model for VMC4030P
0022|[2023-07-01 22:49:57]DEBUG : isCamera...
0023|[2023-07-01 22:49:57]DEBUG : setLastImage
0024|[2023-07-01 22:49:57]DEBUG : new local image:plugins/arlo/data/records/52M1847GB19CF/20230605214129425065.jpg
0025|[2023-07-01 22:49:57]DEBUG : lastLocal:/var/www/html/plugins/arlo/data/records/52M1847GB19CF.jpg from: /var/www/html/plugins/arlo/data/records/52M1847GB19CF/20230605214129425065.jpg
0026|[2023-07-01 22:49:57]DEBUG : next device...
0027|[2023-07-01 22:49:57]INFO : Checking commands of 'Salle à manger' - deviceType/modelId:'camera/VMC4030P'
0028|[2023-07-01 22:49:57]DEBUG : check special model for VMC4030P
0029|[2023-07-01 22:49:57]DEBUG : isCamera...
0030|[2023-07-01 22:49:57]DEBUG : setLastImage
0031|[2023-07-01 22:49:57]DEBUG : new local image:plugins/arlo/data/records/52M1847RAFBA2/20230701201749895673.jpg
0032|[2023-07-01 22:49:57]DEBUG : lastLocal:/var/www/html/plugins/arlo/data/records/52M1847RAFBA2.jpg from: /var/www/html/plugins/arlo/data/records/52M1847RAFBA2/20230701201749895673.jpg
0033|[2023-07-01 22:49:57]DEBUG : next device...
0034|[2023-07-01 22:49:57]INFO : Skipping creation of device with id 'JX48-176-37951004_5KY186ST67AA2' and name 'Arlo Q salon' because not provisioned in arlo app
0035|[2023-07-01 22:49:57]INFO : Checking commands of 'Sonnette' - deviceType/modelId:'doorbell/AVD1001B'
0036|[2023-07-01 22:49:57]DEBUG : check special model for AVD1001B
0037|[2023-07-01 22:49:57]DEBUG : isCamera...
0038|[2023-07-01 22:49:57]DEBUG : setLastImage
0039|[2023-07-01 22:49:57]DEBUG : new local image:plugins/arlo/data/records/A54104K9A0970/20230623110454367476.jpg
0040|[2023-07-01 22:49:57]DEBUG : lastLocal:/var/www/html/plugins/arlo/data/records/A54104K9A0970.jpg from: /var/www/html/plugins/arlo/data/records/A54104K9A0970/20230623110454367476.jpg
0041|[2023-07-01 22:49:57]DEBUG : next device...
0042|[2023-07-01 22:49:57]INFO : Checking commands of 'Base Station S&G' - deviceType/modelId:'basestation/VMB4000'
0043|[2023-07-01 22:49:57]DEBUG : check special model for VMB4000
0044|[2023-07-01 22:49:57]DEBUG : next device...
0045|[2023-07-01 22:49:57]DEBUG : Create modes...
0046|[2023-07-01 22:49:58]DEBUG : Update active modes...
0047|[2023-07-01 22:49:58]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0048|[2023-07-01 22:49:58]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0049|[2023-07-01 22:49:58]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0050|[2023-07-01 22:49:58]DEBUG : Update active modes...
0051|[2023-07-01 22:49:58]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0052|[2023-07-01 22:49:58]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0053|[2023-07-01 22:49:58]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0054|[2023-07-01 22:50:01]DEBUG : calling ResourceEventHandlerForsiren
0055|[2023-07-01 22:50:01]DEBUG : ResourceEventHandlerForSiren 4R05847BA5F0D : off
0056|[2023-07-01 22:51:31]DEBUG : Update active modes...
0057|[2023-07-01 22:51:31]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0058|[2023-07-01 22:51:31]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0059|[2023-07-01 22:51:31]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0060|[2023-07-01 22:51:33]DEBUG : calling ResourceEventHandlerForbasestation
0061|[2023-07-01 22:51:33]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_basestation: connected:1 |
0062|[2023-07-01 22:51:33]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_siren: connected:1 |
0063|[2023-07-01 22:53:03]DEBUG : Update active modes...
0064|[2023-07-01 22:53:03]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0065|[2023-07-01 22:53:03]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0066|[2023-07-01 22:53:03]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0067|[2023-07-01 22:53:06]DEBUG : calling ResourceEventHandlerForbasestation
0068|[2023-07-01 22:53:06]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_basestation: connected:1 |
0069|[2023-07-01 22:53:06]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_siren: connected:1 |
0070|[2023-07-01 22:54:36]DEBUG : Update active modes...
0071|[2023-07-01 22:54:36]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0072|[2023-07-01 22:54:36]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0073|[2023-07-01 22:54:36]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0074|[2023-07-01 22:54:38]DEBUG : calling ResourceEventHandlerForbasestation
0075|[2023-07-01 22:54:38]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_basestation: connected:1 |
0076|[2023-07-01 22:54:38]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_siren: connected:1 |
0077|[2023-07-01 22:56:08]DEBUG : Update active modes...
0078|[2023-07-01 22:56:08]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0079|[2023-07-01 22:56:08]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0080|[2023-07-01 22:56:08]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0081|[2023-07-01 22:56:10]DEBUG : calling ResourceEventHandlerForbasestation
0082|[2023-07-01 22:56:11]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_basestation: connected:1 |
0083|[2023-07-01 22:56:11]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_siren: connected:1 |
0084|[2023-07-01 22:57:40]DEBUG : Update active modes...
0085|[2023-07-01 22:57:40]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0086|[2023-07-01 22:57:40]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0087|[2023-07-01 22:57:40]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0088|[2023-07-01 22:57:43]DEBUG : calling ResourceEventHandlerForbasestation
0089|[2023-07-01 22:57:43]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_basestation: connected:1 |
0090|[2023-07-01 22:57:43]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_siren: connected:1 |
0091|[2023-07-01 22:59:13]DEBUG : Update active modes...
0092|[2023-07-01 22:59:13]INFO : Active mode for 5KY186ST67AA2 => mode0 / Désactivé
0093|[2023-07-01 22:59:13]INFO : Active mode for 4R05847BA5F0D => mode0 / Désactivé
0094|[2023-07-01 22:59:13]INFO : Active mode for 4R05847BA5F0D => mode0 / mode0
0095|[2023-07-01 22:59:15]DEBUG : calling ResourceEventHandlerForbasestation
0096|[2023-07-01 22:59:15]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_basestation: connected:1 |
0097|[2023-07-01 22:59:15]DEBUG : update connectivity properties of:4R05847BA5F0D/Arlo Steph_Gwen_siren: connected:1 |

Si kk1 a une idée

stepharma · Juillet 1, 2023, 9:09

Je voulais envoyé le log du démon, mais trop de caractère
Voici l’extrait de ce qui se répète maintenant …

0253|[2023-07-01 21:03:52]DEBUG : EventHandler : Send to jeedom :  {'event': {'resource': 'basestation', 'properties': {'interfaceVersion': 21, 'apiVersion': 1, 'state': 'idle', 'swVersion': '1.21.0.2_4294_8a519c8', 'hwVersion': 'VMB4000r3', 'modelId': 'VMB4000', 'mcsEnabled': True, 'autoUpdateEnabled': True, 'updateAvailable': None, 'timeZone': 'CET-1CEST,M3.5.0,M10.5.0/3', 'olsonTimeZone': 'Europe/Brussels', 'uploadBandwidthSaturated': False, 'antiFlicker': {'mode': 0, 'autoDefault': 1}, 'lowBatteryAlert': {'enabled': True}, 'lowSignalAlert': {'enabled': False}, 'claimed': True, 'timeSyncState': 'synchronized', 'connectivity': [{'type': 'ethernet', 'connected': True}], 'groups': [{'id': 'A54104K9A0970', 'type': 'doorbell', 'doorbell': 'A54104K9A0970', 'chimes': ['traditionalChime'], 'camera': 'A54104K9A0970'}], 'localCert': {'ownCert': '95a055e9bf8267906051e59454a91cc9', 'peerCerts': ['87746474a2124435a87d2fd648554310']}, 'enableHLS': False}, 'action': 'is', 'transId': 'web!f104f063.fdd2!1688245432393', 'to': 'UCEA-176-54365758_web', 'from': '4R05847BA5F0D'}}
0254|[2023-07-01 21:03:52]DEBUG : EventHandler : Starting new HTTP connection (1): 127.0.0.1:80
0255|[2023-07-01 21:03:52]DEBUG : EventHandler : http://127.0.0.1:80 "POST /plugins/arlo/core/php/jeeArlo.php?apikey=i49ywJU3XS79dZr14cr5d9p0QjPqAavqpKmPEnghDessKwedpsIuQek2Ri85YZI4 HTTP/1.1" 200 2
0256|[2023-07-01 21:04:09]DEBUG : KeepAliveThread : https://myapi.arlo.com:443 "OPTIONS /hmsweb/users/devices/notify/4R05847BA5F0D?eventId=FE%2103d633e8-ff5d-4124-bd14-e68f0922b8b3&time=1688245449182 HTTP/1.1" 204 0
0257|[2023-07-01 21:04:09]DEBUG : KeepAliveThread : https://myapi.arlo.com:443 "POST /hmsweb/users/devices/notify/4R05847BA5F0D?eventId=FE%2103d633e8-ff5d-4124-bd14-e68f0922b8b3&time=1688245449182 HTTP/1.1" 200 None
0258|[2023-07-01 21:04:39]DEBUG : KeepAliveThread : https://myapi.arlo.com:443 "OPTIONS /hmsweb/users/devices/notify/4R05847BA5F0D?eventId=FE%211f08d890-4bab-4a25-84f7-f53187a9a92a&time=1688245479450 HTTP/1.1" 204 0
0259|[2023-07-01 21:04:39]DEBUG : KeepAliveThread : https://myapi.arlo.com:443 "POST /hmsweb/users/devices/notify/4R05847BA5F0D?eventId=FE%211f08d890-4bab-4a25-84f7-f53187a9a92a&time=1688245479450 HTTP/1.1" 200 None
0260|[2023-07-01 21:05:09]DEBUG : KeepAliveThread : https://myapi.arlo.com:443 "OPTIONS /hmsweb/users/devices/notify/4R05847BA5F0D?eventId=FE%2168c434bc-9872-4dd2-82a7-8b846249096e&time=1688245509719 HTTP/1.1" 204 0
0261|[2023-07-01 21:05:09]DEBUG : KeepAliveThread : https://myapi.arlo.com:443 "POST /hmsweb/users/devices/notify/4R05847BA5F0D?eventId=FE%2168c434bc-9872-4dd2-82a7-8b846249096e&time=1688245509719 HTTP/1.1" 200 None
0262|[2023-07-01 21:05:22]INFO : ConnectionThread : Checking connection status...
0263|[2023-07-01 21:05:22]DEBUG : ConnectionThread : https://myapi.arlo.com:443 "OPTIONS /hmsweb/users/devices/automation/active?eventId=FE%2113493514-0a4b-4115-8874-9516e975cbd5&time=1688245522558 HTTP/1.1" 204 0
0264|[2023-07-01 21:05:22]DEBUG : ConnectionThread : https://myapi.arlo.com:443 "GET /hmsweb/users/devices/automation/active?eventId=FE%2113493514-0a4b-4115-8874-9516e975cbd5&time=1688245522558 HTTP/1.1" 200 None
0265|[2023-07-01 21:05:22]DEBUG : ConnectionThread : Send to jeedom :  {'activemode': [{'type': 'activeAutomations', 'schemaVersion': 1, 'activeModes': ['mode0'], 'activeSchedules': [], 'timestamp': 1669758008378, 'uniqueId': 'JX48-176-37951004_5KY186ST67AA2', 'gatewayId': '5KY186ST67AA2'}, {'type': 'activeAutomations', 'schemaVersion': 1, 'activeModes': ['mode0'], 'activeSchedules': [], 'timestamp': 1685945392543, 'uniqueId': 'JX48-176-37951004_4R05847BA5F0D', 'gatewayId': '4R05847BA5F0D'}]}
0266|[2023-07-01 21:05:22]DEBUG : ConnectionThread : Starting new HTTP connection (1): 127.0.0.1:80
0267|[2023-07-01 21:05:22]DEBUG : ConnectionThread : http://127.0.0.1:80 "POST /plugins/arlo/core/php/jeeArlo.php?apikey=i49ywJU3XS79dZr14cr5d9p0QjPqAavqpKmPEnghDessKwedpsIuQek2Ri85YZI4 HTTP/1.1" 200 2
0268|[2023-07-01 21:05:24]DEBUG : ConnectionThread : https://myapi.arlo.com:443 "OPTIONS /hmsweb/users/devices/notify/4R05847BA5F0D?eventId=FE%21c397ee0f-3ab2-4553-8824-01fdd0a247aa&time=1688245524753 HTTP/1.1" 204 0
0269|[2023-07-01 21:05:24]DEBUG : ConnectionThread : https://myapi.arlo.com:443 "POST /hmsweb/users/devices/notify/4R05847BA5F0D?eventId=FE%21c397ee0f-3ab2-4553-8824-01fdd0a247aa&time=1688245524753 HTTP/1.1" 200 None

Mips · Juillet 1, 2023, 9:22

Je ne comprends pas pourquoi vous postez dans ce sujet car je ne vois pas du tout le lien.

Je ne comprends pas le problème que vous pensez avoir non plus: vous dites que rien ne fonctionne mais le log dit le contraire… il est très clair que la connexion avec arlo est établie et fonctionne et que des infos remontent…

Ps: passez en mode INFO pour le niveau de log, pas besoin du DEBUG ici qui est trop verbeux pour le laisser en permanence, cela ne sert que pour debug.
Vous n’avez même pas fournis le démarrage du démon.

Mips · Juillet 1, 2023, 9:24

Et concernant le sujet d’origine, moi je n’ai plus jamais rencontré ce cas (j’avais même oublié ce post) et vu qu’il n’y a plus de retour de @guipom je suppose que lui non plus, confirmes-tu?

Si oui, on va pouvoir ferme le sujet (et le rouvrir si jamais cela se reproduit)

guipom · Juillet 1, 2023, 9:45

Je crois que j’avais régulièrement des soucis avec cloudscrapper pas à jour et ça me bloquait à un moment, mais je n’ai plus eu ce soucis depuis le début de l’année !

system · Juillet 14, 2023, 8:05

Ce sujet a été automatiquement fermé après 24 heures suivant le dernier commentaire. Aucune réponse n’est permise dorénavant.