builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-085 starttime: 1501757610.85 results: success (0) revision: 63e261ce8cb04c913d2e6b19ea451b7078d24dc1 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:30.850642) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:30.851030) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:30.851305) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:30.888728) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:30.888991) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-08-03 03:53:30-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 225M=0s 2017-08-03 03:53:30 (225 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.169630 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.076280) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.076599) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015233 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.131492) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.131841) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 63e261ce8cb04c913d2e6b19ea451b7078d24dc1 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 63e261ce8cb04c913d2e6b19ea451b7078d24dc1 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-08-03 03:53:30,823 truncating revision to first 12 chars 2017-08-03 03:53:30,823 Setting DEBUG logging. 2017-08-03 03:53:30,823 attempt 1/10 2017-08-03 03:53:30,823 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/63e261ce8cb0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-08-03 03:53:31,263 unpacking tar archive at: mozilla-central-63e261ce8cb0/testing/mozharness/ program finished with exit code 0 elapsedTime=0.766807 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.910997) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.911277) ========= script_repo_revision: 63e261ce8cb04c913d2e6b19ea451b7078d24dc1 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.914674) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.914960) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-03 03:53:31.923866) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 50 secs) (at 2017-08-03 03:53:31.924136) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:53:31 INFO - MultiFileLogger online at 20170803 03:53:31 in /builds/slave/test 03:53:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 03:53:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:53:31 INFO - {'append_to_log': False, 03:53:31 INFO - 'base_work_dir': '/builds/slave/test', 03:53:31 INFO - 'blob_upload_branch': 'Firefox', 03:53:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:53:31 INFO - 'branch': 'Firefox', 03:53:31 INFO - 'buildbot_json_path': 'buildprops.json', 03:53:31 INFO - 'code_coverage': False, 03:53:31 INFO - 'config_files': ('talos/linux_config.py',), 03:53:31 INFO - 'default_actions': ('clobber', 03:53:31 INFO - 'read-buildbot-config', 03:53:31 INFO - 'download-and-extract', 03:53:31 INFO - 'populate-webroot', 03:53:31 INFO - 'create-virtualenv', 03:53:31 INFO - 'install', 03:53:31 INFO - 'setup-mitmproxy', 03:53:31 INFO - 'run-tests'), 03:53:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:53:31 INFO - 'disable_ccov_upload': False, 03:53:31 INFO - 'download_minidump_stackwalk': True, 03:53:31 INFO - 'download_symbols': 'ondemand', 03:53:31 INFO - 'enable_stylo': False, 03:53:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:53:31 INFO - 'tooltool.py': '/tools/tooltool.py', 03:53:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:53:31 INFO - '/tools/misc-python/virtualenv.py')}, 03:53:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:53:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:53:31 INFO - 'gecko_profile': False, 03:53:31 INFO - 'gecko_profile_interval': 0, 03:53:31 INFO - 'installer_path': 'installer.exe', 03:53:31 INFO - 'log_level': 'info', 03:53:31 INFO - 'log_name': 'talos', 03:53:31 INFO - 'log_to_console': True, 03:53:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:53:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:53:31 INFO - 'opt_config_files': (), 03:53:31 INFO - 'pip_index': False, 03:53:31 INFO - 'suite': 'dromaeojs-e10s', 03:53:31 INFO - 'system_bits': '32', 03:53:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:53:31 INFO - 'title': 'talos-linux64-ix-085', 03:53:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:53:31 INFO - 'use_talos_json': True, 03:53:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:53:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:53:31 INFO - 'work_dir': 'build'} 03:53:31 INFO - [mozharness: 2017-08-03 10:53:31.715728Z] Running clobber step. 03:53:31 INFO - Running pre-action listener: _resource_record_pre_action 03:53:31 INFO - Running main action method: clobber 03:53:31 INFO - rmtree: /builds/slave/test/build 03:53:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:53:32 INFO - Running post-action listener: _resource_record_post_action 03:53:32 INFO - [mozharness: 2017-08-03 10:53:32.747934Z] Finished clobber step (success) 03:53:32 INFO - [mozharness: 2017-08-03 10:53:32.748038Z] Running read-buildbot-config step. 03:53:32 INFO - Running pre-action listener: _resource_record_pre_action 03:53:32 INFO - Running main action method: read_buildbot_config 03:53:32 INFO - Using buildbot properties: 03:53:32 INFO - { 03:53:32 INFO - "project": "", 03:53:32 INFO - "product": "firefox", 03:53:32 INFO - "who": "archaeopteryx@coole-files.de", 03:53:32 INFO - "installer_path": "public/build/target.tar.bz2", 03:53:32 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 03:53:32 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 03:53:32 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 03:53:32 INFO - "stage_platform": "linux64-pgo", 03:53:32 INFO - "basedir": "/builds/slave/test", 03:53:32 INFO - "buildnumber": 96, 03:53:32 INFO - "platform": "ubuntu64_hw", 03:53:32 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 03:53:32 INFO - "slavebuilddir": "test", 03:53:32 INFO - "taskId": "EEV_zVyeR_W1gv-BfYLp5g", 03:53:32 INFO - "branch": "mozilla-central", 03:53:32 INFO - "script_repo_revision": "production", 03:53:32 INFO - "revision": "63e261ce8cb04c913d2e6b19ea451b7078d24dc1", 03:53:32 INFO - "slavename": "talos-linux64-ix-085", 03:53:32 INFO - "repo_path": "mozilla-central" 03:53:32 INFO - } 03:53:32 INFO - Finding installer, test and symbols from parent task. 03:53:32 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EEV_zVyeR_W1gv-BfYLp5g'}, attempt #1 03:53:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EEV_zVyeR_W1gv-BfYLp5g'}, attempt #1 03:53:33 INFO - Task dependencies: EFNak279TF2_iRL8mLGfJw 03:53:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw'}, attempt #1 03:53:34 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.tar.bz2 03:53:34 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.test_packages.json 03:53:34 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.crashreporter-symbols.zip 03:53:34 INFO - Running post-action listener: _resource_record_post_action 03:53:34 INFO - [mozharness: 2017-08-03 10:53:34.107891Z] Finished read-buildbot-config step (success) 03:53:34 INFO - [mozharness: 2017-08-03 10:53:34.108115Z] Running download-and-extract step. 03:53:34 INFO - Running pre-action listener: _resource_record_pre_action 03:53:34 INFO - Running main action method: download_and_extract 03:53:34 INFO - mkdir: /builds/slave/test/build/tests 03:53:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:53:34 INFO - trying https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.test_packages.json 03:53:34 INFO - Downloading https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 03:53:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 03:53:34 INFO - Downloaded 989 bytes. 03:53:34 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 03:53:34 INFO - Using the following test package requirements: 03:53:34 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 03:53:34 INFO - u'common': [u'target.common.tests.zip'], 03:53:34 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 03:53:34 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 03:53:34 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 03:53:34 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 03:53:34 INFO - u'mozbase': [u'target.common.tests.zip'], 03:53:34 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 03:53:34 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 03:53:34 INFO - u'web-platform': [u'target.common.tests.zip', 03:53:34 INFO - u'target.web-platform.tests.tar.gz'], 03:53:34 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 03:53:34 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 03:53:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.common.tests.zip 03:53:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.common.tests.zip'}, attempt #1 03:53:34 INFO - Fetch https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.common.tests.zip into memory 03:53:36 INFO - Content-Length response header: 54891453 03:53:36 INFO - Bytes received: 54891453 03:53:47 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 03:53:47 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.common.tests.zip 03:53:47 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.common.tests.zip'}, attempt #1 03:53:47 INFO - Fetch https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.common.tests.zip into memory 03:53:48 INFO - Content-Length response header: 54891453 03:53:48 INFO - Bytes received: 54891453 03:54:00 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.talos.tests.zip 03:54:00 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 03:54:00 INFO - Fetch https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.talos.tests.zip into memory 03:54:01 INFO - Content-Length response header: 14496464 03:54:01 INFO - Bytes received: 14496464 03:54:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:01 INFO - trying https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.tar.bz2 03:54:01 INFO - Downloading https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 03:54:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 03:54:03 INFO - Downloaded 63113337 bytes. 03:54:03 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.tar.bz2 03:54:03 INFO - mkdir: /builds/slave/test/properties 03:54:03 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:54:03 INFO - Writing to file /builds/slave/test/properties/build_url 03:54:03 INFO - Contents: 03:54:03 INFO - build_url:https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.tar.bz2 03:54:03 INFO - Running post-action listener: _resource_record_post_action 03:54:03 INFO - Running post-action listener: set_extra_try_arguments 03:54:03 INFO - [mozharness: 2017-08-03 10:54:03.907160Z] Finished download-and-extract step (success) 03:54:03 INFO - [mozharness: 2017-08-03 10:54:03.907296Z] Running populate-webroot step. 03:54:03 INFO - Running pre-action listener: _resource_record_pre_action 03:54:03 INFO - Running main action method: populate_webroot 03:54:03 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:54:03 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:54:03 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 03:54:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:54:03 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 03:54:03 INFO - 'tests': ['damp', 'tps']}, 03:54:03 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:54:03 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 03:54:03 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 03:54:03 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 03:54:03 INFO - 'other-e10s': {'tests': ['a11yr', 03:54:03 INFO - 'ts_paint', 03:54:03 INFO - 'tpaint', 03:54:03 INFO - 'sessionrestore', 03:54:03 INFO - 'sessionrestore_many_windows', 03:54:03 INFO - 'sessionrestore_no_auto_restore', 03:54:03 INFO - 'tabpaint']}, 03:54:03 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 03:54:03 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 03:54:03 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 03:54:03 INFO - 'talos_options': ['--mitmproxy', 03:54:03 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 03:54:03 INFO - '--firstNonBlankPaint'], 03:54:03 INFO - 'tests': ['quantum_pageload_google', 03:54:03 INFO - 'quantum_pageload_youtube', 03:54:03 INFO - 'quantum_pageload_amazon', 03:54:03 INFO - 'quantum_pageload_facebook']}, 03:54:03 INFO - 'quantum-pageload-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 03:54:03 INFO - 'talos_options': ['--stylo', 03:54:03 INFO - '--mitmproxy', 03:54:03 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 03:54:03 INFO - '--firstNonBlankPaint'], 03:54:03 INFO - 'tests': ['quantum_pageload_google', 03:54:03 INFO - 'quantum_pageload_youtube', 03:54:03 INFO - 'quantum_pageload_amazon', 03:54:03 INFO - 'quantum_pageload_facebook']}, 03:54:03 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:54:03 INFO - 'tsvgr_opacity', 03:54:03 INFO - 'tart', 03:54:03 INFO - 'tscrollx', 03:54:03 INFO - 'cart', 03:54:03 INFO - 'tsvg_static']}, 03:54:03 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 03:54:03 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 03:54:03 INFO - 'talos_options': ['--stylo', 03:54:03 INFO - '--stylo-threads=1', 03:54:03 INFO - '--mitmproxy', 03:54:03 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 03:54:03 INFO - '--firstNonBlankPaint'], 03:54:03 INFO - 'tests': ['tp6_google', 03:54:03 INFO - 'tp6_youtube', 03:54:03 INFO - 'tp6_amazon', 03:54:03 INFO - 'tp6_facebook']}, 03:54:03 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 03:54:03 INFO - 'talos_options': ['--xperf_path', 03:54:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:54:03 INFO - 'tests': ['tp5n']}}} 03:54:03 INFO - Running post-action listener: _resource_record_post_action 03:54:03 INFO - [mozharness: 2017-08-03 10:54:03.916678Z] Finished populate-webroot step (success) 03:54:03 INFO - [mozharness: 2017-08-03 10:54:03.916768Z] Running create-virtualenv step. 03:54:03 INFO - Running pre-action listener: _resource_record_pre_action 03:54:03 INFO - Running main action method: create_virtualenv 03:54:03 INFO - Creating virtualenv /builds/slave/test/build/venv 03:54:03 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 03:54:03 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:54:03 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 03:54:04 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:54:04 INFO - Using real prefix '/usr' 03:54:04 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:54:04 INFO - Installing distribute.............................................................................................................................................................................................done. 03:54:06 INFO - Installing pip.................done. 03:54:06 INFO - Return code: 0 03:54:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 03:54:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 03:54:06 INFO - Reading from file tmpfile_stdout 03:54:06 INFO - Output received: 03:54:06 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 03:54:06 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:54:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 03:54:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 03:54:06 INFO - Using env: {'DISPLAY': ':0', 03:54:06 INFO - 'HOME': '/home/cltbld', 03:54:06 INFO - 'LANG': 'en_US.UTF-8', 03:54:06 INFO - 'LANGUAGE': 'en_US:en', 03:54:06 INFO - 'LOGNAME': 'cltbld', 03:54:06 INFO - 'MAIL': '/var/mail/cltbld', 03:54:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:06 INFO - 'MOZ_NO_REMOTE': '1', 03:54:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:06 INFO - 'NO_EM_RESTART': '1', 03:54:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:06 INFO - 'PWD': '/builds/slave/test', 03:54:06 INFO - 'SHELL': '/bin/bash', 03:54:06 INFO - 'SHLVL': '1', 03:54:06 INFO - 'TERM': 'linux', 03:54:06 INFO - 'TMOUT': '86400', 03:54:06 INFO - 'USER': 'cltbld', 03:54:06 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:06 INFO - '_': '/tools/buildbot/bin/python'} 03:54:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:06 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 03:54:06 INFO - Cleaning up... 03:54:06 INFO - Return code: 0 03:54:06 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:54:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 03:54:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 03:54:06 INFO - Using env: {'DISPLAY': ':0', 03:54:06 INFO - 'HOME': '/home/cltbld', 03:54:06 INFO - 'LANG': 'en_US.UTF-8', 03:54:06 INFO - 'LANGUAGE': 'en_US:en', 03:54:06 INFO - 'LOGNAME': 'cltbld', 03:54:06 INFO - 'MAIL': '/var/mail/cltbld', 03:54:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:06 INFO - 'MOZ_NO_REMOTE': '1', 03:54:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:06 INFO - 'NO_EM_RESTART': '1', 03:54:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:06 INFO - 'PWD': '/builds/slave/test', 03:54:06 INFO - 'SHELL': '/bin/bash', 03:54:06 INFO - 'SHLVL': '1', 03:54:06 INFO - 'TERM': 'linux', 03:54:06 INFO - 'TMOUT': '86400', 03:54:06 INFO - 'USER': 'cltbld', 03:54:06 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:06 INFO - '_': '/tools/buildbot/bin/python'} 03:54:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:07 INFO - Downloading/unpacking psutil>=3.1.1 03:54:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:54:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:54:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:54:08 INFO - Installing collected packages: psutil 03:54:08 INFO - Running setup.py install for psutil 03:54:08 INFO - building 'psutil._psutil_linux' extension 03:54:08 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 03:54:08 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 03:54:08 INFO - building 'psutil._psutil_posix' extension 03:54:08 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 03:54:08 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 03:54:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:54:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:54:08 INFO - Successfully installed psutil 03:54:08 INFO - Cleaning up... 03:54:08 INFO - Return code: 0 03:54:08 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:54:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 03:54:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 03:54:08 INFO - Using env: {'DISPLAY': ':0', 03:54:08 INFO - 'HOME': '/home/cltbld', 03:54:08 INFO - 'LANG': 'en_US.UTF-8', 03:54:08 INFO - 'LANGUAGE': 'en_US:en', 03:54:08 INFO - 'LOGNAME': 'cltbld', 03:54:08 INFO - 'MAIL': '/var/mail/cltbld', 03:54:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:08 INFO - 'MOZ_NO_REMOTE': '1', 03:54:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:08 INFO - 'NO_EM_RESTART': '1', 03:54:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:08 INFO - 'PWD': '/builds/slave/test', 03:54:08 INFO - 'SHELL': '/bin/bash', 03:54:08 INFO - 'SHLVL': '1', 03:54:08 INFO - 'TERM': 'linux', 03:54:08 INFO - 'TMOUT': '86400', 03:54:08 INFO - 'USER': 'cltbld', 03:54:08 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:08 INFO - '_': '/tools/buildbot/bin/python'} 03:54:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:09 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:54:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:10 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:54:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:54:10 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:54:10 INFO - Installing collected packages: mozsystemmonitor 03:54:10 INFO - Running setup.py install for mozsystemmonitor 03:54:10 INFO - Successfully installed mozsystemmonitor 03:54:10 INFO - Cleaning up... 03:54:10 INFO - Return code: 0 03:54:10 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:54:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 03:54:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 03:54:10 INFO - Using env: {'DISPLAY': ':0', 03:54:10 INFO - 'HOME': '/home/cltbld', 03:54:10 INFO - 'LANG': 'en_US.UTF-8', 03:54:10 INFO - 'LANGUAGE': 'en_US:en', 03:54:10 INFO - 'LOGNAME': 'cltbld', 03:54:10 INFO - 'MAIL': '/var/mail/cltbld', 03:54:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:10 INFO - 'MOZ_NO_REMOTE': '1', 03:54:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:10 INFO - 'NO_EM_RESTART': '1', 03:54:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:10 INFO - 'PWD': '/builds/slave/test', 03:54:10 INFO - 'SHELL': '/bin/bash', 03:54:10 INFO - 'SHLVL': '1', 03:54:10 INFO - 'TERM': 'linux', 03:54:10 INFO - 'TMOUT': '86400', 03:54:10 INFO - 'USER': 'cltbld', 03:54:10 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:10 INFO - '_': '/tools/buildbot/bin/python'} 03:54:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:10 INFO - Downloading/unpacking jsonschema==2.5.1 03:54:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:11 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:54:11 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:54:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:11 INFO - Downloading functools32-3.2.3-2.tar.gz 03:54:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:54:11 INFO - warning: no files found matching '*.txt' 03:54:11 INFO - no previously-included directories found matching 'build' 03:54:11 INFO - no previously-included directories found matching 'dist' 03:54:11 INFO - no previously-included directories found matching '.git*' 03:54:11 INFO - Installing collected packages: jsonschema, functools32 03:54:11 INFO - Running setup.py install for functools32 03:54:12 INFO - warning: no files found matching '*.txt' 03:54:12 INFO - no previously-included directories found matching 'build' 03:54:12 INFO - no previously-included directories found matching 'dist' 03:54:12 INFO - no previously-included directories found matching '.git*' 03:54:12 INFO - Successfully installed jsonschema functools32 03:54:12 INFO - Cleaning up... 03:54:12 INFO - Return code: 0 03:54:12 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 03:54:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 03:54:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 03:54:12 INFO - Using env: {'DISPLAY': ':0', 03:54:12 INFO - 'HOME': '/home/cltbld', 03:54:12 INFO - 'LANG': 'en_US.UTF-8', 03:54:12 INFO - 'LANGUAGE': 'en_US:en', 03:54:12 INFO - 'LOGNAME': 'cltbld', 03:54:12 INFO - 'MAIL': '/var/mail/cltbld', 03:54:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:12 INFO - 'MOZ_NO_REMOTE': '1', 03:54:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:12 INFO - 'NO_EM_RESTART': '1', 03:54:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:12 INFO - 'PWD': '/builds/slave/test', 03:54:12 INFO - 'SHELL': '/bin/bash', 03:54:12 INFO - 'SHLVL': '1', 03:54:12 INFO - 'TERM': 'linux', 03:54:12 INFO - 'TMOUT': '86400', 03:54:12 INFO - 'USER': 'cltbld', 03:54:12 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:12 INFO - '_': '/tools/buildbot/bin/python'} 03:54:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:12 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 03:54:12 INFO - Cleaning up... 03:54:12 INFO - Return code: 0 03:54:12 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:54:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 03:54:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 03:54:12 INFO - Using env: {'DISPLAY': ':0', 03:54:12 INFO - 'HOME': '/home/cltbld', 03:54:12 INFO - 'LANG': 'en_US.UTF-8', 03:54:12 INFO - 'LANGUAGE': 'en_US:en', 03:54:12 INFO - 'LOGNAME': 'cltbld', 03:54:12 INFO - 'MAIL': '/var/mail/cltbld', 03:54:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:12 INFO - 'MOZ_NO_REMOTE': '1', 03:54:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:12 INFO - 'NO_EM_RESTART': '1', 03:54:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:12 INFO - 'PWD': '/builds/slave/test', 03:54:12 INFO - 'SHELL': '/bin/bash', 03:54:12 INFO - 'SHLVL': '1', 03:54:12 INFO - 'TERM': 'linux', 03:54:12 INFO - 'TMOUT': '86400', 03:54:12 INFO - 'USER': 'cltbld', 03:54:12 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:12 INFO - '_': '/tools/buildbot/bin/python'} 03:54:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:12 INFO - Downloading/unpacking blobuploader==1.2.4 03:54:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:13 INFO - Downloading blobuploader-1.2.4.tar.gz 03:54:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:54:13 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:54:13 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:14 INFO - Downloading docopt-0.6.1.tar.gz 03:54:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:54:14 INFO - Installing collected packages: blobuploader, requests, docopt 03:54:14 INFO - Running setup.py install for blobuploader 03:54:14 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:54:14 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:54:14 INFO - Running setup.py install for requests 03:54:14 INFO - Running setup.py install for docopt 03:54:14 INFO - Successfully installed blobuploader requests docopt 03:54:14 INFO - Cleaning up... 03:54:14 INFO - Return code: 0 03:54:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:54:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:54:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:54:14 INFO - Using env: {'DISPLAY': ':0', 03:54:14 INFO - 'HOME': '/home/cltbld', 03:54:14 INFO - 'LANG': 'en_US.UTF-8', 03:54:14 INFO - 'LANGUAGE': 'en_US:en', 03:54:14 INFO - 'LOGNAME': 'cltbld', 03:54:14 INFO - 'MAIL': '/var/mail/cltbld', 03:54:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:14 INFO - 'MOZ_NO_REMOTE': '1', 03:54:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:14 INFO - 'NO_EM_RESTART': '1', 03:54:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:14 INFO - 'PWD': '/builds/slave/test', 03:54:14 INFO - 'SHELL': '/bin/bash', 03:54:14 INFO - 'SHLVL': '1', 03:54:14 INFO - 'TERM': 'linux', 03:54:14 INFO - 'TMOUT': '86400', 03:54:14 INFO - 'USER': 'cltbld', 03:54:14 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:14 INFO - '_': '/tools/buildbot/bin/python'} 03:54:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:54:15 INFO - Running setup.py (path:/tmp/pip-xqhHQy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:54:15 INFO - Running setup.py (path:/tmp/pip-ILQY4P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:54:15 INFO - Running setup.py (path:/tmp/pip-nnNII5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:54:15 INFO - Running setup.py (path:/tmp/pip-HH36ic-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:54:15 INFO - Running setup.py (path:/tmp/pip-H83Vd3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:54:15 INFO - Running setup.py (path:/tmp/pip-d78qld-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:54:15 INFO - Running setup.py (path:/tmp/pip-4sUBt9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:54:15 INFO - Running setup.py (path:/tmp/pip-bJCIB9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:54:15 INFO - Running setup.py (path:/tmp/pip-Se1uIq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:54:15 INFO - Running setup.py (path:/tmp/pip-61TrTR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:54:15 INFO - Running setup.py (path:/tmp/pip-ywmYgh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:54:15 INFO - Running setup.py (path:/tmp/pip-vgzqtV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:54:15 INFO - Running setup.py (path:/tmp/pip-zTWHy9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:54:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:54:15 INFO - Running setup.py (path:/tmp/pip-buOyNm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:54:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:54:16 INFO - Running setup.py (path:/tmp/pip-_cZYpr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:54:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:54:16 INFO - Running setup.py (path:/tmp/pip-CkLiLN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:54:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:54:16 INFO - Running setup.py (path:/tmp/pip-LwvHyj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:54:16 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:54:16 INFO - Running setup.py install for manifestparser 03:54:16 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:54:16 INFO - Running setup.py install for mozcrash 03:54:16 INFO - Running setup.py install for mozdebug 03:54:16 INFO - Running setup.py install for mozdevice 03:54:16 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:54:16 INFO - Running setup.py install for mozfile 03:54:16 INFO - Running setup.py install for mozhttpd 03:54:16 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:54:16 INFO - Running setup.py install for mozinfo 03:54:16 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:54:16 INFO - Running setup.py install for mozInstall 03:54:16 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:54:16 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Running setup.py install for mozleak 03:54:17 INFO - Running setup.py install for mozlog 03:54:17 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Running setup.py install for moznetwork 03:54:17 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Running setup.py install for mozprocess 03:54:17 INFO - Running setup.py install for mozprofile 03:54:17 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Running setup.py install for mozrunner 03:54:17 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Running setup.py install for mozscreenshot 03:54:17 INFO - Running setup.py install for moztest 03:54:17 INFO - Running setup.py install for mozversion 03:54:17 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:54:17 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:54:17 INFO - Cleaning up... 03:54:17 INFO - Return code: 0 03:54:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:54:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:54:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:54:18 INFO - Using env: {'DISPLAY': ':0', 03:54:18 INFO - 'HOME': '/home/cltbld', 03:54:18 INFO - 'LANG': 'en_US.UTF-8', 03:54:18 INFO - 'LANGUAGE': 'en_US:en', 03:54:18 INFO - 'LOGNAME': 'cltbld', 03:54:18 INFO - 'MAIL': '/var/mail/cltbld', 03:54:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:18 INFO - 'MOZ_NO_REMOTE': '1', 03:54:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:18 INFO - 'NO_EM_RESTART': '1', 03:54:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:18 INFO - 'PWD': '/builds/slave/test', 03:54:18 INFO - 'SHELL': '/bin/bash', 03:54:18 INFO - 'SHLVL': '1', 03:54:18 INFO - 'TERM': 'linux', 03:54:18 INFO - 'TMOUT': '86400', 03:54:18 INFO - 'USER': 'cltbld', 03:54:18 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:18 INFO - '_': '/tools/buildbot/bin/python'} 03:54:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:54:18 INFO - Running setup.py (path:/tmp/pip-AWKzCE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:54:18 INFO - Running setup.py (path:/tmp/pip-Qogk0z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:54:18 INFO - Running setup.py (path:/tmp/pip-v_jV0C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:54:18 INFO - Running setup.py (path:/tmp/pip-gYkhPs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:54:18 INFO - Running setup.py (path:/tmp/pip-mSIvEb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:54:18 INFO - Running setup.py (path:/tmp/pip-OFeP0z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:54:18 INFO - Running setup.py (path:/tmp/pip-w5GEHE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:54:18 INFO - Running setup.py (path:/tmp/pip-LrO67f-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:54:18 INFO - Running setup.py (path:/tmp/pip-v9p5Hj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:54:18 INFO - Running setup.py (path:/tmp/pip-iLjiiR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:54:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:54:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:54:18 INFO - Running setup.py (path:/tmp/pip-gA16xX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 03:54:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:54:19 INFO - Running setup.py (path:/tmp/pip-JVtyvM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 03:54:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:54:19 INFO - Running setup.py (path:/tmp/pip-B5tw2N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 03:54:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:54:19 INFO - Running setup.py (path:/tmp/pip-b4nClp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 03:54:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:54:19 INFO - Running setup.py (path:/tmp/pip-iIavDZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 03:54:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:54:19 INFO - Running setup.py (path:/tmp/pip-dbBVgY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 03:54:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:54:19 INFO - Running setup.py (path:/tmp/pip-Q7Q3tO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 03:54:19 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:54:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:20 INFO - Downloading blessings-1.6.tar.gz 03:54:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:54:20 INFO - Installing collected packages: blessings 03:54:20 INFO - Running setup.py install for blessings 03:54:20 INFO - Successfully installed blessings 03:54:20 INFO - Cleaning up... 03:54:20 INFO - Return code: 0 03:54:20 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:54:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:54:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:54:21 INFO - Reading from file tmpfile_stdout 03:54:21 INFO - Current package versions: 03:54:21 INFO - argparse == 1.2.1 03:54:21 INFO - blessings == 1.6 03:54:21 INFO - blobuploader == 1.2.4 03:54:21 INFO - docopt == 0.6.1 03:54:21 INFO - functools32 == 3.2.3-2 03:54:21 INFO - jsonschema == 2.5.1 03:54:21 INFO - manifestparser == 1.1 03:54:21 INFO - mozInstall == 1.13 03:54:21 INFO - mozcrash == 1.0 03:54:21 INFO - mozdebug == 0.1 03:54:21 INFO - mozdevice == 0.51 03:54:21 INFO - mozfile == 1.2 03:54:21 INFO - mozhttpd == 0.7 03:54:21 INFO - mozinfo == 0.10 03:54:21 INFO - mozleak == 0.1 03:54:21 INFO - mozlog == 3.5 03:54:21 INFO - moznetwork == 0.27 03:54:21 INFO - mozprocess == 0.25 03:54:21 INFO - mozprofile == 0.28 03:54:21 INFO - mozrunner == 6.13 03:54:21 INFO - mozscreenshot == 0.1 03:54:21 INFO - mozsystemmonitor == 0.3 03:54:21 INFO - moztest == 0.8 03:54:21 INFO - mozversion == 1.4 03:54:21 INFO - psutil == 3.1.1 03:54:21 INFO - requests == 1.2.3 03:54:21 INFO - wsgiref == 0.1.2 03:54:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:54:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 03:54:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:54:21 INFO - Using env: {'DISPLAY': ':0', 03:54:21 INFO - 'HOME': '/home/cltbld', 03:54:21 INFO - 'LANG': 'en_US.UTF-8', 03:54:21 INFO - 'LANGUAGE': 'en_US:en', 03:54:21 INFO - 'LOGNAME': 'cltbld', 03:54:21 INFO - 'MAIL': '/var/mail/cltbld', 03:54:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:21 INFO - 'MOZ_NO_REMOTE': '1', 03:54:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:21 INFO - 'NO_EM_RESTART': '1', 03:54:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:21 INFO - 'PWD': '/builds/slave/test', 03:54:21 INFO - 'SHELL': '/bin/bash', 03:54:21 INFO - 'SHLVL': '1', 03:54:21 INFO - 'TERM': 'linux', 03:54:21 INFO - 'TMOUT': '86400', 03:54:21 INFO - 'USER': 'cltbld', 03:54:21 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:21 INFO - '_': '/tools/buildbot/bin/python'} 03:54:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 03:54:21 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 03:54:21 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 03:54:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 03:54:22 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:54:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:54:22 INFO - Installing collected packages: simplejson 03:54:22 INFO - Running setup.py install for simplejson 03:54:22 INFO - building 'simplejson._speedups' extension 03:54:22 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 03:54:23 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 03:54:23 INFO - Successfully installed simplejson 03:54:23 INFO - Cleaning up... 03:54:23 INFO - Return code: 0 03:54:23 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:54:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x293f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b0ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2caed10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:54:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 03:54:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 03:54:23 INFO - Using env: {'DISPLAY': ':0', 03:54:23 INFO - 'HOME': '/home/cltbld', 03:54:23 INFO - 'LANG': 'en_US.UTF-8', 03:54:23 INFO - 'LANGUAGE': 'en_US:en', 03:54:23 INFO - 'LOGNAME': 'cltbld', 03:54:23 INFO - 'MAIL': '/var/mail/cltbld', 03:54:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:23 INFO - 'MOZ_NO_REMOTE': '1', 03:54:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:23 INFO - 'NO_EM_RESTART': '1', 03:54:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:23 INFO - 'PWD': '/builds/slave/test', 03:54:23 INFO - 'SHELL': '/bin/bash', 03:54:23 INFO - 'SHLVL': '1', 03:54:23 INFO - 'TERM': 'linux', 03:54:23 INFO - 'TMOUT': '86400', 03:54:23 INFO - 'USER': 'cltbld', 03:54:23 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:23 INFO - '_': '/tools/buildbot/bin/python'} 03:54:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:23 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:54:23 INFO - Cleaning up... 03:54:23 INFO - Return code: 0 03:54:23 INFO - Running post-action listener: _resource_record_post_action 03:54:23 INFO - Running post-action listener: _start_resource_monitoring 03:54:23 INFO - Starting resource monitoring. 03:54:23 INFO - [mozharness: 2017-08-03 10:54:23.699288Z] Finished create-virtualenv step (success) 03:54:23 INFO - [mozharness: 2017-08-03 10:54:23.699747Z] Running install step. 03:54:23 INFO - Running pre-action listener: _resource_record_pre_action 03:54:23 INFO - Running main action method: install 03:54:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:54:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:54:23 INFO - Reading from file tmpfile_stdout 03:54:23 INFO - Detecting whether we're running mozinstall >=1.0... 03:54:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:54:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:54:24 INFO - Reading from file tmpfile_stdout 03:54:24 INFO - Output received: 03:54:24 INFO - Usage: mozinstall [options] installer 03:54:24 INFO - Options: 03:54:24 INFO - -h, --help show this help message and exit 03:54:24 INFO - -d DEST, --destination=DEST 03:54:24 INFO - Directory to install application into. [default: 03:54:24 INFO - "/builds/slave/test"] 03:54:24 INFO - --app=APP Application being installed. [default: firefox] 03:54:24 INFO - mkdir: /builds/slave/test/build/application 03:54:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 03:54:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 03:54:41 INFO - Reading from file tmpfile_stdout 03:54:41 INFO - Output received: 03:54:41 INFO - /builds/slave/test/build/application/firefox/firefox 03:54:41 INFO - Running post-action listener: _resource_record_post_action 03:54:41 INFO - [mozharness: 2017-08-03 10:54:41.919688Z] Finished install step (success) 03:54:41 INFO - [mozharness: 2017-08-03 10:54:41.919973Z] Running setup-mitmproxy step. 03:54:41 INFO - Running pre-action listener: _resource_record_pre_action 03:54:41 INFO - Running main action method: setup_mitmproxy 03:54:41 INFO - Skipping: mitmproxy is not required 03:54:41 INFO - Running post-action listener: _resource_record_post_action 03:54:41 INFO - [mozharness: 2017-08-03 10:54:41.921117Z] Finished setup-mitmproxy step (success) 03:54:41 INFO - [mozharness: 2017-08-03 10:54:41.921340Z] Running run-tests step. 03:54:41 INFO - Running pre-action listener: _resource_record_pre_action 03:54:41 INFO - Running pre-action listener: _set_gcov_prefix 03:54:41 INFO - Running main action method: run_tests 03:54:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:54:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:54:41 INFO - Python 2.7.3 03:54:41 INFO - Return code: 0 03:54:41 INFO - grabbing minidump binary from tooltool 03:54:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:41 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cabeb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cacdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cad240>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:54:41 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 03:54:41 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 03:54:41 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 03:54:41 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:54:42 INFO - Return code: 0 03:54:42 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:54:42 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:54:42 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:54:42 INFO - ENV: RUST_BACKTRACE is now 1 03:54:42 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:54:42 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:54:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-085', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 03:54:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-085 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 03:54:42 INFO - Using env: {'DISPLAY': ':0', 03:54:42 INFO - 'HOME': '/home/cltbld', 03:54:42 INFO - 'LANG': 'en_US.UTF-8', 03:54:42 INFO - 'LANGUAGE': 'en_US:en', 03:54:42 INFO - 'LOGNAME': 'cltbld', 03:54:42 INFO - 'MAIL': '/var/mail/cltbld', 03:54:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:54:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:54:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:42 INFO - 'MOZ_NO_REMOTE': '1', 03:54:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:54:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:42 INFO - 'NO_EM_RESTART': '1', 03:54:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:42 INFO - 'PWD': '/builds/slave/test', 03:54:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:54:42 INFO - 'RUST_BACKTRACE': '1', 03:54:42 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 03:54:42 INFO - 'SHELL': '/bin/bash', 03:54:42 INFO - 'SHLVL': '1', 03:54:42 INFO - 'TERM': 'linux', 03:54:42 INFO - 'TMOUT': '86400', 03:54:42 INFO - 'USER': 'cltbld', 03:54:42 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312', 03:54:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:42 INFO - '_': '/tools/buildbot/bin/python'} 03:54:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-085', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 03:54:42 INFO - mozversion application_buildid: 20170803094619 03:54:42 INFO - mozversion application_changeset: 63e261ce8cb04c913d2e6b19ea451b7078d24dc1 03:54:42 INFO - mozversion application_display_name: Nightly 03:54:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:54:42 INFO - mozversion application_name: Firefox 03:54:42 INFO - mozversion application_remotingname: firefox 03:54:42 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 03:54:42 INFO - mozversion application_vendor: Mozilla 03:54:42 INFO - mozversion application_version: 57.0a1 03:54:42 INFO - mozversion platform_buildid: 20170803094619 03:54:42 INFO - mozversion platform_changeset: 63e261ce8cb04c913d2e6b19ea451b7078d24dc1 03:54:42 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 03:54:42 INFO - mozversion platform_version: 57.0a1 03:54:42 INFO - using testdate: 1501757682 03:54:42 INFO - actual date: 1501757682 03:54:42 INFO - starting webserver on 'localhost:35760' 03:54:42 INFO - SUITE-START | Running 2 tests 03:54:42 INFO - TEST-START | dromaeo_css 03:54:42 INFO - Initialising browser for dromaeo_css test... 03:54:42 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:35760/getInfo.html -profile /tmp/tmpoDBYKx/profile 03:54:42 INFO - TEST-INFO | started process 25919 (/builds/slave/test/build/application/firefox/firefox http://localhost:35760/getInfo.html) 03:54:48 INFO - TEST-INFO | 25919: exit 0 03:54:48 INFO - Browser initialized. 03:54:48 INFO - Running cycle 1/1 for dromaeo_css test... 03:54:48 INFO - TEST-INFO | started process 26129 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpoDBYKx/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 03:54:49 INFO - PID 26129 | 03:54:49 INFO - PID 26129 | (/builds/slave/test/build/application/firefox/firefox:26178): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 03:54:49 INFO - PID 26129 | 03:54:59 INFO - PID 26129 | RSS: Main: 164462592 03:54:59 INFO - PID 26129 | 03:57:57 INFO - PID 26129 | Cycle 1(1): loaded http://localhost:35760/tests/dromaeo/cssquery-dojo.html (next: http://localhost:35760/tests/dromaeo/cssquery-ext.html) 03:57:58 INFO - PID 26129 | RSS: Main: 166920192 03:57:58 INFO - PID 26129 | 04:01:00 INFO - PID 26129 | Cycle 1(1): loaded http://localhost:35760/tests/dromaeo/cssquery-ext.html (next: http://localhost:35760/tests/dromaeo/cssquery-jquery.html) 04:01:00 INFO - PID 26129 | RSS: Main: 164466688 04:01:00 INFO - PID 26129 | 04:04:02 INFO - PID 26129 | Cycle 1(1): loaded http://localhost:35760/tests/dromaeo/cssquery-jquery.html (next: http://localhost:35760/tests/dromaeo/cssquery-mootools.html) 04:04:03 INFO - PID 26129 | RSS: Main: 166293504 04:04:03 INFO - PID 26129 | 04:07:04 INFO - PID 26129 | Cycle 1(1): loaded http://localhost:35760/tests/dromaeo/cssquery-mootools.html (next: http://localhost:35760/tests/dromaeo/cssquery-prototype.html) 04:07:05 INFO - PID 26129 | RSS: Main: 164773888 04:07:05 INFO - PID 26129 | 04:10:08 INFO - PID 26129 | Cycle 1(1): loaded http://localhost:35760/tests/dromaeo/cssquery-prototype.html (next: http://localhost:35760/tests/dromaeo/cssquery-yui.html) 04:10:09 INFO - PID 26129 | RSS: Main: 168153088 04:10:09 INFO - PID 26129 | 04:13:10 INFO - PID 26129 | Cycle 1(1): loaded http://localhost:35760/tests/dromaeo/cssquery-yui.html (next: http://localhost:35760/tests/dromaeo/cssquery-dojo.html) 04:13:11 INFO - PID 26129 | RSS: Main: 168759296 04:13:11 INFO - PID 26129 | 04:13:11 INFO - PID 26129 | __start_tp_report 04:13:11 INFO - PID 26129 | _x_x_mozilla_page_load 04:13:11 INFO - PID 26129 | _x_x_mozilla_page_load_details 04:13:11 INFO - PID 26129 | |i|pagename|runs| 04:13:11 INFO - PID 26129 | |0;dojo.html;3375.173082594763;3541.061618671054;3566.4472006838937;3582.2298205885763;3584.9462258066123;6155.846103847395;6234.158388617541;6272;6281.748730050798;6321.1150438938585;6085.574009819315;6214.596051256665;6217.813465596039;6231.719572619231;6330.620162790236;5454.53636440903;5514.393416724157;5525.143602741581;5537.446255374471;5545.916811247835;5265.736713164327;5394.298741163643;5466.781328746845;5534.667919924817;5602.327720673525;5461.317335333063;5505.476979686923;5506.201600767907;5561.582881283879;5564.916526252109;5359;5495.093309603911;5542.528885044776;5574.498295153415;5576.498115169654;5402.243685883979;5414;5414.648047876875;5446.972765136188;5454.53636440903;6145.047517634729;6168.105624684441;6185.350538193515;6190.81427557174;6199.566030377875;6758.662066896635;6769.221539522969;6778.389944904982;6783.118194634666;6790.864182716318;6767.221769496522;6792.694328755218;6809.353111454453;6853.862922741567;6882.139732533434;6181.041938499539;6209.6895155242055;6260.686965651745;6268.71790769421;6347.460465860361;6873.175218973755;6966.059581956472;6969;6991.615461149584;6992.370686638125;6583.539152259392;6624.503162262753;6650.634215118215;6660.966695166493;6682.198136223684;6694.062831203635;6750.628715420601;6753.898691519631;6819;6832.111825462658;6707.463402927754;6744.460443164535;6748.055272261888;6750.189977202767;6758.83102922421;6706.061151438803;6770.119884414995;6775.085363475868;6785.728570857209;6796.830079248059;4939.8271060513425;4942.703437793743;4967.925481117786;5022.698638081727;5025.949740502549;4282;4361.520232774392;4369.300911854088;4383.123375324948;4397.582229688174;6488.059231411419;6488.351164883568;6488.837779055561;6505.869882602321;6508.60948343101;6794.592324460548;6800.863982720318;6873.243943166348;6885.862282754317;6887.070245516791;6407.391297826699;6419.679016049179;6433.5496515243485;6505.447037001813;6516.348365163541;5527.115661494142;5620.747066382022;5627.521660658808;5631.465010823965;5685.090385538377;7045.225025247219;7121.074260346122;7121.537100088478;7122.465815063891;7126.2873712628325;6823.215330236888;6828.453723702191;6876.002979568035;6884.690188941609;6900.309969003059;7055.3650171484815;7073.504854660125;7144.821379465555;7158.928410715826;7172.354488096096;6574.243961944438;6703.229128650072;6713.328667133248;6726.764563240263;6736.461083113437;6764.594124352555;6803.693833777591;6821.693023814039;6889.483288753263;6900.068490753684;6507.219133703986;6568.113304703804;6569.9014514783275;6572.671366431755;6584.736610535525;6512.153420055552;6514.934850651623;6521.9673901630185;6591.274959754519;6611.041398997022;6448.516361272829;6572.80281591553;6572.8356791078695;6574.605523668404;6577.901331480128;6538.051982462612;6575.4410875076155;6575.901361479678;6637.933620663925;6670.633115178712;6396.904046439214;6452.419282264619;6508.772192973223;6525.021246813016;6528.608283503005 04:13:11 INFO - PID 26129 | |1;ext.html;843.1484200957032;899.7840518275614;922.4557511068468;926.9258459323255;1116.2744216259434;33592.4961125583;42737.35893961593;43248.783756081255;43375.34936975948;43428;43772;44220.336694949605;44241.55758442415;44294.335584966255;44430;7029.402500787439;7463.589502577356;7465;7466.775996720107;7485.214052524489;7371.926280737204;7431.405487560982;7458.589777562232;7466.029416175889;7480.438967077491;7517.69929202834;7537.170911199763;7548.547087174759;7563.357114645261;7571.848563028736;7476.327130558248;7486.438517111184;7495.287947644965;7507.624618769094;7531.3221810037085;7345.742898998563;7361.227071157558;7365.742199023062;7385.113786345619;7392.55644661322;38856.611433885584;39303.41044884329;39305.21389572193;39389.409158862356;39669;3421.674940880612;3454.5681789776277;3455.706264967456;3456.4642480415323;3457.6369481204365;32276.515852262233;32331.353372932645;32460.513092303634;32548.511772323433;32742.345153096805;4918.01639672067;4921.507849215086;4940.061388336205;4992.825251116194;4998.475160108209;216974;217621;219197;219360;219378.90310548505;52672.473275266755;52681.2097818533;52728.736356317975;52746;52893.7355313221;55395.723021384634;55402.72298638562;55424.445755542736;55463.44536554583;55567;15164.317605707769;15420.691586168214;16806.32774689023;16926.661466770594;16960.660786784196;13791.655208619864;13863.237521936391;13936.58190254294;13943.860561394458;13962.162270263816;15202.543923682308;15268.625823675922;15287.61780955485;15359.539213823604;15419.537413877602;5778.451047150598;5836.124581312837;5905.76376944926;5930.55520835939;6001.339852616209;1052.2423854824515;1052.400131924811;1067.6156583629886;1069.5454431866426;1080.9405482698528;24108.517829643308;32108.357832843678;32123.51814722781;32282.35435291281;32644.34711305808;1162.81394976805;1166.690826930864;1180.0854337888034;1180.598596477202;1180.8110702287593;13094.514473618805;13308.46766129344;13328.333583320795;13523.256220907944;13574.117682350616;275753;283454;284549;284783;284815;54856.177157342674;54964;55030;55202;55202.72398637981;1436.9353379097965;1442.5383877159418;1471.8601732835364;1503.1131632336974;1520.6274462756696;24273.51452970966;24684.382890427165;29964.250893727833;30384.848075760365;30902.84548577243;54834;55103.44896550983;55295.17057244225;55372;55468;227596;229139;229153;229257;231042;36980.63019369772;37322.626773731914;38780.41829372505;38896.222075557765;39000.6099938997;46842;48337.516624833304;48404.75797620989;48552;48832.51167488422;35005.64994350126;35026.64973350234;35156.64843351636;35279.11802204863;35610.46584301186;34842.65157348495;35167;35259.647403526666;35436.46845297374;35561;40265.59734402736;40615.79692101639;41196.79401602973;41250.1749965005;41258.587414126676;33981.320373591894;34080.31839363149;34183.82908085443;34426.48360274548;34741.65258347485;25916.222513324632;25964;25993;26110.216693499224;27033.86483067572 04:13:11 INFO - PID 26129 | |2;jquery.html;579.8318487638585;582.6445868020506;586.9530437564995;590.5069267161921;601.1223613524254;23116.537669246605;23664.171753988612;23738.406539836513;23947.161849335276;24030.75969240307;27446;27925;28004.719952800468;28064.438711225765;28067.85966070172;5619.297587801525;5811.099279611667;5843.883122337551;5846.766129354821;5847.356790753014;5317.308749862513;5503.724813759316;5751.7699292028265;5766.740496677659;5772.134179873011;5741.712914354286;5757.337906140806;5761.510271626917;5767.163761254616;5784.768609255625;5707.42925707428;5754.97122514389;5759.539236861041;5775.047117225653;5778.133280008012;5403.162509810985;5413.404525502192;5428.348598168205;5431.131019036935;5431.375391829911;31568.79018468708;31693;32144.839275803704;33054;33367.49948750771;2114.3762590035976;2119.374784438579;2123.0976834845283;2128.521082756383;2129.3292612827063;19759.30842420523;20144.294949676838;20331.79668203314;20340.898295508574;20357.898210508854;2454.3005243505695;2455.72986971433;2530.202986059404;2535.0746977353133;2535.163396079308;153472;154322;155777;155975;156535;14987.550373488813;15833.445829395916;15834.366625335088;16299.348026079062;16783.916080419764;25360.619590706156;25396.619050714253;25397.61903571448;25399.61900571493;25453.236402907944;10692.572297108029;11165.665030049111;11184.161187910939;11297.43512824372;11317.377544234982;9060.728178154666;10335.379877207391;10360.326578772356;10376.688699339033;10377.325473844176;9058.954705226564;9953.552090155816;10135.619548333147;10193.286469947032;10311.535980880879;2871.55490898911;2895.739383455499;2910.3451723362073;2961.8815247390294;3063.417950589381;1023.3757407981126;1061.3578784835217;1066.36018388966;1068.540527573151;1072.1744256922127;21591.89204054001;21619.35141945744;21645.56708865814;21928;22035.889820550794;1110.6223883879359;1119.1103073056777;1130.2596799096605;1132.3488993828582;1136.931784092957;11937.403129843473;12108.515659373703;12154;12209;12222.572209972608;602576;614371;620371;629185;641145;130779.34610326888;140395.29802351128;140967;142911.2854435742;143177;1297.0920355751011;1301.6160232731368;1342.3825040481488;1356.7829147336379;1359.2727890578492;22949;23009.539809203387;23051.769482305634;23238.535229295656;23346;64843.35156648562;67965.32034679787;68188.31811682018;68419.65790171018;69780;87427.56286218528;87529;87672.56163719141;87684;88023.55988220018;13047.804282935953;15239;15545.222738863238;15609.453669121527;15610.921945390655;24863.62704559469;24867.253982380556;24981.250562483154;25076.749232508173;25165.24504264875;18720.344787932358;18832.811671883654;19479.90260048691;19894;20026.699599505726;16280.67438651244;16782.748258776373;17065.488035358958;17072.658546829243;17275.308987640856;20623.175072997514;20879.26922557703;20887.58224835525;21045.473863153544;21218.7878121223;15132.092074475566;15287.082775033534;15331.310091046153;15375.769363459332;15381.384744610537;19641.803581964;19820.50448738793;19976;20211.494712632302;20213.79786202119 04:13:11 INFO - PID 26129 | |3;mootools.html;1426.144313411953;1464.6191990082582;1481.3185934470143;1487.799147115139;1493.186213513635;15251.161186134772;15430.305636246369;15679.29443175057;15856.3657453702;15912;16083.83916160838;16337.18314084297;16411.507654770347;16412;16417;2743.1359121876644;2755.669319681631;2758.8344699318004;2777.6111344411797;2782.9443411131765;2658.401859581598;2721.863906804662;2771.6673999120135;2773.0433000614757;2773.5423655096984;2672.6792784865843;2674.1442738323744;2717.2935036890453;2717.986410067947;2718.0486829609576;2541.199522150526;2558.0790915270486;2576.0726138590094;2576.9742302576924;2577.3170109920884;2646.2193652872447;2646.563317052684;2648.165827764248;2658.534756417619;2661.813673042888;14884.330205140686;15039.248037598076;15079.54761357161;15164.014339067926;15176.317065732068;8003.239692229229;8290.751277461686;8295.336373090138;8319;8319.459235149756;5124.128898087334;5267.71027593486;5283.973580132075;5404.7838086476495;5416.756245968902;1893.9677875557854;1902.1440351841588;1920.0975541495475;1921.2315073970383;1937.2251099560149;26503;26589;26669.199924002118;26670.86664566684;26776.330591735168;6828.863422731518;6878.621675807879;6909.75815846453;6986.196587392414;7057.611831349325;18416.26334946614;18426.262949482138;18461.907690461463;18480.630387392444;18739.156737946825;7923.564203968837;8169.754907352789;8179.5501247430775;8189;8194.713185038496;7389.408847292204;7527.698892044366;7534.397248220239;7558.659860306189;7571.205023472456;5260.132078207053;5421.566274698093;5434.619576629677;5458.181272809111;5491.28613280271;1514.8485151484983;1518.4305885293015;1519.6808670179164;1524.1845612597428;1536.8539988701054;944.5843828715343;971.7036303927229;972.2367941166292;973.177664873181;980.720494659033;8209.79475513117;8223.54770487629;8238.794030149174;8262.215089566482;8352.248297653241;719.8087165740708;746.9813254668677;754.8490301939634;759.8670232709364;779.473855147773;4951;5522.088855338824;6360.872782544323;6484.837879052967;6535.705893234815;22488.21291254798;22688.546229075655;22797.430064248525;22984.7701522986;23117.537649246922;22053;23067.07731690747;23067.653985190234;23109.88445057764;23177.76822231756;11750.529978800752;11817.527298908119;11819;11972.16194866351;12052.457639406248;8744.475331480131;9353.953230233805;9545.379550329206;9694.079062489052;9784.315097943076;18944.336948206746;19077.61844763125;19112.139953701837;19166.425007249803;19291.710624340365;19602.215911363386;19780.90109549443;19845;19986.800131999076;20029.599408011465;12940.935295323463;13264.872485838427;13293.069485135948;13309.534166304133;13325.600231993056;13924.2341671205;14151.292435378396;14191;14245.358958847084;14259.287035648384;11880.227785193934;11880.584179553674;11890;12217.633470995885;12276;11487.25332853362;11569.305841649191;11704.70738231551;11852.881471185177;12092.274463532216;9653.806923861624;9781.902180978099;9801.362911410735;9815.411075335503;9829.803403932025;7574.424695603521;7633.69465221385;7654.69381224767;7710.11333696632;7722.420818438527;7797.103333116765;7815.531068135702;7896.802579935547;7905.130435651959;8040.5979701015885 04:13:11 INFO - PID 26129 | |4;prototype.html;522.9384349769969;528.7012837746673;538.6821775152661;549.3106151779516;549.4395716369306;6127.3456166834985;6168.691565421722;6205.286392064914;6223.9688801555985;6228.4705800007;6018.247719035121;6053.848653783658;6072.635641861491;6122.234720659918;6179.907301390472;4902;4924.3105965164905;4945.901081978358;4961.957988822333;4972.254161875711;4692.741899195543;4848.739327774769;4903.583195428375;4910.852674419773;4915.680480768757;4704.435467743876;4711.952880471203;4767.833125840579;4767.974885399638;4792.353032340624;4714.811407543694;4749.556571485679;4770.856874293777;4779.832705855296;4781.689190202643;4304.6771492137905;4341.6526677865695;4352.630026447756;4371.060222052274;4374.059577190919;5932.466078052953;5934.881302373971;5962.612430192067;5995.6702381369005;6038.637681739066;5586.804461843856;5694.572907031989;5695.174199741055;5730.512906402961;5763.596548241625;6512.8697426051685;6533.967330163318;6535.313792051814;6566.244881838554;6582.5063120265695;4897.4123105227245;4904.411470623512;4911.533404326583;4952.801887924478;4962.776675049631;6585.835354116138;6616.437602803816;6692.698828552678;6749.156355455568;6821.931780682179;4933.481984391659;4978.576820970258;5016.197408414636;5019.171836646912;5020.799168033311;5041.6470847040355;5050.217216331474;5079.339685840817;5102.183650615883;5124.410692770304;5631.521320687705;5676.68778217202;5694.487496125369;5715;5728.481952282648;6339.320080178756;6379.425851673372;6488.708008139645;6492.630189980623;6535.542512024208;1748.825117488241;1771.3977247735575;1784.3130394797836;1785.8214178582039;1795.2549691877725;1195.7787809255315;1257.7610254051701;1264.367816091954;1271.4469205895466;1275.687456573127;6265.8120256392385;6288.52836037299;6304.306526282106;6355.904661430082;6370.140031095742;6477.190351206099;6536.411722944863;6627.536072474881;6635.23694775107;6707.5975441473665;6210.223722034746;6289.874202516015;6292.406543223473;6300.054991751183;6359.9364006360265;3452.3095380923914;3518.630543792916;3536.5402497675136;3548.8048157351595;3571.3750093733493;6925.818367214311;6940.236573976858;6952.5480843745;6957.130358705162;7000.229974702778;6450.967745161244;6716.1120718090715;6718;6782.8643427132165;6783.762568310085;6741.325867413219;6750.83122921921;6777.525573209828;6791.728330866808;6794.626295553792;6653.334666533308;6676.632785196861;6710.19477662664;6710.865782684221;6747.392734653905;6590.5716128451495;6593.736250549924;6601.24085730128;6623.933760662524;6647.534672572873;6795.966020169867;6907.758228461979;6914.204866440223;6940.548864323803;6994.160700715946;5012.147934851011;5031.169856973558;5054.873628159326;5056.241563765465;5085.160948443466;6519.41325280708;6593.835154121185;6597.868042639025;6662.866742665023;6765.255821859493;6318.494520438446;6411.51913606472;6445.677716114269;6480.773172938924;6502.447291980235;6397.8720425592155;6429.874771914802;6446.806595802133;6480.481561475165;6509.251436084911;6367.808965731036;6424.38968298011;6437.742490300336;6501.08984742127;6540.215174179129;6481.740730370732;6505.902411463737;6555.3772391622715;6561.556457579325;6585.176852893388;6327.841803954938;6402.455791257609;6415.903761443488;6427.646479443675;6428 04:13:11 INFO - PID 26129 | |5;yui.html;934.878465799446;941.844595641719;946.1910066892802;955.0831202046036;965.3001573858951;16113.113778742165;16774.41289554864;16867.40964066258;16891.746623800624;19311.227550897947;19707.31024414146;19729.21083156672;19760.604787904234;19775.307864224756;19836;964.8070385922808;1042.2964498963208;1065.275612583443;1069.5507886687571;1069.9518521666505;1089.1286970423669;1090.5092708281265;1090.6673464593296;1090.7327704712318;1091.2252300866394;1005.2962925951863;1037.8858325584179;1092.4046394714899;1137.7041969088054;1139.453062529986;1074.457399013497;1075.7095584192264;1078.978420431587;1081.389015206406;1083.7399024234205;800.8558459477292;801.4910531812283;802.0896282719098;803.5098589860181;811.4036183405193;17736.55658608532;17783.021933793636;17952.551186220448;18085.547861303574;18169.54576135594;20123;20218.494537636678;20402.28591999273;20554.897225513927;20561.69157462639;15983.280752366056;16264.349426022945;16388.26252818614;16431;16432.178391080397;3518.8064656443885;3565.8751943682105;3567.8216089195435;3568.982155089234;3569.286142771456;142574;142682;142801.2859935704;147297;148899.25550372287;16024.679506409806;16189.838101618832;16434.178291085398;16559.503214903332;16650.58373540671;32674.83662581672;32825.67174328226;33550;33792.32415351679;33812;8889.066648001995;9038.051004644549;9071.81856362869;9136.862947055799;9251.306152038624;4324.2648749712625;4444.599986001275;4458.9554104459185;4462.107578484316;4462.553744625511;5494.36814766307;5544;5551.694656793915;5552.278203833475;5606.6916319602815;1131.5530365505579;1148.2077366617007;1157.1148071725138;1168.4683469021575;1169.5964892112208;708.4615692073958;719.7408932784193;732.2457868395561;742.6843591473602;749.3592978003837;12523.436445359981;13580.524681636096;13741.656458588615;15104.39582416713;15411.537653870402;724.7825652304288;726.3354031061625;745.2919726260075;747.6784982457486;779.473855147773;5904.291485021825;5933.792317268962;6194.690265486798;6201.968990155111;6220.968895155495;127827;129822.35088824495;129976.35011824881;130008;135300;115261;117513.412432939;118301;119048.8095119055;119705;98956.50521747489;99550.5022474883;101289.99999999853;102900;103348;12113.333766642567;12499.750004999667;12518.37408129608;12550.121491495873;12631.178973366701;48191.277130843766;48894.26658600053;48970;49945.25082123699;50273.74863125661;64285.35714642794;64304.67847660919;64615.67692161509;64949.67525162533;65484.345156547824;17641;17799.73300400521;17825.46523604294;17845.73231401504;17986.64026719432;22825;22866.42833929165;23832.642510362013;24048.278551643478;24064.15775447851;20315.492112697302;20625.071871766108;20860;20937.16251349929;20968.68546971827;20995.160193592696;21258.78741212568;21558.568828623655;21584.352469425943;21792.891035544722;20524.179032839118;21107.7889221112;21804.236851710113;21810.127594896025;21981.450463737896;14397.7840332393;14490.34793434319;14511.346989385715;14540.781888271897;14574.85425145735;15147.54557363281;15836.812239082345;16116.27476763572;16148.434804781777;16175.838241617434 04:13:11 INFO - PID 26129 | __end_tp_report 04:13:11 INFO - PID 26129 | __start_cc_report 04:13:11 INFO - PID 26129 | _x_x_mozilla_cycle_collect,322 04:13:11 INFO - PID 26129 | __end_cc_report 04:13:11 INFO - PID 26129 | __startTimestamp1501758791058__endTimestamp 04:13:11 INFO - PID 26129 | 04:13:11 INFO - PID 26129 | ------- Summary: start ------- 04:13:11 INFO - PID 26129 | Number of tests: 6 04:13:11 INFO - PID 26129 | 04:13:11 INFO - PID 26129 | [#0] dojo.html Cycles:165 Average:6225.64 Median:6521.97 stddev:806.72 (12.4%) stddev-sans-first:777.59 04:13:11 INFO - PID 26129 | Values: 3375.2 3541.1 3566.4 3582.2 3584.9 6155.8 6234.2 6272.0 6281.7 6321.1 6085.6 6214.6 6217.8 6231.7 6330.6 5454.5 5514.4 5525.1 5537.4 5545.9 5265.7 5394.3 5466.8 5534.7 5602.3 5461.3 5505.5 5506.2 5561.6 5564.9 5359.0 5495.1 5542.5 5574.5 5576.5 5402.2 5414.0 5414.6 5447.0 5454.5 6145.0 6168.1 6185.4 6190.8 6199.6 6758.7 6769.2 6778.4 6783.1 6790.9 6767.2 6792.7 6809.4 6853.9 6882.1 6181.0 6209.7 6260.7 6268.7 6347.5 6873.2 6966.1 6969.0 6991.6 6992.4 6583.5 6624.5 6650.6 6661.0 6682.2 6694.1 6750.6 6753.9 6819.0 6832.1 6707.5 6744.5 6748.1 6750.2 6758.8 6706.1 6770.1 6775.1 6785.7 6796.8 4939.8 4942.7 4967.9 5022.7 5025.9 4282.0 4361.5 4369.3 4383.1 4397.6 6488.1 6488.4 6488.8 6505.9 6508.6 6794.6 6800.9 6873.2 6885.9 6887.1 6407.4 6419.7 6433.5 6505.4 6516.3 5527.1 5620.7 5627.5 5631.5 5685.1 7045.2 7121.1 7121.5 7122.5 7126.3 6823.2 6828.5 6876.0 6884.7 6900.3 7055.4 7073.5 7144.8 7158.9 7172.4 6574.2 6703.2 6713.3 6726.8 6736.5 6764.6 6803.7 6821.7 6889.5 6900.1 6507.2 6568.1 6569.9 6572.7 6584.7 6512.2 6514.9 6522.0 6591.3 6611.0 6448.5 6572.8 6572.8 6574.6 6577.9 6538.1 6575.4 6575.9 6637.9 6670.6 6396.9 6452.4 6508.8 6525.0 6528.6 04:13:11 INFO - PID 26129 | 04:13:11 INFO - PID 26129 | [#1] ext.html Cycles:180 Average:42724.89 Median:35585.73 stddev:63746.38 (179.1%) stddev-sans-first:63847.63 04:13:11 INFO - PID 26129 | Values: 843.1 899.8 922.5 926.9 1116.3 33592.5 42737.4 43248.8 43375.3 43428.0 43772.0 44220.3 44241.6 44294.3 44430.0 7029.4 7463.6 7465.0 7466.8 7485.2 7371.9 7431.4 7458.6 7466.0 7480.4 7517.7 7537.2 7548.5 7563.4 7571.8 7476.3 7486.4 7495.3 7507.6 7531.3 7345.7 7361.2 7365.7 7385.1 7392.6 38856.6 39303.4 39305.2 39389.4 39669.0 3421.7 3454.6 3455.7 3456.5 3457.6 32276.5 32331.4 32460.5 32548.5 32742.3 4918.0 4921.5 4940.1 4992.8 4998.5 216974.0 217621.0 219197.0 219360.0 219378.9 52672.5 52681.2 52728.7 52746.0 52893.7 55395.7 55402.7 55424.4 55463.4 55567.0 15164.3 15420.7 16806.3 16926.7 16960.7 13791.7 13863.2 13936.6 13943.9 13962.2 15202.5 15268.6 15287.6 15359.5 15419.5 5778.5 5836.1 5905.8 5930.6 6001.3 1052.2 1052.4 1067.6 1069.5 1080.9 24108.5 32108.4 32123.5 32282.4 32644.3 1162.8 1166.7 1180.1 1180.6 1180.8 13094.5 13308.5 13328.3 13523.3 13574.1 275753.0 283454.0 284549.0 284783.0 284815.0 54856.2 54964.0 55030.0 55202.0 55202.7 1436.9 1442.5 1471.9 1503.1 1520.6 24273.5 24684.4 29964.3 30384.8 30902.8 54834.0 55103.4 55295.2 55372.0 55468.0 227596.0 229139.0 229153.0 229257.0 231042.0 36980.6 37322.6 38780.4 38896.2 39000.6 46842.0 48337.5 48404.8 48552.0 48832.5 35005.6 35026.6 35156.6 35279.1 35610.5 34842.7 35167.0 35259.6 35436.5 35561.0 40265.6 40615.8 41196.8 41250.2 41258.6 33981.3 34080.3 34183.8 34426.5 34741.7 25916.2 25964.0 25993.0 26110.2 27033.9 04:13:11 INFO - PID 26129 | 04:13:11 INFO - PID 26129 | [#2] jquery.html Cycles:180 Average:41058.10 Median:21981.94 stddev:104324.52 (474.6%) stddev-sans-first:104572.91 04:13:11 INFO - PID 26129 | Values: 579.8 582.6 587.0 590.5 601.1 23116.5 23664.2 23738.4 23947.2 24030.8 27446.0 27925.0 28004.7 28064.4 28067.9 5619.3 5811.1 5843.9 5846.8 5847.4 5317.3 5503.7 5751.8 5766.7 5772.1 5741.7 5757.3 5761.5 5767.2 5784.8 5707.4 5755.0 5759.5 5775.0 5778.1 5403.2 5413.4 5428.3 5431.1 5431.4 31568.8 31693.0 32144.8 33054.0 33367.5 2114.4 2119.4 2123.1 2128.5 2129.3 19759.3 20144.3 20331.8 20340.9 20357.9 2454.3 2455.7 2530.2 2535.1 2535.2 153472.0 154322.0 155777.0 155975.0 156535.0 14987.6 15833.4 15834.4 16299.3 16783.9 25360.6 25396.6 25397.6 25399.6 25453.2 10692.6 11165.7 11184.2 11297.4 11317.4 9060.7 10335.4 10360.3 10376.7 10377.3 9059.0 9953.6 10135.6 10193.3 10311.5 2871.6 2895.7 2910.3 2961.9 3063.4 1023.4 1061.4 1066.4 1068.5 1072.2 21591.9 21619.4 21645.6 21928.0 22035.9 1110.6 1119.1 1130.3 1132.3 1136.9 11937.4 12108.5 12154.0 12209.0 12222.6 602576.0 614371.0 620371.0 629185.0 641145.0 130779.3 140395.3 140967.0 142911.3 143177.0 1297.1 1301.6 1342.4 1356.8 1359.3 22949.0 23009.5 23051.8 23238.5 23346.0 64843.4 67965.3 68188.3 68419.7 69780.0 87427.6 87529.0 87672.6 87684.0 88023.6 13047.8 15239.0 15545.2 15609.5 15610.9 24863.6 24867.3 24981.3 25076.7 25165.2 18720.3 18832.8 19479.9 19894.0 20026.7 16280.7 16782.7 17065.5 17072.7 17275.3 20623.2 20879.3 20887.6 21045.5 21218.8 15132.1 15287.1 15331.3 15375.8 15381.4 19641.8 19820.5 19976.0 20211.5 20213.8 04:13:11 INFO - PID 26129 | 04:13:11 INFO - PID 26129 | [#3] mootools.html Cycles:180 Average:9734.79 Median:14623.77 stddev:6959.33 (47.6%) stddev-sans-first:6950.86 04:13:11 INFO - PID 26129 | Values: 1426.1 1464.6 1481.3 1487.8 1493.2 15251.2 15430.3 15679.3 15856.4 15912.0 16083.8 16337.2 16411.5 16412.0 16417.0 2743.1 2755.7 2758.8 2777.6 2782.9 2658.4 2721.9 2771.7 2773.0 2773.5 2672.7 2674.1 2717.3 2718.0 2718.0 2541.2 2558.1 2576.1 2577.0 2577.3 2646.2 2646.6 2648.2 2658.5 2661.8 14884.3 15039.2 15079.5 15164.0 15176.3 8003.2 8290.8 8295.3 8319.0 8319.5 5124.1 5267.7 5284.0 5404.8 5416.8 1894.0 1902.1 1920.1 1921.2 1937.2 26503.0 26589.0 26669.2 26670.9 26776.3 6828.9 6878.6 6909.8 6986.2 7057.6 18416.3 18426.3 18461.9 18480.6 18739.2 7923.6 8169.8 8179.6 8189.0 8194.7 7389.4 7527.7 7534.4 7558.7 7571.2 5260.1 5421.6 5434.6 5458.2 5491.3 1514.8 1518.4 1519.7 1524.2 1536.9 944.6 971.7 972.2 973.2 980.7 8209.8 8223.5 8238.8 8262.2 8352.2 719.8 747.0 754.8 759.9 779.5 4951.0 5522.1 6360.9 6484.8 6535.7 22488.2 22688.5 22797.4 22984.8 23117.5 22053.0 23067.1 23067.7 23109.9 23177.8 11750.5 11817.5 11819.0 11972.2 12052.5 8744.5 9354.0 9545.4 9694.1 9784.3 18944.3 19077.6 19112.1 19166.4 19291.7 19602.2 19780.9 19845.0 19986.8 20029.6 12940.9 13264.9 13293.1 13309.5 13325.6 13924.2 14151.3 14191.0 14245.4 14259.3 11880.2 11880.6 11890.0 12217.6 12276.0 11487.3 11569.3 11704.7 11852.9 12092.3 9653.8 9781.9 9801.4 9815.4 9829.8 7574.4 7633.7 7654.7 7710.1 7722.4 7797.1 7815.5 7896.8 7905.1 8040.6 04:13:11 INFO - PID 26129 | 04:13:11 INFO - PID 26129 | [#4] prototype.html Cycles:180 Average:5523.99 Median:6247.14 stddev:1561.74 (25.0%) stddev-sans-first:1520.35 04:13:11 INFO - PID 26129 | Values: 522.9 528.7 538.7 549.3 549.4 6127.3 6168.7 6205.3 6224.0 6228.5 6018.2 6053.8 6072.6 6122.2 6179.9 4902.0 4924.3 4945.9 4962.0 4972.3 4692.7 4848.7 4903.6 4910.9 4915.7 4704.4 4712.0 4767.8 4768.0 4792.4 4714.8 4749.6 4770.9 4779.8 4781.7 4304.7 4341.7 4352.6 4371.1 4374.1 5932.5 5934.9 5962.6 5995.7 6038.6 5586.8 5694.6 5695.2 5730.5 5763.6 6512.9 6534.0 6535.3 6566.2 6582.5 4897.4 4904.4 4911.5 4952.8 4962.8 6585.8 6616.4 6692.7 6749.2 6821.9 4933.5 4978.6 5016.2 5019.2 5020.8 5041.6 5050.2 5079.3 5102.2 5124.4 5631.5 5676.7 5694.5 5715.0 5728.5 6339.3 6379.4 6488.7 6492.6 6535.5 1748.8 1771.4 1784.3 1785.8 1795.3 1195.8 1257.8 1264.4 1271.4 1275.7 6265.8 6288.5 6304.3 6355.9 6370.1 6477.2 6536.4 6627.5 6635.2 6707.6 6210.2 6289.9 6292.4 6300.1 6359.9 3452.3 3518.6 3536.5 3548.8 3571.4 6925.8 6940.2 6952.5 6957.1 7000.2 6451.0 6716.1 6718.0 6782.9 6783.8 6741.3 6750.8 6777.5 6791.7 6794.6 6653.3 6676.6 6710.2 6710.9 6747.4 6590.6 6593.7 6601.2 6623.9 6647.5 6796.0 6907.8 6914.2 6940.5 6994.2 5012.1 5031.2 5054.9 5056.2 5085.2 6519.4 6593.8 6597.9 6662.9 6765.3 6318.5 6411.5 6445.7 6480.8 6502.4 6397.9 6429.9 6446.8 6480.5 6509.3 6367.8 6424.4 6437.7 6501.1 6540.2 6481.7 6505.9 6555.4 6561.6 6585.2 6327.8 6402.5 6415.9 6427.6 6428.0 04:13:11 INFO - PID 26129 | 04:13:11 INFO - PID 26129 | [#5] yui.html Cycles:180 Average:26365.20 Median:19805.65 stddev:37410.72 (188.9%) stddev-sans-first:37466.93 04:13:11 INFO - PID 26129 | Values: 934.9 941.8 946.2 955.1 965.3 16113.1 16774.4 16867.4 16891.7 19311.2 19707.3 19729.2 19760.6 19775.3 19836.0 964.8 1042.3 1065.3 1069.6 1070.0 1089.1 1090.5 1090.7 1090.7 1091.2 1005.3 1037.9 1092.4 1137.7 1139.5 1074.5 1075.7 1079.0 1081.4 1083.7 800.9 801.5 802.1 803.5 811.4 17736.6 17783.0 17952.6 18085.5 18169.5 20123.0 20218.5 20402.3 20554.9 20561.7 15983.3 16264.3 16388.3 16431.0 16432.2 3518.8 3565.9 3567.8 3569.0 3569.3 142574.0 142682.0 142801.3 147297.0 148899.3 16024.7 16189.8 16434.2 16559.5 16650.6 32674.8 32825.7 33550.0 33792.3 33812.0 8889.1 9038.1 9071.8 9136.9 9251.3 4324.3 4444.6 4459.0 4462.1 4462.6 5494.4 5544.0 5551.7 5552.3 5606.7 1131.6 1148.2 1157.1 1168.5 1169.6 708.5 719.7 732.2 742.7 749.4 12523.4 13580.5 13741.7 15104.4 15411.5 724.8 726.3 745.3 747.7 779.5 5904.3 5933.8 6194.7 6202.0 6221.0 127827.0 129822.4 129976.4 130008.0 135300.0 115261.0 117513.4 118301.0 119048.8 119705.0 98956.5 99550.5 101290.0 102900.0 103348.0 12113.3 12499.8 12518.4 12550.1 12631.2 48191.3 48894.3 48970.0 49945.3 50273.7 64285.4 64304.7 64615.7 64949.7 65484.3 17641.0 17799.7 17825.5 17845.7 17986.6 22825.0 22866.4 23832.6 24048.3 24064.2 20315.5 20625.1 20860.0 20937.2 20968.7 20995.2 21258.8 21558.6 21584.4 21792.9 20524.2 21107.8 21804.2 21810.1 21981.5 14397.8 14490.3 14511.3 14540.8 14574.9 15147.5 15836.8 16116.3 16148.4 16175.8 04:13:11 INFO - PID 26129 | -------- Summary: end -------- 04:13:11 INFO - PID 26129 | 04:13:11 INFO - TEST-INFO | 26129: exit 0 04:13:11 INFO - TEST-OK | dromaeo_css | took 1109455ms 04:13:11 INFO - TEST-START | kraken 04:13:11 INFO - Initialising browser for kraken test... 04:13:11 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:35760/getInfo.html -profile /tmp/tmpKTyqvX/profile 04:13:11 INFO - TEST-INFO | started process 26490 (/builds/slave/test/build/application/firefox/firefox http://localhost:35760/getInfo.html) 04:13:17 INFO - TEST-INFO | 26490: exit 0 04:13:17 INFO - Browser initialized. 04:13:17 INFO - Running cycle 1/1 for kraken test... 04:13:17 INFO - TEST-INFO | started process 26699 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKTyqvX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 04:13:18 INFO - PID 26699 | 04:13:18 INFO - PID 26699 | (/builds/slave/test/build/application/firefox/firefox:26747): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 04:13:18 INFO - PID 26699 | 04:13:28 INFO - PID 26699 | RSS: Main: 164515840 04:13:28 INFO - PID 26699 | 04:13:30 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:35760/tests/kraken/driver.html?testName=audio-beat-detection) 04:13:31 INFO - PID 26699 | RSS: Main: 169746432 04:13:31 INFO - PID 26699 | 04:13:34 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:35760/tests/kraken/driver.html?testName=audio-dft) 04:13:34 INFO - PID 26699 | RSS: Main: 170008576 04:13:34 INFO - PID 26699 | 04:13:37 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:35760/tests/kraken/driver.html?testName=audio-fft) 04:13:38 INFO - PID 26699 | RSS: Main: 163885056 04:13:38 INFO - PID 26699 | 04:13:40 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:35760/tests/kraken/driver.html?testName=audio-oscillator) 04:13:41 INFO - PID 26699 | RSS: Main: 165044224 04:13:41 INFO - PID 26699 | 04:13:43 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:35760/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:13:43 INFO - PID 26699 | RSS: Main: 165068800 04:13:43 INFO - PID 26699 | 04:13:46 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:35760/tests/kraken/driver.html?testName=imaging-darkroom) 04:13:47 INFO - PID 26699 | RSS: Main: 165847040 04:13:47 INFO - PID 26699 | 04:13:51 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:35760/tests/kraken/driver.html?testName=imaging-desaturate) 04:13:51 INFO - PID 26699 | RSS: Main: 169803776 04:13:51 INFO - PID 26699 | 04:13:54 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:35760/tests/kraken/driver.html?testName=json-parse-financial) 04:13:55 INFO - PID 26699 | RSS: Main: 168300544 04:13:55 INFO - PID 26699 | 04:13:56 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:35760/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:13:57 INFO - PID 26699 | RSS: Main: 168521728 04:13:57 INFO - PID 26699 | 04:13:58 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:35760/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:13:59 INFO - PID 26699 | RSS: Main: 169009152 04:13:59 INFO - PID 26699 | 04:14:01 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:35760/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:14:02 INFO - PID 26699 | RSS: Main: 165797888 04:14:02 INFO - PID 26699 | 04:14:04 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:35760/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:14:05 INFO - PID 26699 | RSS: Main: 165933056 04:14:05 INFO - PID 26699 | 04:14:08 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:35760/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:14:09 INFO - PID 26699 | RSS: Main: 166506496 04:14:09 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | Cycle 1(1): loaded http://localhost:35760/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:35760/tests/kraken/driver.html?testName=ai-astar) 04:14:10 INFO - PID 26699 | RSS: Main: 168259584 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | __start_tp_report 04:14:10 INFO - PID 26699 | _x_x_mozilla_page_load 04:14:10 INFO - PID 26699 | _x_x_mozilla_page_load_details 04:14:10 INFO - PID 26699 | |i|pagename|runs| 04:14:10 INFO - PID 26699 | |0;ai-astar;100;108;103;107;107;108;110;96;106;110 04:14:10 INFO - PID 26699 | |1;audio-beat-detection;146;113;141;170;114;147;148;120;166;114 04:14:10 INFO - PID 26699 | |2;audio-dft;163;163;162;162;167;163;163;165;162;162 04:14:10 INFO - PID 26699 | |3;audio-fft;76;75;75;164;76;74;74;95;97;74 04:14:10 INFO - PID 26699 | |4;audio-oscillator;78;78;128;79;78;79;138;80;78;130 04:14:10 INFO - PID 26699 | |5;imaging-gaussian-blur;114;115;114;114;113;114;114;114;123;115 04:14:10 INFO - PID 26699 | |6;imaging-darkroom;148;150;148;148;150;146;148;148;147;148 04:14:10 INFO - PID 26699 | |7;imaging-desaturate;94;94;94;94;95;94;93;94;94;94 04:14:10 INFO - PID 26699 | |8;json-parse-financial;46;46;45;47;57;46;52;46;46;47 04:14:10 INFO - PID 26699 | |9;json-stringify-tinderbox;54;54;53;53;53;53;54;54;54;54 04:14:10 INFO - PID 26699 | |10;stanford-crypto-aes;82;86;75;74;74;74;76;74;75;76 04:14:10 INFO - PID 26699 | |11;stanford-crypto-ccm;120;120;123;113;124;121;128;114;117;167 04:14:10 INFO - PID 26699 | |12;stanford-crypto-pbkdf2;167;165;165;166;163;163;159;172;167;176 04:14:10 INFO - PID 26699 | |13;stanford-crypto-sha256-iterative;63;62;63;64;70;60;61;61;63;60 04:14:10 INFO - PID 26699 | __end_tp_report 04:14:10 INFO - PID 26699 | __start_cc_report 04:14:10 INFO - PID 26699 | _x_x_mozilla_cycle_collect,859 04:14:10 INFO - PID 26699 | __end_cc_report 04:14:10 INFO - PID 26699 | __startTimestamp1501758850944__endTimestamp 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | ------- Summary: start ------- 04:14:10 INFO - PID 26699 | Number of tests: 14 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#0] ai-astar Cycles:10 Average:105.50 Median:108.00 stddev:4.53 (4.2%) stddev-sans-first:4.34 04:14:10 INFO - PID 26699 | Values: 100.0 108.0 103.0 107.0 107.0 108.0 110.0 96.0 106.0 110.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#1] audio-beat-detection Cycles:10 Average:137.90 Median:146.50 stddev:21.51 (14.7%) stddev-sans-first:22.61 04:14:10 INFO - PID 26699 | Values: 146.0 113.0 141.0 170.0 114.0 147.0 148.0 120.0 166.0 114.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#2] audio-dft Cycles:10 Average:163.20 Median:163.00 stddev:1.62 (1.0%) stddev-sans-first:1.72 04:14:10 INFO - PID 26699 | Values: 163.0 163.0 162.0 162.0 167.0 163.0 163.0 165.0 162.0 162.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#3] audio-fft Cycles:10 Average:88.00 Median:75.50 stddev:28.13 (37.3%) stddev-sans-first:29.50 04:14:10 INFO - PID 26699 | Values: 76.0 75.0 75.0 164.0 76.0 74.0 74.0 95.0 97.0 74.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#4] audio-oscillator Cycles:10 Average:94.60 Median:78.00 stddev:25.94 (33.3%) stddev-sans-first:26.81 04:14:10 INFO - PID 26699 | Values: 78.0 78.0 128.0 79.0 78.0 79.0 138.0 80.0 78.0 130.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#5] imaging-gaussian-blur Cycles:10 Average:115.00 Median:114.00 stddev:2.87 (2.5%) stddev-sans-first:3.02 04:14:10 INFO - PID 26699 | Values: 114.0 115.0 114.0 114.0 113.0 114.0 114.0 114.0 123.0 115.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#6] imaging-darkroom Cycles:10 Average:148.10 Median:148.00 stddev:1.20 (0.8%) stddev-sans-first:1.27 04:14:10 INFO - PID 26699 | Values: 148.0 150.0 148.0 148.0 150.0 146.0 148.0 148.0 147.0 148.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#7] imaging-desaturate Cycles:10 Average:94.00 Median:94.00 stddev:0.47 (0.5%) stddev-sans-first:0.50 04:14:10 INFO - PID 26699 | Values: 94.0 94.0 94.0 94.0 95.0 94.0 93.0 94.0 94.0 94.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#8] json-parse-financial Cycles:10 Average:47.80 Median:46.50 stddev:3.77 (8.1%) stddev-sans-first:3.94 04:14:10 INFO - PID 26699 | Values: 46.0 46.0 45.0 47.0 57.0 46.0 52.0 46.0 46.0 47.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#9] json-stringify-tinderbox Cycles:10 Average:53.60 Median:54.00 stddev:0.52 (1.0%) stddev-sans-first:0.53 04:14:10 INFO - PID 26699 | Values: 54.0 54.0 53.0 53.0 53.0 53.0 54.0 54.0 54.0 54.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#10] stanford-crypto-aes Cycles:10 Average:76.60 Median:75.50 stddev:4.09 (5.4%) stddev-sans-first:3.84 04:14:10 INFO - PID 26699 | Values: 82.0 86.0 75.0 74.0 74.0 74.0 76.0 74.0 75.0 76.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#11] stanford-crypto-ccm Cycles:10 Average:124.70 Median:122.00 stddev:15.54 (12.7%) stddev-sans-first:16.38 04:14:10 INFO - PID 26699 | Values: 120.0 120.0 123.0 113.0 124.0 121.0 128.0 114.0 117.0 167.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.30 Median:166.50 stddev:4.79 (2.9%) stddev-sans-first:5.07 04:14:10 INFO - PID 26699 | Values: 167.0 165.0 165.0 166.0 163.0 163.0 159.0 172.0 167.0 176.0 04:14:10 INFO - PID 26699 | 04:14:10 INFO - PID 26699 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.70 Median:63.00 stddev:2.91 (4.6%) stddev-sans-first:3.08 04:14:10 INFO - PID 26699 | Values: 63.0 62.0 63.0 64.0 70.0 60.0 61.0 61.0 63.0 60.0 04:14:10 INFO - PID 26699 | -------- Summary: end -------- 04:14:10 INFO - PID 26699 | 04:14:11 INFO - PID 26699 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 04:14:11 INFO - TEST-INFO | 26699: exit 0 04:14:11 INFO - TEST-OK | kraken | took 59875ms 04:14:11 INFO - SUITE-END | took 1169s 04:14:12 INFO - Completed test suite (00:19:29) 04:14:12 INFO - javascript benchmark 04:14:12 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8891.418917685342, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3375.173082594763, 3541.061618671054, 3566.4472006838937, 3582.2298205885763, 3584.9462258066123, 6155.846103847395, 6234.158388617541, 6272.0, 6281.748730050798, 6321.1150438938585, 6085.574009819315, 6214.596051256665, 6217.813465596039, 6231.719572619231, 6330.620162790236, 5454.53636440903, 5514.393416724157, 5525.143602741581, 5537.446255374471, 5545.916811247835, 5265.736713164327, 5394.298741163643, 5466.781328746845, 5534.667919924817, 5602.327720673525, 5461.317335333063, 5505.476979686923, 5506.201600767907, 5561.582881283879, 5564.916526252109, 5359.0, 5495.093309603911, 5542.528885044776, 5574.498295153415, 5576.498115169654, 5402.243685883979, 5414.0, 5414.648047876875, 5446.972765136188, 5454.53636440903, 6145.047517634729, 6168.105624684441, 6185.350538193515, 6190.81427557174, 6199.566030377875, 6758.662066896635, 6769.221539522969, 6778.389944904982, 6783.118194634666, 6790.864182716318, 6767.221769496522, 6792.694328755218, 6809.353111454453, 6853.862922741567, 6882.139732533434, 6181.041938499539, 6209.6895155242055, 6260.686965651745, 6268.71790769421, 6347.460465860361, 6873.175218973755, 6966.059581956472, 6969.0, 6991.615461149584, 6992.370686638125, 6583.539152259392, 6624.503162262753, 6650.634215118215, 6660.966695166493, 6682.198136223684, 6694.062831203635, 6750.628715420601, 6753.898691519631, 6819.0, 6832.111825462658, 6707.463402927754, 6744.460443164535, 6748.055272261888, 6750.189977202767, 6758.83102922421, 6706.061151438803, 6770.119884414995, 6775.085363475868, 6785.728570857209, 6796.830079248059, 4939.8271060513425, 4942.703437793743, 4967.925481117786, 5022.698638081727, 5025.949740502549, 4282.0, 4361.520232774392, 4369.300911854088, 4383.123375324948, 4397.582229688174, 6488.059231411419, 6488.351164883568, 6488.837779055561, 6505.869882602321, 6508.60948343101, 6794.592324460548, 6800.863982720318, 6873.243943166348, 6885.862282754317, 6887.070245516791, 6407.391297826699, 6419.679016049179, 6433.5496515243485, 6505.447037001813, 6516.348365163541, 5527.115661494142, 5620.747066382022, 5627.521660658808, 5631.465010823965, 5685.090385538377, 7045.225025247219, 7121.074260346122, 7121.537100088478, 7122.465815063891, 7126.2873712628325, 6823.215330236888, 6828.453723702191, 6876.002979568035, 6884.690188941609, 6900.309969003059, 7055.3650171484815, 7073.504854660125, 7144.821379465555, 7158.928410715826, 7172.354488096096, 6574.243961944438, 6703.229128650072, 6713.328667133248, 6726.764563240263, 6736.461083113437, 6764.594124352555, 6803.693833777591, 6821.693023814039, 6889.483288753263, 6900.068490753684, 6507.219133703986, 6568.113304703804, 6569.9014514783275, 6572.671366431755, 6584.736610535525, 6512.153420055552, 6514.934850651623, 6521.9673901630185, 6591.274959754519, 6611.041398997022, 6448.516361272829, 6572.80281591553, 6572.8356791078695, 6574.605523668404, 6577.901331480128, 6538.051982462612, 6575.4410875076155, 6575.901361479678, 6637.933620663925, 6670.633115178712, 6396.904046439214, 6452.419282264619, 6508.772192973223, 6525.021246813016, 6528.608283503005], "value": 6163.993848479095, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [843.1484200957032, 899.7840518275614, 922.4557511068468, 926.9258459323255, 1116.2744216259434, 33592.4961125583, 42737.35893961593, 43248.783756081255, 43375.34936975948, 43428.0, 43772.0, 44220.336694949605, 44241.55758442415, 44294.335584966255, 44430.0, 7029.402500787439, 7463.589502577356, 7465.0, 7466.775996720107, 7485.214052524489, 7371.926280737204, 7431.405487560982, 7458.589777562232, 7466.029416175889, 7480.438967077491, 7517.69929202834, 7537.170911199763, 7548.547087174759, 7563.357114645261, 7571.848563028736, 7476.327130558248, 7486.438517111184, 7495.287947644965, 7507.624618769094, 7531.3221810037085, 7345.742898998563, 7361.227071157558, 7365.742199023062, 7385.113786345619, 7392.55644661322, 38856.611433885584, 39303.41044884329, 39305.21389572193, 39389.409158862356, 39669.0, 3421.674940880612, 3454.5681789776277, 3455.706264967456, 3456.4642480415323, 3457.6369481204365, 32276.515852262233, 32331.353372932645, 32460.513092303634, 32548.511772323433, 32742.345153096805, 4918.01639672067, 4921.507849215086, 4940.061388336205, 4992.825251116194, 4998.475160108209, 216974.0, 217621.0, 219197.0, 219360.0, 219378.90310548505, 52672.473275266755, 52681.2097818533, 52728.736356317975, 52746.0, 52893.7355313221, 55395.723021384634, 55402.72298638562, 55424.445755542736, 55463.44536554583, 55567.0, 15164.317605707769, 15420.691586168214, 16806.32774689023, 16926.661466770594, 16960.660786784196, 13791.655208619864, 13863.237521936391, 13936.58190254294, 13943.860561394458, 13962.162270263816, 15202.543923682308, 15268.625823675922, 15287.61780955485, 15359.539213823604, 15419.537413877602, 5778.451047150598, 5836.124581312837, 5905.76376944926, 5930.55520835939, 6001.339852616209, 1052.2423854824515, 1052.400131924811, 1067.6156583629886, 1069.5454431866426, 1080.9405482698528, 24108.517829643308, 32108.357832843678, 32123.51814722781, 32282.35435291281, 32644.34711305808, 1162.81394976805, 1166.690826930864, 1180.0854337888034, 1180.598596477202, 1180.8110702287593, 13094.514473618805, 13308.46766129344, 13328.333583320795, 13523.256220907944, 13574.117682350616, 275753.0, 283454.0, 284549.0, 284783.0, 284815.0, 54856.177157342674, 54964.0, 55030.0, 55202.0, 55202.72398637981, 1436.9353379097965, 1442.5383877159418, 1471.8601732835364, 1503.1131632336974, 1520.6274462756696, 24273.51452970966, 24684.382890427165, 29964.250893727833, 30384.848075760365, 30902.84548577243, 54834.0, 55103.44896550983, 55295.17057244225, 55372.0, 55468.0, 227596.0, 229139.0, 229153.0, 229257.0, 231042.0, 36980.63019369772, 37322.626773731914, 38780.41829372505, 38896.222075557765, 39000.6099938997, 46842.0, 48337.516624833304, 48404.75797620989, 48552.0, 48832.51167488422, 35005.64994350126, 35026.64973350234, 35156.64843351636, 35279.11802204863, 35610.46584301186, 34842.65157348495, 35167.0, 35259.647403526666, 35436.46845297374, 35561.0, 40265.59734402736, 40615.79692101639, 41196.79401602973, 41250.1749965005, 41258.587414126676, 33981.320373591894, 34080.31839363149, 34183.82908085443, 34426.48360274548, 34741.65258347485, 25916.222513324632, 25964.0, 25993.0, 26110.216693499224, 27033.86483067572], "value": 18472.12943311514, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [579.8318487638585, 582.6445868020506, 586.9530437564995, 590.5069267161921, 601.1223613524254, 23116.537669246605, 23664.171753988612, 23738.406539836513, 23947.161849335276, 24030.75969240307, 27446.0, 27925.0, 28004.719952800468, 28064.438711225765, 28067.85966070172, 5619.297587801525, 5811.099279611667, 5843.883122337551, 5846.766129354821, 5847.356790753014, 5317.308749862513, 5503.724813759316, 5751.7699292028265, 5766.740496677659, 5772.134179873011, 5741.712914354286, 5757.337906140806, 5761.510271626917, 5767.163761254616, 5784.768609255625, 5707.42925707428, 5754.97122514389, 5759.539236861041, 5775.047117225653, 5778.133280008012, 5403.162509810985, 5413.404525502192, 5428.348598168205, 5431.131019036935, 5431.375391829911, 31568.79018468708, 31693.0, 32144.839275803704, 33054.0, 33367.49948750771, 2114.3762590035976, 2119.374784438579, 2123.0976834845283, 2128.521082756383, 2129.3292612827063, 19759.30842420523, 20144.294949676838, 20331.79668203314, 20340.898295508574, 20357.898210508854, 2454.3005243505695, 2455.72986971433, 2530.202986059404, 2535.0746977353133, 2535.163396079308, 153472.0, 154322.0, 155777.0, 155975.0, 156535.0, 14987.550373488813, 15833.445829395916, 15834.366625335088, 16299.348026079062, 16783.916080419764, 25360.619590706156, 25396.619050714253, 25397.61903571448, 25399.61900571493, 25453.236402907944, 10692.572297108029, 11165.665030049111, 11184.161187910939, 11297.43512824372, 11317.377544234982, 9060.728178154666, 10335.379877207391, 10360.326578772356, 10376.688699339033, 10377.325473844176, 9058.954705226564, 9953.552090155816, 10135.619548333147, 10193.286469947032, 10311.535980880879, 2871.55490898911, 2895.739383455499, 2910.3451723362073, 2961.8815247390294, 3063.417950589381, 1023.3757407981126, 1061.3578784835217, 1066.36018388966, 1068.540527573151, 1072.1744256922127, 21591.89204054001, 21619.35141945744, 21645.56708865814, 21928.0, 22035.889820550794, 1110.6223883879359, 1119.1103073056777, 1130.2596799096605, 1132.3488993828582, 1136.931784092957, 11937.403129843473, 12108.515659373703, 12154.0, 12209.0, 12222.572209972608, 602576.0, 614371.0, 620371.0, 629185.0, 641145.0, 130779.34610326888, 140395.29802351128, 140967.0, 142911.2854435742, 143177.0, 1297.0920355751011, 1301.6160232731368, 1342.3825040481488, 1356.7829147336379, 1359.2727890578492, 22949.0, 23009.539809203387, 23051.769482305634, 23238.535229295656, 23346.0, 64843.35156648562, 67965.32034679787, 68188.31811682018, 68419.65790171018, 69780.0, 87427.56286218528, 87529.0, 87672.56163719141, 87684.0, 88023.55988220018, 13047.804282935953, 15239.0, 15545.222738863238, 15609.453669121527, 15610.921945390655, 24863.62704559469, 24867.253982380556, 24981.250562483154, 25076.749232508173, 25165.24504264875, 18720.344787932358, 18832.811671883654, 19479.90260048691, 19894.0, 20026.699599505726, 16280.67438651244, 16782.748258776373, 17065.488035358958, 17072.658546829243, 17275.308987640856, 20623.175072997514, 20879.26922557703, 20887.58224835525, 21045.473863153544, 21218.7878121223, 15132.092074475566, 15287.082775033534, 15331.310091046153, 15375.769363459332, 15381.384744610537, 19641.803581964, 19820.50448738793, 19976.0, 20211.494712632302, 20213.79786202119], "value": 12758.6973291964, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1426.144313411953, 1464.6191990082582, 1481.3185934470143, 1487.799147115139, 1493.186213513635, 15251.161186134772, 15430.305636246369, 15679.29443175057, 15856.3657453702, 15912.0, 16083.83916160838, 16337.18314084297, 16411.507654770347, 16412.0, 16417.0, 2743.1359121876644, 2755.669319681631, 2758.8344699318004, 2777.6111344411797, 2782.9443411131765, 2658.401859581598, 2721.863906804662, 2771.6673999120135, 2773.0433000614757, 2773.5423655096984, 2672.6792784865843, 2674.1442738323744, 2717.2935036890453, 2717.986410067947, 2718.0486829609576, 2541.199522150526, 2558.0790915270486, 2576.0726138590094, 2576.9742302576924, 2577.3170109920884, 2646.2193652872447, 2646.563317052684, 2648.165827764248, 2658.534756417619, 2661.813673042888, 14884.330205140686, 15039.248037598076, 15079.54761357161, 15164.014339067926, 15176.317065732068, 8003.239692229229, 8290.751277461686, 8295.336373090138, 8319.0, 8319.459235149756, 5124.128898087334, 5267.71027593486, 5283.973580132075, 5404.7838086476495, 5416.756245968902, 1893.9677875557854, 1902.1440351841588, 1920.0975541495475, 1921.2315073970383, 1937.2251099560149, 26503.0, 26589.0, 26669.199924002118, 26670.86664566684, 26776.330591735168, 6828.863422731518, 6878.621675807879, 6909.75815846453, 6986.196587392414, 7057.611831349325, 18416.26334946614, 18426.262949482138, 18461.907690461463, 18480.630387392444, 18739.156737946825, 7923.564203968837, 8169.754907352789, 8179.5501247430775, 8189.0, 8194.713185038496, 7389.408847292204, 7527.698892044366, 7534.397248220239, 7558.659860306189, 7571.205023472456, 5260.132078207053, 5421.566274698093, 5434.619576629677, 5458.181272809111, 5491.28613280271, 1514.8485151484983, 1518.4305885293015, 1519.6808670179164, 1524.1845612597428, 1536.8539988701054, 944.5843828715343, 971.7036303927229, 972.2367941166292, 973.177664873181, 980.720494659033, 8209.79475513117, 8223.54770487629, 8238.794030149174, 8262.215089566482, 8352.248297653241, 719.8087165740708, 746.9813254668677, 754.8490301939634, 759.8670232709364, 779.473855147773, 4951.0, 5522.088855338824, 6360.872782544323, 6484.837879052967, 6535.705893234815, 22488.21291254798, 22688.546229075655, 22797.430064248525, 22984.7701522986, 23117.537649246922, 22053.0, 23067.07731690747, 23067.653985190234, 23109.88445057764, 23177.76822231756, 11750.529978800752, 11817.527298908119, 11819.0, 11972.16194866351, 12052.457639406248, 8744.475331480131, 9353.953230233805, 9545.379550329206, 9694.079062489052, 9784.315097943076, 18944.336948206746, 19077.61844763125, 19112.139953701837, 19166.425007249803, 19291.710624340365, 19602.215911363386, 19780.90109549443, 19845.0, 19986.800131999076, 20029.599408011465, 12940.935295323463, 13264.872485838427, 13293.069485135948, 13309.534166304133, 13325.600231993056, 13924.2341671205, 14151.292435378396, 14191.0, 14245.358958847084, 14259.287035648384, 11880.227785193934, 11880.584179553674, 11890.0, 12217.633470995885, 12276.0, 11487.25332853362, 11569.305841649191, 11704.70738231551, 11852.881471185177, 12092.274463532216, 9653.806923861624, 9781.902180978099, 9801.362911410735, 9815.411075335503, 9829.803403932025, 7574.424695603521, 7633.69465221385, 7654.69381224767, 7710.11333696632, 7722.420818438527, 7797.103333116765, 7815.531068135702, 7896.802579935547, 7905.130435651959, 8040.5979701015885], "value": 6879.177986156481, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [522.9384349769969, 528.7012837746673, 538.6821775152661, 549.3106151779516, 549.4395716369306, 6127.3456166834985, 6168.691565421722, 6205.286392064914, 6223.9688801555985, 6228.4705800007, 6018.247719035121, 6053.848653783658, 6072.635641861491, 6122.234720659918, 6179.907301390472, 4902.0, 4924.3105965164905, 4945.901081978358, 4961.957988822333, 4972.254161875711, 4692.741899195543, 4848.739327774769, 4903.583195428375, 4910.852674419773, 4915.680480768757, 4704.435467743876, 4711.952880471203, 4767.833125840579, 4767.974885399638, 4792.353032340624, 4714.811407543694, 4749.556571485679, 4770.856874293777, 4779.832705855296, 4781.689190202643, 4304.6771492137905, 4341.6526677865695, 4352.630026447756, 4371.060222052274, 4374.059577190919, 5932.466078052953, 5934.881302373971, 5962.612430192067, 5995.6702381369005, 6038.637681739066, 5586.804461843856, 5694.572907031989, 5695.174199741055, 5730.512906402961, 5763.596548241625, 6512.8697426051685, 6533.967330163318, 6535.313792051814, 6566.244881838554, 6582.5063120265695, 4897.4123105227245, 4904.411470623512, 4911.533404326583, 4952.801887924478, 4962.776675049631, 6585.835354116138, 6616.437602803816, 6692.698828552678, 6749.156355455568, 6821.931780682179, 4933.481984391659, 4978.576820970258, 5016.197408414636, 5019.171836646912, 5020.799168033311, 5041.6470847040355, 5050.217216331474, 5079.339685840817, 5102.183650615883, 5124.410692770304, 5631.521320687705, 5676.68778217202, 5694.487496125369, 5715.0, 5728.481952282648, 6339.320080178756, 6379.425851673372, 6488.708008139645, 6492.630189980623, 6535.542512024208, 1748.825117488241, 1771.3977247735575, 1784.3130394797836, 1785.8214178582039, 1795.2549691877725, 1195.7787809255315, 1257.7610254051701, 1264.367816091954, 1271.4469205895466, 1275.687456573127, 6265.8120256392385, 6288.52836037299, 6304.306526282106, 6355.904661430082, 6370.140031095742, 6477.190351206099, 6536.411722944863, 6627.536072474881, 6635.23694775107, 6707.5975441473665, 6210.223722034746, 6289.874202516015, 6292.406543223473, 6300.054991751183, 6359.9364006360265, 3452.3095380923914, 3518.630543792916, 3536.5402497675136, 3548.8048157351595, 3571.3750093733493, 6925.818367214311, 6940.236573976858, 6952.5480843745, 6957.130358705162, 7000.229974702778, 6450.967745161244, 6716.1120718090715, 6718.0, 6782.8643427132165, 6783.762568310085, 6741.325867413219, 6750.83122921921, 6777.525573209828, 6791.728330866808, 6794.626295553792, 6653.334666533308, 6676.632785196861, 6710.19477662664, 6710.865782684221, 6747.392734653905, 6590.5716128451495, 6593.736250549924, 6601.24085730128, 6623.933760662524, 6647.534672572873, 6795.966020169867, 6907.758228461979, 6914.204866440223, 6940.548864323803, 6994.160700715946, 5012.147934851011, 5031.169856973558, 5054.873628159326, 5056.241563765465, 5085.160948443466, 6519.41325280708, 6593.835154121185, 6597.868042639025, 6662.866742665023, 6765.255821859493, 6318.494520438446, 6411.51913606472, 6445.677716114269, 6480.773172938924, 6502.447291980235, 6397.8720425592155, 6429.874771914802, 6446.806595802133, 6480.481561475165, 6509.251436084911, 6367.808965731036, 6424.38968298011, 6437.742490300336, 6501.08984742127, 6540.215174179129, 6481.740730370732, 6505.902411463737, 6555.3772391622715, 6561.556457579325, 6585.176852893388, 6327.841803954938, 6402.455791257609, 6415.903761443488, 6427.646479443675, 6428.0], "value": 5071.971707718564, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [934.878465799446, 941.844595641719, 946.1910066892802, 955.0831202046036, 965.3001573858951, 16113.113778742165, 16774.41289554864, 16867.40964066258, 16891.746623800624, 19311.227550897947, 19707.31024414146, 19729.21083156672, 19760.604787904234, 19775.307864224756, 19836.0, 964.8070385922808, 1042.2964498963208, 1065.275612583443, 1069.5507886687571, 1069.9518521666505, 1089.1286970423669, 1090.5092708281265, 1090.6673464593296, 1090.7327704712318, 1091.2252300866394, 1005.2962925951863, 1037.8858325584179, 1092.4046394714899, 1137.7041969088054, 1139.453062529986, 1074.457399013497, 1075.7095584192264, 1078.978420431587, 1081.389015206406, 1083.7399024234205, 800.8558459477292, 801.4910531812283, 802.0896282719098, 803.5098589860181, 811.4036183405193, 17736.55658608532, 17783.021933793636, 17952.551186220448, 18085.547861303574, 18169.54576135594, 20123.0, 20218.494537636678, 20402.28591999273, 20554.897225513927, 20561.69157462639, 15983.280752366056, 16264.349426022945, 16388.26252818614, 16431.0, 16432.178391080397, 3518.8064656443885, 3565.8751943682105, 3567.8216089195435, 3568.982155089234, 3569.286142771456, 142574.0, 142682.0, 142801.2859935704, 147297.0, 148899.25550372287, 16024.679506409806, 16189.838101618832, 16434.178291085398, 16559.503214903332, 16650.58373540671, 32674.83662581672, 32825.67174328226, 33550.0, 33792.32415351679, 33812.0, 8889.066648001995, 9038.051004644549, 9071.81856362869, 9136.862947055799, 9251.306152038624, 4324.2648749712625, 4444.599986001275, 4458.9554104459185, 4462.107578484316, 4462.553744625511, 5494.36814766307, 5544.0, 5551.694656793915, 5552.278203833475, 5606.6916319602815, 1131.5530365505579, 1148.2077366617007, 1157.1148071725138, 1168.4683469021575, 1169.5964892112208, 708.4615692073958, 719.7408932784193, 732.2457868395561, 742.6843591473602, 749.3592978003837, 12523.436445359981, 13580.524681636096, 13741.656458588615, 15104.39582416713, 15411.537653870402, 724.7825652304288, 726.3354031061625, 745.2919726260075, 747.6784982457486, 779.473855147773, 5904.291485021825, 5933.792317268962, 6194.690265486798, 6201.968990155111, 6220.968895155495, 127827.0, 129822.35088824495, 129976.35011824881, 130008.0, 135300.0, 115261.0, 117513.412432939, 118301.0, 119048.8095119055, 119705.0, 98956.50521747489, 99550.5022474883, 101289.99999999853, 102900.0, 103348.0, 12113.333766642567, 12499.750004999667, 12518.37408129608, 12550.121491495873, 12631.178973366701, 48191.277130843766, 48894.26658600053, 48970.0, 49945.25082123699, 50273.74863125661, 64285.35714642794, 64304.67847660919, 64615.67692161509, 64949.67525162533, 65484.345156547824, 17641.0, 17799.73300400521, 17825.46523604294, 17845.73231401504, 17986.64026719432, 22825.0, 22866.42833929165, 23832.642510362013, 24048.278551643478, 24064.15775447851, 20315.492112697302, 20625.071871766108, 20860.0, 20937.16251349929, 20968.68546971827, 20995.160193592696, 21258.78741212568, 21558.568828623655, 21584.352469425943, 21792.891035544722, 20524.179032839118, 21107.7889221112, 21804.236851710113, 21810.127594896025, 21981.450463737896, 14397.7840332393, 14490.34793434319, 14511.346989385715, 14540.781888271897, 14574.85425145735, 15147.54557363281, 15836.812239082345, 16116.27476763572, 16148.434804781777, 16175.838241617434], "value": 9747.636488626822, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1478.0, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 108.0, 103.0, 107.0, 107.0, 108.0, 110.0, 96.0, 106.0, 110.0], "value": 105.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 113.0, 141.0, 170.0, 114.0, 147.0, 148.0, 120.0, 166.0, 114.0], "value": 137.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 162.0, 162.0, 167.0, 163.0, 163.0, 165.0, 162.0, 162.0], "value": 163.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 75.0, 164.0, 76.0, 74.0, 74.0, 95.0, 97.0, 74.0], "value": 88.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 78.0, 128.0, 79.0, 78.0, 79.0, 138.0, 80.0, 78.0, 130.0], "value": 94.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 115.0, 114.0, 114.0, 113.0, 114.0, 114.0, 114.0, 123.0, 115.0], "value": 115.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 150.0, 148.0, 148.0, 150.0, 146.0, 148.0, 148.0, 147.0, 148.0], "value": 148.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 94.0, 94.0, 95.0, 94.0, 93.0, 94.0, 94.0, 94.0], "value": 94.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [46.0, 46.0, 45.0, 47.0, 57.0, 46.0, 52.0, 46.0, 46.0, 47.0], "value": 47.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 54.0, 53.0, 53.0, 53.0, 53.0, 54.0, 54.0, 54.0, 54.0], "value": 53.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 86.0, 75.0, 74.0, 74.0, 74.0, 76.0, 74.0, 75.0, 76.0], "value": 76.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [120.0, 120.0, 123.0, 113.0, 124.0, 121.0, 128.0, 114.0, 117.0, 167.0], "value": 124.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 165.0, 165.0, 166.0, 163.0, 163.0, 159.0, 172.0, 167.0, 176.0], "value": 166.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 62.0, 63.0, 64.0, 70.0, 60.0, 61.0, 61.0, 63.0, 60.0], "value": 62.7, "unit": "score"}]}]} 04:14:12 INFO - Return code: 0 04:14:12 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:14:12 INFO - # TBPL SUCCESS # 04:14:12 INFO - Running post-action listener: _package_coverage_data 04:14:12 INFO - Running post-action listener: _resource_record_post_action 04:14:12 INFO - [mozharness: 2017-08-03 11:14:12.254406Z] Finished run-tests step (success) 04:14:12 INFO - Running post-run listener: _resource_record_post_run 04:14:12 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 8192; Write bytes: 428175360; Read time: 348; Write time: 505260 04:14:12 INFO - TinderboxPrint: CPU usage
13.1% 04:14:12 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 348 04:14:12 INFO - TinderboxPrint: I/O write bytes / time
428,175,360 / 505,260 04:14:12 INFO - TinderboxPrint: CPU idle
8,231.8 (86.9%) 04:14:12 INFO - TinderboxPrint: CPU user
1,192.0 (12.6%) 04:14:12 INFO - TinderboxPrint: Swap in / out
0 / 0 04:14:12 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 108605440; Read time: 0; Write time: 147416 04:14:12 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 04:14:12 INFO - run-tests - Wall time: 1170s; CPU: 13.0%; Read bytes: 8192; Write bytes: 319569920; Read time: 348; Write time: 357844 04:14:12 INFO - Running post-run listener: _upload_blobber_files 04:14:12 INFO - Blob upload gear active. 04:14:12 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:14:12 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 04:14:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:14:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:14:13 INFO - (blobuploader) - INFO - Open directory for files ... 04:14:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 04:14:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:14:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:14:14 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 04:14:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:14:14 INFO - (blobuploader) - INFO - Done attempting. 04:14:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:14:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:14:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:14:20 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:14:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:14:20 INFO - (blobuploader) - INFO - Done attempting. 04:14:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:14:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:14:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:14:21 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:14:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:14:21 INFO - (blobuploader) - INFO - Done attempting. 04:14:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:14:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:14:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:14:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:14:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:14:22 INFO - (blobuploader) - INFO - Done attempting. 04:14:22 INFO - (blobuploader) - INFO - Iteration through files over. 04:14:22 INFO - Return code: 0 04:14:22 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:14:22 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:14:22 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7ebb14cc20cf1e2b4ab38600131e409486485ca58f07bfa5189c53e7884d42604c36659c1f946e5c6bee42d6a2f6e3425eebe0692127901c5ba34590c0563b41", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d3b224a086fca6fa2da803f7509331d95b13f54f1e0f80c3325b7c1c8db9bdb68c06fbf078205d493bc49ead40a65c647d21bf50e7fd8fa512c633336e973f86", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b91d61832364062cb80bcf0815c2b32a0f83e87c8f32d13ee9095dccc001dea51465a072ee4fa0ec1c99c9c8ee8e914b977fde3b9a6a827e701619fb0bd3b9bb", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e4acb0d63cd18a8941aedad0128f07991d28dafb070e9d42b7b02e2aa5b09d3937a9cbc5ea2aebd42620a116040b5ea7c05052092c1361913b3fbd2a95bc4768"} 04:14:22 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:14:22 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:14:22 INFO - Contents: 04:14:22 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7ebb14cc20cf1e2b4ab38600131e409486485ca58f07bfa5189c53e7884d42604c36659c1f946e5c6bee42d6a2f6e3425eebe0692127901c5ba34590c0563b41", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d3b224a086fca6fa2da803f7509331d95b13f54f1e0f80c3325b7c1c8db9bdb68c06fbf078205d493bc49ead40a65c647d21bf50e7fd8fa512c633336e973f86", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b91d61832364062cb80bcf0815c2b32a0f83e87c8f32d13ee9095dccc001dea51465a072ee4fa0ec1c99c9c8ee8e914b977fde3b9a6a827e701619fb0bd3b9bb", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e4acb0d63cd18a8941aedad0128f07991d28dafb070e9d42b7b02e2aa5b09d3937a9cbc5ea2aebd42620a116040b5ea7c05052092c1361913b3fbd2a95bc4768"} 04:14:22 INFO - Running post-run listener: copy_logs_to_upload_dir 04:14:22 INFO - Copying logs to upload dir... 04:14:22 INFO - mkdir: /builds/slave/test/build/upload/logs 04:14:22 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1250.811826 ========= master_lag: 0.14 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 50 secs) (at 2017-08-03 04:14:22.872782) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-03 04:14:22.876979) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7ebb14cc20cf1e2b4ab38600131e409486485ca58f07bfa5189c53e7884d42604c36659c1f946e5c6bee42d6a2f6e3425eebe0692127901c5ba34590c0563b41", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d3b224a086fca6fa2da803f7509331d95b13f54f1e0f80c3325b7c1c8db9bdb68c06fbf078205d493bc49ead40a65c647d21bf50e7fd8fa512c633336e973f86", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b91d61832364062cb80bcf0815c2b32a0f83e87c8f32d13ee9095dccc001dea51465a072ee4fa0ec1c99c9c8ee8e914b977fde3b9a6a827e701619fb0bd3b9bb", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e4acb0d63cd18a8941aedad0128f07991d28dafb070e9d42b7b02e2aa5b09d3937a9cbc5ea2aebd42620a116040b5ea7c05052092c1361913b3fbd2a95bc4768"} build_url:https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011260 build_url: 'https://queue.taskcluster.net/v1/task/EFNak279TF2_iRL8mLGfJw/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7ebb14cc20cf1e2b4ab38600131e409486485ca58f07bfa5189c53e7884d42604c36659c1f946e5c6bee42d6a2f6e3425eebe0692127901c5ba34590c0563b41", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d3b224a086fca6fa2da803f7509331d95b13f54f1e0f80c3325b7c1c8db9bdb68c06fbf078205d493bc49ead40a65c647d21bf50e7fd8fa512c633336e973f86", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b91d61832364062cb80bcf0815c2b32a0f83e87c8f32d13ee9095dccc001dea51465a072ee4fa0ec1c99c9c8ee8e914b977fde3b9a6a827e701619fb0bd3b9bb", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e4acb0d63cd18a8941aedad0128f07991d28dafb070e9d42b7b02e2aa5b09d3937a9cbc5ea2aebd42620a116040b5ea7c05052092c1361913b3fbd2a95bc4768"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-03 04:14:22.904061) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-03 04:14:22.904355) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5c37b704b588aaa989324530000001d0-1501756743.285960-2070469312 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004474 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-03 04:14:22.986337) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-03 04:14:22.989647) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-03 04:14:22.989919) ========= ========= Total master_lag: 0.30 =========