rr record failed with Expected EINVAL for 'prctl'

[IamHuskar]

aarch64
rr master branch

[FATAL src/record_syscall.cc:6868:rec_process_syscall_arch()] 
 (task 1320792 (rec:1320792) at time 924)
 -> Assertion `t->regs().syscall_result_signed() == -syscall_state.expect_errno' failed to hold. Expected EINVAL for 'prctl' but got result 0 (errno SUCCESS); unknown prctl(0)
Tail of trace dump:
{
  real_time:1215693.606895 global_time:904, event:`SYSCALL: mmap' (state:ENTERING_SYSCALL) tid:1320792, ticks:2160672
x[0]:0xc69a0d605000 x[1]:0x11000000 x[2]:0x3 x[3]:0x32 x[4]:0xffffffffffffffff x[5]:0x0 x[6]:0x0 x[7]:0x70000000 x[8]:0xde x[9]:0x70011000 x[10]:0x0 x[11]:0x2278d x[12]:0xc69a0b233000 x[13]:0x23d3 x[14]:0x23d4 x[15]:0x70010000 x[16]:0xc69a06864448 x[17]:0xf76b16cb5cf0 x[18]:0x500 x[19]:0x681ffd50 x[20]:0xde x[21]:0x0 x[22]:0xffffffff x[23]:0x3 x[24]:0x22 x[25]:0xf76b16e17000 x[26]:0x0 x[27]:0x0 x[28]:0x11004000 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.606905 global_time:905, event:`SYSCALLBUF_RESET' tid:1320792, ticks:2160672
}
{
  real_time:1215693.606988 global_time:906, event:`SYSCALL: mmap' (state:EXITING_SYSCALL) tid:1320792, ticks:2160672
x[0]:0xc69a0d605000 x[1]:0x11000000 x[2]:0x3 x[3]:0x32 x[4]:0xffffffffffffffff x[5]:0x0 x[6]:0x0 x[7]:0x70000000 x[8]:0xde x[9]:0x70011000 x[10]:0x0 x[11]:0x2278d x[12]:0xc69a0b233000 x[13]:0x23d3 x[14]:0x23d4 x[15]:0x70010000 x[16]:0xc69a06864448 x[17]:0xf76b16cb5cf0 x[18]:0x500 x[19]:0x681ffd50 x[20]:0xde x[21]:0x0 x[22]:0xffffffff x[23]:0x3 x[24]:0x22 x[25]:0xf76b16e17000 x[26]:0x0 x[27]:0x0 x[28]:0x11004000 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
  { map_file:"<ZERO>", addr:0xc69a0d605000, length:0x11000000, prot_flags:"rw-p", file_offset:0x0, device:0, inode:0, data_file:"", data_offset:0x0, file_size:0x11000000 }
}
{
  real_time:1215693.607304 global_time:907, event:`SYSCALLBUF_FLUSH' tid:1320792, ticks:2230439
  { syscall:'rt_sigprocmask', ret:0x0, size:0x18 }
}
{
  real_time:1215693.607317 global_time:908, event:`SYSCALL: prctl' (state:ENTERING_SYSCALL) tid:1320792, ticks:2230439
x[0]:0x53564d41 x[1]:0x0 x[2]:0xc69a0d605000 x[3]:0x11000000 x[4]:0xc69a0676e3a1 x[5]:0xffffe96c9570 x[6]:0xffffe96c9570 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0x0 x[11]:0x1 x[12]:0x133d3 x[13]:0x2678 x[14]:0x7ffff x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x500 x[19]:0x681ffd50 x[20]:0x53564d41 x[21]:0x22 x[22]:0xf76b15e49458 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.607328 global_time:909, event:`SYSCALLBUF_RESET' tid:1320792, ticks:2230439
}
{
  real_time:1215693.607401 global_time:910, event:`SYSCALL: prctl' (state:EXITING_SYSCALL) tid:1320792, ticks:2230439
x[0]:0x0 x[1]:0x0 x[2]:0xc69a0d605000 x[3]:0x11000000 x[4]:0xc69a0676e3a1 x[5]:0xffffe96c9570 x[6]:0xffffe96c9570 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0x0 x[11]:0x1 x[12]:0x133d3 x[13]:0x2678 x[14]:0x7ffff x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x500 x[19]:0x681ffd50 x[20]:0x53564d41 x[21]:0x22 x[22]:0xf76b15e49458 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.607568 global_time:911, event:`SYSCALL: prctl' (state:ENTERING_SYSCALL) tid:1320792, ticks:2230478
x[0]:0x53564d41 x[1]:0x0 x[2]:0xc69a0d605000 x[3]:0x10000000 x[4]:0xc69a0675e2c7 x[5]:0xffffe96c9590 x[6]:0xffffe96c9590 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0x0 x[11]:0x1 x[12]:0x133d3 x[13]:0x2678 x[14]:0x7ffff x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x500 x[19]:0x681ffd50 x[20]:0x53564d41 x[21]:0xf76b15e69010 x[22]:0xf76b15e49458 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.607649 global_time:912, event:`SYSCALL: prctl' (state:EXITING_SYSCALL) tid:1320792, ticks:2230478
x[0]:0x0 x[1]:0x0 x[2]:0xc69a0d605000 x[3]:0x10000000 x[4]:0xc69a0675e2c7 x[5]:0xffffe96c9590 x[6]:0xffffe96c9590 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0x0 x[11]:0x1 x[12]:0x133d3 x[13]:0x2678 x[14]:0x7ffff x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x500 x[19]:0x681ffd50 x[20]:0x53564d41 x[21]:0xf76b15e69010 x[22]:0xf76b15e49458 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.607815 global_time:913, event:`SYSCALL: prctl' (state:ENTERING_SYSCALL) tid:1320792, ticks:2230518
x[0]:0x53564d41 x[1]:0x0 x[2]:0xc69a1d605000 x[3]:0x1000000 x[4]:0xc69a0675e2d3 x[5]:0xffffe96c9590 x[6]:0xffffe96c9590 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0x8000000 x[11]:0x1 x[12]:0x133d3 x[13]:0x2678 x[14]:0x7ffff x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x500 x[19]:0x681ffd50 x[20]:0x53564d41 x[21]:0xf76b15e69010 x[22]:0xf76b15e49458 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.607890 global_time:914, event:`SYSCALL: prctl' (state:EXITING_SYSCALL) tid:1320792, ticks:2230518
x[0]:0x0 x[1]:0x0 x[2]:0xc69a1d605000 x[3]:0x1000000 x[4]:0xc69a0675e2d3 x[5]:0xffffe96c9590 x[6]:0xffffe96c9590 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0x8000000 x[11]:0x1 x[12]:0x133d3 x[13]:0x2678 x[14]:0x7ffff x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x500 x[19]:0x681ffd50 x[20]:0x53564d41 x[21]:0xf76b15e69010 x[22]:0xf76b15e49458 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.608206 global_time:915, event:`SYSCALLBUF_FLUSH' tid:1320792, ticks:2492844
  { syscall:'rt_sigprocmask', ret:0x0, size:0x18 }
}
{
  real_time:1215693.608221 global_time:916, event:`SYSCALL: mmap' (state:ENTERING_SYSCALL) tid:1320792, ticks:2492844
x[0]:0xc69a1e605000 x[1]:0x20000000 x[2]:0x3 x[3]:0x32 x[4]:0xffffffffffffffff x[5]:0x0 x[6]:0x0 x[7]:0x70000000 x[8]:0xde x[9]:0x70011000 x[10]:0x0 x[11]:0x1378d x[12]:0xc69a0b233000 x[13]:0x133d3 x[14]:0x133d4 x[15]:0x70010000 x[16]:0xc69a06864448 x[17]:0xf76b16cb5cf0 x[18]:0x500 x[19]:0x681ffd50 x[20]:0xde x[21]:0x0 x[22]:0xffffffff x[23]:0x3 x[24]:0x22 x[25]:0xf76b16e17000 x[26]:0x0 x[27]:0x0 x[28]:0x20005000 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.608231 global_time:917, event:`SYSCALLBUF_RESET' tid:1320792, ticks:2492844
}
{
  real_time:1215693.608315 global_time:918, event:`SYSCALL: mmap' (state:EXITING_SYSCALL) tid:1320792, ticks:2492844
x[0]:0xc69a1e605000 x[1]:0x20000000 x[2]:0x3 x[3]:0x32 x[4]:0xffffffffffffffff x[5]:0x0 x[6]:0x0 x[7]:0x70000000 x[8]:0xde x[9]:0x70011000 x[10]:0x0 x[11]:0x1378d x[12]:0xc69a0b233000 x[13]:0x133d3 x[14]:0x133d4 x[15]:0x70010000 x[16]:0xc69a06864448 x[17]:0xf76b16cb5cf0 x[18]:0x500 x[19]:0x681ffd50 x[20]:0xde x[21]:0x0 x[22]:0xffffffff x[23]:0x3 x[24]:0x22 x[25]:0xf76b16e17000 x[26]:0x0 x[27]:0x0 x[28]:0x20005000 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
  { map_file:"<ZERO>", addr:0xc69a1e605000, length:0x20000000, prot_flags:"rw-p", file_offset:0x0, device:0, inode:0, data_file:"", data_offset:0x0, file_size:0x20000000 }
}
{
  real_time:1215693.608737 global_time:919, event:`SYSCALLBUF_FLUSH' tid:1320792, ticks:2624051
  { syscall:'rt_sigprocmask', ret:0x0, size:0x18 }
}
{
  real_time:1215693.608750 global_time:920, event:`SYSCALL: prctl' (state:ENTERING_SYSCALL) tid:1320792, ticks:2624051
x[0]:0x53564d41 x[1]:0x0 x[2]:0xc69a1e605000 x[3]:0x20000000 x[4]:0xc69a0676e3a1 x[5]:0xffffe96c9550 x[6]:0xffffe96c9550 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0x0 x[11]:0x1 x[12]:0x333d3 x[13]:0x6678 x[14]:0x7ffff x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x500 x[19]:0x681ffd50 x[20]:0x53564d41 x[21]:0x22 x[22]:0xf76b15e49458 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.608760 global_time:921, event:`SYSCALLBUF_RESET' tid:1320792, ticks:2624051
}
{
  real_time:1215693.608833 global_time:922, event:`SYSCALL: prctl' (state:EXITING_SYSCALL) tid:1320792, ticks:2624051
x[0]:0x0 x[1]:0x0 x[2]:0xc69a1e605000 x[3]:0x20000000 x[4]:0xc69a0676e3a1 x[5]:0xffffe96c9550 x[6]:0xffffe96c9550 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0x0 x[11]:0x1 x[12]:0x333d3 x[13]:0x6678 x[14]:0x7ffff x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x500 x[19]:0x681ffd50 x[20]:0x53564d41 x[21]:0x22 x[22]:0xf76b15e49458 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
{
  real_time:1215693.609062 global_time:923, event:`SYSCALL: prctl' (state:ENTERING_SYSCALL) tid:1320792, ticks:2626611
x[0]:0x42 x[1]:0x0 x[2]:0x0 x[3]:0x0 x[4]:0x0 x[5]:0xffffe96c9480 x[6]:0xffffe96c9480 x[7]:0x70000000 x[8]:0xa7 x[9]:0x70011000 x[10]:0xc69a064c15f0 x[11]:0xc69a064c1080 x[12]:0x41e0000000000000 x[13]:0x41e0000000000000 x[14]:0x41e0000000000000 x[15]:0x70010000 x[16]:0xc69a068645a0 x[17]:0xf76b16cba830 x[18]:0x180 x[19]:0x681ffd50 x[20]:0x42 x[21]:0xf76b15e6b000 x[22]:0xc69a068484a0 x[23]:0x7fffffffecd0 x[24]:0xf76b15f0d6b0 x[25]:0xf76b15f0d698 x[26]:0xffffe96cae38 x[27]:0xffffe96c9878 x[28]:0xffffe96c9778 x[29]:0x681ffc50 x[30]:0xf76b16e46720 sp:0x681ffc20 pc:0x70000004 pstate:0x80001000
}
=== Start rr backtrace:
rr(_ZN2rr13dump_rr_stackERNS_8ScopedFdE+0x58)[0xb3293090f238]
rr(_ZN2rr15emergency_debugEPNS_4TaskE+0xcc)[0xb329306f1e08]
rr(+0x4a5d44)[0xb329306f5d44]
rr(_ZN2rr21EmergencyDebugOstreamD1Ev+0x68)[0xb329306f5ff8]
rr(+0x56ae08)[0xb329307bae08]
rr(+0x555828)[0xb329307a5828]
rr(_ZN2rr19rec_process_syscallEPNS_10RecordTaskE+0xf4)[0xb329307a59a4]
rr(_ZN2rr13RecordSession21syscall_state_changedEPNS_10RecordTaskEPNS0_9StepStateE+0xa4c)[0xb32930781e48]
rr(_ZN2rr13RecordSession11record_stepEv+0x668)[0xb32930787570]
rr(+0x52b76c)[0xb3293077b76c]
rr(_ZN2rr13RecordCommand3runERSt6vectorINSt7__cxx1112basic_stringIcSt11char_traitsIcESaIcEEESaIS7_EE+0x408)[0xb3293077c640]
rr(main+0x280)[0xb32930708acc]
/lib/aarch64-linux-gnu/libc.so.6(+0x27400)[0xefdfd5277400]
/lib/aarch64-linux-gnu/libc.so.6(__libc_start_main+0x98)[0xefdfd52774d8]
rr(_start+0x30)[0xb329305eabb0]
=== End rr backtrace

[IamHuskar]

But according to the log print output, the first parameter appears to be 0x42 (66).
The record obtained using strace is also 0x42 (66).
It seems like " prctl(0) " is incorrect information?

#define PR_GET_MDWE 66

@rocallahan

[khuey]

03c47a7 should fix our error reporting