search

home-assistant / android

:iphone: Home Assistant Companion for Android
https://companion.home-assistant.io/
Apache License 2.0
2.27k stars 629 forks source link

Wear OS: Assist inconsistent connectivity #3958

Open TarheelGrad1998 opened 11 months ago

TarheelGrad1998 commented 11 months ago

Home Assistant Android app version(s): 2023.10.2-full Android version(s): 13 (Wear OS 4.0) Device model(s): Moto Razr+ (Samsung Watch 4) Home Assistant version: 2023.10.1 Last working Home Assistant release (if known):

Description of problem, include YAML if issue is related to notifications: When trying to use Assist on Wear OS, I frequently encounter one of these two errors: Oops, an error has occurred Assist has had trouble connecting to Home Assistant

Companion App Logs:

--------- beginning of system
10-20 13:34:17.232 26345 26345 D VRI[WebViewActivity]: update {(0,0)(fillxfill) ty=BASE_APPLICATION wanim=0x1030300
10-20 13:34:17.232 26345 26345 D VRI[WebViewActivity]:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:34:17.232 26345 26345 D VRI[WebViewActivity]:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:34:17.232 26345 26345 D VRI[WebViewActivity]:   bhv=DEFAULT
10-20 13:34:17.232 26345 26345 D VRI[WebViewActivity]:   fitSides=} by setLayoutParams
10-20 13:34:38.704 26345 26345 D ViewRootImpl: hide bar on moto desktop on io.homeassistant.companion.android/io.homeassistant.companion.android.webview.WebViewActivity
10-20 13:34:38.705 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:34:38.705 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:34:38.705 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:34:38.705 26345 26345 D ViewRootImpl:   vsysui=HIDE_NAVIGATION IMMERSIVE_STICKY
10-20 13:34:38.705 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:34:38.705 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:34:47.689 26345 26345 D ViewRootImpl: hide bar on moto desktop on io.homeassistant.companion.android/io.homeassistant.companion.android.launch.LaunchActivity
10-20 13:34:47.690 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:34:47.690 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:34:47.690 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:34:47.690 26345 26345 D ViewRootImpl:   vsysui=HIDE_NAVIGATION IMMERSIVE_STICKY
10-20 13:34:47.690 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:34:47.690 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:34:47.915 26345 26345 D ViewRootImpl: hide bar on moto desktop on io.homeassistant.companion.android/io.homeassistant.companion.android.webview.WebViewActivity
10-20 13:34:47.916 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:34:47.916 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:34:47.916 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:34:47.916 26345 26345 D ViewRootImpl:   vsysui=HIDE_NAVIGATION IMMERSIVE_STICKY
10-20 13:34:47.916 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:34:47.916 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:35:15.004 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:35:15.004 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:35:15.004 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:35:15.004 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:35:15.004 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:35:15.156 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:35:15.156 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:35:15.156 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:35:15.156 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:35:15.156 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:35:29.907 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:35:29.907 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:35:29.907 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:35:29.907 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:35:29.907 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:35:32.844 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:35:32.844 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:35:32.844 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:35:32.844 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:35:32.844 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:35:32.890 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:35:32.890 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:35:32.890 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:35:32.890 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:35:32.890 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:35:56.949 26345 26345 D VRI[SettingsActivity]: update {(0,0)(fillxfill) ty=BASE_APPLICATION wanim=0x1030300
10-20 13:35:56.949 26345 26345 D VRI[SettingsActivity]:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:35:56.949 26345 26345 D VRI[SettingsActivity]:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:35:56.949 26345 26345 D VRI[SettingsActivity]:   bhv=DEFAULT
10-20 13:35:56.949 26345 26345 D VRI[SettingsActivity]:   fitSides=} by setLayoutParams
10-20 13:35:59.895 26345 26345 D VRI[SettingsActivity]: update {(0,0)(fillxfill) ty=BASE_APPLICATION wanim=0x1030300
10-20 13:35:59.895 26345 26345 D VRI[SettingsActivity]:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:35:59.895 26345 26345 D VRI[SettingsActivity]:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:35:59.895 26345 26345 D VRI[SettingsActivity]:   bhv=DEFAULT
10-20 13:35:59.895 26345 26345 D VRI[SettingsActivity]:   fitSides=} by setLayoutParams
10-20 13:36:02.957 26345 26345 D ViewRootImpl: update {(0,0)(wrapxwrap) gr=CENTER sim={adjust=pan forwardNavigation} ty=APPLICATION fmt=TRANSLUCENT wanim=0x7f140005
10-20 13:36:02.957 26345 26345 D ViewRootImpl:   fl=DIM_BEHIND ALT_FOCUSABLE_IM SPLIT_TOUCH HARDWARE_ACCELERATED
10-20 13:36:02.957 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:36:02.957 26345 26345 D ViewRootImpl:   fitTypes=STATUS_BARS NAVIGATION_BARS CAPTION_BAR} by setView
10-20 13:36:16.733 26345 26345 D VRI[SettingsActivity]: update {(0,0)(fillxfill) sim={adjust=resize forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:36:16.733 26345 26345 D VRI[SettingsActivity]:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:36:16.733 26345 26345 D VRI[SettingsActivity]:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND USE_BLAST FIT_INSETS_CONTROLLED
10-20 13:36:16.733 26345 26345 D VRI[SettingsActivity]:   vsysui=LIGHT_STATUS_BAR LIGHT_NAVIGATION_BAR
10-20 13:36:16.733 26345 26345 D VRI[SettingsActivity]:   apr=LIGHT_STATUS_BARS LIGHT_NAVIGATION_BARS
10-20 13:36:16.733 26345 26345 D VRI[SettingsActivity]:   bhv=DEFAULT
10-20 13:36:16.733 26345 26345 D VRI[SettingsActivity]:   fitSides=} by setLayoutParams
10-20 13:36:19.952 26345 26345 D ViewRootImpl: update {(0,0)(wrapxwrap) gr=CENTER sim={adjust=pan forwardNavigation} ty=APPLICATION fmt=TRANSLUCENT wanim=0x7f140005
10-20 13:36:19.952 26345 26345 D ViewRootImpl:   fl=DIM_BEHIND ALT_FOCUSABLE_IM SPLIT_TOUCH HARDWARE_ACCELERATED
10-20 13:36:19.952 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:36:19.952 26345 26345 D ViewRootImpl:   fitTypes=STATUS_BARS NAVIGATION_BARS CAPTION_BAR} by setView
10-20 13:36:25.691 26345 26345 D VRI[SettingsActivity]: update {(0,0)(fillxfill) sim={adjust=resize forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:36:25.691 26345 26345 D VRI[SettingsActivity]:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:36:25.691 26345 26345 D VRI[SettingsActivity]:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND USE_BLAST FIT_INSETS_CONTROLLED
10-20 13:36:25.691 26345 26345 D VRI[SettingsActivity]:   vsysui=LIGHT_STATUS_BAR LIGHT_NAVIGATION_BAR
10-20 13:36:25.691 26345 26345 D VRI[SettingsActivity]:   apr=LIGHT_STATUS_BARS LIGHT_NAVIGATION_BARS
10-20 13:36:25.691 26345 26345 D VRI[SettingsActivity]:   bhv=DEFAULT
10-20 13:36:25.691 26345 26345 D VRI[SettingsActivity]:   fitSides=} by setLayoutParams
10-20 13:36:28.345 26345 26345 D ViewRootImpl: update {(0,0)(wrapxwrap) gr=CENTER sim={adjust=pan forwardNavigation} ty=APPLICATION fmt=TRANSLUCENT wanim=0x7f140005
10-20 13:36:28.345 26345 26345 D ViewRootImpl:   fl=DIM_BEHIND ALT_FOCUSABLE_IM SPLIT_TOUCH HARDWARE_ACCELERATED
10-20 13:36:28.345 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:36:28.345 26345 26345 D ViewRootImpl:   fitTypes=STATUS_BARS NAVIGATION_BARS CAPTION_BAR} by setView
--------- beginning of main
10-20 13:37:15.031 26345 26345 D LocBroadcastReceiver: Received location update.
10-20 13:37:15.036 26345 26345 D ForegrndServiceLauncher: Check if service HighAccuracyLocationService is running. Service running = false
10-20 13:37:15.037 26345 26553 D LocBroadcastReceiver: Last Location: 
10-20 13:37:15.037 26345 26553 D LocBroadcastReceiver: Coords:(XXXXXXXXXXX, XXXXXXXXXXXXXXX)
10-20 13:37:15.037 26345 26553 D LocBroadcastReceiver: Accuracy: 100.0
10-20 13:37:15.037 26345 26553 D LocBroadcastReceiver: Bearing: 0.0
10-20 13:37:15.037 26345 26553 D LocBroadcastReceiver: Begin evaluating if location update should be skipped
10-20 13:37:15.037 26345 26553 D LocBroadcastReceiver: Received location that is 42 milliseconds old, 1697823434995 compared to 1697823435037 with source fused
10-20 13:37:15.043 26345 26553 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:37:15.241 26345 26553 D LocBroadcastReceiver: Location update sent successfully for 1 as exact
10-20 13:37:15.910 26345 26356 W System  : A resource failed to call destroy. 
10-20 13:37:15.910 26345 26356 W System  : A resource failed to call destroy. 
10-20 13:38:04.526 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:38:04.526 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:38:04.526 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:38:04.526 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:38:04.526 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:38:04.534 26345 26345 D LocBroadcastReceiver: Received location update.
10-20 13:38:04.537 26345 26345 D ForegrndServiceLauncher: Check if service HighAccuracyLocationService is running. Service running = false
10-20 13:38:04.538 26345 26553 D LocBroadcastReceiver: Last Location: 
10-20 13:38:04.538 26345 26553 D LocBroadcastReceiver: Coords:(XXXXXXXXXXX, XXXXXXXXXXX)
10-20 13:38:04.538 26345 26553 D LocBroadcastReceiver: Accuracy: 100.0
10-20 13:38:04.538 26345 26553 D LocBroadcastReceiver: Bearing: 0.0
10-20 13:38:04.539 26345 26553 D LocBroadcastReceiver: Begin evaluating if location update should be skipped
10-20 13:38:04.540 26345 26553 D LocBroadcastReceiver: Received location that is 51 milliseconds old, 1697823484488 compared to 1697823484539 with source fused
10-20 13:38:04.540 26345 26553 D LocBroadcastReceiver: Duplicate location received, not sending to HA
10-20 13:38:04.541 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.541 26345 26345 D ServerConnectionInfo: Using cloud / remote UI URL
10-20 13:38:04.542 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.544 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.544 26345 26345 D ServerConnectionInfo: Using cloud / remote UI URL
10-20 13:38:04.546 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.548 26345 26345 D Instrumentation: startActivity pkg: io.homeassistant.companion.android cmp: io.homeassistant.companion.android/.webview.WebViewActivity link: false
10-20 13:38:04.548 26345 26345 D Instrumentation: startActivity launch: false pkg: io.homeassistant.companion.android intent:Intent { cmp=io.homeassistant.companion.android/.webview.WebViewActivity (has extras) }
10-20 13:38:04.560 26345 26553 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.612 26345 26393 W Parcel  : Expecting binder but got null!
10-20 13:38:04.617 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.641 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.669 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.671 26345 26345 D IntegrationRepository: isAppLocked(): false. (LockEnabled: true, appActive: true, expireMillis: 0, currentMillis: 1697823484671)
10-20 13:38:04.672 26345 26553 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.674 26345 26345 D WebviewActivity: Current webview package com.google.android.webview and version 117.0.5938.153
10-20 13:38:04.675 26345 26345 D WebviewActivity: Matter commissioning status changed to NOT_STARTED
10-20 13:38:04.677 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.679 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.680 26345 26345 D IntegrationRepository: isAppLocked(): false. (LockEnabled: true, appActive: true, expireMillis: 0, currentMillis: 1697823484680)
10-20 13:38:04.745 26345 26553 D WebSocketRepository: Sending message 5: {type=auth/current_user, id=5}
10-20 13:38:04.745 26345 26553 D WebSocketRepository: Message number 5 sent
10-20 13:38:04.748 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:38:04.748 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:38:04.748 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:38:04.748 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:38:04.748 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:38:04.781 26345 26393 W Parcel  : Expecting binder but got null!
10-20 13:38:04.805 26345 26546 D WebSocketRepository: Websocket: onMessage (text)
10-20 13:38:04.806 26345 26460 D WebSocketRepository: Message number 5 received
10-20 13:38:04.809 26345 26381 I WM-Processor: Moving WorkSpec (0aabecc7-fc01-43f2-a7d7-c8a3556a2e8d) to the foreground
10-20 13:38:04.810 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.811 26345 26553 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.813 26345 26345 D IntegrationRepository: isAppLocked(): false. (LockEnabled: true, appActive: true, expireMillis: 0, currentMillis: 1697823484813)
10-20 13:38:04.816 26345 26384 D SensorWorker: Updating all Sensors in foreground.
10-20 13:38:04.816 26345 26381 I WM-WorkerWrapper: Worker result SUCCESS for Work [ id=c1ba1522-2e6a-496b-b285-b2dad4995990, tags={ io.homeassistant.companion.android.websocket.WebsocketManager } ]
10-20 13:38:04.824 26345 26384 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.843 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.843 26345 26345 D ServerConnectionInfo: Using cloud / remote UI URL
10-20 13:38:04.846 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.846 26345 26345 D ServerConnectionInfo: Using cloud / remote UI URL
10-20 13:38:04.848 26345 26345 I WM-SystemFgDispatcher: Started foreground service Intent { act=ACTION_START_FOREGROUND cmp=io.homeassistant.companion.android/androidx.work.impl.foreground.SystemForegroundService (has extras) }
10-20 13:38:04.859 26345 26393 D Surface : Surface::disconnect
10-20 13:38:04.859 26345 26393 D BufferQueueProducer: [VRI[LaunchActivity]#28(BLAST Consumer)28](id:66e90000001c,api:1,p:26345,c:26345) disconnect: api 1
10-20 13:38:04.929 26345 26384 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.937 26345 26384 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:04.965 26345 26460 D LocBroadcastReceiver: High accuracy mode disabled, because defined ([08:FB:EA:63:E7:45, 28:0F:EB:09:F1:18]) bluetooth device(s) not connected (Connected devices: [BluetoothDevice(address=28:3D:C2:4F:9F:33, name=Galaxy Watch4 Classic (Y8DB), paired=true, connected=true), BluetoothDevice(address=08:FB:EA:63:E7:45, name=Carsifi-aa2549, paired=true, connected=false), BluetoothDevice(address=00:00:00:00:10:C1, name=TWS Earbuds-L, paired=true, connected=false), BluetoothDevice(address=3C:BB:FD:55:71:CD, name=Gear S2 (31CD), paired=true, connected=false), BluetoothDevice(address=08:00:23:33:4B:44, name=DECT KX-TG78, paired=true, connected=false), BluetoothDevice(address=28:0F:EB:09:F1:18, name=Santa Fe, paired=true, connected=false)])
10-20 13:38:05.014 26345 26566 D WebviewActivity: External bus {"type":"config/get","id":1}
10-20 13:38:05.015 26345 26345 D WebviewActivity: externalBus({"id":1,"type":"result","success":true,"result":{"hasSettingsScreen":true,"canWriteTag":true,"hasExoPlayer":true,"canCommissionMatter":true,"hasAssist":true}});
10-20 13:38:05.044 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:05.044 26345 26345 D ServerConnectionInfo: Using cloud / remote UI URL
10-20 13:38:05.045 26345 26345 D WebviewActivity: Callback null
10-20 13:38:05.045 26345 26345 D WebviewActivity: Color from webview is "#03a9f4-SPACER-#fafafa"
10-20 13:38:05.046 26345 26345 D WebviewActivity: Color from webview is "#03a9f4-SPACER-#fafafa"
10-20 13:38:05.046 26345 26384 D WebViewPresenterImpl: Try getting color from webview color "#03a9f4".
10-20 13:38:05.047 26345 26384 I WebViewPresenterImpl: Found color -16537100.
10-20 13:38:05.047 26345 26384 D WebViewPresenterImpl: Try getting color from webview color "#fafafa".
10-20 13:38:05.047 26345 26384 I WebViewPresenterImpl: Found color -328966.
10-20 13:38:05.085 26345 26460 D SensorReceiver: Nothing to update for server 1 (Home)
10-20 13:38:05.085 26345 26460 I SensorReceiver: Sensor updates and sync completed
10-20 13:38:05.085 26345 26422 I WM-WorkerWrapper: Worker result SUCCESS for Work [ id=0aabecc7-fc01-43f2-a7d7-c8a3556a2e8d, tags={ io.homeassistant.companion.android.sensors.SensorWorker } ]
10-20 13:38:05.087 26345 26345 I WM-SystemFgDispatcher: Stopping foreground service
10-20 13:38:05.399 26345 26566 D WebviewActivity: External bus {"type":"connection-status","payload":{"event":"connected"},"id":2}
10-20 13:38:05.402 26345 26345 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:05.918 26345 26566 D WebviewActivity: External bus {"type":"theme-update","id":3}
10-20 13:38:05.921 26345 26345 D WebviewActivity: Color from webview is "#03a9f4-SPACER-#fafafa"
10-20 13:38:05.921 26345 26345 D WebviewActivity: Color from webview is "#03a9f4-SPACER-#fafafa"
10-20 13:38:05.921 26345 26460 D WebViewPresenterImpl: Try getting color from webview color "#03a9f4".
10-20 13:38:05.921 26345 26460 I WebViewPresenterImpl: Found color -16537100.
10-20 13:38:05.921 26345 26460 D WebViewPresenterImpl: Try getting color from webview color "#fafafa".
10-20 13:38:05.921 26345 26460 I WebViewPresenterImpl: Found color -328966.
10-20 13:38:06.303 26345 26345 W Choreographer: Frame time is 0.119618 ms in the future!  Check that graphics HAL is generating vsync timestamps using the correct timebase.
10-20 13:38:08.685 26345 26345 W Choreographer: Frame time is 0.156754 ms in the future!  Check that graphics HAL is generating vsync timestamps using the correct timebase.
10-20 13:38:24.134 26345 26566 D WebviewActivity: External bus {"type":"config_screen/show","id":4}
10-20 13:38:24.135 26345 26345 D Instrumentation: startActivity pkg: io.homeassistant.companion.android cmp: io.homeassistant.companion.android/.settings.SettingsActivity link: false
10-20 13:38:24.135 26345 26345 D Instrumentation: startActivity launch: false pkg: io.homeassistant.companion.android intent:Intent { cmp=io.homeassistant.companion.android/.settings.SettingsActivity }
10-20 13:38:24.147 26345 26345 D IntegrationRepository: setAppActive(): false
10-20 13:38:24.147 26345 26345 D IntegrationRepository: setAppActive(): false
10-20 13:38:24.172 26345 26345 D IntegrationRepository: isAppLocked(): false. (LockEnabled: true, appActive: false, expireMillis: 1697823505147, currentMillis: 1697823504172)
10-20 13:38:24.173 26345 26345 D ViewRootImpl: update {(0,0)(fillxfill) sim={forwardNavigation} ty=BASE_APPLICATION wanim=0x1030300
10-20 13:38:24.173 26345 26345 D ViewRootImpl:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:38:24.173 26345 26345 D ViewRootImpl:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:38:24.173 26345 26345 D ViewRootImpl:   bhv=DEFAULT
10-20 13:38:24.173 26345 26345 D ViewRootImpl:   fitSides=} by setView
10-20 13:38:24.211 26345 26393 W Parcel  : Expecting binder but got null!
10-20 13:38:24.212 26345 26345 D SensorReceiver: Received intent: io.homeassistant.companion.android.UPDATE_SENSORS
10-20 13:38:24.218 26345 26460 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:24.219 26345 26384 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:24.261 26345 26460 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:24.266 26345 26460 D ServerConnectionInfo: localUrl is: false, usesInternalSsid is: false, usesWifi is: true
10-20 13:38:24.279 26345 29261 D LocBroadcastReceiver: High accuracy mode disabled, because defined ([08:FB:EA:63:E7:45, 28:0F:EB:09:F1:18]) bluetooth device(s) not connected (Connected devices: [BluetoothDevice(address=28:3D:C2:4F:9F:33, name=Galaxy Watch4 Classic (Y8DB), paired=true, connected=true), BluetoothDevice(address=08:FB:EA:63:E7:45, name=Carsifi-aa2549, paired=true, connected=false), BluetoothDevice(address=00:00:00:00:10:C1, name=TWS Earbuds-L, paired=true, connected=false), BluetoothDevice(address=3C:BB:FD:55:71:CD, name=Gear S2 (31CD), paired=true, connected=false), BluetoothDevice(address=08:00:23:33:4B:44, name=DECT KX-TG78, paired=true, connected=false), BluetoothDevice(address=28:0F:EB:09:F1:18, name=Santa Fe, paired=true, connected=false)])
10-20 13:38:24.308 26345 26345 D IntegrationRepository: isAppLocked(): false. (LockEnabled: true, appActive: false, expireMillis: 1697823505147, currentMillis: 1697823504308)
10-20 13:38:24.308 26345 26345 D IntegrationRepository: setAppActive(): true
10-20 13:38:24.380 26345 29261 D SensorReceiver: Nothing to update for server 1 (Home)
10-20 13:38:24.380 26345 29261 I SensorReceiver: Sensor updates and sync completed
10-20 13:38:24.701 26345 26393 D Surface : Surface::disconnect
10-20 13:38:24.701 26345 26393 D BufferQueueProducer: [VRI[WebViewActivity]#29(BLAST Consumer)29](id:66e90000001d,api:1,p:26345,c:26345) disconnect: api 1
10-20 13:38:33.982 26345 26345 D VRI[SettingsActivity]: update {(0,0)(fillxfill) ty=BASE_APPLICATION wanim=0x1030300
10-20 13:38:33.982 26345 26345 D VRI[SettingsActivity]:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:38:33.982 26345 26345 D VRI[SettingsActivity]:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:38:33.982 26345 26345 D VRI[SettingsActivity]:   bhv=DEFAULT
10-20 13:38:33.982 26345 26345 D VRI[SettingsActivity]:   fitSides=} by setLayoutParams
10-20 13:38:35.722 26345 26345 W Choreographer: Frame time is 0.105929 ms in the future!  Check that graphics HAL is generating vsync timestamps using the correct timebase.
10-20 13:38:35.760 26345 26345 D VRI[SettingsActivity]: update {(0,0)(fillxfill) ty=BASE_APPLICATION wanim=0x1030300
10-20 13:38:35.760 26345 26345 D VRI[SettingsActivity]:   fl=LAYOUT_IN_SCREEN LAYOUT_INSET_DECOR SPLIT_TOUCH HARDWARE_ACCELERATED DRAWS_SYSTEM_BAR_BACKGROUNDS
10-20 13:38:35.760 26345 26345 D VRI[SettingsActivity]:   pfl=NO_MOVE_ANIMATION FORCE_DRAW_STATUS_BAR_BACKGROUND FIT_INSETS_CONTROLLED
10-20 13:38:35.760 26345 26345 D VRI[SettingsActivity]:   bhv=DEFAULT
10-20 13:38:35.760 26345 26345 D VRI[SettingsActivity]:   fitSides=} by setLayoutParams
10-20 13:38:35.767 26345 29261 D LogcatReader: Read logcat for pid 26345

Screenshot or video of problem:

Additional information: My watch is not consistently connected to my phone, but is usually either that or on my home wifi. My intuition says that switchover of the connection might be related. However, Assist has worked both connected to my phone and wifi. Also when this happens, I can go into the HA Wear OS app and access HA, so the app itself is connected but somehow I cannot use Assist. When I get the "Assist is unable to connect" message, I've only been able to restore access by rebooting the watch.

dshokouhi commented 11 months ago

If the error occurs on the watch then the logs from the phone app will not be correct here. Unfortunately the only way to get logs from the watch is using logcat.

TarheelGrad1998 commented 11 months ago

Ok, any clues on how to do that?

dshokouhi commented 11 months ago

Easiest solution is to hook up watch to android studio and grab logs that way.

https://developer.android.com/training/wearables/get-started/debugging#wifi-debugging

jpelgrom commented 11 months ago

For Assist "Oops, an error has occurred" this could also have happened on the server, check the run history in Settings > Voice assistants > [your assistant] > Debug (in the overflow menu).

TarheelGrad1998 commented 11 months ago

For Assist "Oops, an error has occurred" this could also have happened on the server, check the run history in Settings > Voice assistants > [your assistant] > Debug (in the overflow menu).

I did just have it happen again, but checking there did not have a recent/related entry.

TarheelGrad1998 commented 11 months ago

Easiest solution is to hook up watch to android studio and grab logs that way.

https://developer.android.com/training/wearables/get-started/debugging#wifi-debugging

Easy, my behind. Frustrating. I installed the Android Studio and bumbled my way through the steps, but adb keeps giving me "Failed to connect to IP:port". Rebooted the watch, still no luck. Maybe I'm doing something wrong, no idea. I'm not even a dev anymore much less an Android dev. I'm giving up for now.

So much for Assist replacing Alexa.

dshokouhi commented 11 months ago

did you make sure to pair the device to adb before attempting to connect?

TarheelGrad1998 commented 11 months ago

No. How do I do that?

dshokouhi commented 11 months ago

No. How do I do that?

On the same screen where you got the port select pair device. run adb pair 192.x.x:xxxx using the IP and port in the pair screen then when prompted enter the pairing code found on teh same screen, then run the connect command

TarheelGrad1998 commented 11 months ago

Thanks. That worked, and I was able to pull about 12MB of logcat logs.

However, correct me if I'm mistaken, but I assume you'd want a log of around when an error happened? Further, based on research it appears the timestamps from logcat are in the device's time? The logs I was able to pull are all timestamped from 1:30 p.m. - 3:30 p.m. today, and I last got an "Ooops" around noon, so it wouldn't cover any events in question.

I'm guessing it's only keeping about 2 hours of logs, so I'd need to have it happen and then pull the logcat within that 2 hours?

yougotborked commented 10 months ago

As another point of reference, I'm experiencing this on a Samsung Galaxy fold 4 with a Samsung watch 6 LTE.

TarheelGrad1998 commented 10 months ago

Sorry for the delay. Needed the right combination of the issue to occur plus time to pull the logs. I am getting "Assist couldn't reach Home Assistant..." this morning, and here is the logcat output: logcat.txt

TarheelGrad1998 commented 8 months ago

Did you guys get everything you need on this? If not, let me know, it still happens every couple of days.

dshokouhi commented 8 months ago

the only error I see in the logs is listed below however the log line above it seems to indicate this error might be related to our complication and not assist.

12-07 09:03:11.341 31987  8482 E WebSocketRepository: Websocket: onFailure
12-07 09:03:11.341 31987  8482 E WebSocketRepository: java.net.SocketException: Software caused connection abort
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at java.net.SocketInputStream.socketRead0(Native Method)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at java.net.SocketInputStream.socketRead(SocketInputStream.java:118)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at java.net.SocketInputStream.read(SocketInputStream.java:173)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at java.net.SocketInputStream.read(SocketInputStream.java:143)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at com.android.org.conscrypt.ConscryptEngineSocket$SSLInputStream.readFromSocket(ConscryptEngineSocket.java:945)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at com.android.org.conscrypt.ConscryptEngineSocket$SSLInputStream.processDataFromSocket(ConscryptEngineSocket.java:909)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at com.android.org.conscrypt.ConscryptEngineSocket$SSLInputStream.readUntilDataAvailable(ConscryptEngineSocket.java:824)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at com.android.org.conscrypt.ConscryptEngineSocket$SSLInputStream.read(ConscryptEngineSocket.java:797)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okio.InputStreamSource.read(JvmOkio.kt:94)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okio.AsyncTimeout$source$1.read(AsyncTimeout.kt:125)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okio.RealBufferedSource.request(RealBufferedSource.kt:206)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okio.RealBufferedSource.require(RealBufferedSource.kt:199)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okio.RealBufferedSource.readByte(RealBufferedSource.kt:209)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okhttp3.internal.ws.WebSocketReader.readHeader(WebSocketReader.kt:119)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okhttp3.internal.ws.WebSocketReader.processNextFrame(WebSocketReader.kt:102)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okhttp3.internal.ws.RealWebSocket.loopReader(RealWebSocket.kt:293)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okhttp3.internal.ws.RealWebSocket$connect$1.onResponse(RealWebSocket.kt:195)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at okhttp3.internal.connection.RealCall$AsyncCall.run(RealCall.kt:519)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1137)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:637)
12-07 09:03:11.341 31987  8482 E WebSocketRepository:   at java.lang.Thread.run(Thread.java:1012)

I do see a few of to confirm my suscipion

12-07 09:03:44.810 31987 31987 E EntityStateDataSourceService: Unable to get entity state for sensor.kennedy_humidity: Job was cancelled

maybe @jpelgrom see's something I dont?

jpelgrom commented 8 months ago

maybe @jpelgrom see's something I dont?

Unfortunately not. The "Assist couldn't reach Home Assistant, check your connection" message should only show up if it fails the initial load and "Oops, an error has occured" only if the mic is unexpectedly unavailable, but 1) that should be recoverable by closing and reopening, 2) I would at least expect to see getting the config in the log/a more specific websocket failure than connection closed for a complication update and 3) the server Assist logs should also show something for the second message.

TarheelGrad1998 commented 8 months ago

Thanks for checking. I'll get another example or two, maybe that will help. My instinct says it's something about the watch switching between phone and wifi, as it usually seems to happen the first time I entered a new room. FWIW.