Bug#581624: pulseaudio: Stuttering playback from Wine
Mancausoft
andreamilazzo at mancausoft.org
Thu Feb 20 16:57:19 UTC 2014
I have the same problem.
When the audio leaking, in the mixer I see an alsa device appear and
disappear (pavucontrol and kmix).
pulseaudio and kmix use a lot of cpu:
23480 andrea 9 -11 383816 50804 2556 R 99,4 1,3 26:40.74 pulseaudio
23550 andrea 20 0 691120 23872 9700 R 87,7 0,6 22:35.62 kmix
On log I read:
(1539.838| 0.000) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream removed from object /org/pulseaudio/core1/playback_stream73959
(1539.838| 0.000) I: [pulseaudio] sink-input.c: Freeing input 73959 "ALSA Playback"
(1539.838| 0.000) D: [pulseaudio] module-intended-roles.c: Not setting device for stream ALSA Playback, because it lacks role.
(1539.838| 0.000) I: [pulseaudio] sink-input.c: Trying to change sample rate
(1539.838| 0.000) I: [pulseaudio] sink.c: Cannot update rate, SINK_IS_RUNNING, will keep using 48000 Hz
(1539.838| 0.000) I: [pulseaudio] module-stream-restore.c: Restoring volume for sink input sink-input-by-application-name:ALSA plug-in [wine-preloader].
(1539.838| 0.000) D: [pulseaudio] module-suspend-on-idle.c: Sink alsa_output.pci-0000_00_1b.0.analog-stereo becomes busy, resuming.
(1539.838| 0.000) I: [pulseaudio] resampler.c: Forcing resampler 'copy', because of fixed, identical sample rates.
(1539.838| 0.000) I: [pulseaudio] resampler.c: Using resampler 'copy'
(1539.838| 0.000) I: [pulseaudio] resampler.c: Using s16le as working format.
(1539.838| 0.000) D: [pulseaudio] resampler.c: Resampler:
(1539.838| 0.000) D: [pulseaudio] resampler.c: rate 48000 -> 48000 (method copy),
(1539.838| 0.000) D: [pulseaudio] resampler.c: format float32le -> s16le (intermediate s16le),
(1539.838| 0.000) D: [pulseaudio] resampler.c: channels 2 -> 2 (resampling 2)
(1539.838| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=33554432, tlength=0, base=4, prebuf=0, minreq=1 maxrewind=0
(1539.838| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=33554432, tlength=33554432, base=4, prebuf=0, minreq=4 maxrewind=0
(1539.838| 0.000) I: [pulseaudio] sink-input.c: Created input 73961 "ALSA Playback" on alsa_output.pci-0000_00_1b.0.analog-stereo with sample spec float32le 2ch 48000Hz and channel map front-left,front-right
verbose log in attachment.
--
Mancausoft - http://www.mancausoft.org/
GPG key: B53F90F2
-------------- next part --------------
(1539.834| 0.000) I: [pulseaudio] sink-input.c: Created input 73959 "ALSA Playback" on alsa_output.pci-0000_00_1b.0.analog-stereo with sample spec float32le 2ch 48000Hz and channel map front-left,front-right
(1539.834| 0.000) I: [pulseaudio] sink-input.c: media.name = "ALSA Playback"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: application.name = "ALSA plug-in [wine-preloader]"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: native-protocol.peer = "UNIX socket client"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: native-protocol.version = "28"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: application.process.id = "24998"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: application.process.user = "andrea"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: application.process.host = "mrburns"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: application.process.binary = "wine-preloader"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: application.language = "it_IT.UTF-8"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: window.x11.display = ":0"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: application.process.machine_id = "7135e97663f57205e2d64d9850d1d5a3"
(1539.834| 0.000) I: [pulseaudio] sink-input.c: module-stream-restore.id = "sink-input-by-application-name:ALSA plug-in [wine-preloader]"
(1539.834| 0.000) I: [pulseaudio] protocol-native.c: Requested tlength=40.00 ms, minreq=10.00 ms
(1539.834| 0.000) D: [pulseaudio] protocol-native.c: Early requests mode enabled, configuring sink latency to minreq.
(1539.834| 0.000) D: [pulseaudio] protocol-native.c: Requested latency=10.00 ms, Received latency=96.00 ms
(1539.834| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.834| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.834| 0.000) I: [pulseaudio] protocol-native.c: Final latency 384.00 ms = 96.00 ms + 2*96.00 ms + 96.00 ms
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Latency set to 96.00ms
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=47104
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12737
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requesting rewind due to latency change.
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 100% 1: 100%
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 100% 1: 100% (accurate-enough=yes)
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume going down to 65535 at 44840020003
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested to rewind 65536 bytes.
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Limited to 64224 bytes.
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: before: 16056
(1539.834| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: after: 16056
(1539.835| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Rewound 64224 bytes.
(1539.835| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Processing rewind...
(1539.835| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: latency = 1312
(1539.835| 0.000) D: [alsa-sink-CX20585 Analog] sink-input.c: Have to rewind 64224 bytes on render memblockq.
(1539.835| 0.000) D: [alsa-sink-CX20585 Analog] source.c: Processing rewind...
(1539.835| 0.000) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream added for object /org/pulseaudio/core1/playback_stream73959
(1539.835| 0.000) D: [pulseaudio] module-intended-roles.c: Not setting device for stream ALSA Playback, because it lacks role.
(1539.835| 0.000) I: [pulseaudio] sink-input.c: Trying to change sample rate
(1539.835| 0.000) I: [pulseaudio] sink.c: Cannot update rate, SINK_IS_RUNNING, will keep using 48000 Hz
(1539.835| 0.000) I: [pulseaudio] module-stream-restore.c: Restoring volume for sink input sink-input-by-application-name:ALSA plug-in [wine-preloader].
(1539.835| 0.000) D: [pulseaudio] module-suspend-on-idle.c: Sink alsa_output.pci-0000_00_1b.0.analog-stereo becomes busy, resuming.
(1539.835| 0.000) I: [pulseaudio] resampler.c: Forcing resampler 'copy', because of fixed, identical sample rates.
(1539.835| 0.000) I: [pulseaudio] resampler.c: Using resampler 'copy'
(1539.835| 0.000) I: [pulseaudio] resampler.c: Using s16le as working format.
(1539.835| 0.000) D: [pulseaudio] resampler.c: Resampler:
(1539.835| 0.000) D: [pulseaudio] resampler.c: rate 48000 -> 48000 (method copy),
(1539.835| 0.000) D: [pulseaudio] resampler.c: format float32le -> s16le (intermediate s16le),
(1539.835| 0.000) D: [pulseaudio] resampler.c: channels 2 -> 2 (resampling 2)
(1539.835| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=33554432, tlength=0, base=4, prebuf=0, minreq=1 maxrewind=0
(1539.836| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=33554432, tlength=33554432, base=4, prebuf=0, minreq=4 maxrewind=0
(1539.836| 0.000) I: [pulseaudio] sink-input.c: Created input 73960 "ALSA Playback" on alsa_output.pci-0000_00_1b.0.analog-stereo with sample spec float32le 2ch 48000Hz and channel map front-left,front-right
(1539.836| 0.000) I: [pulseaudio] sink-input.c: media.name = "ALSA Playback"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: application.name = "ALSA plug-in [wine-preloader]"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: native-protocol.peer = "UNIX socket client"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: native-protocol.version = "28"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: application.process.id = "24872"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: application.process.user = "andrea"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: application.process.host = "mrburns"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: application.process.binary = "wine-preloader"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: application.language = "it_IT.UTF-8"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: window.x11.display = ":0"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: application.process.machine_id = "7135e97663f57205e2d64d9850d1d5a3"
(1539.836| 0.000) I: [pulseaudio] sink-input.c: module-stream-restore.id = "sink-input-by-application-name:ALSA plug-in [wine-preloader]"
(1539.836| 0.000) I: [pulseaudio] protocol-native.c: Requested tlength=40.00 ms, minreq=10.00 ms
(1539.836| 0.000) D: [pulseaudio] protocol-native.c: Early requests mode enabled, configuring sink latency to minreq.
(1539.836| 0.000) D: [pulseaudio] protocol-native.c: Requested latency=10.00 ms, Received latency=96.00 ms
(1539.836| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.836| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.836| 0.000) I: [pulseaudio] protocol-native.c: Final latency 384.00 ms = 96.00 ms + 2*96.00 ms + 96.00 ms
(1539.836| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Latency set to 96.00ms
(1539.836| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=47104
(1539.836| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12737
(1539.836| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 100% 1: 100%
(1539.836| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.836| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 100% 1: 100% (accurate-enough=yes)
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume going down to 65535 at 44839780168
(1539.837| 0.000) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream added for object /org/pulseaudio/core1/playback_stream73960
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Latency set to 96.00ms
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=47104
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12737
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 100% 1: 100%
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 100% 1: 100% (accurate-enough=yes)
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume going down to 65535 at 44839780168
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65535 at 44839780168 was dropped
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested to rewind 65536 bytes.
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Limited to 17664 bytes.
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: before: 4416
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: after: 4416
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Rewound 17664 bytes.
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Processing rewind...
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: latency = 1261
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65535 at 44839694847 was written 87 usec late
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] sink-input.c: Have to rewind 17664 bytes on render memblockq.
(1539.837| 0.000) D: [alsa-sink-CX20585 Analog] source.c: Processing rewind...
(1539.838| 0.000) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream removed from object /org/pulseaudio/core1/playback_stream73959
(1539.838| 0.000) I: [pulseaudio] sink-input.c: Freeing input 73959 "ALSA Playback"
(1539.838| 0.000) D: [pulseaudio] module-intended-roles.c: Not setting device for stream ALSA Playback, because it lacks role.
(1539.838| 0.000) I: [pulseaudio] sink-input.c: Trying to change sample rate
(1539.838| 0.000) I: [pulseaudio] sink.c: Cannot update rate, SINK_IS_RUNNING, will keep using 48000 Hz
(1539.838| 0.000) I: [pulseaudio] module-stream-restore.c: Restoring volume for sink input sink-input-by-application-name:ALSA plug-in [wine-preloader].
(1539.838| 0.000) D: [pulseaudio] module-suspend-on-idle.c: Sink alsa_output.pci-0000_00_1b.0.analog-stereo becomes busy, resuming.
(1539.838| 0.000) I: [pulseaudio] resampler.c: Forcing resampler 'copy', because of fixed, identical sample rates.
(1539.838| 0.000) I: [pulseaudio] resampler.c: Using resampler 'copy'
(1539.838| 0.000) I: [pulseaudio] resampler.c: Using s16le as working format.
(1539.838| 0.000) D: [pulseaudio] resampler.c: Resampler:
(1539.838| 0.000) D: [pulseaudio] resampler.c: rate 48000 -> 48000 (method copy),
(1539.838| 0.000) D: [pulseaudio] resampler.c: format float32le -> s16le (intermediate s16le),
(1539.838| 0.000) D: [pulseaudio] resampler.c: channels 2 -> 2 (resampling 2)
(1539.838| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=33554432, tlength=0, base=4, prebuf=0, minreq=1 maxrewind=0
(1539.838| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=33554432, tlength=33554432, base=4, prebuf=0, minreq=4 maxrewind=0
(1539.838| 0.000) I: [pulseaudio] sink-input.c: Created input 73961 "ALSA Playback" on alsa_output.pci-0000_00_1b.0.analog-stereo with sample spec float32le 2ch 48000Hz and channel map front-left,front-right
(1539.838| 0.000) I: [pulseaudio] sink-input.c: media.name = "ALSA Playback"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: application.name = "ALSA plug-in [wine-preloader]"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: native-protocol.peer = "UNIX socket client"
(1539.838| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65536 at 44839695849 was written 12 usec late
(1539.838| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65535 at 44839685514 was written 10347 usec late
(1539.838| 0.000) I: [pulseaudio] sink-input.c: native-protocol.version = "28"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: application.process.id = "24998"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: application.process.user = "andrea"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: application.process.host = "mrburns"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: application.process.binary = "wine-preloader"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: application.language = "it_IT.UTF-8"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: window.x11.display = ":0"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: application.process.machine_id = "7135e97663f57205e2d64d9850d1d5a3"
(1539.838| 0.000) I: [pulseaudio] sink-input.c: module-stream-restore.id = "sink-input-by-application-name:ALSA plug-in [wine-preloader]"
(1539.838| 0.000) I: [pulseaudio] protocol-native.c: Requested tlength=40.00 ms, minreq=10.00 ms
(1539.838| 0.000) D: [pulseaudio] protocol-native.c: Early requests mode enabled, configuring sink latency to minreq.
(1539.839| 0.000) D: [pulseaudio] protocol-native.c: Requested latency=10.00 ms, Received latency=96.00 ms
(1539.839| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.839| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.839| 0.000) I: [pulseaudio] protocol-native.c: Final latency 384.00 ms = 96.00 ms + 2*96.00 ms + 96.00 ms
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Latency set to 96.00ms
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=47104
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12737
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 100% 1: 100%
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 100% 1: 100% (accurate-enough=yes)
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume going down to 65535 at 44839783003
(1539.839| 0.000) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream added for object /org/pulseaudio/core1/playback_stream73961
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Latency set to 96.00ms
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=47104
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12737
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 100% 1: 100%
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 100% 1: 100% (accurate-enough=yes)
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume going down to 65535 at 44839783002
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65535 at 44839783003 was dropped
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested to rewind 65536 bytes.
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Limited to 17792 bytes.
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: before: 4448
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: after: 4448
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Rewound 17792 bytes.
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Processing rewind...
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: latency = 1189
(1539.839| 0.000) D: [alsa-sink-CX20585 Analog] sink-input.c: Have to rewind 17792 bytes on render memblockq.
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] source.c: Processing rewind...
(1539.840| 0.000) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream removed from object /org/pulseaudio/core1/playback_stream73960
(1539.840| 0.000) I: [pulseaudio] sink-input.c: Freeing input 73960 "ALSA Playback"
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] protocol-native.c: Requesting rewind due to end of underrun.
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested to rewind 65536 bytes.
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Limited to 18048 bytes.
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: before: 4512
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: after: 4512
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Rewound 18048 bytes.
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Processing rewind...
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: latency = 1273
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] sink-input.c: Have to rewind 18048 bytes on render memblockq.
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] source.c: Processing rewind...
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] protocol-native.c: Implicit underrun of 'ALSA Playback'
(1539.840| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (2144 bytes ahead in playback buffer)
(1539.841| 0.000) D: [pulseaudio] module-intended-roles.c: Not setting device for stream ALSA Playback, because it lacks role.
(1539.841| 0.000) I: [pulseaudio] sink-input.c: Trying to change sample rate
(1539.841| 0.000) I: [pulseaudio] sink.c: Cannot update rate, SINK_IS_RUNNING, will keep using 48000 Hz
(1539.841| 0.000) I: [pulseaudio] module-stream-restore.c: Restoring volume for sink input sink-input-by-application-name:ALSA plug-in [wine-preloader].
(1539.841| 0.000) D: [pulseaudio] module-suspend-on-idle.c: Sink alsa_output.pci-0000_00_1b.0.analog-stereo becomes busy, resuming.
(1539.841| 0.000) I: [pulseaudio] resampler.c: Forcing resampler 'copy', because of fixed, identical sample rates.
(1539.841| 0.000) I: [pulseaudio] resampler.c: Using resampler 'copy'
(1539.841| 0.000) I: [pulseaudio] resampler.c: Using s16le as working format.
(1539.841| 0.000) D: [pulseaudio] resampler.c: Resampler:
(1539.841| 0.000) D: [pulseaudio] resampler.c: rate 48000 -> 48000 (method copy),
(1539.841| 0.000) D: [pulseaudio] resampler.c: format float32le -> s16le (intermediate s16le),
(1539.841| 0.000) D: [pulseaudio] resampler.c: channels 2 -> 2 (resampling 2)
(1539.841| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=33554432, tlength=0, base=4, prebuf=0, minreq=1 maxrewind=0
(1539.841| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=33554432, tlength=33554432, base=4, prebuf=0, minreq=4 maxrewind=0
(1539.841| 0.000) I: [pulseaudio] sink-input.c: Created input 73962 "ALSA Playback" on alsa_output.pci-0000_00_1b.0.analog-stereo with sample spec float32le 2ch 48000Hz and channel map front-left,front-right
(1539.841| 0.000) I: [pulseaudio] sink-input.c: media.name = "ALSA Playback"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: application.name = "ALSA plug-in [wine-preloader]"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: native-protocol.peer = "UNIX socket client"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: native-protocol.version = "28"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: application.process.id = "24872"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: application.process.user = "andrea"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: application.process.host = "mrburns"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: application.process.binary = "wine-preloader"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: application.language = "it_IT.UTF-8"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: window.x11.display = ":0"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: application.process.machine_id = "7135e97663f57205e2d64d9850d1d5a3"
(1539.841| 0.000) I: [pulseaudio] sink-input.c: module-stream-restore.id = "sink-input-by-application-name:ALSA plug-in [wine-preloader]"
(1539.841| 0.000) I: [pulseaudio] protocol-native.c: Requested tlength=40.00 ms, minreq=10.00 ms
(1539.841| 0.000) D: [pulseaudio] protocol-native.c: Early requests mode enabled, configuring sink latency to minreq.
(1539.841| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1984 bytes ahead in playback buffer)
(1539.841| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1984 bytes ahead in playback buffer)
(1539.841| 0.000) D: [pulseaudio] protocol-native.c: Requested latency=10.00 ms, Received latency=96.00 ms
(1539.841| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.841| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.841| 0.000) I: [pulseaudio] protocol-native.c: Final latency 384.00 ms = 96.00 ms + 2*96.00 ms + 96.00 ms
(1539.841| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1952 bytes ahead in playback buffer)
(1539.841| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Latency set to 96.00ms
(1539.841| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=47104
(1539.841| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12737
(1539.841| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 100% 1: 100%
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 100% 1: 100% (accurate-enough=yes)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume going down to 65535 at 44839786003
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1888 bytes ahead in playback buffer)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1856 bytes ahead in playback buffer)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1856 bytes ahead in playback buffer)
(1539.842| 0.000) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream added for object /org/pulseaudio/core1/playback_stream73962
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1824 bytes ahead in playback buffer)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1792 bytes ahead in playback buffer)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1792 bytes ahead in playback buffer)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1792 bytes ahead in playback buffer)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1760 bytes ahead in playback buffer)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1760 bytes ahead in playback buffer)
(1539.842| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16288 bytes ago (1728 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] protocol-native.c: Requesting rewind due to end of underrun.
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested to rewind 65536 bytes.
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Limited to 17760 bytes.
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: before: 4440
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: after: 4440
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Rewound 17760 bytes.
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Processing rewind...
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: latency = 1232
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink-input.c: Have to rewind 17760 bytes on render memblockq.
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink-input.c: Have to rewind 17760 bytes on render memblockq.
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] source.c: Processing rewind...
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] protocol-native.c: Implicit underrun of 'ALSA Playback'
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1664 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1664 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1632 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1600 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1600 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1600 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1568 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1568 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1568 bytes ahead in playback buffer)
(1539.843| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1536 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1536 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1536 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1504 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1504 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1504 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1472 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1472 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1472 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1472 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1440 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1408 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1408 bytes ahead in playback buffer)
(1539.844| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (1408 bytes ahead in playback buffer)
(1539.847| 0.002) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65535 at 44839704194 was written 50 usec late
(1539.847| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (896 bytes ahead in playback buffer)
(1539.849| 0.001) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65535 at 44839706348 was written 30 usec late
(1539.849| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (512 bytes ahead in playback buffer)
(1539.849| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (480 bytes ahead in playback buffer)
(1539.849| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (448 bytes ahead in playback buffer)
(1539.849| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (416 bytes ahead in playback buffer)
(1539.849| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16736 bytes ago (416 bytes ahead in playback buffer)
(1539.852| 0.002) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 12448 bytes ago (4288 bytes ahead in playback buffer)
(1539.852| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65535 at 44839709515 was written 15 usec late
(1539.852| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 12448 bytes ago (4192 bytes ahead in playback buffer)
(1539.862| 0.009) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16064 bytes ago (2336 bytes ahead in playback buffer)
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Latency set to 96.00ms
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=47104
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12737
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 100% 1: 100%
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 100% 1: 100% (accurate-enough=yes)
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume not changing
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested to rewind 65536 bytes.
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Limited to 18112 bytes.
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: before: 4528
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: after: 4528
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Rewound 18112 bytes.
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Processing rewind...
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: latency = 1187
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink-input.c: Have to rewind 18112 bytes on render memblockq.
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] source.c: Processing rewind...
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16160 bytes ago (2272 bytes ahead in playback buffer)
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Found underrun 16160 bytes ago (2240 bytes ahead in playback buffer)
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=0
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12736
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 128% 1: 128%
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 6.48 dB 1: 6.48 dB
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 128% 1: 128% (accurate-enough=no)
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 6.48 dB 1: 6.48 dB
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume going up to 65536 at 44839823669
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested to rewind 65536 bytes.
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Limited to 18112 bytes.
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: before: 4528
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: after: 4528
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Rewound 18112 bytes.
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Processing rewind...
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: latency = 1270
(1539.862| 0.000) D: [alsa-sink-CX20585 Analog] source.c: Processing rewind...
(1539.862| 0.000) D: [pulseaudio] module-suspend-on-idle.c: Sink alsa_output.pci-0000_00_1b.0.analog-stereo becomes idle, timeout in 5 seconds.
(1539.863| 0.000) D: [pulseaudio] module-suspend-on-idle.c: Sink alsa_output.pci-0000_00_1b.0.analog-stereo becomes idle, timeout in 5 seconds.
(1539.863| 0.000) D: [pulseaudio] core.c: Hmm, no streams around, trying to vacuum.
(1539.865| 0.002) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream removed from object /org/pulseaudio/core1/playback_stream73961
(1539.866| 0.000) I: [pulseaudio] sink-input.c: Freeing input 73961 "ALSA Playback"
(1539.866| 0.000) D: [pulseaudio] protocol-dbus.c: Interface org.PulseAudio.Core1.Stream removed from object /org/pulseaudio/core1/playback_stream73962
(1539.866| 0.000) I: [pulseaudio] sink-input.c: Freeing input 73962 "ALSA Playback"
(1539.871| 0.004) D: [pulseaudio] module-intended-roles.c: Not setting device for stream ALSA Playback, because it lacks role.
(1539.871| 0.000) I: [pulseaudio] sink-input.c: Trying to change sample rate
(1539.871| 0.000) I: [pulseaudio] module-stream-restore.c: Restoring volume for sink input sink-input-by-application-name:ALSA plug-in [wine-preloader].
(1539.871| 0.000) D: [pulseaudio] module-suspend-on-idle.c: Sink alsa_output.pci-0000_00_1b.0.analog-stereo becomes busy, resuming.
(1539.871| 0.000) I: [pulseaudio] resampler.c: Forcing resampler 'copy', because of fixed, identical sample rates.
(1539.871| 0.000) I: [pulseaudio] resampler.c: Using resampler 'copy'
(1539.871| 0.000) I: [pulseaudio] resampler.c: Using s16le as working format.
(1539.871| 0.000) D: [pulseaudio] resampler.c: Resampler:
(1539.871| 0.000) D: [pulseaudio] resampler.c: rate 48000 -> 48000 (method copy),
(1539.871| 0.000) D: [pulseaudio] resampler.c: format float32le -> s16le (intermediate s16le),
(1539.871| 0.000) D: [pulseaudio] resampler.c: channels 2 -> 2 (resampling 2)
(1539.871| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=33554432, tlength=0, base=4, prebuf=0, minreq=1 maxrewind=0
(1539.871| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=33554432, tlength=33554432, base=4, prebuf=0, minreq=4 maxrewind=0
(1539.871| 0.000) I: [pulseaudio] sink-input.c: Created input 73963 "ALSA Playback" on alsa_output.pci-0000_00_1b.0.analog-stereo with sample spec float32le 2ch 48000Hz and channel map front-left,front-right
(1539.871| 0.000) I: [pulseaudio] sink-input.c: media.name = "ALSA Playback"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: application.name = "ALSA plug-in [wine-preloader]"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: native-protocol.peer = "UNIX socket client"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: native-protocol.version = "28"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: application.process.id = "24998"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: application.process.user = "andrea"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: application.process.host = "mrburns"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: application.process.binary = "wine-preloader"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: application.language = "it_IT.UTF-8"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: window.x11.display = ":0"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: application.process.machine_id = "7135e97663f57205e2d64d9850d1d5a3"
(1539.871| 0.000) I: [pulseaudio] sink-input.c: module-stream-restore.id = "sink-input-by-application-name:ALSA plug-in [wine-preloader]"
(1539.871| 0.000) I: [pulseaudio] protocol-native.c: Requested tlength=40.00 ms, minreq=10.00 ms
(1539.871| 0.000) D: [pulseaudio] protocol-native.c: Early requests mode enabled, configuring sink latency to minreq.
(1539.871| 0.000) D: [pulseaudio] protocol-native.c: Requested latency=10.00 ms, Received latency=96.00 ms
(1539.871| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.871| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=4194304, tlength=110592, base=8, prebuf=3840, minreq=36864 maxrewind=0
(1539.871| 0.000) I: [pulseaudio] protocol-native.c: Final latency 384.00 ms = 96.00 ms + 2*96.00 ms + 96.00 ms
(1539.871| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Latency set to 96.00ms
(1539.871| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: hwbuf_unused=47104
(1539.871| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: setting avail_min=12737
(1539.871| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requesting rewind due to latency change.
(1539.871| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested volume: 0: 100% 1: 100%
(1539.871| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.871| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Got hardware volume: 0: 100% 1: 100%
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: 0.00 dB 1: 0.00 dB
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Calculated software volume: 0: 100% 1: 100% (accurate-enough=yes)
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: in dB: 0: -0.00 dB 1: -0.00 dB
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume going down to 65535 at 44840053336
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Requested to rewind 65536 bytes.
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Limited to 63520 bytes.
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: before: 15880
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: after: 15880
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] alsa-sink.c: Rewound 63520 bytes.
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Processing rewind...
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: latency = 1194
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] sink-input.c: Have to rewind 63520 bytes on render memblockq.
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] source.c: Processing rewind...
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65536 at 44839729348 was written 55 usec late
(1539.872| 0.000) D: [alsa-sink-CX20585 Analog] sink.c: Volume change to 65535 at 44839722513 was written 6890 usec late
(1539.872| 0.000) D: [pulseaudio] module-intended-roles.c: Not setting device for stream ALSA Playback, because it lacks role.
(1539.872| 0.000) I: [pulseaudio] sink-input.c: Trying to change sample rate
(1539.872| 0.000) I: [pulseaudio] sink.c: Cannot update rate, SINK_IS_RUNNING, will keep using 48000 Hz
(1539.872| 0.000) I: [pulseaudio] module-stream-restore.c: Restoring volume for sink input sink-input-by-application-name:ALSA plug-in [wine-preloader].
(1539.872| 0.000) D: [pulseaudio] module-suspend-on-idle.c: Sink alsa_output.pci-0000_00_1b.0.analog-stereo becomes busy, resuming.
(1539.872| 0.000) I: [pulseaudio] resampler.c: Forcing resampler 'copy', because of fixed, identical sample rates.
(1539.872| 0.000) I: [pulseaudio] resampler.c: Using resampler 'copy'
(1539.872| 0.000) I: [pulseaudio] resampler.c: Using s16le as working format.
(1539.872| 0.000) D: [pulseaudio] resampler.c: Resampler:
(1539.872| 0.000) D: [pulseaudio] resampler.c: rate 48000 -> 48000 (method copy),
(1539.872| 0.000) D: [pulseaudio] resampler.c: format float32le -> s16le (intermediate s16le),
(1539.872| 0.000) D: [pulseaudio] resampler.c: channels 2 -> 2 (resampling 2)
(1539.872| 0.000) D: [pulseaudio] memblockq.c: memblockq requested: maxlength=33554432, tlength=0, base=4, prebuf=0, minreq=1 maxrewind=0
(1539.872| 0.000) D: [pulseaudio] memblockq.c: memblockq sanitized: maxlength=33554432, tlength=33554432, base=4, prebuf=0, minreq=4 maxrewind=0
(1539.873| 0.000) I: [pulseaudio] sink-input.c: Created input 73964 "ALSA Playback" on alsa_output.pci-0000_00_1b.0.analog-stereo with sample spec float32le 2ch 48000Hz and channel map front-left,front-right
(
-------------- next part --------------
A non-text attachment was scrubbed...
Name: signature.asc
Type: application/pgp-signature
Size: 181 bytes
Desc: Digital signature
URL: <http://lists.alioth.debian.org/pipermail/pkg-pulseaudio-devel/attachments/20140220/19a80176/attachment-0001.sig>
More information about the pkg-pulseaudio-devel
mailing list