UPDATE 31.10.: Amazon Alexa - ioBroker Skill läuft aus ?

[Grizzelbee]

@jupzup
Hi Jupzup!

Danke für diesen Fehlerhinweis. :)
Ich musste selber erst einmal den HTTP-Code 504 googlen und habe gelernt das das ein "Gateway timeout" ist. Will sagen: Der Request den der Adapter losschickt wird nicht in der erwarteten Zeit vom Miele-Server beantwortet. Will sagen: Da klemmt irgend etwas zwischen deinem ioBroker und dem Miele Server.
Ich fürchte, außer dem Tipp den Fehler und seine Lösungsansätze mal zu googlen, kann ich leider nicht viel für dich tun.
Ich habe das allerdings zum Anlass genommen, das im Log (in der Version 1.2.2) mal herauszuarbeiten. ;)

viele Grüße
Grizzelbee

[simpixo]

Habe heute auch ein paar Fehlermeldungen im Log gehabt

mielecloudservice.0	2020-05-21 16:31:39.831	error	at processTicksAndRejections (internal/process/task_queues.js:97:5)
mielecloudservice.0	2020-05-21 16:31:39.831	error	at runMicrotasks (<anonymous>)
mielecloudservice.0	2020-05-21 16:31:39.831	error	at refreshMieledata (/opt/iobroker/node_modules/iobroker.mielecloudservice/main.js:700:5)
mielecloudservice.0	2020-05-21 16:31:39.831	error	at splitMieleDevices (/opt/iobroker/node_modules/iobroker.mielecloudservice/main.js:295:9)
mielecloudservice.0	2020-05-21 16:31:39.831	error	at parseMieleDevice (/opt/iobroker/node_modules/iobroker.mielecloudservice/main.js:309:56)
mielecloudservice.0	2020-05-21 16:31:39.831	error	(20621) TypeError: Cannot read property 'type' of undefined
mielecloudservice.0	2020-05-21 16:31:39.830	error	(20621) unhandled promise rejection: Cannot read property 'type' of undefined
Unhandled	2020-05-21 16:31:39.830	error	promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch().
mielecloudservice.0	2020-05-21 16:31:39.830	error	(20621) undefined
mielecloudservice.0	2020-05-21 16:31:39.830	error	(20621) Error: Request failed with status code 504
mielecloudservice.0	2020-05-21 16:31:39.829	error	(20621) APISendRequest returned an error!

Woran kann den das liegen?

Gruß
Adrian

[Steffl]

Ich hatte das gleiche Problem seit letzter Nacht, inzwischen ist es aber gelöst.
Allerdings kann ich nicht genau sagen, was jetzt geholfen hat. Könnte auch sein, dass die mielecloud ein Problem hatte und das jetzt einfach gefixt wurde.
Aber ich habe noch folgendes gemacht. In der Miele-App am Handy geschaut, ob die funktioniert (tat sie). Da wurde mir gleich ein Modul-Update für mein Gerät (Waschmaschine) angeboten. Also dieses Update eingespielt.
Dann konnte ich mich erinnern, dass von Miele letztes Jahr im Juli eine Mail kam, dass sie an die API 1.0 jetzt demnächst mal live nehmen und sich da was ändert und man dann dort die credentials nochmal ändern muss. Also bin ich auf die Seite https://www.miele.com/developer/ gegangen und hab mich dort mal umgeschaut, ob man da was mit den credentials machen kann. Hab mich dann auf der API Documentation Seite mal Authorisiert (mit den vorhandenen Credentials) und mal testweise mein Gerät abgefragt (was funktionierte). Dann wieder im iobroker den Adapter gestartet und seitdem ist alles grün und keine Fehler mehr im Log.

[M-A-X]

Hey,
erstmal danke für den Adapter. Er funktioniert eigentlich sehr gut.
Gerade habe ich aber gemerkt, dass er gelb ist. Das einzige, was ich im Log finden konnte, das damit zu tun haben KÖNNTE:

 Access-Token expires at: [Tue Jun 30 2020 11:33:00 GMT+0200 (GMT+02:00)]

Habe ich da bei der Installation was verpasst zu machen? Ist der Token jetzt "für immer" abgelaufen und ich muss einen komplett neuen Zugang (ID, Secret, Name) erstellen?
Danke im Voraus
Max

[Grizzelbee]

@M-A-X
Ich kann dich beruhigen!
Starte den Adapter einfach neu. Dann sollte er wieder laufen. Deinen Credentials ist nichts passiert. Das token, das in der Meldung gemeint ist, ist das oauth2-Access-Token. Das läuft regelmäßig ab. Das soll so sein.

Ich wäre aber dennoch an einer weiteren Analyse interessiert.
Kannst du Mal versuchen alles was den Adapter betrifft und nach Fehler aussieht hier zu posten? Dann kann ich Mal drauf gucken.

Viele Grüße
Grizzelbee

[M-A-X]

@Grizzelbee
Hallo.
Ich war gestern noch spät unterwegs und komme erst jetzt dazu. Ich habe seit gestern "regelmäßig" folgende Zeilen im Log, was den Adapter betrifft (insgesamt 7 mal diese Zeilen zwischen ca. 22 Uhr und 23:20 Uhr., davor keine Errors im Log, da ich - dummerweise - das Log kurz nach meinem Post gelöscht habe :( )

2020-05-31 23:20:02.517 - error: mielecloudservice.0 (10520) Error: Request failed with status code 503
2020-05-31 23:20:02.519 - error: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch().
2020-05-31 23:20:02.519 - error: mielecloudservice.0 (10520) unhandled promise rejection: response is not defined
2020-05-31 23:20:02.522 - error: mielecloudservice.0 (10520) ReferenceError: response is not defined
at APISendRequest (/opt/iobroker/node_modules/iobroker.mielecloudservice/main.js:877:34)
at runMicrotasks ()
at processTicksAndRejections (internal/process/task_queues.js:97:5)
2020-05-31 23:20:02.523 - info: mielecloudservice.0 (10520) Clearing Timeout: pollTimeout
2020-05-31 23:20:02.526 - info: mielecloudservice.0 (10520) Unloading MieleCloudService...
2020-05-31 23:20:02.536 - info: mielecloudservice.0 (10520) terminating
2020-05-31 23:20:02.538 - info: mielecloudservice.0 (10520) Terminated (NO_ERROR): Without reason
2020-05-31 23:20:03.069 - info: host.iobroker instance system.adapter.mielecloudservice.0 terminated with code 0 (NO_ERROR)
2020-05-31 23:20:03.074 - info: host.iobroker Restart adapter system.adapter.mielecloudservice.0 because enabled
2020-05-31 23:20:33.106 - info: host.iobroker instance system.adapter.mielecloudservice.0 st
arted with pid 10699
2020-05-31 23:20:34.950 - info: mielecloudservice.0 (10699) starting. Version 1.2.2 in /opt/iobroker/node_modules/iobroker.mielecloudservice, node: v12.17.0, js-controller: 3.1.4
2020-05-31 23:20:35.305 - info: mielecloudservice.0 (10699) Access-Token expires at: [Tue Jun 30 2020 23:20:00 GMT+0200 (GMT+02:00)]
2020-05-31 23:20:35.308 - info: mielecloudservice.0 (10699) Starting Polltimer with a 3 Minutes interval.

Zur Zeit ist der Adapter aber grün.

[Grizzelbee]

Moin Zusammen,

ich musste heute feststellen, dass sich nicht nur die Fehlerberichte hier plötzlich häufen, sondern Miele die API auch auf die Version 1.0.2 angehoben hat. Leider ohne zu dokumentieren was sie denn wohl im Einzelnen geändert haben - zumindest finde ich nichts.
Naja. Sei es drum.

Ich werde ein bisschen Zeit brauchen mir das anzugucken und den Adapter wieder auf stabile Füße zu stellen.
Bleibt dem Adapter bitte so lange gewogen. Ich melde mich mit Neuigkeiten, wenn ich welche habe.

viele Grüße
Grizzelbee

[Grizzelbee]

@Grizzelbee
Tach Leute,

ich habe gerade mal die Version 1.2.3 online gestellt (Github und latest Repo). Im Wesentlichen habe ich das Fehlerhandling etwas robuster gestaltet.
Ich freue mich, wenn ihr das mal testet und mir weitere Infos zu den Fehlern, die ihr habt meldet.

Die Änderungen an der Miele-API 1.0.2 habe ich mir jetzt aber och nicht im Detail angesehen. das kommt noch.

viele Grüße
Grizzelbee

[M-A-X]

Kann sie derzeit über latest noch nicht installieren. Dauert das immer ein bischen?
Danke für deine schnelle Reaktion.
Ich habe übrigens seit du geschrieben hast keine ERROR mehr bekommen :) Obwohl sich nichts geändert hat.

[Grizzelbee]

@M-A-X sagte in MieleCloudService Adapter:

Kann sie derzeit über latest noch nicht installieren. Dauert das immer ein bischen?

Ja. Das dauert gerne mal bis zu 12 Stunden.

Ich habe übrigens seit du geschrieben hast keine ERROR mehr bekommen 🙂 Obwohl sich nichts geändert hat.

Möglicherweise hat sich geändert, dass Miele die API wieder in Ruhe lässt. ;)
Keine Ahung. Wir werden sehen.
Wie gesagt: Fehler bitte gerne reporten!

viele Grüße
Grizzelbee

[surfer09]

Hallo zusammen,

ich habe mir auch gerade den Miele-Adapter installiert und wollte mal sehen, was so an Daten reinkommt. Leider gar nichts :-( Der Adapter ist zwar grün aber unter den Objekten ist kein Datenpunkt angelegt. Habe ich etwas vergessen?

Gruß surfer ;-)

[M-A-X]

@surfer09
Hmm. Seltsam. Aber in der miele app siehst du deine Geräte?
Und die Geräte sind auch an :)?

[surfer09]

@M-A-X Ja, die Waschmaschine wird in der App angezeigt und eingeschaltet ist sie auch. Ich hatte sie eben auch extra kurz schleudern lassen, weil ich dachte, dass dann erst Daten weggeschrieben werden. Aber leider Fehlanzeige.
Auch ein Neustart vom IO-Broker hat nichts gebracht.

[M-A-X]

@surfer09
Poste mal bitte das log, wenn du den Adapter neu startest.
Habe den Adapter gerade entfernt und neu installiert und meine Waschmaschine wird automatisch angelegt und zeigt auch Daten an.
Du hast ja den 'mielecloudservice' Adapter genommen und nicht den 'miele' Adapter?!
Der 'Miele' Adapter funktioniert nur mit dem Miele Gateway.

[surfer09]

@M-A-X Ja genau. Ich habe den MieleCloud Adapter genommen, weil ich kein Gateway habe.
Hier das LOG vom stoppen / starten des Adapters:

