Uploaded image for project: 'MariaDB Server'
  1. MariaDB Server
  2. MDEV-9361

rpl.create_select fails sporadically on p8-rhel6-bintar-debug, InnoDB does not start

    Details

      Description

      http://buildbot.askmonty.org/buildbot/builders/p8-rhel6-bintar-debug/builds/1222/steps/test/logs/stdio

      rpl.create_select 'stmt,xtradb'          w2 [ fail ]
              Test ended at 2016-01-04 18:06:36
       
      CURRENT_TEST: rpl.create_select
       
       
      Failed to start mysqld.3
      mysqltest failed but provided no output
      The result from queries just before the failure was:
      < snip >
      Tables_in_test_8428
      t1
      t2
      t3
      # On server_3
      SHOW TABLES IN test_8428;
      Tables_in_test_8428
      t1
      t2
      t3
      SELECT * from test_8428.t1;
      i
      1
      2
      3
      4
      5
      DROP DATABASE test_8428;
      include/rpl_end.inc
      # End of test

      In the error log it looks like this:

      CURRENT_TEST: rpl.create_select
      2016-01-04 18:03:34 17590559273024 [Note] /home/buildbot/maria-slave/power8-vlp01-bintar-debug/build/sql/mysqld (mysqld 10.1.10-MariaDB-debug-log) starting as process 13170 ...
      2016-01-04 18:03:34 17590559273024 [Warning] Could not increase number of max_open_files to more than 1024 (request: 4162)
      2016-01-04 18:03:34 17590559273024 [Note] Plugin 'partition' is disabled.
      2016-01-04 18:03:34 17590559273024 [Note] Plugin 'SEQUENCE' is disabled.
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: Using mutexes to ref count buffer pool pages
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB:  InnoDB: !!!!!!!! UNIV_DEBUG switched on !!!!!!!!!
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB:  InnoDB: !!!!!!!! UNIV_SYNC_DEBUG switched on !!!!!!!!!
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: The InnoDB memory heap is disabled
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: Mutexes and rw_locks use GCC atomic builtins
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: GCC builtin __atomic_thread_fence() is used for memory barrier
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: Compressed tables use zlib 1.2.6
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: Using Linux native AIO
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: Using generic crc32 instructions
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: Initializing buffer pool, size = 8.0M
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: Completed initialization of buffer pool
      2016-01-04 18:03:34 17590559273024 [Note] InnoDB: Highest supported file format is Barracuda.
      CURRENT_TEST: rpl.rpl_heartbeat_2slaves
      2016-01-04 18:06:36 17590872141888 [Note] /home/buildbot/maria-slave/power8-vlp01-bintar-debug/build/sql/mysqld (mysqld 10.1.10-MariaDB-debug-log) starting as process 24363 ...

      Normally, when the test passes, the log looks like this:

      CURRENT_TEST: rpl.create_select
      2016-01-04 18:03:25 17590050058304 [Note] /home/buildbot/maria-slave/power8-vlp01-bintar-debug/build/sql/mysqld (mysqld 10.1.10-MariaDB-debug-log) starting as process 10885 ...
      2016-01-04 18:03:25 17590050058304 [Warning] Could not increase number of max_open_files to more than 1024 (request: 4162)
      2016-01-04 18:03:25 17590050058304 [Note] Plugin 'partition' is disabled.
      2016-01-04 18:03:25 17590050058304 [Note] Plugin 'SEQUENCE' is disabled.
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: Using mutexes to ref count buffer pool pages
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB:  InnoDB: !!!!!!!! UNIV_DEBUG switched on !!!!!!!!!
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB:  InnoDB: !!!!!!!! UNIV_SYNC_DEBUG switched on !!!!!!!!!
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: The InnoDB memory heap is disabled
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: Mutexes and rw_locks use GCC atomic builtins
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: GCC builtin __atomic_thread_fence() is used for memory barrier
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: Compressed tables use zlib 1.2.6
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: Using Linux native AIO
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: Using generic crc32 instructions
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: Initializing buffer pool, size = 8.0M
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: Completed initialization of buffer pool
      2016-01-04 18:03:25 17590050058304 [Note] InnoDB: Highest supported file format is Barracuda.
      2016-01-04 18:03:27 17590050058304 [Note] InnoDB: 128 rollback segment(s) are active.
      2016-01-04 18:03:27 17590050058304 [Note] InnoDB: Waiting for purge to start

      That is, the next step should have been rollback segments, and it should happen very fast, but instead everything just stops until startup timeout is exceeded.

        Attachments

          Issue Links

            Activity

              People

              • Assignee:
                jplindst Jan Lindström
                Reporter:
                elenst Elena Stepanova
              • Votes:
                0 Vote for this issue
                Watchers:
                1 Start watching this issue

                Dates

                • Created:
                  Updated: