Develop Bugs

[Q] Phone intermittently reboots and has no WiFi

This is driving me nuts!
Realizing that my Desire GSM (PVT3, S-OFF, stock HBOOT) won't ever go beyond GB only with the help of HTC, I started looking at alternatives and flashed a ICS build. This was at an early stage so I wasn't expecting much and that's what I got: not much. System app hung, leaving me with no alternative but to take the battery out and wipe Dalvik to boot it.
As the ROMs have progressed, my expectations have risen but still I two major issues:
1) Spontaneous reboots
Often when picking up the phone, I need to enter my PIN because the phone has rebooted. Sometimes I can go a day without that happening, sometimes it happens 3 or 4 times in a row.
2) No WiFi
It won't even turn on, the aLogcat trace is as below.
Seems it can't find the H/W at all! Is this something that can be attributed to the RIL?
This is all really confusing to me, had no problems at all w/ stock HTC ROMs. I have so far tried different versions of Sandvold and MIUI ROMs. Anybody experience the same or has a clue to what's wrong?

Still no go - more evidence
As I thought WiFi was dead, I restored the phone to stock HTC 2.2. Lo and behold, now WiFi worked!
Armed with fresh new confidence I installed a number of 2.3 Sense and non-Sense ROMs (Runnymede, CM 7.1 etc.) just to see the same problem again.
Any idea? According to the dmesg below it's a hardware problem but since it work at least sometimes with stock ROMs it can't be that bad. Any other 2.3 user who could post their dmesg for a functioning WiFi card?
Code:
[ 509.333282] [WLAN] wifi_set_power = 1
[ 509.333404] bravo_wifi_power: 1
[ 509.618499] [WLAN] wifi_set_carddetect = 1
[ 509.618713] bravo_wifi_set_carddetect: 1
[ 509.618804] mmc0: card_present 1
[ 509.618896] mmc0: Slot status change detected (0 -> 1)
[ 509.620269] [WLAN] Dongle Host Driver, version 4.218.204.2
[ 512.170501] mmc0: queuing CIS tuple 0x91 length 3
[ 512.170928] mmc0: new high speed SDIO card at address 0001
[ 514.212982] mmc0: Data timeout
[ 514.213256] mmc0: Controller has been reset
[ 516.248565] mmc0: Data timeout
[ 516.248840] mmc0: Controller has been reset
[ 518.286071] mmc0: Data timeout
[ 518.286529] mmc0: Controller has been reset
[ 519.613403] [WLAN][WRN] dhd_module_init: sdio_register_driver timeout
[ 520.323638] mmc0: Data timeout
[ 520.324096] mmc0: Controller has been reset
[ 522.359191] mmc0: Data timeout
[ 522.359405] mmc0: Controller has been reset
[ 524.396606] mmc0: Data timeout
[ 524.396911] mmc0: Controller has been reset
[ 524.397430] [WLAN][WRN] dhdsdio_probe_attach: si_attach failed!
[ 524.397827] [WLAN][WRN] dhdsdio_probe: dhdsdio_probe_attach failed
[ 524.399444] [WLAN] wifi_set_carddetect = 0
[ 524.399841] bravo_wifi_set_carddetect: 0
[ 524.400054] mmc0: card_present 0
[ 524.400268] mmc0: Slot status change detected (1 -> 0)
[ 524.400665] [WLAN] wifi_set_power = 0
[ 524.400878] bravo_wifi_power: 0
[ 524.404449] btsdio: probe of mmc0:0001:3 failed with error -123
[ 524.407867] mmc0: card 0001 removed

First of all, go back to stock 2.2 (clean install from RUU, not a nandroid) and keep runnin' it for a few days while monitoring WiFi. If the WiFi's stable with stock, then it must be a software fault, in which case i'd advise you to upgrade to the latest radio from the official GB ROM when using GB/ICS ROMs. If the WiFi's not stable even with stock 2.2 + stock 2.2 radio, then you have a hardware problem on your hands and my bet is that nobody but an HTC service can help you with that.
Here's my logcat for enabling the WiFi connection + connecting to my router (i have replaced the MAC strings with ADDR).
Code:
D/WifiStatusBarPreference( 188): set wifi enable: true
D/WifiService( 122): setWifiEnabled =truemAirplaneModeOverwridden =false
D/WifiService( 122): setWifiEnabledBlocking:Enable Wifi
I/WifiHW ( 122): wifi_load_driver enter
I/WifiHW ( 122): check_driver_loaded
I/WifiHW ( 122): insmod
D/NetSharing_NSReceiver( 4957): onReceive : android.net.wifi.WIFI_STATE_CHANGED
D/NetSharing( 4957): wifi enabled change, state = false
D/NetSharing( 4957): wifi enabled change, state = false
I/WifiHW ( 122): wifi_load_driver end right 3
I/WifiHW ( 122): wifi_start_supplicant enter
D/WifiHW ( 122): create dhcp dir ok!
I/WifiHW ( 122): ensure_config_file_exists
I/WifiHW ( 122): wifi_start_supplicant end right 2
D/WifiService( 122): [smart wifi] mSmartWiFiStatus: 0 mBatteryLevel: 83 mWifiConnected: false
D/WifiService( 122): [smart wifi] ACTION_BATTERY_CHANGED pluggedType: 0
I/WifiHW ( 122): can't access IFACE_DIR OK
D/WifiService( 122): acquireWifiLockLocked: WifiLock{NetworkLocationProvider type=2 [email protected]} Mode: 2
D/NetSharing_NSReceiver( 4957): onReceive : android.net.wifi.WIFI_STATE_CHANGED
D/NetSharing( 4957): wifi enabled change, state = false
D/NetSharing( 4957): wifi enabled change, state = false
D/WifiService( 122): releaseWifiLockLocked: WifiLock{NetworkLocationProvider type=2 [email protected]} Mode: 2
I/WifiHW ( 122): Connect to Supplicant done
D/WifiService( 122): enable and start wifi due to updateWifiState
D/WifiService( 122): enable and start wifi due to updateWifiState
D/WifiStateTracker( 122): Not get IP address yet, shall not do WiFi offload
V/WifiMonitor( 122): Event [CTRL-EVENT-STATE-CHANGE id=-1 state=2 BSSID=00:00:00:00:00:00]
I/wpa_supplicant( 5325): Check WiFi offload status: wpa_s->vh_wifi_to_mobile:-1 ,wpa_s->vh_user_connect:-1
V/WifiMonitor( 122): Event [Trying to associate with ADDR (SSID='TV' freq=2412 MHz)]
V/WifiMonitor( 122): Event [CTRL-EVENT-STATE-CHANGE id=-1 state=3 BSSID=ADDR]
V/WifiStateTracker( 122): Connection to supplicant established, state=DISCONNECTED
V/WifiStateTracker( 122): KeyStore.LOCKED
V/WifiStateTracker( 122): Changing supplicant state: DISCONNECTED ==> SCANNING
V/WifiStateTracker( 122): Changing supplicant state: SCANNING ==> ASSOCIATING
V/WifiStateTracker( 122): KeyStore.LOCKED
D/ConnectivityService( 122): ConnectivityChange for WIFI: CONNECTING/CONNECTING
D/ConnectivityService( 122): Dropping ConnectivityChange for WIFI: CONNECTING/CONNECTING
V/WifiMonitor( 122): Event [CTRL-EVENT-STATE-CHANGE id=5 state=4 BSSID=ADDR]
V/WifiStateTracker( 122): Changing supplicant state: ASSOCIATING ==> ASSOCIATED
V/WifiMonitor( 122): Event [Associated with ADDR]
V/WifiMonitor( 122): Event [CTRL-EVENT-STATE-CHANGE id=5 state=5 BSSID=00:00:00:00:00:00]
V/WifiStateTracker( 122): Changing supplicant state: ASSOCIATED ==> FOUR_WAY_HANDSHAKE
D/ConnectivityService( 122): Dropping ConnectivityChange for WIFI: CONNECTING/AUTHENTICATING
V/WifiMonitor( 122): Event [CTRL-EVENT-STATE-CHANGE id=5 state=5 BSSID=00:00:00:00:00:00]
V/WifiStateTracker( 122): Changing supplicant state: FOUR_WAY_HANDSHAKE ==> FOUR_WAY_HANDSHAKE
V/WifiMonitor( 122): Event [CTRL-EVENT-STATE-CHANGE id=5 state=6 BSSID=00:00:00:00:00:00]
V/WifiStateTracker( 122): Changing supplicant state: FOUR_WAY_HANDSHAKE ==> GROUP_HANDSHAKE
V/WifiMonitor( 122): Event [WPA: Key negotiation completed with ADDR [PTK=CCMP GTK=TKIP]]
V/WifiMonitor( 122): Event [CTRL-EVENT-STATE-CHANGE id=5 state=7 BSSID=00:00:00:00:00:00]
V/WifiMonitor( 122): Event [CTRL-EVENT-CONNECTED - Connection to ADDR completed (auth) [id=5 id_str=]]
V/WifiStateTracker( 122): Changing supplicant state: GROUP_HANDSHAKE ==> COMPLETED
V/WifiStateTracker( 122): New network state is CONNECTED
D/WifiStateTracker( 122): DhcpHandler: acquire ddWakeLock
D/WifiStateTracker( 122): DhcpHandler: DHCP request started
D/ConnectivityService( 122): Dropping ConnectivityChange for WIFI: CONNECTING/OBTAINING_IPADDR
D/NetSharing_NSReceiver( 4957): onReceive : android.net.wifi.STATE_CHANGE
I/NetSharing_NSReceiver( 4957): wifienabled:false
V/WifiStateTracker( 122): DhcpHandler: DHCP request succeeded
D/WifiStateTracker( 122): DhcpHandler: release ddWakeLock
D/WifiStateTracker( 122): change state to connected for wifi supplicant state=COMPLETED
D/StatusBarService( 188): updateIcon slot=wifi index=16 viewIndex=10 old=StatusBarIcon(pkg=com.android.systemui id=0x7f0200d3 level=0 visible=false num=0 ) icon=StatusBarIcon(pkg=com.android.systemui id=0x7f0200d2 level=0 visible=true num=0 )
D/WifiWatchdogService( 122): (android.server.ServerThread) TV (ADDR) does not require the watchdog
D/NetSharing_NSReceiver( 4957): onReceive : android.net.wifi.STATE_CHANGE
I/NetSharing_NSReceiver( 4957): wifienabled:true
D/WifiStateTracker( 122): adding routing rule table=>wifi fromIp=all, toIp=all priority=3001
I/ipd ( 78): IP CMD: /system/bin/ip ro flush table wifi
V/WifiStateTracker( 122): IP configuration: ipaddr 192.168.100.5 gateway 192.168.100.1 netmask 255.255.255.0 dns1 192.168.100.1 dns2 0.0.0.0 DHCP server 192.168.100.1 lease 86400 seconds
I/wpa_supplicant( 5325): WiFi gateway: 0x 164a8c0
D/ConnectivityService( 122): ConnectivityChange for WIFI: CONNECTED/CONNECTED
V/NetworkStateTracker( 122): Setting TCP values: [4095,87380,110208,4096,16384,110208] which comes from [net.tcp.buffersize.wifi]
D/ConnectivityService( 122): adding dns 192.168.100.1 for WIFI
I/ipd ( 78): IP CMD: /system/bin/ip ro add 192.168.100.0/24 dev eth0 src 192.168.100.5 table wifi
D/WifiService( 122): type: WIFI, connected: true
D/StatusBarService( 188): updateIcon slot=wifi index=16 viewIndex=10 old=StatusBarIcon(pkg=com.android.systemui id=0x7f0200d2 level=0 visible=true num=0 ) icon=StatusBarIcon(pkg=com.android.systemui id=0x7f0200d9 level=0 visible=true num=0 )
I/ipd ( 78): IP CMD: /system/bin/ip ro add default via 192.168.100.1 dev eth0 table wifi
I/ipd ( 78): IP CMD: /system/bin/ip ru del from all to all table wifi prio 3001
I/ipd ( 78): IP CMD: /system/bin/ip ru add from all to all table wifi prio 3001
D/Tethering( 122): Tethering got CONNECTIVITY_ACTION type: WIFI, subtype: , status: CONNECTED
D/AutoSetting( 3674): receiver - NetworkInfo: type: WIFI[], state: CONNECTED/CONNECTED, reason: (unspecified), extra: (none), roaming: false, failover: false, isAvailable: true, if: eth0
D/AutoSetting( 3674): Util - wifi connected
D/AutoSetting( 3674): Util - wifi connected
D/GpsLocationProvider( 122): updateNetworkState available info: NetworkInfo: type: WIFI[], state: CONNECTED/CONNECTED, reason: (unspecified), extra: (none), roaming: false, failover: false, isAvailable: true, if: eth0
D/StatusBarService( 188): updateIcon slot=wifi index=16 viewIndex=10 old=StatusBarIcon(pkg=com.android.systemui id=0x7f0200d9 level=0 visible=true num=0 ) icon=StatusBarIcon(pkg=com.android.systemui id=0x7f0200d9 level=0 visible=true num=0 )
DMESG:
Code:
<6>[29199.683929] [WLAN] wifi_set_power = 1
<6>[29199.683929] bravo_wifi_power: 1
<6>[29199.959381] [WLAN] wifi_set_carddetect = 1
<6>[29199.959503] bravo_wifi_set_carddetect: 1
<7>[29199.959686] mmc0: card_present 1
<6>[29199.959808] mmc0: Slot status change detected (0 -> 1)
<6>[29199.962219] [WLAN] Dongle Host Driver, version 4.218.204.2
<7>[29202.517456] mmc0: queuing CIS tuple 0x91 length 3
<6>[29202.517944] mmc0: new high speed SDIO card at address 0001
<6>[29202.538635] [WLAN] DHD: dongle ram size is set to 294912(orig 294912)
<6>[29202.783966] [WLAN] irq: 239
<6>[29202.784729] [WLAN] firmware version: wl0: Aug 2 2010 16:45:25 version 4.218.207.0
<6>[29202.786743] [WLAN] wifi: Disable 802.11n
<6>[29202.929382] [WLAN] dhd_preinit_ioctls:str=0x6e756c6c207061636b657400
<6>[29202.937347] [WLAN] eth0: Broadcom Dongle Host Driver mac=xx:xx:xx:xx:xx:xx
<6>[29202.942016] [WLAN] enter dhd_set_multicast_list
<6>[29202.943939] [WLAN] enter dhd_set_multicast_list
<6>[29202.948150] [WLAN] enter dhd_set_multicast_list
<6>[29202.953033] [ATS][press_widget][launch]
<6>[29203.873687] [WLAN] Send Event ISCAN complete
<6>[29204.597991] [WLAN] disassoc client!
<6>[29204.621032] [LS][CM3602] ALS value: 0x0, level: 1 #
<6>[29204.703704] [WLAN] wl_iw_iscan_get_scan return to WE 852 bytes APs=4
<6>[29204.713378] [WLAN] pfn: set ssid = TV
<6>[29204.713500] [WLAN] lightest is 0, weightest is 0, samessid = 65535
<6>[29204.728271] [WLAN] Enter set packet filter
<6>[29204.729187] [WLAN] start to add pkt filter 100
<6>[29204.730865] [WLAN] RXFILTER-ADD MULTICAST filter
<6>[29204.730987] [WLAN] Enter set packet filter
<6>[29204.731933] [WLAN] start to add pkt filter 104
<6>[29204.733917] [WLAN] Enter set packet filter
<6>[29204.734893] [WLAN] start to add pkt filter 102
<6>[29205.651885] [LS][CM3602] ALS value: 0x0, level: 1 #
<6>[29205.842590] [WLAN] wake lock 15 secs!
<6>[29205.843170] [WLAN] Link UP
<6>[29205.881042] [WLAN] STA connect received 1
<6>[29205.946594] [WLAN] getpower: and_pm = 0, dhd_pm: 2, ctrl_mask: 0x0, usb_act: 1
<6>[29205.947204] [WLAN] power active. ctrl_mask: 0x1
<6>[29205.948211] [WLAN] btcoex_dhcp_timer_start: sco time=0
<6>[29207.952178] [WLAN] update pm: PM_FAST, wifiLock: 0
<6>[29207.970855] [WLAN] Enter set packet filter
<6>[29207.973663] [WLAN] start to add pkt filter 101
<6>[29207.975738] [WLAN] ip: c0a86405
<6>[29208.118255] [WLAN] Driver GET GATEWAY-ADD CMD!!!
<6>[29208.118499] [WLAN] gatewaybuf: c0a86401

Looking through your logs and comparing them to mine, it seems to me that your logs say that your device doesn't seem to be able to properly mount the SD card.
Code:
[ 512.170928] mmc0: new high speed SDIO card at address 0001
[ 514.212982] mmc0: Data timeout
[ 514.213256] mmc0: Controller has been reset
I know (from reading XDA) that USB bricks are associated with SD card read errors, WiFi dropouts, network dropouts etc. While i am in no way versed in mobile devices, i believe that your issue is somehow software-related, not a hardware fault. If i were in your place, as i said earlier, i'd try reverting to stock 2.2 (full RUU - stock bootloader, stock radio, stock everything) and i'd monitor the device for a couple of days. If i would encounter the same problems as under the ICS ROM you're using, i'd switch to a different custom recovery (some recoveries/recovery versions are known to have bugs) and i'd try to use ye olde USB brick fixes. Only if all would fail i'd call it a hardware issue and dip the phone in liquid Frackitol.

Thanks for your suggestions, TVTV.
I have tried reverting to stock RUU 2.2 - naturally the WiFi works... Right now, I'm running RunnyMede 5.0.1 (Android 2.3.5, Sense 3.5) and everything just works - WiFi running well and no hard or soft reboots. With any ICS build, though, I get the "data timeout" and occasional CRC check failure for mmc0 as above.
Your post got me thinking of the USB brick case. Although I have none of the other symptons, it could be a case of messed up misc partition, I guess. Tried updating to Alpharev HBOOT and them misc reset as described here -> android.modaco.com/topic/309939-usb-brickrickrolledb0rked-fixed/
Running out of ideas so pass me that bottle of Frackitol, please...

It seems that you're not the only one who ran into this issue. Check this thread out.
The OP seems to have solved his problem by replacing his/her SD card which was faulty and was being mounted as read-only.

FF18 Leak (OTA) Bluetooth Panasonic Home phone

I have a panasonic th12 home phone base that normally my phone connects to when I am at home over bluetooth. This allows me to use regular handsets while in the house to make / receive phone calls. I just updated to the FF18 from sfhub's odin and now my device no longer will connect the home phone base. It pairs but it will not stay connected or allow me to check the box for phone calls as well. Any ideas? is this a bluetooth bug?

Every time I flash I have to pair my phone with car again. I typically delete device profile from phone, delete phone profile from device, change bluetooth name of phone, pair phone with device under new name. Finally after paired wait for message to pop up on phone asking if device has permission to access your stuff and check box for always allow.

Yes my phone does the same for Microsoft sync in my vehicle but it will not connect with my home phone.
EDIT: I have a couple of logcat during the time i tried to connect my device to the base if that helps anything?
Code:
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/plugins/hciops.c:conn_complete() status 0x00
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/src/adapter.c:adapter_get_device() 00:80:F0:8F:61:B6
V/BluetoothEventLoop.cpp( 1910): event_filter: Received signal org.bluez.Device:PropertyChanged from /org/bluez/2534/hci0/dev_00_80_F0_8F_61_B6
D/BluetoothEventLoop( 1910): Device property changed: 00:80:F0:8F:61:B6 property: Connected value: true
I/BluetoothService( 1910): ACL connected, mAclLinkCount = 1
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/plugins/hciops.c:remote_features_information() hci0 status 0
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/plugins/hciops.c:remote_name_information() hci0 status 0
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/plugins/hciops.c:link_key_request() hci0 dba 00:80:F0:8F:61:B6
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/plugins/hciops.c:get_auth_info() hci0 dba 00:80:F0:8F:61:B6
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/plugins/hciops.c:link_key_request() kernel auth requirements = 0x04
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/plugins/hciops.c:link_key_request() Matching key found
I//system/bin/bluetoothd( 2530): bluetoothd[2534]: external/bluetooth/bluez/plugins/hciops.c:link_key_request() link key type 0x00
W/ActivityManager( 1910): Permission Denial: receiving Intent { act=android.bluetooth.device.action.ACL_CONNECTED flg=0x10000010 (has extras) } to com.locationlabs.v3client requires android.permission.BLUETOOTH due to sender android (uid 1000)
V/BluetoothEventManager( 4127): Received android.bluetooth.device.action.UUID
D/Bluetooth HSHFP( 2156): SDP UUID: TYPE_HANDSFREE
E/CachedBluetoothDevice( 4127): updating profiles for Base TH12
V/CachedBluetoothDevice( 4127): Class: 620210
V/CachedBluetoothDevice( 4127): UUID:
V/CachedBluetoothDevice( 4127): 0000111e-0000-1000-8000-00805f9b34fb
E/CachedBluetoothDevice( 4127): onUuidChanged: Time since last connect2151
D/CachedBluetoothDevice( 4127): Command sent successfully:CONNECT Address:00:80:F0:8F:61:B6 Profile:HEADSET
D/CachedBluetoothDevice( 4127): Preferred profiles = 1
D/BluetoothUtils( 2156): isHeadsetAllowedBySecurityPolicy
V/BT HSHFP( 2156): waitForAsyncConnectNative
V/BT HSHFP( 2156): connectAsyncNative
I/BT HSHFP( 2156): Created RFCOMM socket fd 125.
I/BT HSHFP( 2156): async connect is in progress (Operation now in progress)
V/BT HSHFP( 2156): Remaining time 486ms
V/BT HSHFP( 2156): select() returned 2.
E/BT HSHFP( 2156): RFCOMM async connect() error: Connection refused (111), nr = -1
V/BT HSHFP( 2156): disconnectNative
D/BluetoothService( 1910): CONNECTION_STATE_CHANGE: : 1 -> 0
V/BluetoothEventManager( 4127): Received android.bluetooth.headset.profile.action.CONNECTION_STATE_CHANGED
I/BluetoothDeviceProfileState( 1910): Entering ACL Connected state with: 102
D/BluetoothPbap( 1910): disconnect()
Looks like someone on CM had issues with this as well, but it eventually worked... mine doesnt
http://forum.cyanogenmod.com/topic/41497-bluetooth-wont-auto-connect/

Maybe someone can even point me in the right direction as to how to debug this situation? I have a development environment up for apps, but havent ever explored the base source code. If anyone has any thoughts it would truly be appreciated.
Its really makes me made because I had a similar problem with my last phone, the HTC hero. It got to the point you wait for all of these updates and then I had to limit my phone to like andorid 1.5 otherwise my phone would not connect. Its should be a bigger issue only because users who are not on xda would be screwed and could not rollback to a previous Android release. At lease this community exists so that I can go back if needed. As of right now I'm liking the new ics on this phone and will be very disappointed if I have to to back to GB just for this.

BlueZ nexus 7 2013

I build the AOSP whit full bluez support. I build it and flash it but it doesn't connect. It just disconnect automatically.
Here are some logs:
Code:
<6>[ 1099.458312] device bt-pan0 entered promiscuous mode
<6>[ 1099.507263] device bt-pan0 left promiscuous mode
<6>[ 1099.507751] bt-pan: port 1(bt-pan0) entered disabled state
Code:
D/BluetoothPanServiceJni( 3085): connection_state_callback(L72): state:1, local_role:1, remote_role:2
D/PanService( 3085): handlePanDeviceStateChange preState: 0 state: 1
I/bluetoothd( 3104): bnep: bridge bt-pan: interface bt-pan0 added
D/BluetoothPanServiceJni( 3085): control_state_callback(L61): state:0, local_role:1, ifname:bt-pan
D/BluetoothPanServiceJni( 3085): connection_state_callback(L72): state:0, local_role:1, remote_role:2
D/PanService( 3085): Pan Device state : device: 14:30:C6:77:39:D2 State:0->1
D/BluetoothAdapterService( 3085): getAdapterService() - returning [email protected]
D/Tethering( 627): sendTetherStateChangedBroadcast 1, 0, 0
D/Tethering( 627): InitialState.processMessage what=4
D/PanService( 3085): handlePanDeviceStateChange preState: 1 state: 2
D/PanService( 3085): handlePanDeviceStateChange BT tethering is off/Local role is PANU drop the connection
D/BlueZ ( 3085): external/bluetooth/bluez/android/hal-pan.c:pan_disconnect()
D/Tethering( 627): sendTetherStateChangedBroadcast 0, 0, 0
D/BluetoothPanServiceJni( 3085): connection_state_callback(L72): state:2, local_role:1, remote_role:2
D/CachedBluetoothDevice( 2119): onProfileStateChanged: profile PAN newProfileState 1
E/bluetoothd( 3104): bnep: Can't delete bt-pan0 from the bridge bt-pan: No such device(19)
D/BluetoothAdapterProperties( 3085): CONNECTION_STATE_CHANGE: 14:30:C6:77:39:D2: 0 -> 1
D/PanService( 3085): handlePanDeviceStateChange preState: 1 state: 0
D/PanService( 3085): Pan Device state : device: 14:30:C6:77:39:D2 State:1->0
D/BluetoothAdapterService( 3085): getAdapterService() - returning [email protected]
D/BluetoothAdapterProperties( 3085): CONNECTION_STATE_CHANGE: 14:30:C6:77:39:D2: 1 -> 0
I/LocalBluetoothProfileManager( 2119): Failed to connect PAN device
D/CachedBluetoothDevice( 2119): onProfileStateChanged: profile PAN newProfileState 0

[FireTvStick 5.2.1.1] Failed to add tun0 to VPN net