2020-06-08 21:06:58.474 - info: host.IO-Broker-Server "system.adapter.mielecloudservice.0" disabled
2020-06-08 21:06:58.490 - info: mielecloudservice.0 (11912) Got terminate signal TERMINATE_YOURSELF
2020-06-08 21:06:58.492 - info: mielecloudservice.0 (11912) Clearing Timeout: pollTimeout
2020-06-08 21:06:58.493 - info: mielecloudservice.0 (11912) Unloading MieleCloudService...
2020-06-08 21:06:58.493 - info: mielecloudservice.0 (11912) terminating
2020-06-08 21:06:58.493 - info: mielecloudservice.0 (11912) Terminated (ADAPTER_REQUESTED_TERMINATION): Without reason
2020-06-08 21:06:58.477 - info: host.IO-Broker-Server stopInstance system.adapter.mielecloudservice.0 (force=false, process=true)
2020-06-08 21:06:58.478 - info: host.IO-Broker-Server stopInstance system.adapter.mielecloudservice.0 send kill signal
2020-06-08 21:06:59.018 - info: host.IO-Broker-Server instance system.adapter.mielecloudservice.0 terminated with code 11 (ADAPTER_REQUESTED_TERMINATION)
2020-06-08 21:06:59.890 - info: host.IO-Broker-Server "system.adapter.mielecloudservice.0" enabled
2020-06-08 21:06:59.897 - info: host.IO-Broker-Server instance system.adapter.mielecloudservice.0 started with pid 11676
2020-06-08 21:07:00.474 - info: mielecloudservice.0 (11676) starting. Version 1.2.3 in I:/iobroker/node_modules/iobroker.mielecloudservice, node: v12.16.1, js-controller: 3.1.5
2020-06-08 21:07:00.852 - info: mielecloudservice.0 (11676) Access-Token expires at: [Wed Jul 08 2020 21:07:00 GMT+0200 (GMT+02:00)]
2020-06-08 21:07:00.853 - info: mielecloudservice.0 (11676) Starting Polltimer with a 2 Minutes 

[Grizzelbee]

@surfer09
Hmm. Komisch. Der Adapter bekommt eine Verbindung zur API und terminiert sich dann angeblich selbst.
Wenn ich das richtig im Kopf habe habe ich nur zwei Gründe implementiert das der Adapter sich selbst terminiert:

1. : Die Config ist nicht vollständig (scheidet aus)
2. : der Adapter konnte initial kein Access Token bekommen (scheidet ebenfalls aus)

Wechsle bitte die Adapter Instanz in den Debug Modus und poste bitte, was da beim Start passiert.
Irgendwas ist da echt komisch.

Und erschrick nicht: im Debug wird der Adapter zum plappermäulchen. ;)

Viele Grüße
Grizzelbee

[surfer09]

@Grizzelbee Komisch, dass bei mir immer alles komplizierter ist :grinning:

Ich hoffe, ich habe das so richtig eingestellt mit dem LOG:

2020-06-08 21:33:10.811 - debug: mielecloudservice.0 (2160) Redis Objects: Use Redis connection: 127.0.0.1:9001
2020-06-08 21:33:10.826 - debug: mielecloudservice.0 (2160) Objects client ready ... initialize now
2020-06-08 21:33:10.827 - debug: mielecloudservice.0 (2160) Objects create System PubSub Client
2020-06-08 21:33:10.828 - debug: mielecloudservice.0 (2160) Objects create User PubSub Client
2020-06-08 21:33:10.828 - debug: mielecloudservice.0 (2160) Objects client initialize lua scripts
2020-06-08 21:33:10.835 - debug: mielecloudservice.0 (2160) Objects connected to redis: 127.0.0.1:9001
2020-06-08 21:33:10.837 - debug: mielecloudservice.0 (2160) objectDB connected
2020-06-08 21:33:10.838 - debug: mielecloudservice.0 (2160) Redis States: Use Redis connection: 127.0.0.1:9000
2020-06-08 21:33:10.841 - debug: mielecloudservice.0 (2160) States create User PubSub Client
2020-06-08 21:33:10.842 - debug: mielecloudservice.0 (2160) States create System PubSub Client
2020-06-08 21:33:10.845 - debug: mielecloudservice.0 (2160) States connected to redis: 127.0.0.1:9000
2020-06-08 21:33:10.845 - debug: mielecloudservice.0 (2160) statesDB connected
2020-06-08 21:33:10.911 - info: mielecloudservice.0 (2160) starting. Version 1.2.3 in I:/iobroker/node_modules/iobroker.mielecloudservice, node: v12.16.1, js-controller: 3.1.5
2020-06-08 21:33:10.922 - debug: mielecloudservice.0 (2160) function APIGetAccessToken
2020-06-08 21:33:10.923 - debug: mielecloudservice.0 (2160) Awaiting OAuth2 Token.
2020-06-08 21:33:10.923 - debug: mielecloudservice.0 (2160) OAuth2 grant_type: [password]
2020-06-08 21:33:10.923 - debug: mielecloudservice.0 (2160) options OAuth2-VG: [de-DE]
2020-06-08 21:33:10.923 - debug: mielecloudservice.0 (2160) config API Language: [de]
2020-06-08 21:33:11.276 - info: mielecloudservice.0 (2160) Access-Token expires at: [Wed Jul 08 2020 21:33:00 GMT+0200 (GMT+02:00)]
2020-06-08 21:33:11.277 - info: mielecloudservice.0 (2160) Starting Polltimer with a 2 Minutes interval.
2020-06-08 21:33:11.388 - debug: mielecloudservice.0 (2160) Updating device states (polling API scheduled).
2020-06-08 21:33:11.389 - debug: mielecloudservice.0 (2160) refreshMieledata: get data from API
2020-06-08 21:33:11.389 - debug: mielecloudservice.0 (2160) APISendRequest: Awaiting requested data.
2020-06-08 21:33:11.390 - debug: mielecloudservice.0 (2160) refreshMieledata: handover data to splitMieledevices
2020-06-08 21:33:11.558 - debug: mielecloudservice.0 (2160) API returned Status: [200]
2020-06-08 21:33:13.142 - info: host.IO-Broker-Server "system.adapter.mielecloudservice.0" disabled
2020-06-08 21:33:13.143 - info: mielecloudservice.0 (2160) Got terminate signal TERMINATE_YOURSELF
2020-06-08 21:33:13.143 - info: mielecloudservice.0 (2160) Clearing Timeout: pollTimeout
2020-06-08 21:33:13.145 - info: mielecloudservice.0 (2160) Unloading MieleCloudService...
2020-06-08 21:33:13.145 - info: mielecloudservice.0 (2160) terminating
2020-06-08 21:33:13.145 - info: mielecloudservice.0 (2160) Terminated (ADAPTER_REQUESTED_TERMINATION): Without reason
2020-06-08 21:33:13.143 - info: host.IO-Broker-Server stopInstance system.adapter.mielecloudservice.0 (force=false, process=true)
2020-06-08 21:33:13.143 - info: host.IO-Broker-Server stopInstance system.adapter.mielecloudservice.0 send kill signal
2020-06-08 21:33:13.672 - info: host.IO-Broker-Server instance system.adapter.mielecloudservice.0 terminated with code 11 (ADAPTER_REQUESTED_TERMINATION)
2020-06-08 21:33:23.153 - info: host.IO-Broker-Server "system.adapter.mielecloudservice.0" enabled
2020-06-08 21:33:23.178 - info: host.IO-Broker-Server instance system.adapter.mielecloudservice.0 started with pid 5720
2020-06-08 21:33:23.833 - debug: mielecloudservice.0 (5720) Redis Objects: Use Redis connection: 127.0.0.1:9001
2020-06-08 21:33:23.851 - debug: mielecloudservice.0 (5720) Objects client ready ... initialize now
2020-06-08 21:33:23.853 - debug: mielecloudservice.0 (5720) Objects create System PubSub Client
2020-06-08 21:33:23.853 - debug: mielecloudservice.0 (5720) Objects create User PubSub Client
2020-06-08 21:33:23.860 - debug: mielecloudservice.0 (5720) Objects client initialize lua scripts
2020-06-08 21:33:23.882 - debug: mielecloudservice.0 (5720) Objects connected to redis: 127.0.0.1:9001
2020-06-08 21:33:23.885 - debug: mielecloudservice.0 (5720) objectDB connected
2020-06-08 21:33:23.886 - debug: mielecloudservice.0 (5720) Redis States: Use Redis connection: 127.0.0.1:9000
2020-06-08 21:33:23.891 - debug: mielecloudservice.0 (5720) States create User PubSub Client
2020-06-08 21:33:23.895 - debug: mielecloudservice.0 (5720) States create System PubSub Client
2020-06-08 21:33:23.902 - debug: mielecloudservice.0 (5720) States connected to redis: 127.0.0.1:9000
2020-06-08 21:33:23.902 - debug: mielecloudservice.0 (5720) statesDB connected
2020-06-08 21:33:23.960 - info: mielecloudservice.0 (5720) starting. Version 1.2.3 in I:/iobroker/node_modules/iobroker.mielecloudservice, node: v12.16.1, js-controller: 3.1.5
2020-06-08 21:33:23.968 - debug: mielecloudservice.0 (5720) function APIGetAccessToken
2020-06-08 21:33:23.970 - debug: mielecloudservice.0 (5720) Awaiting OAuth2 Token.
2020-06-08 21:33:23.970 - debug: mielecloudservice.0 (5720) OAuth2 grant_type: [password]
2020-06-08 21:33:23.970 - debug: mielecloudservice.0 (5720) options OAuth2-VG: [de-DE]
2020-06-08 21:33:23.970 - debug: mielecloudservice.0 (5720) config API Language: [de]
2020-06-08 21:33:24.258 - info: mielecloudservice.0 (5720) Access-Token expires at: [Wed Jul 08 2020 21:33:00 GMT+0200 (GMT+02:00)]
2020-06-08 21:33:24.259 - info: mielecloudservice.0 (5720) Starting Polltimer with a 2 Minutes interval.
2020-06-08 21:33:24.363 - debug: mielecloudservice.0 (5720) Updating device states (polling API scheduled).
2020-06-08 21:33:24.363 - debug: mielecloudservice.0 (5720) refreshMieledata: get data from API
2020-06-08 21:33:24.364 - debug: mielecloudservice.0 (5720) APISendRequest: Awaiting requested data.
2020-06-08 21:33:24.364 - debug: mielecloudservice.0 (5720) refreshMieledata: handover data to splitMieledevices
2020-06-08 21:33:24.510 - debug: mielecloudservice.0 (5720) API returned Status: [200]

