Uploaded image for project: ' AGL Development'
  1. AGL Development
  2. SPEC-2387

Missing audio playback over bluetooth

XMLWordPrintable

      Playing audio over bluetooth on GG7.0.2 produces no sound on headphones connected to HDMI audio port.

      Pressing the bluetooth icon in the media player and switching to local audio files produces sound immediately.

      Bluetooth logs do not indicate any error. 

      intel-corei7-64:~# journalctl -u bluetooth
      -- Logs begin at Tue 2019-05-07 13:31:56 UTC, end at Tue 2019-05-07 13:50:33 UTC. --
      May 07 13:31:57 intel-corei7-64 systemd[1]: Starting Bluetooth service...
      May 07 13:31:58 intel-corei7-64 bluetoothd[261]: Bluetooth daemon 5.46
      May 07 13:31:58 intel-corei7-64 systemd[1]: Started Bluetooth service.
      May 07 13:31:58 intel-corei7-64 bluetoothd[261]: Starting SDP server
      May 07 13:31:58 intel-corei7-64 bluetoothd[261]: Bluetooth management interface 1.14 initialized
      May 07 13:31:58 intel-corei7-64 bluetoothd[261]: Endpoint registered: sender=:1.11 path=/A2DP/SBC/Sink/1
      May 07 13:32:07 intel-corei7-64 bluetoothd[261]: Endpoint registered: sender=:1.11 path=/A2DP/SBC/Sink/2
      May 07 13:32:14 intel-corei7-64 bluetoothd[261]: /org/bluez/hci0/dev_98_29_A6_C9_6E_AA/fd0: fd(24) ready

      4a-audio service logs indicate errors for halBlueAlsaRegisterAll and MixerAttachVerb 

      intel-corei7-64:~# journalctl -u afm-service-agl-service-audio-4a--1.0-2153350--main@0.service
      -- Logs begin at Tue 2019-05-07 13:31:56 UTC, end at Tue 2019-05-07 13:53:53 UTC. --
      May 07 13:32:00 intel-corei7-64 systemd[1]: Starting AGL High Level Interface for Audio...
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: 4AWAITBT bluetooth kernel module detected
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: 4AWAITBT detecting hci devices...
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: 4AWAITBT found HCI controller: device
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: 4AWAITBT HCI controller device state: UP RUNNING PSCAN
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: 4AWAITBT HCI device up and running after 0 seconds
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: 4AWAITBT Bluetooth-Manager/power: {"address":"00:1A:7D:DA:71:04","powered":true,"discoverable":false,"discoverabletimeout":180,"pairable":true,"pairabletimeout":0,"discovering":false,"uuids":["00001801-0000-1000-8000-00805f9b34fb","0000110b-0000-1000-8000-00805f9b34fb","0000110e-0000-1000-8000-00805f9b34fb","00001200-0000-1000-8000-00805f9b34fb","00001800-0000-1000-8000-00805f9b34fb","0000111e-0000-1000-8000-00805f9b34fb","0000110c-0000-1000-8000-00805f9b34fb"]}
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: 4AWAITBT Bluetooth-Manager ready after 0 seconds
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: 4AWAITBT 4A now starting...
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: ------BEGIN OF CONFIG-----
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- {
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "ldpaths": [
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "\/usr\/libexec\/agl\/4a-alsa-core\/lib:\/usr\/libexec\/agl\/4a-hal\/lib:\/usr\/libexec\/agl\/smixer\/lib"
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- ],
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "name": "afbd-4a-service-audio-4a@1.0-2153350",
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "rootdir": "\/var\/local\/lib\/afm\/applications\/agl-service-audio-4a\/1.0-2153350",
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "workdir": "\/home\/0\/app-data\/agl-service-audio-4a",
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "monitoring": true,
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "port": 31002,
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "token": "HELLO",
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "roothttp": ".",
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "ws-client": [
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "unix:\/run\/user\/0\/apis\/ws\/unicens"
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- ],
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "binding": [
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "\/var\/local\/lib\/afm\/applications\/agl-service-audio-4a\/1.0-2153350\/lib\/afb-audiohighlevel.so"
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- ],
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "ws-server": [
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "sd:ahl-4a"
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- ],
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "apitimeout": 20,
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "cache-eol": 100000,
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "cntxtimeout": 32000000,
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "session-max": 200,
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "uploaddir": ".",
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "rootbase": "\/opa",
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "rootapi": "\/api",
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "alias": [
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- "\/monitoring:\/usr\/lib\/afb\/monitoring"
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- ]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: -- }
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: ------END OF CONFIG-----
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: running with pid 507 [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/main-afb-daemon.c:898,main]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API monitor added [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:505,afb_apiset_add]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: binding [/var/local/lib/afm/applications/agl-service-audio-4a/1.0-2153350/lib/afb-audiohighlevel.so] looks like an AFB binding V3 [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so-v3.c:83,afb_api_so_v3_add]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API ahl-4a added [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:505,afb_apiset_add]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API ahl-4a] CTL-LOAD-CONFIG: loading config filepath=/var/local/lib/afm/applications/agl-service-audio-4a/1.0-2153350/etc/policy-4a-sample1.json [/usr/src/debug/agl-service-audio-4a/0.1+gitAUTOINC+b14ab7544f-r0/git/controller/ctl-lib/ctl-config.c:209,CtlLoadMetaDataUsingPrefix]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API ahl-4a] New audio role: radio [/usr/src/debug/agl-service-audio-4a/0.1+gitAUTOINC+b14ab7544f-r0/git/ahl-binding/ahl-binding.cpp:246,create_api_verb]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API ahl-4a] New audio role: multimedia [/usr/src/debug/agl-service-audio-4a/0.1+gitAUTOINC+b14ab7544f-r0/git/ahl-binding/ahl-binding.cpp:246,create_api_verb]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API ahl-4a] New audio role: emergency [/usr/src/debug/agl-service-audio-4a/0.1+gitAUTOINC+b14ab7544f-r0/git/ahl-binding/ahl-binding.cpp:246,create_api_verb]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API ahl-4a] New audio role: navigation [/usr/src/debug/agl-service-audio-4a/0.1+gitAUTOINC+b14ab7544f-r0/git/ahl-binding/ahl-binding.cpp:246,create_api_verb]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: Scanning dir=[/usr/libexec/agl/4a-alsa-core/lib] for bindings [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so.c:165,adddirs]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: binding [/usr/libexec/agl/4a-alsa-core/lib/afb-alsa-4a.so] looks like an AFB binding V3 [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so-v3.c:83,afb_api_so_v3_add]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API alsacore added [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:505,afb_apiset_add]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: Scanning dir=[/usr/libexec/agl/4a-hal/lib] for bindings [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so.c:165,adddirs]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: Scanning dir=[/usr/libexec/agl/4a-hal/lib/plugins] for bindings [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so.c:165,adddirs]
      May 07 13:32:00 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: binding [/usr/libexec/agl/4a-hal/lib/4a-hal.so] looks like an AFB binding V3 [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so-v3.c:83,afb_api_so_v3_add]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API /usr/libexec/agl/4a-hal/lib/4a-hal.so] Binding start [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/4a-hal/4a-hal-manager/4a-hal-manager.c:154,afbBindingV3entry]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API 4a-hal-manager added [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:505,afb_apiset_add]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API /usr/libexec/agl/4a-hal/lib/4a-hal.so] Begining to create all APIs [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/4a-hal/4a-hal-controllers/4a-hal-controllers-api-loader.c:213,HalCtlsCreateAllApi]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API /usr/libexec/agl/4a-hal/lib/4a-hal.so] CTL-LOAD-CONFIG: loading config filepath=/usr/libexec/agl/4a-hal/etc/hal-4a-intel-upsquared-hdmi.json [/usr/src/debug/libappcontroller/7.0.2-r0/git/ctl-lib/ctl-config.c:204,CtlLoadMetaDataUsingPrefix]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API 4a-hal-intel-upsquared-hdmi added [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:505,afb_apiset_add]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-upsquared-hdmi] CTL-PLUGIN-LOADONE hal-bluealsa successfully registered [/usr/src/debug/libappcontroller/7.0.2-r0/git/ctl-lib/ctl-plugin.c:102,PluginLoadCOne]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-upsquared-hdmi] hal-bluealsa Plugin Registered correctly: uid='hal-bluealsa' 'info='Bluealsa hal plugin' [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:59,CtlPluginOnload]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API /usr/libexec/agl/4a-hal/lib/4a-hal.so] CTL-LOAD-CONFIG: loading config filepath=/usr/libexec/agl/4a-hal/etc/hal-4a-intel-minnow.json [/usr/src/debug/libappcontroller/7.0.2-r0/git/ctl-lib/ctl-config.c:204,CtlLoadMetaDataUsingPrefix]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API 4a-hal-intel-minnow added [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:505,afb_apiset_add]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-minnow] CTL-PLUGIN-LOADONE hal-bluealsa successfully registered [/usr/src/debug/libappcontroller/7.0.2-r0/git/ctl-lib/ctl-plugin.c:102,PluginLoadCOne]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-minnow] hal-bluealsa Plugin Registered correctly: uid='hal-bluealsa' 'info='Bluealsa hal plugin' [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:59,CtlPluginOnload]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: Scanning dir=[/usr/libexec/agl/smixer/lib] for bindings [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so.c:165,adddirs]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: Scanning dir=[/usr/libexec/agl/smixer/lib/plugins] for bindings [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so.c:165,adddirs]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: binding [/usr/libexec/agl/smixer/lib/softmixer-binding.so] looks like an AFB binding V3 [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-api-so-v3.c:83,afb_api_so_v3_add]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API /usr/libexec/agl/smixer/lib/softmixer-binding.so] Controller in afbBindingEntry [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/mixer-binding/mixer-binding.c:105,afbBindingV3entry]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API /usr/libexec/agl/smixer/lib/softmixer-binding.so] CTL-INIT JSON file found but not used : /usr/libexec/agl/smixer/etc/smixer-4a-default.json [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/app-controller-submodule/ctl-lib/ctl-config.c:94,ConfigSearch]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API /usr/libexec/agl/smixer/lib/softmixer-binding.so] CTL-INIT JSON file found but not used : /usr/libexec/agl/smixer/etc/smixer-4a-avirt.json [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/app-controller-submodule/ctl-lib/ctl-config.c:94,ConfigSearch]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API /usr/libexec/agl/smixer/lib/softmixer-binding.so] CTL-INIT JSON file found but not used : /usr/libexec/agl/smixer/etc/smixer-4a-default.json [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/app-controller-submodule/ctl-lib/ctl-config.c:94,ConfigSearch]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API /usr/libexec/agl/smixer/lib/softmixer-binding.so] CTL-LOAD-CONFIG: loading config filepath=/usr/libexec/agl/smixer/etc/smixer-4a-avirt.json [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/app-controller-submodule/ctl-lib/ctl-config.c:209,CtlLoadMetaDataUsingPrefix]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API /usr/libexec/agl/smixer/lib/softmixer-binding.so] Controller API='smixer' info='Soft Mixer emulating hardware mixer' [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/mixer-binding/mixer-binding.c:128,afbBindingV3entry]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API smixer added [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:505,afb_apiset_add]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CTL-PLUGIN-LOADONE alsa-softmixer successfully registered [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/app-controller-submodule/ctl-lib/ctl-plugin.c:102,PluginLoadCOne]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MIXER INIT [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:55,CtlPluginOnload]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API unicens added [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:505,afb_apiset_add]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: API 4a-hal-intel-minnow starting... [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:787,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: API alsacore starting... [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:787,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API alsacore started [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:806,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API alsacore] alsaCardProbe: DevPath '/dev/snd/by-path/pci-0000:00:1b.0' open error: -1 [/usr/src/debug/4a-alsa-core/0.1+gitAUTOINC+985df9fad7-r0/git/alsa-binding/Alsa-SetGet.c:388,alsaCardProbe]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: ERROR: [API 4a-hal-intel-minnow] Something went wrong during call to verb 'infoget' of api 'alsacore' with error 'sndscard-notfound' and info 'SndCard '(null)' Not Found' [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/4a-hal/4a-hal-controllers/4a-hal-controllers-alsacore-link.c:99,HalCtlsGetCardIdByCardPath]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: API smixer starting... [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:787,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API smixer started [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:806,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-minnow] Plugin initialization of hal-bluealsa plugin correctly done [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:93,CtlPluginInit]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-minnow] Controller onload event [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:105,init]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API 4a-hal-intel-minnow] init: sco parameters: { "mic": "INTEL-MINNOW", "zone": "full-stereo", "delayms": 800 } [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:139,init]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API 4a-hal-intel-minnow] init: a2dp parameters: { "zone": "full-stereo", "delayms": 500 } [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:151,init]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: ERROR: [API 4a-hal-intel-minnow] Ask DBus for the list of services [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:870,halBlueAlsaRegisterAll]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API 4a-hal-intel-minnow] Hal is unavailable, 'halmap' section data can't be handle [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/4a-hal/4a-hal-controllers/4a-hal-controllers-cb.c:378,HalCtlsHalMapConfig]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API 4a-hal-intel-minnow started [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:806,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: API 4a-hal-intel-upsquared-hdmi starting... [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:787,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: ERROR: [API 4a-hal-intel-minnow] name_changed_cb: wrong message signature 's' [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:779,name_changed_cb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-upsquared-hdmi] Plugin initialization of hal-bluealsa plugin correctly done [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:93,CtlPluginInit]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb: { "uid": "intel-upsquared-hdmi", "mixerapi": "smixer", "prefix": "intel-upsquared-hdmi", "ramps": [ { "uid": "ramp-very-fast", "delay": 50, "up": 6, "down": 10 }, { "uid": "ramp-fast", "delay": 50, "up": 2, "down": 10 }, { "uid": "ramp-normal", "delay": 50, "up": 2, "down": 4 }, { "uid": "ramp-slow", "delay": 50, "up": 2, "down": 2 }, { "uid": "ramp-very-slow", "delay": 100, "up": 1, "down": 1 } ], "playbacks": { "uid": "INTEL-UPSQUARED-HDMI", "cardid": "hw:PCH", "device": 7, "params": { "rate": 48000 }, "sink": { "channels": [ { "uid": "front-right", "port": 0 }, { "uid": "front-left", "port": 1 } ] } }, "captures": { "uid": "INTEL-UPSQUARED-HDMI", "path": "\/dev\/snd\/by-path\/pci-0000:00:0e.0", "params": { "rate": 48000 }, "source": { "channels": [ { "uid": "mic-right", "port": 0 }, { "uid": "mic-left", "port": 1 } ] } }, "zones": [ { "uid": "full-stereo", "sink": [ { "target": "front-right", "channel": 0 }, { "target": "front-left", "channel": 1 } ] }, { "uid": "front-seats", "sink": [ { "target": "front-right", "channel": 0 }, { "target": "front-left", "channel": 1 } ] } ], "streams": [ { "uid": "multimedia", "verb": "multimedia", "zone": "full-stereo", "volume": 60, "mute": false, "params": { "rate": 48000 } }, { "uid": "navigation", "verb": "navigation", "zone": "front-seats", "volume": 70, "mute": false, "params": { "rate": 48000 } }, { "uid": "emergency", "verb": "emergency", "zone": "front-seats", "volume": 60, "mute": false, "params": { "rate": 48000 } }, { "uid": "radio_stream", "verb": "radio_stream", "zone": "full-stereo", "volume": 70, "mute": true, "params": { "rate": 48000 } } ] } [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:552,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set PLAYBACKS [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:581,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] Looking for card 'hw:PCH' [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:286,AlsaCtlGetCardInfo]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] Opening card control 'hw:PCH' [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:300,AlsaCtlGetCardInfo]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaByPathOpenCtl: uid=INTEL-UPSQUARED-HDMI cardid=hw:2 cardname=HDA Intel PCH at 0x91510000 irq 127 pcmplug (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-utils-bypath.c:246,AlsaByPathOpenCtl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams: INTEL-UPSQUARED-HDMI format set to SND_PCM_FORMAT_S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:450,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams:INTEL-UPSQUARED-HDMI access set to (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:471,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCreateDmix: dmix-INTEL-UPSQUARED-HDMI done [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-plug-dmix.c:126,AlsaCreateDmix]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set CAPTURES [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:591,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaByPathOpenCtl: uid=INTEL-UPSQUARED-HDMI cardid=hw:2 cardname=HDA Intel PCH at 0x91510000 irq 127 pcmplug (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-utils-bypath.c:246,AlsaByPathOpenCtl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams: INTEL-UPSQUARED-HDMI format set to SND_PCM_FORMAT_S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:450,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams:INTEL-UPSQUARED-HDMI access set to (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:471,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set ZONES [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:604,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCreateRoute: zone(full-stereo) DONE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-plug-route.c:281,AlsaCreateRoute]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCreateRoute: zone(front-seats) DONE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-plug-route.c:281,AlsaCreateRoute]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] MixerInfoZones: response={ "uid": "full-stereo" } [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:360,MixerInfoZones]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] MixerInfoZones: response={ "uid": "front-seats" } [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:360,MixerInfoZones]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] MixerInfoZones: response=[ { "uid": "full-stereo" }, { "uid": "front-seats" } ] [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:360,MixerInfoZones]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set LOOPS/AVIRT [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:619,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AttachOneLoop, uid intel-upsquared-hdmi [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:242,AttachOneLoop]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] nbStreams: 0 max.streams: 16 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:333,AttachOneLoop]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] ProcessOneAvirtSubdev: 0 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:129,ProcessOneAvirtSubdev]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: AVIRT DEBUG: Successfully mounted configfs
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: [snd_avirt_stream_new]: AVIRT DEBUG: Created stream: multimedia, map: ap_loopback, chans: 2
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] ProcessOneAvirtSubdev: 1 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:129,ProcessOneAvirtSubdev]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: [snd_avirt_stream_new]: AVIRT DEBUG: Created stream: navigation, map: ap_loopback, chans: 2
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] ProcessOneAvirtSubdev: 2 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:129,ProcessOneAvirtSubdev]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: [snd_avirt_stream_new]: AVIRT DEBUG: Created stream: emergency, map: ap_loopback, chans: 2
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] ProcessOneAvirtSubdev: 3 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:129,ProcessOneAvirtSubdev]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: [snd_avirt_stream_new]: AVIRT DEBUG: Created stream: radio_stream, map: ap_loopback, chans: 2
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: AVIRT DEBUG: Card configured!
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaByPathOpenCtl: uid=AVIRT-Loopback cardid=hw:1 cardname=A virtual sound card driver for ALSA pcmplug (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-utils-bypath.c:246,AlsaByPathOpenCtl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AttachOneLoop, uid intel-upsquared-hdmi DONE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:377,AttachOneLoop]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Mixer Alsa-Mixer LOOPS: [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:497,loopsDisplay]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] LOOP AVIRT-Loopback [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:499,loopsDisplay]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] subdev id 0, uid (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:492,subdevDisplay]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] subdev id 1, uid (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:492,subdevDisplay]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] subdev id 2, uid (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:492,subdevDisplay]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] subdev id 3, uid (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:492,subdevDisplay]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] -------------- [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-loop.c:505,loopsDisplay]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set RAMPS [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:625,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set STREAMS [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:636,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams: multimedia format set to SND_PCM_FORMAT_S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:450,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams:multimedia access set to (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:471,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCtlCreateControl cardid=hw:1 cardname=A virtual sound card driver for ALSA ctl create name=pause-multimedia numid=1 value=0 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:515,AlsaCtlCreateControl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCreateSoftvol: multimedia(stream) done [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-plug-vol.c:103,AlsaCreateSoftvol]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Stream PARAMS: rate=48000, format=2, formatString=S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:388,ApiPcmParamsShow]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Zone PARAMS: rate=48000, format=2, formatString=S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:388,ApiPcmParamsShow]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCtlCreateControl cardid=hw:1 cardname=A virtual sound card driver for ALSA ctl create name=vol-multimedia numid=2 value=60 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:515,AlsaCtlCreateControl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CreateOneStream: no need for a converter [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:443,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaPcmConf (hw:1): mixer=Alsa-Mixer Done channels=2 rate=48000 format=2 access=3 ... DONE ! [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:327,AlsaPcmConf]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaPcmConf (softvol-multimedia): mixer=Alsa-Mixer Done channels=2 rate=48000 format=2 access=3 ... DONE ! [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:327,AlsaPcmConf]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] AlsaPcmCopyStart: Failed to increase stream read thread priority pcmIn=hw:1 [multimedia](0,0) err=Operation not permitted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:895,AlsaPcmCopyStart]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] AlsaPcmCopyStart: Failed to increase stream write thread priority pcmIn=hw:2 [HDMI 1](7,0) err=Operation not permitted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:902,AlsaPcmCopyStart]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CreateOneStream: mixer=Alsa-Mixer stream=multimedia CREATED [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:533,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams: navigation format set to SND_PCM_FORMAT_S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:450,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams:navigation access set to (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:471,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] readThreadEntry :pcmCpy/664 Started, muted=0 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:473,readThreadEntry]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCtlCreateControl cardid=hw:1 cardname=A virtual sound card driver for ALSA ctl create name=pause-navigation numid=3 value=0 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:515,AlsaCtlCreateControl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCreateSoftvol: navigation(stream) done [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-plug-vol.c:103,AlsaCreateSoftvol]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Stream PARAMS: rate=48000, format=2, formatString=S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:388,ApiPcmParamsShow]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Zone PARAMS: rate=48000, format=2, formatString=S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:388,ApiPcmParamsShow]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCtlCreateControl cardid=hw:1 cardname=A virtual sound card driver for ALSA ctl create name=vol-navigation numid=4 value=70 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:515,AlsaCtlCreateControl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CreateOneStream: no need for a converter [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:443,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaPcmConf (hw:1,1): mixer=Alsa-Mixer Done channels=2 rate=48000 format=2 access=3 ... DONE ! [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:327,AlsaPcmConf]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaPcmConf (softvol-navigation): mixer=Alsa-Mixer Done channels=2 rate=48000 format=2 access=3 ... DONE ! [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:327,AlsaPcmConf]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] AlsaPcmCopyStart: Failed to increase stream read thread priority pcmIn=hw:1 [navigation](1,0) err=Operation not permitted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:895,AlsaPcmCopyStart]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] AlsaPcmCopyStart: Failed to increase stream write thread priority pcmIn=hw:2 [HDMI 1](7,0) err=Operation not permitted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:902,AlsaPcmCopyStart]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CreateOneStream: mixer=Alsa-Mixer stream=navigation CREATED [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:533,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams: emergency format set to SND_PCM_FORMAT_S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:450,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams:emergency access set to (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:471,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCtlCreateControl cardid=hw:1 cardname=A virtual sound card driver for ALSA ctl create name=pause-emergency numid=5 value=0 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:515,AlsaCtlCreateControl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCreateSoftvol: emergency(stream) done [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-plug-vol.c:103,AlsaCreateSoftvol]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Stream PARAMS: rate=48000, format=2, formatString=S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:388,ApiPcmParamsShow]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Zone PARAMS: rate=48000, format=2, formatString=S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:388,ApiPcmParamsShow]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] readThreadEntry :pcmCpy/666 Started, muted=0 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:473,readThreadEntry]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCtlCreateControl cardid=hw:1 cardname=A virtual sound card driver for ALSA ctl create name=vol-emergency numid=6 value=60 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:515,AlsaCtlCreateControl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CreateOneStream: no need for a converter [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:443,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaPcmConf (hw:1,2): mixer=Alsa-Mixer Done channels=2 rate=48000 format=2 access=3 ... DONE ! [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:327,AlsaPcmConf]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaPcmConf (softvol-emergency): mixer=Alsa-Mixer Done channels=2 rate=48000 format=2 access=3 ... DONE ! [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:327,AlsaPcmConf]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] AlsaPcmCopyStart: Failed to increase stream read thread priority pcmIn=hw:1 [emergency](2,0) err=Operation not permitted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:895,AlsaPcmCopyStart]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] readThreadEntry :pcmCpy/668 Started, muted=0 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:473,readThreadEntry]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] AlsaPcmCopyStart: Failed to increase stream write thread priority pcmIn=hw:2 [HDMI 1](7,0) err=Operation not permitted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:902,AlsaPcmCopyStart]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] CreateOneStream: mixer=Alsa-Mixer [capturePcm=hw:1,2] fail to pause error=File descriptor in bad state [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:484,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CreateOneStream: mixer=Alsa-Mixer stream=emergency CREATED [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:533,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams: radio_stream format set to SND_PCM_FORMAT_S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:450,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams:radio_stream access set to (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:471,ApiPcmSetParams]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCtlCreateControl cardid=hw:1 cardname=A virtual sound card driver for ALSA ctl create name=pause-radio_stream numid=7 value=1 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:515,AlsaCtlCreateControl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCreateSoftvol: radio_stream(stream) done [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-plug-vol.c:103,AlsaCreateSoftvol]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Stream PARAMS: rate=48000, format=2, formatString=S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:388,ApiPcmParamsShow]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] Zone PARAMS: rate=48000, format=2, formatString=S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:388,ApiPcmParamsShow]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaCtlCreateControl cardid=hw:1 cardname=A virtual sound card driver for ALSA ctl create name=vol-radio_stream numid=8 value=70 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:515,AlsaCtlCreateControl]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CreateOneStream: no need for a converter [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:443,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaPcmConf (hw:1,3): mixer=Alsa-Mixer Done channels=2 rate=48000 format=2 access=3 ... DONE ! [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:327,AlsaPcmConf]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaPcmConf (softvol-radio_stream): mixer=Alsa-Mixer Done channels=2 rate=48000 format=2 access=3 ... DONE ! [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:327,AlsaPcmConf]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] AlsaPcmCopyStart: Failed to increase stream read thread priority pcmIn=hw:1 [radio_stream](3,0) err=Operation not permitted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:895,AlsaPcmCopyStart]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: WARNING: [API smixer] AlsaPcmCopyStart: Failed to increase stream write thread priority pcmIn=hw:2 [HDMI 1](7,0) err=Operation not permitted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:902,AlsaPcmCopyStart]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] CreateOneStream: mixer=Alsa-Mixer stream=radio_stream CREATED [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-streams.c:533,CreateOneStream]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] MixerAttachVerb responseJ={ "playbacks": { "uid": "INTEL-UPSQUARED-HDMI", "verb": "none" }, "captures": { "uid": "INTEL-UPSQUARED-HDMI", "verb": "none" }, "zone": [ { "uid": "full-stereo" }, { "uid": "front-seats" } ], "ramps": [ { "uid": "ramp-very-fast" }, { "uid": "ramp-fast" }, { "uid": "ramp-normal" }, { "uid": "ramp-slow" }, { "uid": "ramp-very-slow" } ], "streams": [ { "uid": "multimedia", "verb": "intel-upsquared-hdmi#multimedia", "alsa": "hw:1,0,0" }, { "uid": "navigation", "verb": "intel-upsquared-hdmi#navigation", "alsa": "hw:1,1,0" }, { "uid": "emergency", "verb": "intel-upsquared-hdmi#emergency", "alsa": "hw:1,2,0" }, { "uid": "radio_stream", "verb": "intel-upsquared-hdmi#radio_stream", "alsa": "hw:1,3,0" } ] } [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:654,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb DONE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:657,MixerAttachVerb]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] readThreadEntry :pcmCpy/670 Started, muted=1 [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:473,readThreadEntry]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] capture muted [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-pcm.c:451,readSuspend]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-upsquared-hdmi] Seems that attach call to api smixer succeed with no warning raised : '{ "playbacks": { "uid": "INTEL-UPSQUARED-HDMI", "verb": "none" }, "captures": { "uid": "INTEL-UPSQUARED-HDMI", "verb": "none" }, "zone": [ { "uid": "full-stereo" }, { "uid": "front-seats" } ], "ramps": [ { "uid": "ramp-very-fast" }, { "uid": "ramp-fast" }, { "uid": "ramp-normal" }, { "uid": "ramp-slow" }, { "uid": "ramp-very-slow" } ], "streams": [ { "uid": "multimedia", "verb": "intel-upsquared-hdmi#multimedia", "alsa": "hw:1,0,0" }, { "uid": "navigation", "verb": "intel-upsquared-hdmi#navigation", "alsa": "hw:1,1,0" }, { "uid": "emergency", "verb": "intel-upsquared-hdmi#emergency", "alsa": "hw:1,2,0" }, { "uid": "radio_stream", "verb": "intel-upsquared-hdmi#radio_stream", "alsa": "hw:1,3,0" } ] }' [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/4a-hal/4a-hal-controllers/4a-hal-controllers-mixer-link.c:289,HalCtlsAttachToMixer]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API 4a-hal-intel-upsquared-hdmi] Controller onload event [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:105,init]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API 4a-hal-intel-upsquared-hdmi] init: sco parameters: { "mic": "INTEL-UPSQUARED-HDMI", "zone": "full-stereo", "delayms": 800 } [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:139,init]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API 4a-hal-intel-upsquared-hdmi] init: a2dp parameters: { "zone": "full-stereo", "delayms": 500 } [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:151,init]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: ERROR: [API 4a-hal-intel-upsquared-hdmi] Ask DBus for the list of services [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:870,halBlueAlsaRegisterAll]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API 4a-hal-intel-upsquared-hdmi started [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:806,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: API 4a-hal-manager starting... [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:787,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API 4a-hal-manager started [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:806,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: API ahl-4a starting... [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:787,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API ahl-4a] Required '4a-hal-manager' API found! [/usr/src/debug/agl-service-audio-4a/0.1+gitAUTOINC+b14ab7544f-r0/git/ahl-binding/ahl-binding.cpp:347,init]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API ahl-4a] API is now sealed! [/usr/src/debug/agl-service-audio-4a/0.1+gitAUTOINC+b14ab7544f-r0/git/ahl-binding/ahl-binding.cpp:350,init]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API ahl-4a started [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:806,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: API monitor starting... [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:787,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API monitor started [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:806,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: API unicens starting... [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:787,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: API unicens started [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-apiset.c:806,start_api]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: Alias for url=/monitoring to path=/usr/lib/afb/monitoring [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/main-afb-daemon.c:296,init_alias]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: Waiting port=31002 rootdir=/var/local/lib/afm/applications/agl-service-audio-4a/1.0-2153350 [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/main-afb-daemon.c:375,start_http_server]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: Browser URL= http://localhost:31002 [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/main-afb-daemon.c:376,start_http_server]
      May 07 13:32:01 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: Listening interface *:31002 [/usr/src/debug/af-binder/guppy+gitAUTOINC+f878e8026a-r0/git/src/afb-hsrv.c:557,hsrv_itf_connect]
      May 07 13:32:01 intel-corei7-64 systemd[1]: Started AGL High Level Interface for Audio.
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API 4a-hal-intel-minnow] Registering transport type a2dp, dev 98:29:A6:C9:6E:AA [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:646,halBlueAlsaFetchTransports]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API 4a-hal-intel-upsquared-hdmi] Registering transport type a2dp, dev 98:29:A6:C9:6E:AA [/usr/src/debug/4a-hal-generic/0.1+gitAUTOINC+2d4da5da14-r0/git/plugins/lib/bluealsa/hal-bluealsa.c:646,halBlueAlsaFetchTransports]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb: { "uid": "a2dp_98:29:A6:C9:6E:AA", "captures": { "uid": "a2dp_listen_capture", "pcmplug_params": "bluealsa:HCI=hci0,DEV=98:29:A6:C9:6E:AA,PROFILE=a2dp", "source": { "channels": [ { "uid": "a2dp-right", "port": 0 }, { "uid": "a2dp-left", "port": 1 } ] } }, "streams": [ { "uid": "a2dp_listen_stream", "source": "a2dp_listen_capture", "zone": "full-stereo", "delayms": 500 } ] } [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:552,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set PLAYBACKS [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:581,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set CAPTURES [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:591,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] Looking for card 'bluealsa:HCI=hci0,DEV=98:29:A6:C9:6E:AA,PROFILE=a2dp' [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:286,AlsaCtlGetCardInfo]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] Opening card control 'bluealsa' [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:300,AlsaCtlGetCardInfo]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaByPathOpenCtl: uid=a2dp_listen_capture cardid=hw:0 cardname=Bluetooth Audio Hub Controller pcmplug bluealsa:HCI=hci0,DEV=98:29:A6:C9:6E:AA,PROFILE=a2dp [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-utils-bypath.c:246,AlsaByPathOpenCtl]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams: a2dp_listen_capture format set to SND_PCM_FORMAT_S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:450,ApiPcmSetParams]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams:a2dp_listen_capture access set to (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:471,ApiPcmSetParams]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set ZONES [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:604,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set LOOPS/AVIRT [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:619,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: ERROR: [API smixer] MixerAttachVerb FAILED [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:677,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb: { "uid": "a2dp_98:29:A6:C9:6E:AA", "captures": { "uid": "a2dp_listen_capture", "pcmplug_params": "bluealsa:HCI=hci0,DEV=98:29:A6:C9:6E:AA,PROFILE=a2dp", "source": { "channels": [ { "uid": "a2dp-right", "port": 0 }, { "uid": "a2dp-left", "port": 1 } ] } }, "streams": [ { "uid": "a2dp_listen_stream", "source": "a2dp_listen_capture", "zone": "full-stereo", "delayms": 500 } ] } [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:552,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set PLAYBACKS [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:581,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set CAPTURES [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:591,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] Looking for card 'bluealsa:HCI=hci0,DEV=98:29:A6:C9:6E:AA,PROFILE=a2dp' [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:286,AlsaCtlGetCardInfo]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] Opening card control 'bluealsa' [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-core-ctl.c:300,AlsaCtlGetCardInfo]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] AlsaByPathOpenCtl: uid=a2dp_listen_capture cardid=hw:0 cardname=Bluetooth Audio Hub Controller pcmzplug bluealsa:HCI=hci0,DEV=98:29:A6:C9:6E:AA,PROFILE=a2dp [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-utils-bypath.c:246,AlsaByPathOpenCtl]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams: a2dp_listen_capture format set to SND_PCM_FORMAT_S16_LE [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:450,ApiPcmSetParams]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: NOTICE: [API smixer] ApiPcmSetParams:a2dp_listen_capture access set to (null) [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-pcm.c:471,ApiPcmSetParams]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set ZONES [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:604,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: INFO: [API smixer] MixerAttachVerb set LOOPS/AVIRT [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:619,MixerAttachVerb]
      May 07 13:32:07 intel-corei7-64 afbd-agl-service-audio-4a@1.0-2153350[507]: ERROR: [API smixer] MixerAttachVerb FAILED [/usr/src/debug/4a-softmixer/0.1+gitAUTOINC+6c627f8650-r0/git/plugins/alsa/alsa-api-mixer.c:677,MixerAttachVerb]

       

        # Subject Branch Project Status CR V

            tbultel Thierry Bultel
            edi.feschiyan Edi Feschiyan
            Votes:
            0 Vote for this issue
            Watchers:
            4 Start watching this issue

              Created:
              Updated:
              Resolved:

                Estimated:
                Original Estimate - Not Specified
                Not Specified
                Remaining:
                Remaining Estimate - 0 minutes
                0m
                Logged:
                Time Spent - 3 minutes
                3m