[pulseaudio-discuss] Problem when loading module-always-sink or module-alsa-sink

Sat Mar 13 09:59:43 PST 2010

Hi,

I'm developing a LFS system and since I installed Pulseaudio-0.9.21
I'm running with some problems to play audio on my box.
I first notice this when I started gnome and no sound applet was
showed in the Notification area, so I thought at first that this was
related to gnome, but after reading and talking with some friends on
#gnome (irc.gimp.org) I saw that the problem was with pulseaudio not
being loaded properly so the Sound apple (gnome-volume-control-applet)
was trying to connect to pulseaudio daemon and like no connection
could be made it tries and tries and keep trying to connect and this
is why it wasn't showing:

$ gnome-volume-control-applet

** (gnome-volume-control-applet:1369): WARNING **: Connection failed,
reconnecting...

So I tried to ran pulseaudio with -vvvv option, this is the output:

$ LANG=c pulseaudio -vvvv

I: main.c: setrlimit(RLIMIT_NICE, (31, 31)) failed: Operation not permitted
I: main.c: setrlimit(RLIMIT_RTPRIO, (9, 9)) failed: Operation not permitted
D: core-rtclock.c: Timer slack is set to 50 us.
I: core-util.c: Failed to acquire high-priority scheduling: No such
file or directory
I: main.c: This is PulseAudio 0.9.21
D: main.c: Compilation host: i686-pc-linux-gnu
D: main.c: Compilation CFLAGS: -g -O2 -Wall -W -Wextra -pipe
-Wno-long-long -Winline -Wvla -Wno-overlength-strings
-Wunsafe-loop-optimizations -Wundef -Wformat=2 -Wlogical-op
-Wsign-compare -Wformat-security -Wmissing-include-dirs
-Wformat-nonliteral -Wold-style-definition -Wpointer-arith -Winit-self
-Wdeclaration-after-statement -Wfloat-equal -Wmissing-prototypes
-Wstrict-prototypes -Wredundant-decls -Wmissing-declarations
-Wmissing-noreturn -Wshadow -Wendif-labels -Wcast-align
-Wstrict-aliasing=2 -Wwrite-strings -Wno-unused-parameter -ffast-math
-Wp,-D_FORTIFY_SOURCE=2 -fno-common -fdiagnostics-show-option
D: main.c: Running on host: Linux i686 2.6.30.2 #2 SMP Wed Jan 27
17:14:41 BRST 2010
D: main.c: Found 1 CPUs.
I: main.c: Page size is 4096 bytes
D: main.c: Compiled with Valgrind support: no
D: main.c: Running in valgrind mode: no
D: main.c: Running in VM: yes
D: main.c: Optimized build: yes
D: main.c: All asserts enabled.
I: main.c: Machine ID is avant.
I: main.c: Using runtime directory /home/maginot/.pulse/avant-runtime.
I: main.c: Using state directory /home/maginot/.pulse.
I: main.c: Using modules directory /usr/lib/pulse-0.9.21/modules.
I: main.c: Running in system mode: no
W: pid.c: Stale PID file, overwriting.
I: main.c: Fresh high-resolution timers available! Bon appetit!
I: cpu-x86.c: CPU flags: MMX SSE SSE2 SSE3 SSSE3 SSE4_1
I: svolume_mmx.c: Initialising MMX optimized functions.
I: remap_mmx.c: Initialising MMX optimized remappers.
I: svolume_sse.c: Initialising SSE2 optimized functions.
I: remap_sse.c: Initialising SSE2 optimized remappers.
I: sconv_sse.c: Initialising SSE2 optimized conversions.
D: memblock.c: Using shared memory pool with 1024 slots of size 64.0
KiB each, total size is 64.0 MiB, maximum usable slot size is 65496
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-device-volumes.i686-pc-linux-gnu.gdbm'
I: module-device-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-device-volumes'.
I: module.c: Loaded "module-device-restore" (index: #0; argument: "").
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-stream-volumes.i686-pc-linux-gnu.gdbm'
I: module-stream-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-stream-volumes'.
I: module.c: Loaded "module-stream-restore" (index: #1; argument: "").
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-card-database.i686-pc-linux-gnu.gdbm'
I: module-card-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-card-database'.
I: module.c: Loaded "module-card-restore" (index: #2; argument: "").
I: module.c: Loaded "module-augment-properties" (index: #3; argument: "").
N: alsa-util.c: Disabling timer-based scheduling because running inside a VM.
E: fdsem.c: Assertion 'pa_atomic_dec(&f->data->waiting) >= 1' failed
at pulsecore/fdsem.c:283, function pa_fdsem_before_poll(). Aborting.

Like you may notice, it finishes with an error line: E: fdsem.c:
Assertion 'pa_atomic_dec(&f->data->waiting) >= 1' failed at
pulsecore/fdsem.c:283, function

After tweaking around a little I first disabled module-always-sink
from /etc/pulse/default.pa

$ DISPLAY=:0.0 LANG=c pulseaudio -vvvv

I: main.c: setrlimit(RLIMIT_NICE, (31, 31)) failed: Operation not permitted
I: main.c: setrlimit(RLIMIT_RTPRIO, (9, 9)) failed: Operation not permitted
D: core-rtclock.c: Timer slack is set to 50 us.
I: core-util.c: Failed to acquire high-priority scheduling: No such
file or directory
I: main.c: This is PulseAudio 0.9.21
D: main.c: Compilation host: i686-pc-linux-gnu
D: main.c: Compilation CFLAGS: -g -O2 -Wall -W -Wextra -pipe
-Wno-long-long -Winline -Wvla -Wno-overlength-strings
-Wunsafe-loop-optimizations -Wundef -Wformat=2 -Wlogical-op
-Wsign-compare -Wformat-security -Wmissing-include-dirs
-Wformat-nonliteral -Wold-style-definition -Wpointer-arith -Winit-self
-Wdeclaration-after-statement -Wfloat-equal -Wmissing-prototypes
-Wstrict-prototypes -Wredundant-decls -Wmissing-declarations
-Wmissing-noreturn -Wshadow -Wendif-labels -Wcast-align
-Wstrict-aliasing=2 -Wwrite-strings -Wno-unused-parameter -ffast-math
-Wp,-D_FORTIFY_SOURCE=2 -fno-common -fdiagnostics-show-option
D: main.c: Running on host: Linux i686 2.6.30.2 #2 SMP Wed Jan 27
17:14:41 BRST 2010
D: main.c: Found 1 CPUs.
I: main.c: Page size is 4096 bytes
D: main.c: Compiled with Valgrind support: no
D: main.c: Running in valgrind mode: no
D: main.c: Running in VM: yes
D: main.c: Optimized build: yes
D: main.c: All asserts enabled.
I: main.c: Machine ID is avant.
I: main.c: Using runtime directory /home/maginot/.pulse/avant-runtime.
I: main.c: Using state directory /home/maginot/.pulse.
I: main.c: Using modules directory /usr/lib/pulse-0.9.21/modules.
I: main.c: Running in system mode: no
I: main.c: Fresh high-resolution timers available! Bon appetit!
I: cpu-x86.c: CPU flags: MMX SSE SSE2 SSE3 SSSE3 SSE4_1
I: svolume_mmx.c: Initialising MMX optimized functions.
I: remap_mmx.c: Initialising MMX optimized remappers.
I: svolume_sse.c: Initialising SSE2 optimized functions.
I: remap_sse.c: Initialising SSE2 optimized remappers.
I: sconv_sse.c: Initialising SSE2 optimized conversions.
D: memblock.c: Using shared memory pool with 1024 slots of size 64.0
KiB each, total size is 64.0 MiB, maximum usable slot size is 65496
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-device-volumes.i686-pc-linux-gnu.gdbm'
I: module-device-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-device-volumes'.
I: module.c: Loaded "module-device-restore" (index: #0; argument: "").
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-stream-volumes.i686-pc-linux-gnu.gdbm'
I: module-stream-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-stream-volumes'.
I: module.c: Loaded "module-stream-restore" (index: #1; argument: "").
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-card-database.i686-pc-linux-gnu.gdbm'
I: module-card-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-card-database'.
I: module.c: Loaded "module-card-restore" (index: #2; argument: "").
I: module.c: Loaded "module-augment-properties" (index: #3; argument: "").
D: cli-command.c: Checking for existance of
'/usr/lib/pulse-0.9.21/modules/module-udev-detect.so': success
I: module-udev-detect.c: Found 0 cards.
I: module.c: Loaded "module-udev-detect" (index: #4; argument: "").
D: cli-command.c: Checking for existance of
'/usr/lib/pulse-0.9.21/modules/module-bluetooth-discover.so': success
D: dbus-util.c: Successfully connected to D-Bus system bus
4f471c0c66dc378ba74f50224b9b9fa9 as :1.120
D: bluetooth-util.c: dbus: interface=org.freedesktop.DBus,
path=/org/freedesktop/DBus, member=NameAcquired
D: bluetooth-util.c: Bluetooth daemon is apparently not available.
I: module.c: Loaded "module-bluetooth-discover" (index: #5; argument: "").
D: cli-command.c: Checking for existance of
'/usr/lib/pulse-0.9.21/modules/module-esound-protocol-unix.so':
success
I: module.c: Loaded "module-esound-protocol-unix" (index: #6; argument: "").
I: module.c: Loaded "module-native-protocol-unix" (index: #7; argument: "").
D: cli-command.c: Checking for existance of
'/usr/lib/pulse-0.9.21/modules/module-gconf.so': success
E: module-gconf.c: Unable to read or parse data from client.
E: module.c: Failed to load  module "module-gconf" (argument: ""):
initialization failed.
I: module.c: Loaded "module-default-device-restore" (index: #8; argument: "").
I: module.c: Loaded "module-rescue-streams" (index: #9; argument: "").
I: module.c: Loaded "module-intended-roles" (index: #10; argument: "").
I: module.c: Loaded "module-suspend-on-idle" (index: #11; argument: "").
I: client.c: Created 0 "ConsoleKit Session /org/freedesktop/ConsoleKit/Session1"
D: module-console-kit.c: Added new session /org/freedesktop/ConsoleKit/Session1
I: module.c: Loaded "module-console-kit" (index: #12; argument: "").
I: module.c: Loaded "module-position-event-sounds" (index: #13; argument: "").
I: module.c: Loaded "module-cork-music-on-phone" (index: #14; argument: "").
E: main.c: Module load failed.
D: dbus-util.c: Successfully connected to D-Bus session bus
8ed3a80302e25ae1bd53feb94b9ba49a as :1.38
D: main.c: Got org.pulseaudio.Server!
I: main.c: Daemon startup complete.
I: client.c: Created 1 "Native client (UNIX socket client)"
D: protocol-native.c: Protocol version: remote 16, local 16
I: protocol-native.c: Got credentials: uid=1000 gid=1000 success=1
D: protocol-native.c: SHM possible: yes
D: protocol-native.c: Negotiated SHM: yes
D: module-augment-properties.c: Looking for .desktop file for
gnome-settings-daemon

it look to be working, but so I tried to ran
gnome-volume-control-applet now, and got this:

$ gnome-volume-control-applet

** (gnome-volume-control-applet:1572): WARNING **: Unable to get default sink

** (gnome-volume-control-applet:1572): WARNING **: Unable to get default source

and at the same time pulseaudio -vvvv throws more information:

I: client.c: Created 2 "Native client (UNIX socket client)"
D: protocol-native.c: Protocol version: remote 16, local 16
I: protocol-native.c: Got credentials: uid=1000 gid=1000 success=1
D: protocol-native.c: SHM possible: yes
D: protocol-native.c: Negotiated SHM: yes
D: module-augment-properties.c: Looking for .desktop file for
gnome-volume-control-applet

Well, for what I saw, now I have no sound (maybe because there is no
sink and source?)
So I enabled module-alsa-sink (load-module module-alsa-sink
device=hw:0)  to see what happens and well, here we go again with the
same problem from module-always-sink:

$ LANG=c pulseaudio -vvvv
I: main.c: setrlimit(RLIMIT_NICE, (31, 31)) failed: Operation not permitted
I: main.c: setrlimit(RLIMIT_RTPRIO, (9, 9)) failed: Operation not permitted
D: core-rtclock.c: Timer slack is set to 50 us.
I: core-util.c: Failed to acquire high-priority scheduling: No such
file or directory
I: main.c: This is PulseAudio 0.9.21
D: main.c: Compilation host: i686-pc-linux-gnu
D: main.c: Compilation CFLAGS: -g -O2 -Wall -W -Wextra -pipe
-Wno-long-long -Winline -Wvla -Wno-overlength-strings
-Wunsafe-loop-optimizations -Wundef -Wformat=2 -Wlogical-op
-Wsign-compare -Wformat-security -Wmissing-include-dirs
-Wformat-nonliteral -Wold-style-definition -Wpointer-arith -Winit-self
-Wdeclaration-after-statement -Wfloat-equal -Wmissing-prototypes
-Wstrict-prototypes -Wredundant-decls -Wmissing-declarations
-Wmissing-noreturn -Wshadow -Wendif-labels -Wcast-align
-Wstrict-aliasing=2 -Wwrite-strings -Wno-unused-parameter -ffast-math
-Wp,-D_FORTIFY_SOURCE=2 -fno-common -fdiagnostics-show-option
D: main.c: Running on host: Linux i686 2.6.30.2 #2 SMP Wed Jan 27
17:14:41 BRST 2010
D: main.c: Found 1 CPUs.
I: main.c: Page size is 4096 bytes
D: main.c: Compiled with Valgrind support: no
D: main.c: Running in valgrind mode: no
D: main.c: Running in VM: yes
D: main.c: Optimized build: yes
D: main.c: All asserts enabled.
I: main.c: Machine ID is avant.
I: main.c: Using runtime directory /home/maginot/.pulse/avant-runtime.
I: main.c: Using state directory /home/maginot/.pulse.
I: main.c: Using modules directory /usr/lib/pulse-0.9.21/modules.
I: main.c: Running in system mode: no
I: main.c: Fresh high-resolution timers available! Bon appetit!
I: cpu-x86.c: CPU flags: MMX SSE SSE2 SSE3 SSSE3 SSE4_1
I: svolume_mmx.c: Initialising MMX optimized functions.
I: remap_mmx.c: Initialising MMX optimized remappers.
I: svolume_sse.c: Initialising SSE2 optimized functions.
I: remap_sse.c: Initialising SSE2 optimized remappers.
I: sconv_sse.c: Initialising SSE2 optimized conversions.
D: memblock.c: Using shared memory pool with 1024 slots of size 64.0
KiB each, total size is 64.0 MiB, maximum usable slot size is 65496
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-device-volumes.i686-pc-linux-gnu.gdbm'
I: module-device-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-device-volumes'.
I: module.c: Loaded "module-device-restore" (index: #0; argument: "").
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-stream-volumes.i686-pc-linux-gnu.gdbm'
I: module-stream-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-stream-volumes'.
I: module.c: Loaded "module-stream-restore" (index: #1; argument: "").
D: database-gdbm.c: Opened GDBM database
'/home/maginot/.pulse/avant-card-database.i686-pc-linux-gnu.gdbm'
I: module-card-restore.c: Sucessfully opened database file
'/home/maginot/.pulse/avant-card-database'.
I: module.c: Loaded "module-card-restore" (index: #2; argument: "").
I: module.c: Loaded "module-augment-properties" (index: #3; argument: "").
N: alsa-util.c: Disabling timer-based scheduling because running inside a VM.
E: fdsem.c: Assertion 'pa_atomic_dec(&f->data->waiting) >= 1' failed
at pulsecore/fdsem.c:283, function pa_fdsem_before_poll(). Aborting.

I think this is it. Please if anyone need any further information just ask.

Thanks.

--
Maginot Júnior