I sideloaded OpenVPNConnect and OpenVPN(blinkt.de) on my FireTvStick 5.2.1.1.
Both apps are able to connect to my vpn server and according to their own logs routes (especialle for 0.0.0.0) have been created and the sequence is completed.
But in opposite to all other my android devices where the same vpn config works the FireTvStick is not using the vpn.
The output of logcat follows for both applications.
de.blinkt.openvpn.apk:
Code:
12-20 19:59:37.588: D/VpnJni(987): Address added on tun0: 10.8.0.10/30
12-20 19:59:37.608: D/ConnectivityService(987): registerNetworkAgent NetworkAgentInfo{ ni{[type: VPN[], state: CONNECTED/CONNECTED, reason: (unspecified), extra: (none), roaming: false, failover: false, isAvailable: true, isConnectedToProvisioningNetwork: false]} network{null} lp{{InterfaceName: tun0 LinkAddresses: [10.8.0.10/30,] Routes: [0.0.0.0/1 -> 0.0.0.0 tun0,128.0.0.0/2 -> 0.0.0.0 tun0,192.0.0.0/9 -> 0.0.0.0 tun0,192.128.0.0/11 -> 0.0.0.0 tun0,192.160.0.0/13 -> 0.0.0.0 tun0,192.168.0.0/17 -> 0.0.0.0 tun0,192.168.128.0/19 -> 0.0.0.0 tun0,192.168.160.0/20 -> 0.0.0.0 tun0,192.168.176.0/23 -> 0.0.0.0 tun0,192.168.179.0/24 -> 0.0.0.0 tun0,192.168.180.0/22 -> 0.0.0.0 tun0,192.168.184.0/21 -> 0.0.0.0 tun0,192.168.192.0/18 -> 0.0.0.0 tun0,192.169.0.0/16 -> 0.0.0.0 tun0,192.170.0.0/15 -> 0.0.0.0 tun0,192.172.0.0/14 -> 0.0.0.0 tun0,192.176.0.0/12 -> 0.0.0.0 tun0,192.192.0.0/10 -> 0.0.0.0 tun0,193.0.0.0/8 -> 0.0.0.0 tun0,194.0.0.0/7 -> 0.0.0.0 tun0,196.0.0.0/6 -> 0.0.0.0 tun0,200.0.0.0/5 -> 0.0.0.0 tun0,208.0.0.0/4 -> 0.0.0.0 tun0,] DnsAddresses: [208.67.222.222,208.67.220.220,] Domains: MTU: 0}} nc{[ Transports: VPN Capabilities: NOT_RESTRICTED&TRUSTED]} Score{0} everValidated{false} lastValidated{false} created{false} explicitlySelected{false} }
12-20 19:59:37.608: D/ConnectivityService(987): Adding iface tun0 to network 110
12-20 19:59:37.628: I/Vpn(987): Established by de.blinkt.openvpn on tun0
12-20 19:59:37.688: E/Netd(153): failed to add interface tun0 to VPN netId 110
12-20 19:59:37.698: E/ConnectivityService(987): Exception adding interface: java.lang.IllegalStateException: command '366 network interface add 110 tun0' failed with '400 366 addInterfaceToNetwork() failed (Invalid argument)'
12-20 19:59:37.698: E/ConnectivityService(987): Unexpected mtu value: 0, tun0
12-20 19:59:37.698: E/Netd(153): interface tun0 not assigned to any netId
...
net.openvpn.openvpn.apk:
Code:
12-20 20:00:19.226: D/VpnJni(987): Address added on tun0: 10.8.0.10/30
12-20 20:00:19.246: I/Vpn(987): Established by net.openvpn.openvpn on tun0
12-20 20:00:19.246: D/ConnectivityService(987): registerNetworkAgent NetworkAgentInfo{ ni{[type: VPN[], state: CONNECTED/CONNECTED, reason: (unspecified), extra: (none), roaming: false, failover: false, isAvailable: true, isConnectedToProvisioningNetwork: false]} network{null} lp{{InterfaceName: tun0 LinkAddresses: [10.8.0.10/30,] Routes: [10.8.0.1/32 -> 0.0.0.0 tun0,0.0.0.0/0 -> 0.0.0.0 tun0,::/0 unreachable,] DnsAddresses: [208.67.222.222,208.67.220.220,] Domains: MTU: 0}} nc{[ Transports: VPN Capabilities: INTERNET&NOT_RESTRICTED&TRUSTED]} Score{0} everValidated{false} lastValidated{false} created{false} explicitlySelected{false} }
12-20 20:00:19.246: D/ConnectivityService(987): Adding iface tun0 to network 111
12-20 20:00:19.306: E/Netd(153): failed to add interface tun0 to VPN netId 111
12-20 20:00:19.316: E/ConnectivityService(987): Exception adding interface: java.lang.IllegalStateException: command '401 network interface add 111 tun0' failed with '400 401 addInterfaceToNetwork() failed (Invalid argument)'
12-20 20:00:19.316: E/ConnectivityService(987): Unexpected mtu value: 0, tun0
12-20 20:00:19.316: E/Netd(153): interface tun0 not assigned to any netId
12-20 20:00:19.316: E/ConnectivityService(987): Exception in addRoute for non-gateway: java.lang.IllegalStateException: command '402 network route add 111 tun0 10.8.0.1/32' failed with '400 402 addRoute() failed (No such device)'
12-20 20:00:19.316: E/Netd(153): interface tun0 not assigned to any netId
12-20 20:00:19.326: E/ConnectivityService(987): Exception in addRoute for non-gateway: java.lang.IllegalStateException: command '403 network route add 111 tun0 0.0.0.0/0' failed with '400 403 addRoute() failed (No such device)'
12-20 20:00:19.326: E/Netd(153): interface tun0 not assigned to any netId
12-20 20:00:19.396: E/ConnectivityService(987): Attempting to register duplicate agent for type 17: NetworkAgentInfo{ ni{[type: VPN[], state: CONNECTED/CONNECTED, reason: (unspecified), extra: (none), roaming: false, failover: false, isAvailable: true, isConnectedToProvisioningNetwork: false]} network{111} lp{{InterfaceName: tun0 LinkAddresses: [10.8.0.10/30,] Routes: [10.8.0.1/32 -> 0.0.0.0 tun0,0.0.0.0/0 -> 0.0.0.0 tun0,::/0 unreachable,] DnsAddresses: [208.67.222.222,208.67.220.220,] Domains: MTU: 0}} nc{[ Transports: VPN Capabilities: INTERNET&NOT_RESTRICTED&TRUSTED]} Score{0} everValidated{true} lastValidated{true} created{true} explicitlySelected{false} }
adding a route by hand via "route add default gw 10.8.0.1 dev tun0" is not permitted.
so is the whole thing an rooted/unrooted issue?

[ROM][UNOFFICIAL][GAPPS][13] ArrowOS for Fire HD10 9th gen (maverick)

{
"lightbox_close": "Close",
"lightbox_next": "Next",
"lightbox_previous": "Previous",
"lightbox_error": "The requested content cannot be loaded. Please try again later.",
"lightbox_start_slideshow": "Start slideshow",
"lightbox_stop_slideshow": "Stop slideshow",
"lightbox_full_screen": "Full screen",
"lightbox_thumbnails": "Thumbnails",
"lightbox_download": "Download",
"lightbox_share": "Share",
"lightbox_zoom": "Zoom",
"lightbox_new_window": "New window",
"lightbox_toggle_sidebar": "Toggle sidebar"
}
ArrowOS​
This is an alpha build, not intended for use as a daily driver!
This ROM requires the temporary unlock to work, along with TWRP!
Your device must be on the 7.3.1.0 launch firmware!
Code:
/*
* We are not responsible for bricked devices, dead SD cards,
* thermonuclear war, or you getting fired because the alarm app failed. Please
* do some research if you have any concerns about features included in this ROM
* before flashing it! YOU are choosing to make these modifications, and if
* you point the finger at us for messing up your device, We will laugh at you.
* It is your fault because you chose to do all the modifications on your device.
* Remember projects like these and the work done on them is a hobby to the
* contributors and the team members, no one is working for you nor is getting paid for it
* have some respect for the work done by them since it is done purely on interest or a hobby
*/
ABOUT
ArrowOS is an Android Open Source Project based Android mobile operating system started with the aim of keeping things simple, clean and neat.
Website: https://arrowos.net
Telegram: Channel | TG Portal/Links
Github: https://github.com/ArrowOS
Code Review: review.arrowos.net
E-mail: arrowos.contact
PayPal: Donate to us
Blog: blog.arrowos.net
Checkout more documentation at (maintainership/contributing): Check this out
WHAT WORKS?
Everything except those mentioned on the not working list.
WHAT DOESN'T WORK?
Bluetooth audio
Hardware codecs
Brightness adjustment is buggy
SELinux permissive
Known performance issues
com.android.phone crashes from time to time
DRM
You tell me!
DOWNLOADS
Click here to Download
Read our blog article/post about:
* HOW-TO report a bug
* GAPPS and VANILLA variants
* Checking build integrity
GPL compliance:
ROM Source- https://github.com/ArrowOS
Kernel Source- https://github.com/amazon-maverick-dev/android_kernel_amazon_mt8183 (branch: 13.0-new)
Device Source- https://github.com/amazon-maverick-dev/android_device_amazon_maverick