[Grizzelbee]

@surfer09 sagte in MieleCloudService Adapter:

Ich hoffe, ich habe das so richtig eingestellt mit dem LOG:

Yapp. Alles bestens! :)

Komisch, dass bei mir immer alles komplizierter ist :grinning:

Das hier liegt nicht an dir. Du bist (allem Anschein nach) nur zu einem ungünstigen Zeitpunkt auf den Zug aufgesprungen.

Ich habe, wie es scheint, mit der letzten Version einen Bug mit der Asynchronität des Codes eingebaut - was dazu führt, dass der Adapter zwar Daten bei der API anfordert (Log Zeile 59) und auch bekommt (Log Zeile 62) - mit der Verarbeitung der Daten aber bereits in der Zwischenzeit loslegt (Log Zeile 61). Bildlich gesprochen: Das Amazon-Paket wird schon ausgepackt, noch bevor es geliefert wurde. Das muss ja eine Luftnummer werden. ::man-shrugging: :face_palm:

Ich fixe das heute Abend und stelle dann eine neue Version online. Falls du in der Zwischenzeit weiter machen möchtest, kannst du einfach eine ältere Version installieren (Im Adapter-Tab auf den Adapter klicken - dort dann auf das kleine Fragezeichen und die gewünschte Version auswählen).

viele Grüße
Grizzelbee

[surfer09]

@Grizzelbee Na dann bin ich ja beruhigt :-) Danke dir!

[Grizzelbee]

@surfer09
Sehr gerne! :)

Die V1.2.4 habe ich gerade eben online gestellt - bis das lastest Repo sie erkennt dauert es wie üblich etwas. Wer es eilig hat, kann gerne über Github installieren.

Version 1.2.4 (2020-06-09)

• (grizzelbee) Fix: fixed No-Data Bug (introduced in V1.2.3)

viele Grüße
Grizzelbee