02-07-2011, 09:50 PM
Broken on r1893 and later.
r1893
Running with dynarec compiler (log level set to INFO)
Compability options used: None
r1893
Running with dynarec compiler (log level set to INFO)
Compability options used: None
Code:
...
78314 snd_stream_service_thread_0 INFO stdout snd_stream: looping not yet supported. This atrac has a loop marker in it!
78314 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser hleKernelDelayThread micros=5000, callbacks=false
78315 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=5000 forever:false thread:'snd_stream_service_thread_0' caller:'ThreadManForUser.hleKernelDelayThread'
78315 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser Context switching to 'snd_tick_timer_thread(Status PSP_THREAD_READY, Wait None)' after reschedule
78315 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=2f name:'snd_tick_timer_thread'
78316 snd_stream_service_thread_0 DEBUG runtime Switching from Thread snd_stream_service_thread_0 to snd_tick_timer_thread
78316 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_tick_timer_thread
78317 snd_stream_service_thread_0 DEBUG runtime Waiting to be scheduled...
78317 snd_tick_timer_thread DEBUG runtime Scheduled, restarting...
78318 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78318 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelPollSema id=0x2e signal=1 'snd_tick_lock_sema'
78319 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78319 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78320 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78320 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78320 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78320 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78321 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78321 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78322 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6ACF0, returnAddress=0x08A63DD8
78322 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6AB68, returnAddress=0x08A637AC
78323 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A637AC
78323 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelReferThreadStatus uid=0x0 addr=0x9f71950
78324 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78324 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78325 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A63DD8
78325 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78326 snd_tick_timer_thread DEBUG hle.sceCtrl hleCtrlExecuteSampling
78326 snd_tick_timer_thread DEBUG hle.ThreadManForUser Triggering Interrupt VBLANK(0x1E)
78327 snd_tick_timer_thread DEBUG hle.ThreadManForUser Calling InterruptHandler 0x08A00114(0x00000000,0x00000000)
78327 snd_tick_timer_thread DEBUG runtime Start of Callback 0x08A00114
78327 snd_tick_timer_thread DEBUG runtime End of Callback 0x08A00114
78328 snd_tick_timer_thread DEBUG hle.ThreadManForUser End of Interrupt
78328 snd_tick_timer_thread DEBUG hle.ThreadManForUser Context switching to 'callbacks(Status PSP_THREAD_READY, Wait None)' after reschedule
78329 snd_tick_timer_thread DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=b name:'callbacks'
78329 snd_tick_timer_thread DEBUG runtime Switching from Thread snd_tick_timer_thread to callbacks
78329 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=callbacks
78330 snd_tick_timer_thread DEBUG runtime Waiting to be scheduled...
78330 callbacks DEBUG runtime Scheduled, restarting...
78331 callbacks DEBUG runtime syncEmulator immediately=false
78331 callbacks DEBUG hle.ThreadManForUser hleKernelDelayThread micros=16666, callbacks=true
78332 callbacks DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=16666 forever:false thread:'callbacks' caller:'ThreadManForUser.hleKernelDelayThread'
78332 callbacks DEBUG hle.ThreadManForUser Context switching to 'snd_tick_timer_thread(Status PSP_THREAD_READY, Wait None)' after reschedule
78333 callbacks DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=2f name:'snd_tick_timer_thread'
78333 callbacks DEBUG runtime Switching from Thread callbacks to snd_tick_timer_thread
78333 callbacks DEBUG runtime syncThread currentThread=callbacks, currentRuntimeThread=snd_tick_timer_thread
78334 callbacks DEBUG runtime Waiting to be scheduled...
78334 snd_tick_timer_thread DEBUG runtime Scheduled, restarting...
78335 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78335 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2e name='snd_tick_lock_sema' signal=1
78336 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78336 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78336 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelPollSema id=0x2e signal=1 'snd_tick_lock_sema'
78337 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78337 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78337 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78338 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78339 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78339 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78339 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78340 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78340 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6ACF0, returnAddress=0x08A63DD8
78340 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6AB68, returnAddress=0x08A637AC
78341 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A637AC
78341 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelReferThreadStatus uid=0x0 addr=0x9f71950
78342 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78342 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78343 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A63DD8
78354 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78355 snd_tick_timer_thread DEBUG hle.sceCtrl hleCtrlExecuteSampling
78355 snd_tick_timer_thread DEBUG hle.ThreadManForUser Triggering Interrupt VBLANK(0x1E)
78355 snd_tick_timer_thread DEBUG hle.ThreadManForUser Calling InterruptHandler 0x08A00114(0x00000000,0x00000000)
78355 snd_tick_timer_thread DEBUG runtime Start of Callback 0x08A00114
78356 snd_tick_timer_thread DEBUG runtime End of Callback 0x08A00114
78356 snd_tick_timer_thread DEBUG hle.ThreadManForUser End of Interrupt
78356 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78356 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78356 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2e name='snd_tick_lock_sema' signal=1
78357 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78357 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78357 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78357 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78358 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78358 snd_tick_timer_thread DEBUG hle.Kernel_Library sceKernelIsCpuIntrEnable interruptsEnabled=true
78358 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78358 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78359 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema(id=0x2b,signal=1,timeout=0x0) callbacks=false
78359 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema - 'valloc_mutex_sema' fast check succeeded
78359 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78359 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78359 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78360 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78360 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78360 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78361 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78361 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78361 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78361 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78362 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78362 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78362 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78362 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78362 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78363 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78363 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78363 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2b name='valloc_mutex_sema' signal=1
78363 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78364 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78364 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasCore 0x08D91AC0, out=0x08D8AB40
78364 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelDelayThread micros=5000, callbacks=false
78364 snd_tick_timer_thread DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=5000 forever:false thread:'snd_tick_timer_thread' caller:'ThreadManForUser.hleKernelDelayThread'
78365 snd_tick_timer_thread DEBUG hle.ThreadManForUser Context switching to 'callbacks(Status PSP_THREAD_READY, Wait None)' after reschedule
78365 snd_tick_timer_thread DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=b name:'callbacks'
78365 snd_tick_timer_thread DEBUG runtime Switching from Thread snd_tick_timer_thread to callbacks
78365 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=callbacks
78366 snd_tick_timer_thread DEBUG runtime Waiting to be scheduled...
78366 callbacks DEBUG runtime Scheduled, restarting...
78366 callbacks DEBUG runtime syncEmulator immediately=false
78367 callbacks DEBUG hle.ThreadManForUser hleKernelDelayThread micros=16666, callbacks=true
78367 callbacks DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=16666 forever:false thread:'callbacks' caller:'ThreadManForUser.hleKernelDelayThread'
78367 callbacks DEBUG hle.ThreadManForUser Context switching to 'snd_stream_service_thread_0(Status PSP_THREAD_READY, Wait None)' after reschedule
78367 callbacks DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=31 name:'snd_stream_service_thread_0'
78367 callbacks DEBUG runtime Switching from Thread callbacks to snd_stream_service_thread_0
78368 callbacks DEBUG runtime syncThread currentThread=callbacks, currentRuntimeThread=snd_stream_service_thread_0
78368 callbacks DEBUG runtime Waiting to be scheduled...
78368 snd_stream_service_thread_0 DEBUG runtime Scheduled, restarting...
78369 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78369 snd_stream_service_thread_0 DEBUG hle free buffer 1660950336
78369 snd_stream_service_thread_0 DEBUG hle.sceAudio hleAudioGetChannelRestLen(1) = 0
78369 snd_stream_service_thread_0 WARN hle.sceAudio sceAudioOutputPannedBlocking (pvoid_buf==0): not delaying current thread
78369 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78369 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78370 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser sceIoWaitAsync redirecting to hleIoWaitAsync
78370 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser hleIoWaitAsync(uid=1f8,res=0x9f70a68) wait=true callbacks=false
78371 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser hleIoWaitAsync - PSP_ERROR_NO_ASYNC_OP, not waiting
78371 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78371 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78371 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser sceIoClose - uid 1f8
78372 snd_stream_service_thread_0 DEBUG hle.sceCtrl hleCtrlExecuteSampling
78372 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser Triggering Interrupt VBLANK(0x1E)
78372 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser Calling InterruptHandler 0x08A00114(0x00000000,0x00000000)
78372 snd_stream_service_thread_0 DEBUG runtime Start of Callback 0x08A00114
78372 snd_stream_service_thread_0 DEBUG runtime End of Callback 0x08A00114
78373 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser End of Interrupt
78373 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser Context switching to 'snd_tick_timer_thread(Status PSP_THREAD_READY, Wait None)' after reschedule
78373 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=2f name:'snd_tick_timer_thread'
78373 snd_stream_service_thread_0 DEBUG runtime Switching from Thread snd_stream_service_thread_0 to snd_tick_timer_thread
78374 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_tick_timer_thread
78374 snd_stream_service_thread_0 DEBUG runtime Waiting to be scheduled...
78374 snd_tick_timer_thread DEBUG runtime Scheduled, restarting...
78374 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78375 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelPollSema id=0x2e signal=1 'snd_tick_lock_sema'
78375 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78375 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78375 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78375 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78376 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78376 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78376 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78376 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78377 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6ACF0, returnAddress=0x08A63DD8
78377 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6AB68, returnAddress=0x08A637AC
78377 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A637AC
78377 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelReferThreadStatus uid=0x0 addr=0x9f71950
78377 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78378 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78378 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A63DD8
78378 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78379 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78379 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78379 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2e name='snd_tick_lock_sema' signal=1
78380 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78380 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78380 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78380 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78380 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78381 snd_tick_timer_thread DEBUG hle.Kernel_Library sceKernelIsCpuIntrEnable interruptsEnabled=true
78381 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78381 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78381 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema(id=0x2b,signal=1,timeout=0x0) callbacks=false
78382 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema - 'valloc_mutex_sema' fast check succeeded
78382 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78382 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78382 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78382 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78383 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78383 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78384 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78384 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78384 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78384 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78384 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78385 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78385 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78385 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78385 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78386 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78386 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78386 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2b name='valloc_mutex_sema' signal=1
78387 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78387 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78387 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasCore 0x08D91AC0, out=0x08D8AF40
78387 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelDelayThread micros=5000, callbacks=false
78388 snd_tick_timer_thread DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=5000 forever:false thread:'snd_tick_timer_thread' caller:'ThreadManForUser.hleKernelDelayThread'
78388 snd_tick_timer_thread DEBUG hle.ThreadManForUser Context switching to 'callbacks(Status PSP_THREAD_READY, Wait None)' after reschedule
78388 snd_tick_timer_thread DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=b name:'callbacks'
78389 snd_tick_timer_thread DEBUG runtime Switching from Thread snd_tick_timer_thread to callbacks
78389 snd_tick_timer_thread DEBUG hle.sceCtrl hleCtrlExecuteSampling
78389 snd_tick_timer_thread DEBUG hle.ThreadManForUser Triggering Interrupt VBLANK(0x1E)
78389 snd_tick_timer_thread DEBUG hle.ThreadManForUser Calling InterruptHandler 0x08A00114(0x00000000,0x00000000)
78390 snd_tick_timer_thread DEBUG runtime Start of Callback 0x08A00114
78390 snd_tick_timer_thread DEBUG runtime End of Callback 0x08A00114
78390 snd_tick_timer_thread DEBUG hle.ThreadManForUser End of Interrupt
78390 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=callbacks
78391 snd_tick_timer_thread DEBUG runtime Waiting to be scheduled...
78391 callbacks DEBUG runtime Scheduled, restarting...
78391 callbacks DEBUG runtime syncEmulator immediately=false
78391 callbacks DEBUG hle.ThreadManForUser hleKernelDelayThread micros=16666, callbacks=true
78392 callbacks DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=16666 forever:false thread:'callbacks' caller:'ThreadManForUser.hleKernelDelayThread'
78392 callbacks DEBUG hle.ThreadManForUser Context switching to 'snd_stream_service_thread_0(Status PSP_THREAD_READY, Wait None)' after reschedule
78392 callbacks DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=31 name:'snd_stream_service_thread_0'
78393 callbacks DEBUG runtime Switching from Thread callbacks to snd_stream_service_thread_0
78393 callbacks DEBUG runtime syncThread currentThread=callbacks, currentRuntimeThread=snd_stream_service_thread_0
78393 callbacks DEBUG runtime Waiting to be scheduled...
78393 snd_stream_service_thread_0 DEBUG runtime Scheduled, restarting...
78393 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78394 snd_stream_service_thread_0 DEBUG hle.sceAtrac3plus sceAtracReleaseAtracID: atracID = 0
78394 snd_stream_service_thread_0 WARN hle.sceAtrac3plus sceAtracReleaseAtracID: bad atracID= 0
78394 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78394 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78395 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser hleKernelWaitSema(id=0x0,signal=1,timeout=0x0) callbacks=false
78395 snd_stream_service_thread_0 WARN hle.ThreadManForUser hleKernelWaitSema - unknown uid 0x0
78395 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78395 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78396 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser sceIoOpen redirecting to hleIoOpen
78396 snd_stream_service_thread_0 INFO hle.IoFileMgrForUser hleIoOpen filename = disc0:/PSP_GAME/USRDIR/SNDSPSP/MK_2B780A85.MUS flags = 1 permissions = 00
78396 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser PSP_O_RDONLY
78396 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser hleIoOpen - opening file disc0/PSP_GAME/USRDIR/SNDSPSP/MK_2B780A85.MUS
78396 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser hleIoOpen assigned uid = 0x1f9
78397 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser hleKernelDelayThread micros=5000, callbacks=false
78397 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=5000 forever:false thread:'snd_stream_service_thread_0' caller:'ThreadManForUser.hleKernelDelayThread'
78397 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser Context switching to 'snd_tick_timer_thread(Status PSP_THREAD_READY, Wait None)' after reschedule
78398 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=2f name:'snd_tick_timer_thread'
78398 snd_stream_service_thread_0 DEBUG runtime Switching from Thread snd_stream_service_thread_0 to snd_tick_timer_thread
78398 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_tick_timer_thread
78399 snd_stream_service_thread_0 DEBUG runtime Waiting to be scheduled...
78399 snd_tick_timer_thread DEBUG runtime Scheduled, restarting...
78399 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78399 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelPollSema id=0x2e signal=1 'snd_tick_lock_sema'
78399 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78400 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78400 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78400 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78400 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78401 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78401 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78401 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78402 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6ACF0, returnAddress=0x08A63DD8
78402 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6AB68, returnAddress=0x08A637AC
78402 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A637AC
78402 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelReferThreadStatus uid=0x0 addr=0x9f71950
78402 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78402 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78403 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A63DD8
78403 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78403 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78404 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78404 snd_tick_timer_thread DEBUG hle.Kernel_Library sceKernelIsCpuIntrEnable interruptsEnabled=true
78404 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78405 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78405 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema(id=0x2b,signal=1,timeout=0x0) callbacks=false
78405 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema - 'valloc_mutex_sema' fast check succeeded
78405 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78405 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78406 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78406 snd_tick_timer_thread DEBUG hle.sceCtrl hleCtrlExecuteSampling
78406 snd_tick_timer_thread DEBUG hle.ThreadManForUser Triggering Interrupt VBLANK(0x1E)
78407 snd_tick_timer_thread DEBUG hle.ThreadManForUser Calling InterruptHandler 0x08A00114(0x00000000,0x00000000)
78407 snd_tick_timer_thread DEBUG runtime Start of Callback 0x08A00114
78407 snd_tick_timer_thread DEBUG runtime End of Callback 0x08A00114
78407 snd_tick_timer_thread DEBUG hle.ThreadManForUser End of Interrupt
78408 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78408 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78408 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78408 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78408 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78409 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2b name='valloc_mutex_sema' signal=1
78409 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78409 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78409 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78410 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78410 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78410 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2e name='snd_tick_lock_sema' signal=1
78411 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78411 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78411 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelPollSema id=0x2e signal=1 'snd_tick_lock_sema'
78412 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78412 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78412 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78412 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78413 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78413 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78413 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78414 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78414 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6ACF0, returnAddress=0x08A63DD8
78414 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6AB68, returnAddress=0x08A637AC
78414 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A637AC
78414 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelReferThreadStatus uid=0x0 addr=0x9f71950
78415 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78415 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78416 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A63DD8
78416 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78416 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78416 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78416 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2e name='snd_tick_lock_sema' signal=1
78417 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78417 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78417 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78418 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78418 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78418 snd_tick_timer_thread DEBUG hle.Kernel_Library sceKernelIsCpuIntrEnable interruptsEnabled=true
78418 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78419 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78419 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema(id=0x2b,signal=1,timeout=0x0) callbacks=false
78419 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema - 'valloc_mutex_sema' fast check succeeded
78419 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78419 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78420 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78420 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78420 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78421 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78421 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78421 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78421 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78422 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78422 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78422 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78422 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78422 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78423 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78423 snd_tick_timer_thread DEBUG hle.sceCtrl hleCtrlExecuteSampling
78423 snd_tick_timer_thread DEBUG hle.ThreadManForUser Triggering Interrupt VBLANK(0x1E)
78424 snd_tick_timer_thread DEBUG hle.ThreadManForUser Calling InterruptHandler 0x08A00114(0x00000000,0x00000000)
78424 snd_tick_timer_thread DEBUG runtime Start of Callback 0x08A00114
78424 snd_tick_timer_thread DEBUG runtime End of Callback 0x08A00114
78425 snd_tick_timer_thread DEBUG hle.ThreadManForUser End of Interrupt
78425 snd_tick_timer_thread DEBUG hle.ThreadManForUser Context switching to 'callbacks(Status PSP_THREAD_READY, Wait None)' after reschedule
78425 snd_tick_timer_thread DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=b name:'callbacks'
78425 snd_tick_timer_thread DEBUG runtime Switching from Thread snd_tick_timer_thread to callbacks
78425 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=callbacks
78426 snd_tick_timer_thread DEBUG runtime Waiting to be scheduled...
78426 callbacks DEBUG runtime Scheduled, restarting...
78427 callbacks DEBUG runtime syncEmulator immediately=false
78427 callbacks DEBUG hle.ThreadManForUser hleKernelDelayThread micros=16666, callbacks=true
78427 callbacks DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=16666 forever:false thread:'callbacks' caller:'ThreadManForUser.hleKernelDelayThread'
78427 callbacks DEBUG hle.ThreadManForUser Context switching to 'snd_tick_timer_thread(Status PSP_THREAD_READY, Wait None)' after reschedule
78428 callbacks DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=2f name:'snd_tick_timer_thread'
78428 callbacks DEBUG runtime Switching from Thread callbacks to snd_tick_timer_thread
78428 callbacks DEBUG runtime syncThread currentThread=callbacks, currentRuntimeThread=snd_tick_timer_thread
78428 callbacks DEBUG runtime Waiting to be scheduled...
78428 snd_tick_timer_thread DEBUG runtime Scheduled, restarting...
78429 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78429 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2b name='valloc_mutex_sema' signal=1
78430 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78430 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78430 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasCore 0x08D91AC0, out=0x08D8B340
78430 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelDelayThread micros=5000, callbacks=false
78431 snd_tick_timer_thread DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=5000 forever:false thread:'snd_tick_timer_thread' caller:'ThreadManForUser.hleKernelDelayThread'
78431 snd_tick_timer_thread DEBUG hle.ThreadManForUser Context switching to 'snd_stream_service_thread_0(Status PSP_THREAD_READY, Wait None)' after reschedule
78431 snd_tick_timer_thread DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=31 name:'snd_stream_service_thread_0'
78432 snd_tick_timer_thread DEBUG runtime Switching from Thread snd_tick_timer_thread to snd_stream_service_thread_0
78432 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_stream_service_thread_0
78432 snd_tick_timer_thread DEBUG runtime Waiting to be scheduled...
78432 snd_stream_service_thread_0 DEBUG runtime Scheduled, restarting...
78432 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78433 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser sceIoChangeAsyncPriority uid=0x1f9, priority=0xffffffff
78433 snd_stream_service_thread_0 WARN hle.IoFileMgrForUser sceIoChangeAsyncPriority invalid fd=505
78433 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78434 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78434 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser sceIoLseek - uid 1f9 offset 0 (hex=0x0) whence PSP_SEEK_SET
78434 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78434 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78435 snd_stream_service_thread_0 DEBUG hle.IoFileMgrForUser hleIoRead(uid=1f9,data=0x0,size=0x0) async=false
78435 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser hleKernelDelayThread micros=5000, callbacks=false
78435 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=5000 forever:false thread:'snd_stream_service_thread_0' caller:'ThreadManForUser.hleKernelDelayThread'
78435 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser Context switching to 'user_main(Status PSP_THREAD_READY, Wait None)' after reschedule
78436 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=8 name:'user_main'
78436 snd_stream_service_thread_0 DEBUG runtime Switching from Thread snd_stream_service_thread_0 to user_main
78436 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=user_main
78436 snd_stream_service_thread_0 DEBUG runtime Waiting to be scheduled...
78436 user_main DEBUG runtime Scheduled, restarting...
78436 user_main DEBUG runtime syncEmulator immediately=false
78437 user_main DEBUG hle.ThreadManForUser hleKernelDelayThread micros=33000, callbacks=false
78437 user_main DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=33000 forever:false thread:'user_main' caller:'ThreadManForUser.hleKernelDelayThread'
78437 user_main DEBUG hle.ThreadManForUser Context switching to 'snd_tick_timer_thread(Status PSP_THREAD_READY, Wait None)' after reschedule
78437 user_main DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=2f name:'snd_tick_timer_thread'
78437 user_main DEBUG runtime Switching from Thread user_main to snd_tick_timer_thread
78437 user_main DEBUG runtime syncThread currentThread=user_main, currentRuntimeThread=snd_tick_timer_thread
78438 user_main DEBUG runtime Waiting to be scheduled...
78438 snd_tick_timer_thread DEBUG runtime Scheduled, restarting...
78439 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78439 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelPollSema id=0x2e signal=1 'snd_tick_lock_sema'
78439 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78439 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78440 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78440 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78440 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78440 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78440 snd_tick_timer_thread DEBUG hle.sceCtrl hleCtrlExecuteSampling
78441 snd_tick_timer_thread DEBUG hle.ThreadManForUser Triggering Interrupt VBLANK(0x1E)
78441 snd_tick_timer_thread DEBUG hle.ThreadManForUser Calling InterruptHandler 0x08A00114(0x00000000,0x00000000)
78441 snd_tick_timer_thread DEBUG runtime Start of Callback 0x08A00114
78441 snd_tick_timer_thread DEBUG runtime End of Callback 0x08A00114
78441 snd_tick_timer_thread DEBUG hle.ThreadManForUser End of Interrupt
78442 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78442 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78442 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6ACF0, returnAddress=0x08A63DD8
78442 snd_tick_timer_thread DEBUG runtime RuntimeContext.call address=0x08A6AB68, returnAddress=0x08A637AC
78442 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A637AC
78442 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelReferThreadStatus uid=0x0 addr=0x9f71950
78442 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78443 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78443 snd_tick_timer_thread DEBUG runtime RuntimeContext.jumpCall returning 0x08A63DD8
78444 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78444 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78444 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78444 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2e name='snd_tick_lock_sema' signal=1
78445 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78445 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78445 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78445 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78446 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78446 snd_tick_timer_thread DEBUG hle.Kernel_Library sceKernelIsCpuIntrEnable interruptsEnabled=true
78446 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78446 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78446 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema(id=0x2b,signal=1,timeout=0x0) callbacks=false
78446 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelWaitSema - 'valloc_mutex_sema' fast check succeeded
78447 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78447 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78447 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78448 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78448 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78449 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasGetEndFlag(sasCore=0x8d91ac0)
78449 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78449 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78449 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78449 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78449 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78449 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78450 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78450 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78450 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelGetThreadId returning uid=0x2f
78451 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78451 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78451 snd_tick_timer_thread DEBUG hle.ThreadManForUser sceKernelSignalSema id=0x2b name='valloc_mutex_sema' signal=1
78451 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=snd_tick_timer_thread
78451 snd_tick_timer_thread DEBUG runtime syncEmulator immediately=false
78452 snd_tick_timer_thread DEBUG hle.sceSasCore __sceSasCore 0x08D91AC0, out=0x08D8B740
78452 snd_tick_timer_thread DEBUG hle.ThreadManForUser hleKernelDelayThread micros=5000, callbacks=false
78452 snd_tick_timer_thread DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=5000 forever:false thread:'snd_tick_timer_thread' caller:'ThreadManForUser.hleKernelDelayThread'
78453 snd_tick_timer_thread DEBUG hle.ThreadManForUser Context switching to 'callbacks(Status PSP_THREAD_READY, Wait None)' after reschedule
78453 snd_tick_timer_thread DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=b name:'callbacks'
78453 snd_tick_timer_thread DEBUG runtime Switching from Thread snd_tick_timer_thread to callbacks
78454 snd_tick_timer_thread DEBUG runtime syncThread currentThread=snd_tick_timer_thread, currentRuntimeThread=callbacks
78454 snd_tick_timer_thread DEBUG runtime Waiting to be scheduled...
78454 callbacks DEBUG runtime Scheduled, restarting...
78454 callbacks DEBUG runtime syncEmulator immediately=false
78455 callbacks DEBUG hle.ThreadManForUser hleKernelDelayThread micros=16666, callbacks=true
78455 callbacks DEBUG hle.ThreadManForUser -------------------- hleKernelThreadWait micros=16666 forever:false thread:'callbacks' caller:'ThreadManForUser.hleKernelDelayThread'
78455 callbacks DEBUG hle.ThreadManForUser Context switching to 'snd_stream_service_thread_0(Status PSP_THREAD_READY, Wait None)' after reschedule
78456 callbacks DEBUG hle.ThreadManForUser ---------------------------------------- SceUID=31 name:'snd_stream_service_thread_0'
78456 callbacks DEBUG runtime Switching from Thread callbacks to snd_stream_service_thread_0
78456 callbacks DEBUG runtime syncThread currentThread=callbacks, currentRuntimeThread=snd_stream_service_thread_0
78456 callbacks DEBUG runtime Waiting to be scheduled...
78456 snd_stream_service_thread_0 DEBUG runtime Scheduled, restarting...
78457 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78457 snd_stream_service_thread_0 DEBUG hle.sceAtrac3plus sceAtracSetDataAndGetID buffer = 0x00000000, bufferSize = 0x00000000
78457 snd_stream_service_thread_0 DEBUG hle.sceCtrl hleCtrlExecuteSampling
78458 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser Triggering Interrupt VBLANK(0x1E)
78458 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser Calling InterruptHandler 0x08A00114(0x00000000,0x00000000)
78458 snd_stream_service_thread_0 DEBUG runtime Start of Callback 0x08A00114
78458 snd_stream_service_thread_0 DEBUG runtime End of Callback 0x08A00114
78459 snd_stream_service_thread_0 DEBUG hle.ThreadManForUser End of Interrupt
78459 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78459 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78459 snd_stream_service_thread_0 DEBUG hle.sceAtrac3plus sceAtracGetSecondBufferInfo: atracID = 0, outPos=0x9f70a74, outBytes=0x9f70a78
78460 snd_stream_service_thread_0 WARN hle.sceAtrac3plus sceAtracGetSecondBufferInfo: bad atracID= 0
78460 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78460 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78461 snd_stream_service_thread_0 DEBUG runtime syncThread currentThread=snd_stream_service_thread_0, currentRuntimeThread=snd_stream_service_thread_0
78461 snd_stream_service_thread_0 DEBUG runtime syncEmulator immediately=false
78461 snd_stream_service_thread_0 INFO stdout snd_stream: looping not yet supported. This atrac has a loop marker in it!
...
Code:
------------------------------------------------------------
Thread ID - 0x0000002F
Th Name - snd_tick_timer_thread
zr:0x00000000 at:0x08A51BE4 v0:0x00000001 v1:0xFFFFFFFF
a0:0x00000001 a1:0x12345678 a2:0x08BB0000 a3:0x08BABE58
t0:0x00004000 t1:0xFFFFFFFF t2:0x08DDA1A0 t3:0x09F71A0C
t4:0x00000000 t5:0x00000001 t6:0x0000001F t7:0x08D90000
s0:0x12345678 s1:0x08BB0000 s2:0x00000001 s3:0x08BB0000
s4:0x00000003 s5:0x08BB0000 s6:0x08BB0000 s7:0x08BB0000
t8:0x08D90000 t9:0x00000000 k0:0x09F71B00 k1:0x00000000
gp:0x00000000 sp:0x09F719F0 fp:0x08AE72E8 ra:0x08A65080
0x08A60A3C: 0x27BDFFB0 - addiu $sp, $sp, -80
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'snd_stream_service_thread_0' ID: 0x0031 Module ID: 0x0001
Thread Status: 0x00000002 PSP_THREAD_READY
Thread Attr: 0x80200000 Current Priority: 0x11 Initial Priority: 0x11
Thread Entry: 0x08A6B1B0 Stack: 0x09F68C00 - 0x09F70C00 Stack Size: 0x00008000
Thread Run Clocks: 2538433 Exit Code: 0x800201A4
Thread Wait Type: None Us: 5000 Forever: false
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'idle0' ID: 0x0004 Module ID: 0x0000
Thread Status: 0x00000002 PSP_THREAD_READY
Thread Attr: 0x00001000 Current Priority: 0x7F Initial Priority: 0x7F
Thread Entry: 0x88000000 Stack: 0x08800000 - 0x08802000 Stack Size: 0x00002000
Thread Run Clocks: 17919 Exit Code: 0x800201A4
Thread Wait Type: None Us: 0 Forever: false
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'idle1' ID: 0x0005 Module ID: 0x0000
Thread Status: 0x00000002 PSP_THREAD_READY
Thread Attr: 0x00001000 Current Priority: 0x7F Initial Priority: 0x7F
Thread Entry: 0x88000000 Stack: 0x08802000 - 0x08804000 Stack Size: 0x00002000
Thread Run Clocks: 18054 Exit Code: 0x800201A4
Thread Wait Type: None Us: 0 Forever: false
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'user_main' ID: 0x0008 Module ID: 0x0001
Thread Status: 0x00000002 PSP_THREAD_READY
Thread Attr: 0x80004000 Current Priority: 0x34 Initial Priority: 0x20
Thread Entry: 0x089E131C Stack: 0x09F7FC00 - 0x09FFFC00 Stack Size: 0x00080000
Thread Run Clocks: 200416578 Exit Code: 0x800201A4
Thread Wait Type: None Us: 33000 Forever: false
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'UMDAReadManager' ID: 0x001B Module ID: 0x0001
Thread Status: 0x00000004 PSP_THREAD_WAITING
Thread Attr: 0x80000000 Current Priority: 0x0E Initial Priority: 0x0E
Thread Entry: 0x08A3B250 Stack: 0x09F75C00 - 0x09F77C00 Stack Size: 0x00002000
Thread Run Clocks: 13673663 Exit Code: 0x800201A4
Thread Wait Type: None (sleeping) Us: 0 Forever: true
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'callbacks' ID: 0x000B Module ID: 0x0001
Thread Status: 0x00000004 PSP_THREAD_WAITING
Thread Attr: 0x80000000 Current Priority: 0x0F Initial Priority: 0x0F
Thread Entry: 0x089F0D78 Stack: 0x09F77C00 - 0x09F7FC00 Stack Size: 0x00008000
Thread Run Clocks: 26024 Exit Code: 0x800201A4
Thread Wait Type: None (delay 16666 us, rest 6697 us) Us: 16666 Forever: false
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'SceIofileAsync' ID: 0x001D Module ID: 0x0001
Thread Status: 0x00000004 PSP_THREAD_WAITING
Thread Attr: 0x80000000 Current Priority: 0x0E Initial Priority: 0x0E
Thread Entry: 0x08000040 Stack: 0x09F73C00 - 0x09F75C00 Stack Size: 0x00002000
Thread Run Clocks: 388 Exit Code: 0x800201A2
Thread Wait Type: None (sleeping) Us: 0 Forever: true
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'snd_tick_timer_thread' ID: 0x002F Module ID: 0x0001
Thread Status: 0x00000001 PSP_THREAD_RUNNING
Thread Attr: 0x80200000 Current Priority: 0x10 Initial Priority: 0x10
Thread Entry: 0x08A60A3C Stack: 0x09F70C00 - 0x09F71C00 Stack Size: 0x00001000
Thread Run Clocks: 18760638 Exit Code: 0x800201A4
Thread Wait Type: None Us: 5000 Forever: false
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Thread Name: 'AsyncFileManager' ID: 0x001F Module ID: 0x0001
Thread Status: 0x00000004 PSP_THREAD_WAITING
Thread Attr: 0x80000000 Current Priority: 0x20 Initial Priority: 0x20
Thread Entry: 0x08A3B250 Stack: 0x09F71C00 - 0x09F73C00 Stack Size: 0x00002000
Thread Run Clocks: 3185605 Exit Code: 0x800201A4
Thread Wait Type: None (sleeping) Us: 0 Forever: true
++++++++++++++++++++++++++++++++++++++++++++++++++++++++++++
Allocated memory: 02779BC0 41393088 bytes
[XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX XX]
Fragmented memory: 0008E000 581632 bytes
[ XX X]
------------------------------------------------------------