Reserved #2

Reserved #3

Installed it on my device. Looking good! Are the bluetooth issues isolated to Bluetooth audio? I was unable to pair a bluetooth game controller or a mouse.

moomph said:
Installed it on my device. Looking good! Are the bluetooth issues isolated to Bluetooth audio? I was unable to pair a bluetooth game controller or a mouse.
Click to expand...
Click to collapse
Hey, it's possible that there are more Bluetooth issues than meets the eye, I didn't really do much real world testing since this is in very early stages.
I'd be happy to have a look if you could attach a logcat while trying to pair the game controller.

Hey, thanks for getting back. To preface, when I attempt to pair the controller, the UI in the "Connected devices" screen behaves as if it is connected for a second, but the controller disconnects and moves down to the list of "Saved devices". I saw similar behavior with a bluetooth mouse - it seems to pair, but then it disconnects immediately.
Simply running logcat results in a deluge of log messages - lots of errors amongst them.
When I run logcat | grep bluetooth and attempt to pair the controller, this is what I see. Pardon how massive this is:
Code:
09-23 11:44:53.264 22003 22214 I bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:113 drop: Dropping event MAX_SLOTS_CHANGE
09-23 11:44:53.281 22003 22214 I bluetooth: packages/modules/Bluetooth/system/main/shim/acl.cc:525 OnReadClockOffsetComplete: UNIMPLEMENTED
09-23 11:44:53.287 21733 21759 I ActivityManager: Start proc 10056:com.google.android.projection.gearhead:shared/u0a54 for broadcast {com.google.android.projection.gearhead/com.google.android.apps.auto.wireless.bluetooth.WifiBluetoothReceiver}
09-23 11:44:53.403 21733 21904 I ActivityTaskManager: START u0 {act=android.bluetooth.device.action.PAIRING_REQUEST flg=0x10000000 cmp=com.android.settings/.bluetooth.BluetoothPairingDialog (has extras)} from uid 1000
09-23 11:44:53.514 21733 22058 D CoreBackPreview: Window{90ec256 u0 com.android.settings/com.android.settings.bluetooth.BluetoothPairingDialog}: Setting back callback OnBackInvokedCallbackInfo{[email protected]65, mPriority=0}
09-23 11:44:53.519 21733 22058 D CoreBackPreview: Window{97a6d06 u0 com.android.settings/com.android.settings.bluetooth.BluetoothPairingDialog}: Setting back callback OnBackInvokedCallbackInfo{[email protected]92, mPriority=0}
09-23 11:44:53.562 21733 21748 I ActivityTaskManager: Displayed com.android.settings/.bluetooth.BluetoothPairingDialog: +153ms
09-23 11:44:53.760 10056 10056 I GH.WifiBluetoothRcvr: Connection action: android.bluetooth.device.action.ACL_CONNECTED, device E4:17:D8:85:79:73
09-23 11:44:53.863 29843 30332 I BistoWorker: (REDACTED) bluetoothConnectionStateChanged. Action: %s
09-23 11:44:54.793 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:375 on_hci_event: Unhandled event of type 0xe5 (Unknown EventCode: 229)
09-23 11:44:58.628 369 369 I HwBinder:369_3: type=1400 audit(0.0:16620973): avc: denied { call } for scontext=u:r:init:s0 tcontext=u:r:bluetooth:s0 tclass=binder permissive=1
09-23 11:44:58.632 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:375 on_hci_event: Unhandled event of type 0xe5 (Unknown EventCode: 229)
09-23 11:44:59.775 21733 22688 D CoreBackPreview: Window{90ec256 u0 com.android.settings/com.android.settings.bluetooth.BluetoothPairingDialog}: Setting back callback null
09-23 11:44:59.787 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/vendor_specific_event_manager.cc:86 on_vendor_specific_event: Unhandled vendor specific event of type 0x52
09-23 11:44:59.787 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/vendor_specific_event_manager.cc:86 on_vendor_specific_event: Unhandled vendor specific event of type 0x52
09-23 11:44:59.788 21733 23979 W InputManager-JNI: Input channel object '90ec256 com.android.settings/com.android.settings.bluetooth.BluetoothPairingDialog (client)' was disposed without first being removed with the input manager!
09-23 11:44:59.860 21733 22058 D CoreBackPreview: Window{97a6d06 u0 com.android.settings/com.android.settings.bluetooth.BluetoothPairingDialog}: Setting back callback null
09-23 11:44:59.862 21733 22058 W InputManager-JNI: Input channel object '97a6d06 com.android.settings/com.android.settings.bluetooth.BluetoothPairingDialog (client)' was disposed without first being removed with the input manager!
09-23 11:45:00.152 21733 21758 W BroadcastQueue: Background execution not allowed: receiving Intent { act=android.bluetooth.device.action.UUID flg=0x10 (has extras) } to com.google.android.gms/.chimera.GmsIntentOperationService$PersistentTrustedReceiver
09-23 11:45:00.152 21733 21758 W BroadcastQueue: Background execution not allowed: receiving Intent { act=android.bluetooth.device.action.UUID flg=0x10 (has extras) } to com.google.android.googlequicksearchbox/com.google.android.apps.gsa.broadcastreceiver.external.ExternalCommonBroadcastReceiver
09-23 11:45:00.152 21733 21758 W BroadcastQueue: Background execution not allowed: receiving Intent { act=android.bluetooth.device.action.UUID flg=0x10 (has extras) } to com.google.android.projection.gearhead/com.google.android.apps.auto.carservice.gmscorecompat.CarBluetoothReceiver
09-23 11:45:00.156 21733 21758 W BroadcastQueue: Background execution not allowed: receiving Intent { act=android.bluetooth.device.action.BOND_STATE_CHANGED flg=0x10 (has extras) } to com.google.android.gms/.chimera.GmsIntentOperationService$PersistentTrustedReceiver
09-23 11:45:00.156 21733 21758 W BroadcastQueue: Background execution not allowed: receiving Intent { act=android.bluetooth.device.action.BOND_STATE_CHANGED flg=0x10 (has extras) } to com.google.android.googlequicksearchbox/com.google.android.apps.gsa.broadcastreceiver.external.ExternalCommonBroadcastReceiver
09-23 11:45:00.157 10918 17585 I NearbyDiscovery: FastPairHandler: Received action android.bluetooth.device.action.UUID [CONTEXT service_id=49 ]
09-23 11:45:00.274 22003 22214 I bluetooth: packages/modules/Bluetooth/system/gd/hci/le_scanning_manager.cc:639 stop_scan: Scanning already stopped, return!
09-23 11:45:02.037 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:375 on_hci_event: Unhandled event of type 0xe5 (Unknown EventCode: 229)
09-23 11:45:02.249 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:375 on_hci_event: Unhandled event of type 0xe5 (Unknown EventCode: 229)
09-23 11:45:02.681 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:375 on_hci_event: Unhandled event of type 0xe5 (Unknown EventCode: 229)
09-23 11:45:03.315 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:375 on_hci_event: Unhandled event of type 0xe5 (Unknown EventCode: 229)
09-23 11:45:03.534 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:375 on_hci_event: Unhandled event of type 0xe5 (Unknown EventCode: 229)
09-23 11:45:04.136 22003 22003 I bt_stack_manage: type=1400 audit(0.0:16623299): avc: denied { call } for scontext=u:r:bluetooth:s0 tcontext=u:r:init:s0 tclass=binder permissive=1
09-23 11:45:04.136 369 369 I HwBinder:369_3: type=1400 audit(0.0:16623300): avc: denied { call } for scontext=u:r:init:s0 tcontext=u:r:bluetooth:s0 tclass=binder permissive=1
09-23 11:45:04.219 22003 22230 E bluetooth: packages/modules/Bluetooth/system/stack/btm/btm_sco.cc:950 btm_sco_on_disconnected: Unable to find sco connection
09-23 11:45:04.245 29843 30332 I BistoWorker: (REDACTED) bluetoothConnectionStateChanged. Action: %s
09-23 11:45:06.296 22003 22003 I bt_stack_manage: type=1400 audit(0.0:16624639): avc: denied { call } for scontext=u:r:bluetooth:s0 tcontext=u:r:init:s0 tclass=binder permissive=1
09-23 11:45:06.299 22003 22214 I bluetooth: packages/modules/Bluetooth/system/gd/hci/le_scanning_manager.cc:639 stop_scan: Scanning already stopped, return!
09-23 11:45:06.300 369 369 I HwBinder:369_3: type=1400 audit(0.0:16624640): avc: denied { call } for scontext=u:r:init:s0 tcontext=u:r:bluetooth:s0 tclass=binder permissive=1

Did this again and saw some other logs relevant looking logs that perhaps I somehow missed in the first dump:
Code:
09-23 13:09:33.240 22003 22214 W bluetooth: packages/modules/Bluetooth/system/gd/hci/hci_layer.cc:375 on_hci_event: Unhandled event of type 0xe5 (Unknown EventCode: 229)
09-23 13:09:33.467 22003 22230 W l2c_link: packages/modules/Bluetooth/system/stack/l2cap/l2c_link.cc:500 l2c_link_timeout: TODO: Remove this callback into bcm_sec_disconnect
09-23 13:09:33.467 22003 22230 I btm_acl : packages/modules/Bluetooth/system/stack/acl/btm_acl.cc:188 hci_btsnd_hcic_disconnect: Disconnecting peer:xx:xx:xx:xx:79:73 reason:Remote Terminated Connection comment:stack::l2cap::l2c_link::l2c_link_timeout All channels closed
09-23 13:09:33.562 22003 22230 E bluetooth: packages/modules/Bluetooth/system/stack/btm/btm_sco.cc:950 btm_sco_on_disconnected: Unable to find sco connection
09-23 13:09:33.562 22003 22230 I btm_acl : packages/modules/Bluetooth/system/stack/acl/btm_acl.cc:2569 btm_acl_iso_disconnected: ISO disconnection from GD, handle: 0x32, reason: 0x16
09-23 13:09:33.563 22003 22230 I btif_av : packages/modules/Bluetooth/system/btif/src/btif_av.cc:3409 btif_av_acl_disconnected: btif_av_acl_disconnected: Peer XX:XX:XX:XX:79:73 : ACL Disconnected
09-23 13:09:33.565 22003 22161 W BatteryService: getBatteryService(): service is NULL
09-23 13:09:33.604 26918 27235 I BistoWorker: (REDACTED) bluetoothConnectionStateChanged. Action: %s
09-23 13:09:33.611 26918 27027 I BistoWorker: (REDACTED) Failed to get bistoDeviceInfo %s
09-23 13:09:33.615 22003 22073 D BluetoothDatabase: getBondedDevicesOrdered: Invalid address for device LocalStorage
09-23 13:09:33.624 26982 26982 I NearbyDiscovery: onAclChange: state=DISCONNECTED, device=XX:XX:XX:XX:79:73 [CONTEXT service_id=49 ]
Also, I found that the telephony service was failing and infinitely restarting, causing the deluge of error logs. Running the following solved it:
am service-restart-backoff disable com.android.phone

After further testing with the Bluetooth mouse, looking at the logs and UI behavior, it appears that the pairing does succeed. The device remains listed within the section of currently paired devices, and when I turn off the mouse, the UI updates accordingly and new log messages appear indicating a disconnection. However, a mouse pointer never materializes on screen during connection.