builder: mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s slave: talos-linux64-ix-009 starttime: 1495747096.86 results: success (0) revision: 55e5723b1e62190a38c00927eda796e2ad14778f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:16.862480) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:16.862830) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:16.863103) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:16.887233) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:16.887493) ========= 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=17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-25 14:18:16-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 230M=0s 2017-05-25 14:18:17 (230 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.143361 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:17.043571) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:17.043848) ========= 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=17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015273 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:17.096617) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-05-25 14:18:17.099959) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 55e5723b1e62190a38c00927eda796e2ad14778f --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 55e5723b1e62190a38c00927eda796e2ad14778f --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=17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-25 14:18:17,176 truncating revision to first 12 chars 2017-05-25 14:18:17,176 Setting DEBUG logging. 2017-05-25 14:18:17,176 attempt 1/10 2017-05-25 14:18:17,176 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/55e5723b1e62?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-25 14:18:18,135 unpacking tar archive at: mozilla-central-55e5723b1e62/testing/mozharness/ program finished with exit code 0 elapsedTime=1.361087 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-05-25 14:18:18.477208) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:18.477533) ========= script_repo_revision: 55e5723b1e62190a38c00927eda796e2ad14778f ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:18.477938) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:18.478232) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-25 14:18:18.487620) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 58 secs) (at 2017-05-25 14:18:18.487904) ========= /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=17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 14:18:18 INFO - MultiFileLogger online at 20170525 14:18:18 in /builds/slave/test 14:18:18 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 14:18:18 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 14:18:18 INFO - {'append_to_log': False, 14:18:18 INFO - 'base_work_dir': '/builds/slave/test', 14:18:18 INFO - 'blob_upload_branch': 'Firefox', 14:18:18 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 14:18:18 INFO - 'branch': 'Firefox', 14:18:18 INFO - 'buildbot_json_path': 'buildprops.json', 14:18:18 INFO - 'config_files': ('talos/linux_config.py',), 14:18:18 INFO - 'default_actions': ('clobber', 14:18:18 INFO - 'read-buildbot-config', 14:18:18 INFO - 'download-and-extract', 14:18:18 INFO - 'populate-webroot', 14:18:18 INFO - 'create-virtualenv', 14:18:18 INFO - 'install', 14:18:18 INFO - 'run-tests'), 14:18:18 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 14:18:18 INFO - 'download_minidump_stackwalk': True, 14:18:18 INFO - 'download_symbols': 'ondemand', 14:18:18 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 14:18:18 INFO - 'tooltool.py': '/tools/tooltool.py', 14:18:18 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 14:18:18 INFO - '/tools/misc-python/virtualenv.py')}, 14:18:18 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 14:18:18 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 14:18:18 INFO - 'gecko_profile': False, 14:18:18 INFO - 'gecko_profile_interval': 0, 14:18:18 INFO - 'installer_path': 'installer.exe', 14:18:18 INFO - 'log_level': 'info', 14:18:18 INFO - 'log_name': 'talos', 14:18:18 INFO - 'log_to_console': True, 14:18:18 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 14:18:18 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 14:18:18 INFO - 'opt_config_files': (), 14:18:18 INFO - 'pip_index': False, 14:18:18 INFO - 'suite': 'dromaeojs-e10s', 14:18:18 INFO - 'system_bits': '32', 14:18:18 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 14:18:18 INFO - 'title': 'talos-linux64-ix-009', 14:18:18 INFO - 'tooltool_cache': '/builds/tooltool_cache', 14:18:18 INFO - 'use_talos_json': True, 14:18:18 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 14:18:18 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 14:18:18 INFO - 'work_dir': 'build'} 14:18:18 INFO - [mozharness: 2017-05-25 21:18:18.665483Z] Running clobber step. 14:18:18 INFO - Running pre-action listener: _resource_record_pre_action 14:18:18 INFO - Running main action method: clobber 14:18:18 INFO - rmtree: /builds/slave/test/build 14:18:18 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 14:18:19 INFO - Running post-action listener: _resource_record_post_action 14:18:19 INFO - [mozharness: 2017-05-25 21:18:19.682569Z] Finished clobber step (success) 14:18:19 INFO - [mozharness: 2017-05-25 21:18:19.682670Z] Running read-buildbot-config step. 14:18:19 INFO - Running pre-action listener: _resource_record_pre_action 14:18:19 INFO - Running main action method: read_buildbot_config 14:18:19 INFO - Using buildbot properties: 14:18:19 INFO - { 14:18:19 INFO - "project": "", 14:18:19 INFO - "product": "firefox", 14:18:19 INFO - "who": "ryanvm@gmail.com", 14:18:19 INFO - "installer_path": "public/build/target.tar.bz2", 14:18:19 INFO - "builddir": "mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s", 14:18:19 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 14:18:19 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo-sequential mozilla-central talos dromaeojs-e10s", 14:18:19 INFO - "stage_platform": "linux64-stylosequential", 14:18:19 INFO - "basedir": "/builds/slave/test", 14:18:19 INFO - "buildnumber": 20, 14:18:19 INFO - "platform": "ubuntu64_hw_styloseq", 14:18:19 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 14:18:19 INFO - "slavebuilddir": "test", 14:18:19 INFO - "taskId": "Ylx8pDUWQL691q_Ifu_C_Q", 14:18:19 INFO - "branch": "mozilla-central", 14:18:19 INFO - "script_repo_revision": "production", 14:18:19 INFO - "revision": "55e5723b1e62190a38c00927eda796e2ad14778f", 14:18:19 INFO - "slavename": "talos-linux64-ix-009", 14:18:19 INFO - "repo_path": "mozilla-central" 14:18:19 INFO - } 14:18:19 INFO - Finding installer, test and symbols from parent task. 14:18:19 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Ylx8pDUWQL691q_Ifu_C_Q'}, attempt #1 14:18:20 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Ylx8pDUWQL691q_Ifu_C_Q'}, attempt #1 14:18:20 INFO - Task dependencies: Ti71EBITRXS4dxuwSZXJCQ 14:18:20 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ'}, attempt #1 14:18:21 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.tar.bz2 14:18:21 INFO - Set test_url: https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/test_packages.json 14:18:21 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.crashreporter-symbols.zip 14:18:21 INFO - Running post-action listener: _resource_record_post_action 14:18:21 INFO - [mozharness: 2017-05-25 21:18:21.045115Z] Finished read-buildbot-config step (success) 14:18:21 INFO - [mozharness: 2017-05-25 21:18:21.045340Z] Running download-and-extract step. 14:18:21 INFO - Running pre-action listener: _resource_record_pre_action 14:18:21 INFO - Running main action method: download_and_extract 14:18:21 INFO - mkdir: /builds/slave/test/build/tests 14:18: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')]} 14:18:21 INFO - trying https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.test_packages.json 14:18:21 INFO - Downloading https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 14:18:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 14:18:21 INFO - Downloaded 986 bytes. 14:18:21 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 14:18:21 INFO - Using the following test package requirements: 14:18:21 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 14:18:21 INFO - u'common': [u'target.common.tests.zip'], 14:18:21 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 14:18:21 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 14:18:21 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 14:18:21 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 14:18:21 INFO - u'mozbase': [u'target.common.tests.zip'], 14:18:21 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 14:18:21 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 14:18:21 INFO - u'web-platform': [u'target.common.tests.zip', 14:18:21 INFO - u'target.web-platform.tests.zip'], 14:18:21 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 14:18:21 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 14:18:21 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.common.tests.zip 14:18:21 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 14:18:21 INFO - Fetch https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.common.tests.zip into memory 14:18:23 INFO - Content-Length response header: 63525255 14:18:23 INFO - Bytes received: 63525255 14:18:34 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 14:18:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.common.tests.zip 14:18:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 14:18:34 INFO - Fetch https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.common.tests.zip into memory 14:18:35 INFO - Content-Length response header: 63525255 14:18:35 INFO - Bytes received: 63525255 14:18:47 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.talos.tests.zip 14:18:47 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 14:18:47 INFO - Fetch https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.talos.tests.zip into memory 14:18:48 INFO - Content-Length response header: 14411888 14:18:48 INFO - Bytes received: 14411888 14:18:48 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')]} 14:18:48 INFO - trying https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.tar.bz2 14:18:48 INFO - Downloading https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 14:18:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 14:18:50 INFO - Downloaded 55607731 bytes. 14:18:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.tar.bz2 14:18:50 INFO - mkdir: /builds/slave/test/properties 14:18:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 14:18:50 INFO - Writing to file /builds/slave/test/properties/build_url 14:18:50 INFO - Contents: 14:18:50 INFO - build_url:https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.tar.bz2 14:18:50 INFO - Running post-action listener: _resource_record_post_action 14:18:50 INFO - Running post-action listener: set_extra_try_arguments 14:18:50 INFO - [mozharness: 2017-05-25 21:18:50.453102Z] Finished download-and-extract step (success) 14:18:50 INFO - [mozharness: 2017-05-25 21:18:50.453250Z] Running populate-webroot step. 14:18:50 INFO - Running pre-action listener: _resource_record_pre_action 14:18:50 INFO - Running main action method: populate_webroot 14:18:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 14:18:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 14:18:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 14:18:50 INFO - '--tppagecycles', 14:18:50 INFO - '7'], 14:18:50 INFO - 'tests': ['tsvgm']}}, 14:18:50 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 14:18:50 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 14:18:50 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['dromaeo_css', 'kraken']}, 14:18:50 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 14:18:50 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 14:18:50 INFO - 'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:18:50 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 14:18:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:18:50 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 14:18:50 INFO - 'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['damp', 'tps']}, 14:18:50 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 14:18:50 INFO - 'tests': ['damp', 'tps']}, 14:18:50 INFO - 'g3': {'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['dromaeo_dom']}, 14:18:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 14:18:50 INFO - 'g4': {'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 14:18:50 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 14:18:50 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 14:18:50 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 14:18:50 INFO - 'other': {'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['a11yr', 14:18:50 INFO - 'ts_paint', 14:18:50 INFO - 'tpaint', 14:18:50 INFO - 'sessionrestore', 14:18:50 INFO - 'sessionrestore_no_auto_restore', 14:18:50 INFO - 'tabpaint']}, 14:18:50 INFO - 'other-e10s': {'tests': ['a11yr', 14:18:50 INFO - 'ts_paint', 14:18:50 INFO - 'tpaint', 14:18:50 INFO - 'sessionrestore', 14:18:50 INFO - 'sessionrestore_no_auto_restore', 14:18:50 INFO - 'tabpaint']}, 14:18:50 INFO - 'other-e10s_l64': {'tests': ['a11yr', 14:18:50 INFO - 'ts_paint', 14:18:50 INFO - 'tpaint', 14:18:50 INFO - 'sessionrestore', 14:18:50 INFO - 'sessionrestore_no_auto_restore', 14:18:50 INFO - 'tabpaint']}, 14:18:50 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 14:18:50 INFO - 'ts_paint', 14:18:50 INFO - 'tpaint', 14:18:50 INFO - 'sessionrestore', 14:18:50 INFO - 'sessionrestore_no_auto_restore', 14:18:50 INFO - 'tabpaint']}, 14:18:50 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['a11yr', 14:18:50 INFO - 'ts_paint', 14:18:50 INFO - 'tpaint', 14:18:50 INFO - 'sessionrestore', 14:18:50 INFO - 'sessionrestore_no_auto_restore', 14:18:50 INFO - 'tabpaint']}, 14:18:50 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['a11yr', 14:18:50 INFO - 'ts_paint', 14:18:50 INFO - 'tpaint', 14:18:50 INFO - 'sessionrestore', 14:18:50 INFO - 'sessionrestore_no_auto_restore', 14:18:50 INFO - 'tabpaint']}, 14:18:50 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 14:18:50 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 14:18:50 INFO - 'bloom_basic_ref']}, 14:18:50 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['tsvgx', 14:18:50 INFO - 'tsvgr_opacity', 14:18:50 INFO - 'tart', 14:18:50 INFO - 'tscrollx', 14:18:50 INFO - 'cart', 14:18:50 INFO - 'tsvg_static']}, 14:18:50 INFO - 'svgr-e10s': {'tests': ['tsvgx', 14:18:50 INFO - 'tsvgr_opacity', 14:18:50 INFO - 'tart', 14:18:50 INFO - 'tscrollx', 14:18:50 INFO - 'cart', 14:18:50 INFO - 'tsvg_static']}, 14:18:50 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 14:18:50 INFO - 'talos_options': ['--disable-e10s'], 14:18:50 INFO - 'tests': ['tp5o']}, 14:18:50 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 14:18:50 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 14:18:50 INFO - 'talos_options': ['--disable-e10s', 14:18:50 INFO - '--xperf_path', 14:18:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:18:50 INFO - 'tests': ['tp5n']}, 14:18:50 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 14:18:50 INFO - 'talos_options': ['--xperf_path', 14:18:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:18:50 INFO - 'tests': ['tp5n']}}, 14:18:50 INFO - 'talos.zip': {'path': '', 14:18:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 14:18:50 INFO - Running post-action listener: _resource_record_post_action 14:18:50 INFO - [mozharness: 2017-05-25 21:18:50.471646Z] Finished populate-webroot step (success) 14:18:50 INFO - [mozharness: 2017-05-25 21:18:50.471735Z] Running create-virtualenv step. 14:18:50 INFO - Running pre-action listener: _resource_record_pre_action 14:18:50 INFO - Running main action method: create_virtualenv 14:18:50 INFO - Creating virtualenv /builds/slave/test/build/venv 14:18:50 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 14:18:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 14:18:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 14:18:50 INFO - Using real prefix '/usr' 14:18:50 INFO - New python executable in /builds/slave/test/build/venv/bin/python 14:18:51 INFO - Installing distribute.............................................................................................................................................................................................done. 14:18:53 INFO - Installing pip.................done. 14:18:53 INFO - Return code: 0 14:18:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 14:18:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 14:18:53 INFO - Reading from file tmpfile_stdout 14:18:53 INFO - Output received: 14:18:53 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) 14:18:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 14:18:53 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')]} 14:18:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:18:53 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')]} 14:18:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:18:53 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:18:53 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 14:18:53 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 14:18:53 INFO - Using env: {'DISPLAY': ':0', 14:18:53 INFO - 'HOME': '/home/cltbld', 14:18:53 INFO - 'LANG': 'en_US.UTF-8', 14:18:53 INFO - 'LANGUAGE': 'en_US:en', 14:18:53 INFO - 'LOGNAME': 'cltbld', 14:18:53 INFO - 'MAIL': '/var/mail/cltbld', 14:18:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:18:53 INFO - 'MOZ_NO_REMOTE': '1', 14:18:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:18:53 INFO - 'NO_EM_RESTART': '1', 14:18:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:18:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:18:53 INFO - 'PWD': '/builds/slave/test', 14:18:53 INFO - 'SHELL': '/bin/bash', 14:18:53 INFO - 'SHLVL': '1', 14:18:53 INFO - 'TERM': 'linux', 14:18:53 INFO - 'TMOUT': '86400', 14:18:53 INFO - 'USER': 'cltbld', 14:18:53 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:18:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:18:53 INFO - '_': '/tools/buildbot/bin/python'} 14:18:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:18:53 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 14:18:53 INFO - Cleaning up... 14:18:53 INFO - Return code: 0 14:18:53 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 14:18:53 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')]} 14:18:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:18:53 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')]} 14:18:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:18:53 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:18:53 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 14:18:53 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 14:18:53 INFO - Using env: {'DISPLAY': ':0', 14:18:53 INFO - 'HOME': '/home/cltbld', 14:18:53 INFO - 'LANG': 'en_US.UTF-8', 14:18:53 INFO - 'LANGUAGE': 'en_US:en', 14:18:53 INFO - 'LOGNAME': 'cltbld', 14:18:53 INFO - 'MAIL': '/var/mail/cltbld', 14:18:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:18:53 INFO - 'MOZ_NO_REMOTE': '1', 14:18:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:18:53 INFO - 'NO_EM_RESTART': '1', 14:18:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:18:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:18:53 INFO - 'PWD': '/builds/slave/test', 14:18:53 INFO - 'SHELL': '/bin/bash', 14:18:53 INFO - 'SHLVL': '1', 14:18:53 INFO - 'TERM': 'linux', 14:18:53 INFO - 'TMOUT': '86400', 14:18:53 INFO - 'USER': 'cltbld', 14:18:53 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:18:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:18:53 INFO - '_': '/tools/buildbot/bin/python'} 14:18:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:18:53 INFO - Downloading/unpacking psutil>=3.1.1 14:18:53 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 14:18:53 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 14:18:53 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 14:18:53 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 14:18:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 14:18:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:18:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:18:54 INFO - Installing collected packages: psutil 14:18:54 INFO - Running setup.py install for psutil 14:18:54 INFO - building 'psutil._psutil_linux' extension 14:18:54 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 14:18:55 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 14:18:55 INFO - building 'psutil._psutil_posix' extension 14:18:55 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 14:18:55 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 14:18:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:18:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:18:55 INFO - Successfully installed psutil 14:18:55 INFO - Cleaning up... 14:18:55 INFO - Return code: 0 14:18:55 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 14:18:55 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')]} 14:18:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:18:55 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')]} 14:18:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:18:55 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:18:55 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 14:18:55 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 14:18:55 INFO - Using env: {'DISPLAY': ':0', 14:18:55 INFO - 'HOME': '/home/cltbld', 14:18:55 INFO - 'LANG': 'en_US.UTF-8', 14:18:55 INFO - 'LANGUAGE': 'en_US:en', 14:18:55 INFO - 'LOGNAME': 'cltbld', 14:18:55 INFO - 'MAIL': '/var/mail/cltbld', 14:18:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:18:55 INFO - 'MOZ_NO_REMOTE': '1', 14:18:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:18:55 INFO - 'NO_EM_RESTART': '1', 14:18:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:18:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:18:55 INFO - 'PWD': '/builds/slave/test', 14:18:55 INFO - 'SHELL': '/bin/bash', 14:18:55 INFO - 'SHLVL': '1', 14:18:55 INFO - 'TERM': 'linux', 14:18:55 INFO - 'TMOUT': '86400', 14:18:55 INFO - 'USER': 'cltbld', 14:18:55 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:18:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:18:55 INFO - '_': '/tools/buildbot/bin/python'} 14:18:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:18:55 INFO - Downloading/unpacking mozsystemmonitor==0.3 14:18:55 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 14:18:55 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 14:18:55 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 14:18:55 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 14:18:56 INFO - Downloading mozsystemmonitor-0.3.tar.gz 14:18:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 14:18:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 14:18:56 INFO - Installing collected packages: mozsystemmonitor 14:18:56 INFO - Running setup.py install for mozsystemmonitor 14:18:56 INFO - Successfully installed mozsystemmonitor 14:18:56 INFO - Cleaning up... 14:18:56 INFO - Return code: 0 14:18:56 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 14:18:56 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')]} 14:18:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:18:56 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')]} 14:18:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:18:56 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:18:56 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 14:18:56 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 14:18:56 INFO - Using env: {'DISPLAY': ':0', 14:18:56 INFO - 'HOME': '/home/cltbld', 14:18:56 INFO - 'LANG': 'en_US.UTF-8', 14:18:56 INFO - 'LANGUAGE': 'en_US:en', 14:18:56 INFO - 'LOGNAME': 'cltbld', 14:18:56 INFO - 'MAIL': '/var/mail/cltbld', 14:18:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:18:56 INFO - 'MOZ_NO_REMOTE': '1', 14:18:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:18:56 INFO - 'NO_EM_RESTART': '1', 14:18:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:18:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:18:56 INFO - 'PWD': '/builds/slave/test', 14:18:56 INFO - 'SHELL': '/bin/bash', 14:18:56 INFO - 'SHLVL': '1', 14:18:56 INFO - 'TERM': 'linux', 14:18:56 INFO - 'TMOUT': '86400', 14:18:56 INFO - 'USER': 'cltbld', 14:18:56 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:18:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:18:56 INFO - '_': '/tools/buildbot/bin/python'} 14:18:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:18:57 INFO - Downloading/unpacking jsonschema==2.5.1 14:18:57 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 14:18:57 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 14:18:57 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 14:18:57 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 14:18:58 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 14:18:58 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 14:18:58 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 14:18:58 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 14:18:58 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 14:18:58 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 14:18:58 INFO - Downloading functools32-3.2.3-2.tar.gz 14:18:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 14:18:58 INFO - warning: no files found matching '*.txt' 14:18:58 INFO - no previously-included directories found matching 'build' 14:18:58 INFO - no previously-included directories found matching 'dist' 14:18:58 INFO - no previously-included directories found matching '.git*' 14:18:58 INFO - Installing collected packages: jsonschema, functools32 14:18:58 INFO - Running setup.py install for functools32 14:18:58 INFO - warning: no files found matching '*.txt' 14:18:58 INFO - no previously-included directories found matching 'build' 14:18:58 INFO - no previously-included directories found matching 'dist' 14:18:58 INFO - no previously-included directories found matching '.git*' 14:18:58 INFO - Successfully installed jsonschema functools32 14:18:58 INFO - Cleaning up... 14:18:58 INFO - Return code: 0 14:18:58 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 14:18:58 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')]} 14:18:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:18:58 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')]} 14:18:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:18:58 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:18:58 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 14:18:58 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 14:18:58 INFO - Using env: {'DISPLAY': ':0', 14:18:58 INFO - 'HOME': '/home/cltbld', 14:18:58 INFO - 'LANG': 'en_US.UTF-8', 14:18:58 INFO - 'LANGUAGE': 'en_US:en', 14:18:58 INFO - 'LOGNAME': 'cltbld', 14:18:58 INFO - 'MAIL': '/var/mail/cltbld', 14:18:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:18:58 INFO - 'MOZ_NO_REMOTE': '1', 14:18:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:18:58 INFO - 'NO_EM_RESTART': '1', 14:18:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:18:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:18:58 INFO - 'PWD': '/builds/slave/test', 14:18:58 INFO - 'SHELL': '/bin/bash', 14:18:58 INFO - 'SHLVL': '1', 14:18:58 INFO - 'TERM': 'linux', 14:18:58 INFO - 'TMOUT': '86400', 14:18:58 INFO - 'USER': 'cltbld', 14:18:58 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:18:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:18:58 INFO - '_': '/tools/buildbot/bin/python'} 14:18:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:18:58 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 14:18:58 INFO - Cleaning up... 14:18:58 INFO - Return code: 0 14:18:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 14:18:58 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')]} 14:18:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:18:58 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')]} 14:18:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:18:58 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:18:58 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 14:18:58 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 14:18:58 INFO - Using env: {'DISPLAY': ':0', 14:18:58 INFO - 'HOME': '/home/cltbld', 14:18:58 INFO - 'LANG': 'en_US.UTF-8', 14:18:58 INFO - 'LANGUAGE': 'en_US:en', 14:18:58 INFO - 'LOGNAME': 'cltbld', 14:18:58 INFO - 'MAIL': '/var/mail/cltbld', 14:18:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:18:58 INFO - 'MOZ_NO_REMOTE': '1', 14:18:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:18:58 INFO - 'NO_EM_RESTART': '1', 14:18:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:18:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:18:58 INFO - 'PWD': '/builds/slave/test', 14:18:58 INFO - 'SHELL': '/bin/bash', 14:18:58 INFO - 'SHLVL': '1', 14:18:58 INFO - 'TERM': 'linux', 14:18:58 INFO - 'TMOUT': '86400', 14:18:58 INFO - 'USER': 'cltbld', 14:18:58 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:18:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:18:58 INFO - '_': '/tools/buildbot/bin/python'} 14:18:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:18:58 INFO - Downloading/unpacking blobuploader==1.2.4 14:18:58 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 14:18:58 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 14:18:58 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 14:18:58 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 14:19:00 INFO - Downloading blobuploader-1.2.4.tar.gz 14:19:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 14:19:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 14:19:00 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 14:19:00 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 14:19:00 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 14:19:00 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 14:19:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 14:19:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 14:19:00 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 14:19:00 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 14:19:00 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 14:19:00 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 14:19:00 INFO - Downloading docopt-0.6.1.tar.gz 14:19:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 14:19:00 INFO - Installing collected packages: blobuploader, requests, docopt 14:19:00 INFO - Running setup.py install for blobuploader 14:19:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 14:19:00 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 14:19:00 INFO - Running setup.py install for requests 14:19:01 INFO - Running setup.py install for docopt 14:19:01 INFO - Successfully installed blobuploader requests docopt 14:19:01 INFO - Cleaning up... 14:19:01 INFO - Return code: 0 14:19:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:19: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')]} 14:19:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:19: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')]} 14:19:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:19:01 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:19:01 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 14:19:01 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 14:19:01 INFO - Using env: {'DISPLAY': ':0', 14:19:01 INFO - 'HOME': '/home/cltbld', 14:19:01 INFO - 'LANG': 'en_US.UTF-8', 14:19:01 INFO - 'LANGUAGE': 'en_US:en', 14:19:01 INFO - 'LOGNAME': 'cltbld', 14:19:01 INFO - 'MAIL': '/var/mail/cltbld', 14:19:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:19:01 INFO - 'MOZ_NO_REMOTE': '1', 14:19:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:19:01 INFO - 'NO_EM_RESTART': '1', 14:19:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:19:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:19:01 INFO - 'PWD': '/builds/slave/test', 14:19:01 INFO - 'SHELL': '/bin/bash', 14:19:01 INFO - 'SHLVL': '1', 14:19:01 INFO - 'TERM': 'linux', 14:19:01 INFO - 'TMOUT': '86400', 14:19:01 INFO - 'USER': 'cltbld', 14:19:01 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:19:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:19:01 INFO - '_': '/tools/buildbot/bin/python'} 14:19:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:19:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:19:01 INFO - Running setup.py (path:/tmp/pip-1RFzug-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:19:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:19:01 INFO - Running setup.py (path:/tmp/pip-YpWmtm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:19:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:19:01 INFO - Running setup.py (path:/tmp/pip-hj7dSs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:19:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:19:01 INFO - Running setup.py (path:/tmp/pip-ziOYaO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:19:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:19:01 INFO - Running setup.py (path:/tmp/pip-S5mWMb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:19:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:19:01 INFO - Running setup.py (path:/tmp/pip-uUlddU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:19:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:19:01 INFO - Running setup.py (path:/tmp/pip-4IkFpa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:19:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:19:01 INFO - Running setup.py (path:/tmp/pip-9jEJfL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:19:02 INFO - Running setup.py (path:/tmp/pip-8SUFGF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:19:02 INFO - Running setup.py (path:/tmp/pip-dRuI7d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:19:02 INFO - Running setup.py (path:/tmp/pip-EYQDfL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:19:02 INFO - Running setup.py (path:/tmp/pip-sTZsBq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:19:02 INFO - Running setup.py (path:/tmp/pip-9XMQyN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:19:02 INFO - Running setup.py (path:/tmp/pip-yc2j3y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:19:02 INFO - Running setup.py (path:/tmp/pip-ig7SHT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:19:02 INFO - Running setup.py (path:/tmp/pip-F90Vz4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:19:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:19:02 INFO - Running setup.py (path:/tmp/pip-ZyZO4_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:19:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 14:19:02 INFO - Running setup.py install for manifestparser 14:19:02 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 14:19:02 INFO - Running setup.py install for mozcrash 14:19:02 INFO - Running setup.py install for mozdebug 14:19:02 INFO - Running setup.py install for mozdevice 14:19:03 INFO - Installing dm script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Running setup.py install for mozfile 14:19:03 INFO - Running setup.py install for mozhttpd 14:19:03 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Running setup.py install for mozinfo 14:19:03 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Running setup.py install for mozInstall 14:19:03 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Running setup.py install for mozleak 14:19:03 INFO - Running setup.py install for mozlog 14:19:03 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Running setup.py install for moznetwork 14:19:03 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 14:19:03 INFO - Running setup.py install for mozprocess 14:19:03 INFO - Running setup.py install for mozprofile 14:19:04 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 14:19:04 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 14:19:04 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 14:19:04 INFO - Running setup.py install for mozrunner 14:19:04 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 14:19:04 INFO - Running setup.py install for mozscreenshot 14:19:04 INFO - Running setup.py install for moztest 14:19:04 INFO - Running setup.py install for mozversion 14:19:04 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 14:19:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 14:19:04 INFO - Cleaning up... 14:19:04 INFO - Return code: 0 14:19:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:19:04 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')]} 14:19:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:19:04 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')]} 14:19:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:19:04 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:19:04 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 14:19:04 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 14:19:04 INFO - Using env: {'DISPLAY': ':0', 14:19:04 INFO - 'HOME': '/home/cltbld', 14:19:04 INFO - 'LANG': 'en_US.UTF-8', 14:19:04 INFO - 'LANGUAGE': 'en_US:en', 14:19:04 INFO - 'LOGNAME': 'cltbld', 14:19:04 INFO - 'MAIL': '/var/mail/cltbld', 14:19:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:19:04 INFO - 'MOZ_NO_REMOTE': '1', 14:19:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:19:04 INFO - 'NO_EM_RESTART': '1', 14:19:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:19:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:19:04 INFO - 'PWD': '/builds/slave/test', 14:19:04 INFO - 'SHELL': '/bin/bash', 14:19:04 INFO - 'SHLVL': '1', 14:19:04 INFO - 'TERM': 'linux', 14:19:04 INFO - 'TMOUT': '86400', 14:19:04 INFO - 'USER': 'cltbld', 14:19:04 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:19:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:19:04 INFO - '_': '/tools/buildbot/bin/python'} 14:19:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:19:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:19:04 INFO - Running setup.py (path:/tmp/pip-KFPWDq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:19:04 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)) 14:19:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:19:04 INFO - Running setup.py (path:/tmp/pip-EgN_cB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:19:04 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)) 14:19:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:19:04 INFO - Running setup.py (path:/tmp/pip-T5ohLN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:19:04 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)) 14:19:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:19:04 INFO - Running setup.py (path:/tmp/pip-D1zVQI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:19:04 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)) 14:19:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:19:04 INFO - Running setup.py (path:/tmp/pip-La5dny-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:19:05 INFO - Running setup.py (path:/tmp/pip-5ZcuM0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:19:05 INFO - Running setup.py (path:/tmp/pip-mwW0T3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:19:05 INFO - Running setup.py (path:/tmp/pip-zs6TWC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:19:05 INFO - Running setup.py (path:/tmp/pip-MsZx1Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:19:05 INFO - Running setup.py (path:/tmp/pip-Qe8DPb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:19:05 INFO - Running setup.py (path:/tmp/pip-iX8dfp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:19:05 INFO - Running setup.py (path:/tmp/pip-13DwFq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:19:05 INFO - Running setup.py (path:/tmp/pip-zk39RT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:19:05 INFO - Running setup.py (path:/tmp/pip-0QtSBe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:19:05 INFO - Running setup.py (path:/tmp/pip-EquQ8Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:19:05 INFO - Running setup.py (path:/tmp/pip-J31KRH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:19:05 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)) 14:19:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:19:05 INFO - Running setup.py (path:/tmp/pip-vlpPvO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:19:05 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)) 14:19:05 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)) 14:19:05 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)) 14:19:05 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)) 14:19:05 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)) 14:19:05 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)) 14:19:05 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 14:19:05 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 14:19:05 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 14:19:05 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 14:19:05 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 14:19:06 INFO - Downloading blessings-1.6.tar.gz 14:19:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 14:19:07 INFO - Installing collected packages: blessings 14:19:07 INFO - Running setup.py install for blessings 14:19:07 INFO - Successfully installed blessings 14:19:07 INFO - Cleaning up... 14:19:07 INFO - Return code: 0 14:19:07 INFO - Done creating virtualenv /builds/slave/test/build/venv. 14:19:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:19:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:19:07 INFO - Reading from file tmpfile_stdout 14:19:07 INFO - Current package versions: 14:19:07 INFO - argparse == 1.2.1 14:19:07 INFO - blessings == 1.6 14:19:07 INFO - blobuploader == 1.2.4 14:19:07 INFO - docopt == 0.6.1 14:19:07 INFO - functools32 == 3.2.3-2 14:19:07 INFO - jsonschema == 2.5.1 14:19:07 INFO - manifestparser == 1.1 14:19:07 INFO - mozInstall == 1.12 14:19:07 INFO - mozcrash == 1.0 14:19:07 INFO - mozdebug == 0.1 14:19:07 INFO - mozdevice == 0.51 14:19:07 INFO - mozfile == 1.2 14:19:07 INFO - mozhttpd == 0.7 14:19:07 INFO - mozinfo == 0.9 14:19:07 INFO - mozleak == 0.1 14:19:07 INFO - mozlog == 3.4 14:19:07 INFO - moznetwork == 0.27 14:19:07 INFO - mozprocess == 0.25 14:19:07 INFO - mozprofile == 0.28 14:19:07 INFO - mozrunner == 6.13 14:19:07 INFO - mozscreenshot == 0.1 14:19:07 INFO - mozsystemmonitor == 0.3 14:19:07 INFO - moztest == 0.8 14:19:07 INFO - mozversion == 1.4 14:19:07 INFO - psutil == 3.1.1 14:19:07 INFO - requests == 1.2.3 14:19:07 INFO - wsgiref == 0.1.2 14:19:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:19:07 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')]} 14:19:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:19:07 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')]} 14:19:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:19:07 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:19:07 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 14:19:07 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 14:19:07 INFO - Using env: {'DISPLAY': ':0', 14:19:07 INFO - 'HOME': '/home/cltbld', 14:19:07 INFO - 'LANG': 'en_US.UTF-8', 14:19:07 INFO - 'LANGUAGE': 'en_US:en', 14:19:07 INFO - 'LOGNAME': 'cltbld', 14:19:07 INFO - 'MAIL': '/var/mail/cltbld', 14:19:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:19:07 INFO - 'MOZ_NO_REMOTE': '1', 14:19:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:19:07 INFO - 'NO_EM_RESTART': '1', 14:19:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:19:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:19:07 INFO - 'PWD': '/builds/slave/test', 14:19:07 INFO - 'SHELL': '/bin/bash', 14:19:07 INFO - 'SHLVL': '1', 14:19:07 INFO - 'TERM': 'linux', 14:19:07 INFO - 'TMOUT': '86400', 14:19:07 INFO - 'USER': 'cltbld', 14:19:07 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:19:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:19:07 INFO - '_': '/tools/buildbot/bin/python'} 14:19:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:19:07 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)) 14:19:07 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)) 14:19:07 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)) 14:19:07 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)) 14:19:07 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)) 14:19:07 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)) 14:19:07 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)) 14:19:07 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)) 14:19:07 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)) 14:19:07 INFO - Downloading/unpacking marionette-driver>=1.4.0 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 14:19: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 14:19: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 14:19: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 14:19: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 14:19:08 INFO - Downloading marionette_driver-1.4.0.tar.gz 14:19:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/marionette-driver/setup.py) egg_info for package marionette-driver 14:19:08 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)) 14:19:08 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)) 14:19:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner>=6.9 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 14:19:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice>=0.37 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozrunner>=6.9->marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 14:19:08 INFO - Installing collected packages: marionette-driver 14:19:08 INFO - Running setup.py install for marionette-driver 14:19:08 INFO - Successfully installed marionette-driver 14:19:08 INFO - Cleaning up... 14:19:09 INFO - Return code: 0 14:19:09 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 14:19:09 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')]} 14:19:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:19:09 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')]} 14:19:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:19:09 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 0x188f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c025c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, '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': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', '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 14:19:09 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 14:19:09 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 14:19:09 INFO - Using env: {'DISPLAY': ':0', 14:19:09 INFO - 'HOME': '/home/cltbld', 14:19:09 INFO - 'LANG': 'en_US.UTF-8', 14:19:09 INFO - 'LANGUAGE': 'en_US:en', 14:19:09 INFO - 'LOGNAME': 'cltbld', 14:19:09 INFO - 'MAIL': '/var/mail/cltbld', 14:19:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:19:09 INFO - 'MOZ_NO_REMOTE': '1', 14:19:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:19:09 INFO - 'NO_EM_RESTART': '1', 14:19:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:19:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:19:09 INFO - 'PWD': '/builds/slave/test', 14:19:09 INFO - 'SHELL': '/bin/bash', 14:19:09 INFO - 'SHLVL': '1', 14:19:09 INFO - 'TERM': 'linux', 14:19:09 INFO - 'TMOUT': '86400', 14:19:09 INFO - 'USER': 'cltbld', 14:19:09 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:19:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:19:09 INFO - '_': '/tools/buildbot/bin/python'} 14:19:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:19:09 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 14:19:09 INFO - Cleaning up... 14:19:09 INFO - Return code: 0 14:19:09 INFO - Running post-action listener: _resource_record_post_action 14:19:09 INFO - Running post-action listener: _start_resource_monitoring 14:19:09 INFO - Starting resource monitoring. 14:19:09 INFO - [mozharness: 2017-05-25 21:19:09.254224Z] Finished create-virtualenv step (success) 14:19:09 INFO - [mozharness: 2017-05-25 21:19:09.254687Z] Running install step. 14:19:09 INFO - Running pre-action listener: _resource_record_pre_action 14:19:09 INFO - Running main action method: install 14:19:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:19:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:19:09 INFO - Reading from file tmpfile_stdout 14:19:09 INFO - Detecting whether we're running mozinstall >=1.0... 14:19:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 14:19:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 14:19:09 INFO - Reading from file tmpfile_stdout 14:19:09 INFO - Output received: 14:19:09 INFO - Usage: mozinstall [options] installer 14:19:09 INFO - Options: 14:19:09 INFO - -h, --help show this help message and exit 14:19:09 INFO - -d DEST, --destination=DEST 14:19:09 INFO - Directory to install application into. [default: 14:19:09 INFO - "/builds/slave/test"] 14:19:09 INFO - --app=APP Application being installed. [default: firefox] 14:19:09 INFO - mkdir: /builds/slave/test/build/application 14:19:09 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'] 14:19:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 14:19:26 INFO - Reading from file tmpfile_stdout 14:19:26 INFO - Output received: 14:19:26 INFO - /builds/slave/test/build/application/firefox/firefox 14:19:26 INFO - Running post-action listener: _resource_record_post_action 14:19:26 INFO - [mozharness: 2017-05-25 21:19:26.055632Z] Finished install step (success) 14:19:26 INFO - [mozharness: 2017-05-25 21:19:26.055915Z] Running run-tests step. 14:19:26 INFO - Running pre-action listener: _resource_record_pre_action 14:19:26 INFO - Running main action method: run_tests 14:19:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 14:19:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 14:19:26 INFO - Python 2.7.3 14:19:26 INFO - Return code: 0 14:19:26 INFO - grabbing minidump binary from tooltool 14:19:26 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')]} 14:19:26 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 0x1bff7a0>, '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 0x1c006a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c00b30>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 14:19:26 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 14:19:26 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 14:19:26 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 14:19:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 14:19:26 INFO - Return code: 0 14:19:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 14:19:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 14:19:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 14:19:26 INFO - ENV: RUST_BACKTRACE is now 1 14:19:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 14:19:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 14:19:26 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/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-009', '--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 14:19:26 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/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-009 --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 14:19:26 INFO - Using env: {'DISPLAY': ':0', 14:19:26 INFO - 'HOME': '/home/cltbld', 14:19:26 INFO - 'LANG': 'en_US.UTF-8', 14:19:26 INFO - 'LANGUAGE': 'en_US:en', 14:19:26 INFO - 'LOGNAME': 'cltbld', 14:19:26 INFO - 'MAIL': '/var/mail/cltbld', 14:19:26 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 14:19:26 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 14:19:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:19:26 INFO - 'MOZ_NO_REMOTE': '1', 14:19:26 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 14:19:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:19:26 INFO - 'NO_EM_RESTART': '1', 14:19:26 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:19:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:19:26 INFO - 'PWD': '/builds/slave/test', 14:19:26 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 14:19:26 INFO - 'RUST_BACKTRACE': '1', 14:19:26 INFO - 'SHELL': '/bin/bash', 14:19:26 INFO - 'SHLVL': '1', 14:19:26 INFO - 'TERM': 'linux', 14:19:26 INFO - 'TMOUT': '86400', 14:19:26 INFO - 'USER': 'cltbld', 14:19:26 INFO - 'XDG_SESSION_COOKIE': '17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518', 14:19:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:19:26 INFO - '_': '/tools/buildbot/bin/python'} 14:19:26 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/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-009', '--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 14:19:26 INFO - mozversion application_buildid: 20170525203424 14:19:26 INFO - mozversion application_changeset: 55e5723b1e62190a38c00927eda796e2ad14778f 14:19:26 INFO - mozversion application_display_name: Nightly 14:19:26 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 14:19:26 INFO - mozversion application_name: Firefox 14:19:26 INFO - mozversion application_remotingname: firefox 14:19:26 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 14:19:26 INFO - mozversion application_vendor: Mozilla 14:19:26 INFO - mozversion application_version: 55.0a1 14:19:26 INFO - mozversion platform_buildid: 20170525203424 14:19:26 INFO - mozversion platform_changeset: 55e5723b1e62190a38c00927eda796e2ad14778f 14:19:26 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 14:19:26 INFO - mozversion platform_version: 55.0a1 14:19:26 INFO - using testdate: 1495747166 14:19:26 INFO - actual date: 1495747166 14:19:26 INFO - starting webserver on 'localhost:52088' 14:19:26 INFO - SUITE-START | Running 2 tests 14:19:26 INFO - TEST-START | dromaeo_css 14:19:26 INFO - operating with platform_type : linux_ 14:19:26 INFO - Initialising browser for dromaeo_css test... 14:19:26 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:52088/getInfo.html -profile /tmp/tmpS2TmM1/profile 14:19:26 INFO - TEST-INFO | started process 10030 (/builds/slave/test/build/application/firefox/firefox http://localhost:52088/getInfo.html) 14:20:01 INFO - TEST-INFO | 10030: killed by SIGTERM 14:20:01 INFO - Browser initialized. 14:20:01 INFO - Running cycle 1/1 for dromaeo_css test... 14:20:01 INFO - TEST-INFO | started process 10252 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS2TmM1/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:20:13 INFO - PID 10252 | RSS: Main: 172257280 14:20:13 INFO - PID 10252 | 14:23:18 INFO - PID 10252 | Cycle 1(1): loaded http://localhost:52088/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52088/tests/dromaeo/cssquery-ext.html) 14:23:19 INFO - PID 10252 | RSS: Main: 169545728 14:23:19 INFO - PID 10252 | 14:26:21 INFO - PID 10252 | Cycle 1(1): loaded http://localhost:52088/tests/dromaeo/cssquery-ext.html (next: http://localhost:52088/tests/dromaeo/cssquery-jquery.html) 14:26:22 INFO - PID 10252 | RSS: Main: 175824896 14:26:22 INFO - PID 10252 | 14:29:24 INFO - PID 10252 | Cycle 1(1): loaded http://localhost:52088/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52088/tests/dromaeo/cssquery-mootools.html) 14:29:24 INFO - PID 10252 | RSS: Main: 173846528 14:29:24 INFO - PID 10252 | 14:32:26 INFO - PID 10252 | Cycle 1(1): loaded http://localhost:52088/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52088/tests/dromaeo/cssquery-prototype.html) 14:32:27 INFO - PID 10252 | RSS: Main: 177688576 14:32:27 INFO - PID 10252 | 14:35:30 INFO - PID 10252 | Cycle 1(1): loaded http://localhost:52088/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52088/tests/dromaeo/cssquery-yui.html) 14:35:30 INFO - PID 10252 | RSS: Main: 177180672 14:35:30 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | Cycle 1(1): loaded http://localhost:52088/tests/dromaeo/cssquery-yui.html (next: http://localhost:52088/tests/dromaeo/cssquery-dojo.html) 14:38:32 INFO - PID 10252 | RSS: Main: 173973504 14:38:32 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | __start_tp_report 14:38:32 INFO - PID 10252 | _x_x_mozilla_page_load 14:38:32 INFO - PID 10252 | _x_x_mozilla_page_load_details 14:38:32 INFO - PID 10252 | |i|pagename|runs| 14:38:32 INFO - PID 10252 | |0;dojo.html;2727.3999720061584;2736;2755.366265758875;2758.117402431222;2766.502029634666;5118.846434606959;5260.947390526088;5271.604629652777;5297.735113244342;5315.574754019679;5115.923261151086;5130.102232109384;5223.608229382792;5343.385510666275;5374.167004114369;4665.4168228971375;4695.3191787190835;4747.691400059002;4767.880802979936;4784.90430191396;4571.748553829538;4729.550692684206;4733.976330118345;4750.477447480775;4779.498152693952;4605.263157894721;4702.27114797207;4722.952770472286;4768.690035147722;4768.785404656782;4596.965682721394;4616.722996620214;4626.976865115653;4722;4723.126221648971;4664.463586687541;4670.089332580148;4692.671512994092;4693.272542755878;4710.599599034086;5223.242629818693;5224.242484839677;5236.266922630796;5265.815696450606;5282.418933917266;5544.528715059225;5650.5479561634975;5679.318481782171;5771.538276937877;5789.392113828029;5739.569532285053;5740;5744.109663002199;5754.913676294859;5801;5277.498637629457;5319.468053194727;5320.600954928396;5327.893442131136;5329.680219186861;5720.456556627114;5793.913091303634;5819.88360232793;5876.559258055663;5931.288245410578;5530.640508366943;5552.3892371839065;5562.749676264578;5565.582581306418;5645.80239691617;5701.486866182064;5722.971385143131;5728.169415434739;5728.77084916607;5732.111522713986;5571.888562228733;5670.659760414306;5682;5691.03252447085;5691.857703557362;5543.36251331094;5579.995600791815;5631.831045068655;5665.150227465913;5682.062459694187;4745;4760.45254795696;4770.189067858403;4779.996200797871;4813.3983252093485;4080.897977550585;4093.406456063854;4100.425940368351;4122.670186385082;4138.79306034697;4699.906001879944;4705.529447055335;4760.09558183944;4768;4800.903981920412;5682.602217844711;5733.741981610838;5743.62666426681;5790.94209057904;5794.246747922743;4796.112719146969;4801.51984801517;4814.542618451242;4817.205161148371;4843.878903027382;4942.555170034714;5012.774425150877;5039.84880453587;5047.520485553867;5051.823186188466;5244.029854476934;5325.961437519646;5329.307190065267;5333.866653333697;5349.866253343542;5573.080441727232;5713.657180569179;5737.254156959569;5741.91387129185;5755.53955683536;5214.426413094632;5236.423993360651;5244.580433565229;5248.317718696545;5258.132408152612;5430.67415955044;5598.440155984369;5601.215829783752;5605.439456054362;5611.270534830446;5760.913586296125;5771.538276937918;5801.796937107181;5821.039528477754;5838.065909454467;5465.808696695596;5585.2180694701965;5589.972050139723;5596.356419011703;5602;5491.945080549303;5504.504594586507;5534.612577119563;5580.497755202051;5581.7209139543675;5492.752826122914;5514.36584792754;5523.1991361253195;5525.613207075467;5526.949879522877;5501.697406642673;5608.579356548356;5622.297212848394;5626.746796394254;5631.155326701028;5325.041492531382;5404.270423492935;5414.756335964812;5485.286912701324;5491.066518691752 14:38:32 INFO - PID 10252 | |1;ext.html;680.2415306932771;718.6227230703881;739.7743688175107;1039.3711804358368;1048.5700862646318;31807.204819879487;32664.183395415097;32716.83641581789;32722.345553088922;32782.508262376025;33943.321133577374;34270.82864585674;34295.485567716445;34370;34429.65570344296;6359.8092057238355;6415.679216039202;6826.214985276694;6952.652367381636;6955.374016338528;6573.769918052869;6744.730210791562;6744.763933262337;6746.730130794786;6762.594244345355;6719.260881303053;6806.285340039299;6809.761658341959;6810.557313774589;6824.4199243064395;6710;6737.292584278629;6762.695678694446;6765.05289259504;6794.0827988221945;6660.400563949268;6717.6977036033495;6720.83197920051;6731.899021514681;6733.528652994292;30700.2324941876;31044.223894402596;31085.844570777;31114;31219.84390078035;3012.9849350753325;3050.6186726659166;3052.526858336961;3054.541818727209;3057;23599;23794.76205237943;23816.28551143451;23823.761762382328;23863.52272954531;3051.5117581186905;3081.091078131934;3083.491223948046;3087.5986121804244;3130.2800355918266;145022;145853;148025;151171.9999999989;152854;38899;38998.80500597479;39008.804955975036;39063.609363906566;39070.41394379087;40387.19225615471;40543.39184912229;40605;40778.79610601987;40833.387499187535;11679.299242045505;11766.705832354088;11768.764624707457;11806.40967951599;11846.585369512199;9376.812463750686;9386.577604007836;9387.483688397204;9390.67132650354;9391.812163756687;12130.211536250115;12133.635990920286;12161.817572736416;12217.694557635952;12236.143469957196;5130.461301563357;5164.380274367025;5197.1684530475695;5311.893762124736;5335.599830012765;862.3618522293458;904.6924045824451;908.5230254116642;914.0049628778756;939.084392717109;20019.499512512302;20641;20694.379168624964;20864.791352086588;21140.47148821292;988.8615593816871;992.4640694025146;992.806402751471;993.5429702336861;1012.3824467075078;10787.244892857425;10856.34861908288;11180.91268472843;11190.38452885083;11282;175667;176703;177470.11264943593;177580;177765;39371.40942885859;39419.80290098531;39574.406383904265;39646.801765991564;39685.60314396819;1169.3682095695126;1227.9324637145044;1231.956881509143;1234.2594443333749;1245.8131280308025;19157.521061973563;19828.90085549563;20288.492787680425;20534.281300154424;20721.481962951046;28493.430131397672;28600.570991434728;28756.137315880558;28823.279418014718;28834;148951;149770;149787;149791;149914.25042874715;27887.860560697878;28173.154805355873;29190.27024324409;29612.259693507836;30096.69903300939;35177.64822351744;35828.283434330646;36010.819945900104;36050.27899441944;36683.63316366802;27166.72833271642;27613.171604851887;27927.720722793325;27929.860350698116;28322.433551328446;26713.465730685668;27025.59461608038;27314.317142071606;27848.025319113734;28738.85630571834;29539;30421.543676844423;30672.693273066983;30736.077917662507;30862.382752345275;26393;26694.19917402481;26964;27074;27868.442631147667;21127.366179014654;22121;22242.443938901655;22390.552188955804;22494.887525562266 14:38:32 INFO - PID 10252 | |2;jquery.html;409.38796499233666;414.2274657763269;426.8122026308424;435.8627032484767;436.8187202311041;11908.940455297712;16502.25739841707;17218.3112675493;17240.999999999985;17943.910280448614;18395.632087358244;18512.629747405044;18516.0741962902;18641.627167456678;18661.34685286015;5237.3715154181555;5390.730463476821;5582.302212223472;5596.3284405871145;5605.943940560604;5364.034473794715;5410.296661434028;5421.83734487966;5422.2951016367815;5457.536109430684;5327.401779466164;5396.271503347057;5399.325084364455;5399.514043736063;5401.513863752261;5426.457354264562;5478.863028424321;5483.479069488392;5503.449655034505;5516.227728118067;4896.828610998634;4941.802327906879;4956.752162391902;4981.178105612606;4992.625553083497;21166.259180928595;21656.24203152898;21893;22059.889700551554;22077.558448831092;1639.9262033208533;1665.3172199398189;1672.0720000399774;1678.4461127827788;1682.2850288627285;14381.137131772128;14436.278186090758;14486.565403037926;14915.105093694305;14926.925365373212;1980.821726044663;2013.9395818125479;2045.6829191475197;2054.260466232155;2055.969160462594;86190.56904715499;88658;92941;94729.52635236848;97634;10851.67444976652;11014.118870490342;11087.889121108685;11090.722731931766;11099.77902430732;15026.398944042334;15560.922195389177;15584.688306233811;15596.688066238612;15598.220088995506;7931.682732690743;7975.162607926084;8072.798180045545;8104.311133553596;8139.226773456512;7337;7421.962890185622;7423.665935032936;7563.600733864143;7654.349380302625;6873.312668733087;6876.965615171892;6880.621565813928;7017.824554386079;7018.75434359795;1917.9904100479687;1931.671615825313;1935.951601209981;1953.1601411392953;2070.6893965905233;842.6966292134827;883.5449743382163;892.433304851424;898.5237823953315;913.8949020862553;16686.83313166853;16876.409325673543;16883.24025418859;16927.238274277686;17627.206775695126;874.9125087491327;881.3345923827469;886.5301390263171;893.0890491698431;901.2519608724742;9072.228860546928;9183.90816091844;10701.197410194267;11802.763944721057;11862.110341724232;376412;393854;398617;403490;404160;77893.61053194698;78123.60938195387;80720;81786.59106704428;81849.59075204586;993.1707024634367;1026.4457193115634;1042.926995110335;1042.968710938673;1099.8570185875785;16810.495685129466;16899.66200676004;17668.469945901645;17690.734638980684;17699.469015929542;39296.80351598224;40346;40503.59496405116;40718;40897.38653920253;51024;52098.21852672137;52171.47828521666;52210.21684674809;53900.92198155937;8194.959025204837;8231.753047408587;8451.704190353308;8490.386826502945;8496.490210587384;11881.801866654696;12195.329256890602;12752.87247127554;13027.609171724484;13277.468901243841;10380.792384152124;10534.94732526363;10649.733756655836;11040.613578524713;11618.6514404568;9808.754781130243;9971.800563988825;10044.748881278027;10069.546870390997;10179.38923664553;10222.795544088927;10348.689539313833;10463.424511651932;11394.829077563678;11659.825102623297;8104.351651867954;8203.958980205061;8220.63007164667;8285;8425.873611895704;10923.672289831318;10993.945030274797;11120;11275.379854108103;11563.6530904073 14:38:32 INFO - PID 10252 | |3;mootools.html;1234.771567260057;1287.639460950934;1293.3533233383303;1294.2881415221625;1301.2842936384989;10514.21143414244;10687.145028397728;11054.115670746341;11063.612773552928;11135.164862635294;10904.563817447312;10992.120630349573;11011.559537618487;11087.057600104;11099.112071034318;2234.8770817604986;2277.52172043871;2281.041962375798;2298.712660917385;2300.482391461916;2202.922897698581;2240.8879556022216;2242.990654205606;2243.080337061805;2246.067881829047;1998.4404366777326;2013.7180794688682;2017.3342796877068;2028.381343690174;2031.2890488329115;2110.746710394747;2120.109553987329;2124.957500849982;2129.7018417421573;2131.5843410534953;1895.0619443375617;1985.4143027806688;2061.9484512887148;2123.5115923337717;2171.392010237136;10561.471926403648;10651.25441219115;10666;10675.41285229312;10676.252662313642;5635.154726790973;5854.47309742121;5878;5882.6764527950945;5898.174255604219;3275.132089996153;3378.2905589826164;3459.775114617542;3486.4247399179103;3489.668481494254;1162.4536467860091;1163.5345861655405;1166.8424762657019;1183.0417361936773;1191.4281145050425;15723.292451839694;15872;15894.284757185838;15904.125273109974;15930.442434514736;4730.219513780256;4801.663883528119;4955.8017679292425;4980.850574482772;5025.346704928336;11081.27971681838;11125.499352529156;11171.106311495061;11180.832287515694;11220.887791122148;5549.500544950974;5679.545636349165;5688.573356998241;5727.8854422912145;5740.512056475246;5265.868353291198;5320.441353657888;5334.91997620036;5337.172738225581;5392.4607539246545;3831.942520862189;3902.7658340499092;3914.8434062637743;3971.001893570336;4016.0763024504527;1118.8209886418133;1142.9371384573928;1144.9370284634258;1162.002034750342;1172.2556176827604;669.521292276025;704.2886684448744;708.2068083746237;715.0347031507423;722.241646271413;5437.8368648940595;5575.8884822304135;5578.442155784389;5607.719614019283;5639.097744360883;537.5350321971466;554.4510934175138;565.7708628005664;566.125336355332;566.4081035318103;3639.1448009717697;3699.7595156314756;3743.8502459901297;4022.738521996061;4274.444322238089;13556.59330220095;13823.654408639864;14117.43530258778;14123.78814317786;14164.929175354056;13778.724425511635;13809.093134927914;13830.170189788645;13903.721925561635;14134.222617756122;7790.376769858511;7974.401919855918;7991.640376183086;7992.560409177551;8005.959970200228;6087.604305720114;6240.7503699851495;6259.061140828912;6267.2165979252595;6342.651154186564;12392.75214495723;12489.562865299671;12522.311272880079;12708.491660333853;12753.171043882117;12819.923218427697;12947.741045179233;12953.805692914426;13082.411291492095;13153.53962611304;7776.988991431078;7878.094019187867;7890.171531989058;7890.763277101696;7919.802004949923;9766.316357854881;10019.849702254618;10101.69694909154;10109.49452527356;10124.59501619927;8075.515469071875;8200.794980125545;8242.670293188205;8330.958345208235;8362.790930226793;7949.165337639696;8058.758237252891;8062.879056814035;8074.798130046795;8132.634031468479;7487.475876688797;7732.265434783687;7811.218878112143;7823.647935842787;7858.882116768139;5020.272060551272;5465.672059676433;5528.419515950767;5546.168074788814;5566.359868615161;5508.173773933942;5518.420565840529;5574.386817449996;5607;5658.547316214611 14:38:32 INFO - PID 10252 | |4;prototype.html;349.5089399393851;366.1468777747848;366.9284489524544;376.60268416820253;379.9012256813228;5307.469253074691;5524.751386187621;5532.944670553294;5534.363548191959;5552.361478429977;5292.259083728281;5366.255966810782;5370.5435038021715;5384.1923711443305;5385.78456861726;4074.4906886639096;4084.7344922579937;4085.83656653735;4099.528554216274;4116.444280022203;3926.528816542019;4100.261952848486;4106.1992911382295;4107.424960505532;4119.485064366954;4072.7149099563044;4072.8778136655947;4076.082881351702;4077.8164982575854;4090.6522945549664;4039.858604948842;4055.1889622075555;4060.127072679388;4062.1469491406842;4065.654419374342;3520.348735483918;3538.8938331849827;3547.0954906498937;3557.288542291552;3557.8932632021083;5191.299174611417;5262.289590905217;5267.051930652481;5277.920831187535;5310.734463276859;4768.332433459318;4771.4512831024185;4781.665283430161;4784.067106914154;4799.904001919942;5573.27547418837;5700;5715.485606295453;5719.97040532704;5741.138829175616;3928.292907276689;3960.8019599019935;3986.960130398717;3991.9221810111108;3994.1013272013856;5839.503642190419;6033.396660333975;6048.123022161806;6076.574639775217;6087.239095113111;3979.2837289288204;3980.9402858957137;3999.9800000999808;4003.199360127986;4010.057636455431;4046.109855831712;4046.9275641954905;4048.8785336439955;4055.2295063938345;4058.894945366797;4663.976680116645;4666.393368862026;4683.016566521069;4714;4721.220998535272;5744.4829965303325;5764.241906218644;5782.508486778671;5785.768569257267;5796.362400135981;1415.476273778688;1429.9142051476945;1431.2986636548017;1434.1395162902174;1435.2464955898238;914.5792935249726;959.6689142245914;970.6408628807386;973.9870534643891;975.5463709375033;4991.47589503097;5005.324281221989;5006.52438018395;5006.74966251686;5010.599152067826;5914.822555323347;5927.911081333784;5938.248216776062;5958.901371286906;5975.014122669798;4810.158222311152;4888.60891128716;4937.802487900515;4952.62855285855;4961.330220420269;3091;3124.8906638143585;3134.905952821419;3136.40408322418;3149.346593038673;5442.292501974718;5455.8363249102595;5459.580509067671;5464.398916119224;5476.397596264408;5826.41735826414;6022.126791615279;6038.245219347582;6100.633961962208;6107.8473038173515;5490.835274941758;5492.5331346835965;5497.39528651848;5500.779968801203;5523.171524271311;5755.45319197829;5894.174815525916;5913.852153696192;5925.407459254213;5968.910466343095;5829.417058294137;5832.24180856486;5834.27071616048;5835.824925252249;5848.824535263949;5295.338082739658;5458.2904222450825;5480.6437581557075;5487.5884308677805;5505.724713764376;4039.8990025249605;4048.9797551012057;4074.286999774968;4079.6736261099636;4101.8974525637095;5850.765969361178;5971.984762590457;5982.102684597346;5988.101784732325;5992.543057346467;5711.343710323959;5723.399043100415;5778.537716982547;5785.27684039495;5787.334456537384;5735.627184233012;5741.712914354349;5762.394948530344;5763.884722305615;5805.242509807807;5641.971790141023;5677.233573467529;5695.835582478631;5704.458076482728;5709.771609135588;5752.884942301047;5784.884302314014;5791.739371728198;5792.7103644818435;5825.94174058254;5447.863803404946;5550.167474878639;5597.384287728428;5626.943730562642;5637.633553818989 14:38:32 INFO - PID 10252 | |5;yui.html;743.2864450127878;745.4595418321715;765.1392183793237;777.7861088200744;781.4295564238105;11811.409429528532;12464.314462704548;13122.737545249101;14073.225972571505;14169.71660566788;14225.217613031278;14835.406583736638;14840.25798710063;15167.924160379183;15175.317110730017;868.5006121480159;883.4346018548134;883.5493898111977;884.5621417398397;887.3699673232013;890.875277461156;892.5314210039717;892.8437523433406;893.1515060692336;893.7006102955518;909.7179874238974;913.8674892140668;919.0350132361027;919.7884486568094;921.2814005076051;886.9113088691112;921.3412410126758;930.7207837648679;942.9717108486757;947.8767760191131;680.7038938061959;683.3883674111692;684.4626967830279;686;688.686647575352;13604.455821767118;13656.112352697042;13738.175709457464;13752.587422377344;13809.309534523234;15163.241837908061;16233.83766162335;16524;16594.75107873383;16766.413175538797;12581.433835477334;12630.115891887572;12838.550650727273;12896.87103128966;13017.958563314913;3061.6938306169427;3094.675059118805;3096.349766549027;3097.334073174256;3099.550565168038;84509.57745211296;85629.57185214035;86121;86345;87179.56410217908;12779.936100319439;12859.357032148355;12875.163114397534;13174.670633234246;13215.66960825987;23447.296581102593;23724.881375593355;23808.761912381;23993.640095398583;23999.7600024001;5988.28140623128;6044.969775151184;6058.12157237207;6062.666553339609;6096.993995990611;2752.779777617786;2821.971780282212;2823.7599804016477;2826.4771017361854;2826.943461130766;3775.7356985011334;3834.5206849143856;3834.8082595870096;3845.5000849889893;3887.37801951692;773.9806504837425;788.9763307100797;789.9802504937308;797.5613412623034;835.0480452284401;583.9270091238595;603.4810063345519;622.8909940760349;629.5876201088295;634.2104080419815;9758.219342452587;9977.750556236007;10589.735256618493;11075.72310692239;11077.778444431066;606.1090197409801;620.7641096383436;626.2985456288985;627.97802076928;635.6408629124622;4721.811127554928;4729.361536192639;4773.880652983703;4919.77860996256;4937.333459982929;79125;80461;81118;81914.59042704868;84397.45031871017;74737;75871.24128758752;78025;78690;79988.60005699935;66196.00705989414;66349.6682516594;66411.33588664148;66925.66537167283;68596;9260;9869.605215791287;9949.452780097165;9968.202543796333;9980.550875210778;26680.59979100276;26785.33036674099;27206.591901121894;27527.31181720393;27965.580516291866;51848.481515184365;52056.47943520516;52570.21727610036;52633.7368313156;54492.727536362065;15169.24153792328;15403.383864645737;15497.690046199239;15701.685966280382;15727.213639318217;16251.51245462638;16616.086115263777;16628.667426651642;17180.656386871942;17428;13089.607311780663;14692.779608306098;14947.103173809606;15199.77200342018;15225;15056.6988660224;15698.215089245721;15732.370705172123;15889;16159.838401616304;15515.922420387826;15547.84452155464;15683.29425175847;15905.125218113115;15907.284172212047;10748.247622666338;10810.24328297043;10999.890001099886;11319.264247823865;11564.306141631192;11923.284602923852;12038.699032524257;12435.067369947472;12601.747965040831;12647.620571382873 14:38:32 INFO - PID 10252 | __end_tp_report 14:38:32 INFO - PID 10252 | __start_cc_report 14:38:32 INFO - PID 10252 | _x_x_mozilla_cycle_collect,338 14:38:32 INFO - PID 10252 | __end_cc_report 14:38:32 INFO - PID 10252 | __startTimestamp1495748312778__endTimestamp 14:38:32 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | ------- Summary: start ------- 14:38:32 INFO - PID 10252 | Number of tests: 6 14:38:32 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | [#0] dojo.html Cycles:165 Average:5201.07 Median:5333.87 stddev:617.05 (11.6%) stddev-sans-first:587.63 14:38:32 INFO - PID 10252 | Values: 2727.4 2736.0 2755.4 2758.1 2766.5 5118.8 5260.9 5271.6 5297.7 5315.6 5115.9 5130.1 5223.6 5343.4 5374.2 4665.4 4695.3 4747.7 4767.9 4784.9 4571.7 4729.6 4734.0 4750.5 4779.5 4605.3 4702.3 4723.0 4768.7 4768.8 4597.0 4616.7 4627.0 4722.0 4723.1 4664.5 4670.1 4692.7 4693.3 4710.6 5223.2 5224.2 5236.3 5265.8 5282.4 5544.5 5650.5 5679.3 5771.5 5789.4 5739.6 5740.0 5744.1 5754.9 5801.0 5277.5 5319.5 5320.6 5327.9 5329.7 5720.5 5793.9 5819.9 5876.6 5931.3 5530.6 5552.4 5562.7 5565.6 5645.8 5701.5 5723.0 5728.2 5728.8 5732.1 5571.9 5670.7 5682.0 5691.0 5691.9 5543.4 5580.0 5631.8 5665.2 5682.1 4745.0 4760.5 4770.2 4780.0 4813.4 4080.9 4093.4 4100.4 4122.7 4138.8 4699.9 4705.5 4760.1 4768.0 4800.9 5682.6 5733.7 5743.6 5790.9 5794.2 4796.1 4801.5 4814.5 4817.2 4843.9 4942.6 5012.8 5039.8 5047.5 5051.8 5244.0 5326.0 5329.3 5333.9 5349.9 5573.1 5713.7 5737.3 5741.9 5755.5 5214.4 5236.4 5244.6 5248.3 5258.1 5430.7 5598.4 5601.2 5605.4 5611.3 5760.9 5771.5 5801.8 5821.0 5838.1 5465.8 5585.2 5590.0 5596.4 5602.0 5491.9 5504.5 5534.6 5580.5 5581.7 5492.8 5514.4 5523.2 5525.6 5526.9 5501.7 5608.6 5622.3 5626.7 5631.2 5325.0 5404.3 5414.8 5485.3 5491.1 14:38:32 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | [#1] ext.html Cycles:180 Average:29964.42 Median:16864.85 stddev:41018.90 (243.2%) stddev-sans-first:41075.03 14:38:32 INFO - PID 10252 | Values: 680.2 718.6 739.8 1039.4 1048.6 31807.2 32664.2 32716.8 32722.3 32782.5 33943.3 34270.8 34295.5 34370.0 34429.7 6359.8 6415.7 6826.2 6952.7 6955.4 6573.8 6744.7 6744.8 6746.7 6762.6 6719.3 6806.3 6809.8 6810.6 6824.4 6710.0 6737.3 6762.7 6765.1 6794.1 6660.4 6717.7 6720.8 6731.9 6733.5 30700.2 31044.2 31085.8 31114.0 31219.8 3013.0 3050.6 3052.5 3054.5 3057.0 23599.0 23794.8 23816.3 23823.8 23863.5 3051.5 3081.1 3083.5 3087.6 3130.3 145022.0 145853.0 148025.0 151172.0 152854.0 38899.0 38998.8 39008.8 39063.6 39070.4 40387.2 40543.4 40605.0 40778.8 40833.4 11679.3 11766.7 11768.8 11806.4 11846.6 9376.8 9386.6 9387.5 9390.7 9391.8 12130.2 12133.6 12161.8 12217.7 12236.1 5130.5 5164.4 5197.2 5311.9 5335.6 862.4 904.7 908.5 914.0 939.1 20019.5 20641.0 20694.4 20864.8 21140.5 988.9 992.5 992.8 993.5 1012.4 10787.2 10856.3 11180.9 11190.4 11282.0 175667.0 176703.0 177470.1 177580.0 177765.0 39371.4 39419.8 39574.4 39646.8 39685.6 1169.4 1227.9 1232.0 1234.3 1245.8 19157.5 19828.9 20288.5 20534.3 20721.5 28493.4 28600.6 28756.1 28823.3 28834.0 148951.0 149770.0 149787.0 149791.0 149914.3 27887.9 28173.2 29190.3 29612.3 30096.7 35177.6 35828.3 36010.8 36050.3 36683.6 27166.7 27613.2 27927.7 27929.9 28322.4 26713.5 27025.6 27314.3 27848.0 28738.9 29539.0 30421.5 30672.7 30736.1 30862.4 26393.0 26694.2 26964.0 27074.0 27868.4 21127.4 22121.0 22242.4 22390.6 22494.9 14:38:32 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | [#2] jquery.html Cycles:180 Average:25908.62 Median:403825.00 stddev:65781.73 (16.3%) stddev-sans-first:65938.40 14:38:32 INFO - PID 10252 | Values: 409.4 414.2 426.8 435.9 436.8 11908.9 16502.3 17218.3 17241.0 17943.9 18395.6 18512.6 18516.1 18641.6 18661.3 5237.4 5390.7 5582.3 5596.3 5605.9 5364.0 5410.3 5421.8 5422.3 5457.5 5327.4 5396.3 5399.3 5399.5 5401.5 5426.5 5478.9 5483.5 5503.4 5516.2 4896.8 4941.8 4956.8 4981.2 4992.6 21166.3 21656.2 21893.0 22059.9 22077.6 1639.9 1665.3 1672.1 1678.4 1682.3 14381.1 14436.3 14486.6 14915.1 14926.9 1980.8 2013.9 2045.7 2054.3 2056.0 86190.6 88658.0 92941.0 94729.5 97634.0 10851.7 11014.1 11087.9 11090.7 11099.8 15026.4 15560.9 15584.7 15596.7 15598.2 7931.7 7975.2 8072.8 8104.3 8139.2 7337.0 7422.0 7423.7 7563.6 7654.3 6873.3 6877.0 6880.6 7017.8 7018.8 1918.0 1931.7 1936.0 1953.2 2070.7 842.7 883.5 892.4 898.5 913.9 16686.8 16876.4 16883.2 16927.2 17627.2 874.9 881.3 886.5 893.1 901.3 9072.2 9183.9 10701.2 11802.8 11862.1 376412.0 393854.0 398617.0 403490.0 404160.0 77893.6 78123.6 80720.0 81786.6 81849.6 993.2 1026.4 1042.9 1043.0 1099.9 16810.5 16899.7 17668.5 17690.7 17699.5 39296.8 40346.0 40503.6 40718.0 40897.4 51024.0 52098.2 52171.5 52210.2 53900.9 8195.0 8231.8 8451.7 8490.4 8496.5 11881.8 12195.3 12752.9 13027.6 13277.5 10380.8 10534.9 10649.7 11040.6 11618.7 9808.8 9971.8 10044.7 10069.5 10179.4 10222.8 10348.7 10463.4 11394.8 11659.8 8104.4 8204.0 8220.6 8285.0 8425.9 10923.7 10993.9 11120.0 11275.4 11563.7 14:38:32 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | [#3] mootools.html Cycles:180 Average:6505.79 Median:3419.03 stddev:4289.04 (125.4%) stddev-sans-first:4282.79 14:38:32 INFO - PID 10252 | Values: 1234.8 1287.6 1293.4 1294.3 1301.3 10514.2 10687.1 11054.1 11063.6 11135.2 10904.6 10992.1 11011.6 11087.1 11099.1 2234.9 2277.5 2281.0 2298.7 2300.5 2202.9 2240.9 2243.0 2243.1 2246.1 1998.4 2013.7 2017.3 2028.4 2031.3 2110.7 2120.1 2125.0 2129.7 2131.6 1895.1 1985.4 2061.9 2123.5 2171.4 10561.5 10651.3 10666.0 10675.4 10676.3 5635.2 5854.5 5878.0 5882.7 5898.2 3275.1 3378.3 3459.8 3486.4 3489.7 1162.5 1163.5 1166.8 1183.0 1191.4 15723.3 15872.0 15894.3 15904.1 15930.4 4730.2 4801.7 4955.8 4980.9 5025.3 11081.3 11125.5 11171.1 11180.8 11220.9 5549.5 5679.5 5688.6 5727.9 5740.5 5265.9 5320.4 5334.9 5337.2 5392.5 3831.9 3902.8 3914.8 3971.0 4016.1 1118.8 1142.9 1144.9 1162.0 1172.3 669.5 704.3 708.2 715.0 722.2 5437.8 5575.9 5578.4 5607.7 5639.1 537.5 554.5 565.8 566.1 566.4 3639.1 3699.8 3743.9 4022.7 4274.4 13556.6 13823.7 14117.4 14123.8 14164.9 13778.7 13809.1 13830.2 13903.7 14134.2 7790.4 7974.4 7991.6 7992.6 8006.0 6087.6 6240.8 6259.1 6267.2 6342.7 12392.8 12489.6 12522.3 12708.5 12753.2 12819.9 12947.7 12953.8 13082.4 13153.5 7777.0 7878.1 7890.2 7890.8 7919.8 9766.3 10019.8 10101.7 10109.5 10124.6 8075.5 8200.8 8242.7 8331.0 8362.8 7949.2 8058.8 8062.9 8074.8 8132.6 7487.5 7732.3 7811.2 7823.6 7858.9 5020.3 5465.7 5528.4 5546.2 5566.4 5508.2 5518.4 5574.4 5607.0 5658.5 14:38:32 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | [#4] prototype.html Cycles:180 Average:4705.88 Median:5384.99 stddev:1404.82 (26.1%) stddev-sans-first:1370.18 14:38:32 INFO - PID 10252 | Values: 349.5 366.1 366.9 376.6 379.9 5307.5 5524.8 5532.9 5534.4 5552.4 5292.3 5366.3 5370.5 5384.2 5385.8 4074.5 4084.7 4085.8 4099.5 4116.4 3926.5 4100.3 4106.2 4107.4 4119.5 4072.7 4072.9 4076.1 4077.8 4090.7 4039.9 4055.2 4060.1 4062.1 4065.7 3520.3 3538.9 3547.1 3557.3 3557.9 5191.3 5262.3 5267.1 5277.9 5310.7 4768.3 4771.5 4781.7 4784.1 4799.9 5573.3 5700.0 5715.5 5720.0 5741.1 3928.3 3960.8 3987.0 3991.9 3994.1 5839.5 6033.4 6048.1 6076.6 6087.2 3979.3 3980.9 4000.0 4003.2 4010.1 4046.1 4046.9 4048.9 4055.2 4058.9 4664.0 4666.4 4683.0 4714.0 4721.2 5744.5 5764.2 5782.5 5785.8 5796.4 1415.5 1429.9 1431.3 1434.1 1435.2 914.6 959.7 970.6 974.0 975.5 4991.5 5005.3 5006.5 5006.7 5010.6 5914.8 5927.9 5938.2 5958.9 5975.0 4810.2 4888.6 4937.8 4952.6 4961.3 3091.0 3124.9 3134.9 3136.4 3149.3 5442.3 5455.8 5459.6 5464.4 5476.4 5826.4 6022.1 6038.2 6100.6 6107.8 5490.8 5492.5 5497.4 5500.8 5523.2 5755.5 5894.2 5913.9 5925.4 5968.9 5829.4 5832.2 5834.3 5835.8 5848.8 5295.3 5458.3 5480.6 5487.6 5505.7 4039.9 4049.0 4074.3 4079.7 4101.9 5850.8 5972.0 5982.1 5988.1 5992.5 5711.3 5723.4 5778.5 5785.3 5787.3 5735.6 5741.7 5762.4 5763.9 5805.2 5642.0 5677.2 5695.8 5704.5 5709.8 5752.9 5784.9 5791.7 5792.7 5825.9 5447.9 5550.2 5597.4 5626.9 5637.6 14:38:32 INFO - PID 10252 | 14:38:32 INFO - PID 10252 | [#5] yui.html Cycles:180 Average:18027.16 Median:3840.15 stddev:23563.78 (613.6%) stddev-sans-first:23594.14 14:38:32 INFO - PID 10252 | Values: 743.3 745.5 765.1 777.8 781.4 11811.4 12464.3 13122.7 14073.2 14169.7 14225.2 14835.4 14840.3 15167.9 15175.3 868.5 883.4 883.5 884.6 887.4 890.9 892.5 892.8 893.2 893.7 909.7 913.9 919.0 919.8 921.3 886.9 921.3 930.7 943.0 947.9 680.7 683.4 684.5 686.0 688.7 13604.5 13656.1 13738.2 13752.6 13809.3 15163.2 16233.8 16524.0 16594.8 16766.4 12581.4 12630.1 12838.6 12896.9 13018.0 3061.7 3094.7 3096.3 3097.3 3099.6 84509.6 85629.6 86121.0 86345.0 87179.6 12779.9 12859.4 12875.2 13174.7 13215.7 23447.3 23724.9 23808.8 23993.6 23999.8 5988.3 6045.0 6058.1 6062.7 6097.0 2752.8 2822.0 2823.8 2826.5 2826.9 3775.7 3834.5 3834.8 3845.5 3887.4 774.0 789.0 790.0 797.6 835.0 583.9 603.5 622.9 629.6 634.2 9758.2 9977.8 10589.7 11075.7 11077.8 606.1 620.8 626.3 628.0 635.6 4721.8 4729.4 4773.9 4919.8 4937.3 79125.0 80461.0 81118.0 81914.6 84397.5 74737.0 75871.2 78025.0 78690.0 79988.6 66196.0 66349.7 66411.3 66925.7 68596.0 9260.0 9869.6 9949.5 9968.2 9980.6 26680.6 26785.3 27206.6 27527.3 27965.6 51848.5 52056.5 52570.2 52633.7 54492.7 15169.2 15403.4 15497.7 15701.7 15727.2 16251.5 16616.1 16628.7 17180.7 17428.0 13089.6 14692.8 14947.1 15199.8 15225.0 15056.7 15698.2 15732.4 15889.0 16159.8 15515.9 15547.8 15683.3 15905.1 15907.3 10748.2 10810.2 10999.9 11319.3 11564.3 11923.3 12038.7 12435.1 12601.7 12647.6 14:38:32 INFO - PID 10252 | -------- Summary: end -------- 14:38:32 INFO - PID 10252 | 14:38:33 INFO - TEST-INFO | 10252: exit 0 14:38:33 INFO - TEST-OK | dromaeo_css | took 1147178ms 14:38:33 INFO - TEST-START | kraken 14:38:33 INFO - operating with platform_type : linux_ 14:38:33 INFO - Initialising browser for kraken test... 14:38:33 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:52088/getInfo.html -profile /tmp/tmp0E1wdE/profile 14:38:33 INFO - TEST-INFO | started process 10671 (/builds/slave/test/build/application/firefox/firefox http://localhost:52088/getInfo.html) 14:39:08 INFO - TEST-INFO | 10671: killed by SIGTERM 14:39:08 INFO - Browser initialized. 14:39:08 INFO - Running cycle 1/1 for kraken test... 14:39:08 INFO - TEST-INFO | started process 10895 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0E1wdE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:39:20 INFO - PID 10895 | RSS: Main: 171900928 14:39:20 INFO - PID 10895 | 14:39:23 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52088/tests/kraken/driver.html?testName=audio-beat-detection) 14:39:24 INFO - PID 10895 | RSS: Main: 177868800 14:39:24 INFO - PID 10895 | 14:39:26 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52088/tests/kraken/driver.html?testName=audio-dft) 14:39:27 INFO - PID 10895 | RSS: Main: 176955392 14:39:27 INFO - PID 10895 | 14:39:30 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52088/tests/kraken/driver.html?testName=audio-fft) 14:39:31 INFO - PID 10895 | RSS: Main: 174321664 14:39:31 INFO - PID 10895 | 14:39:33 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52088/tests/kraken/driver.html?testName=audio-oscillator) 14:39:33 INFO - PID 10895 | RSS: Main: 174747648 14:39:33 INFO - PID 10895 | 14:39:35 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52088/tests/kraken/driver.html?testName=imaging-gaussian-blur) 14:39:36 INFO - PID 10895 | RSS: Main: 175161344 14:39:36 INFO - PID 10895 | 14:39:39 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52088/tests/kraken/driver.html?testName=imaging-darkroom) 14:39:40 INFO - PID 10895 | RSS: Main: 178954240 14:39:40 INFO - PID 10895 | 14:39:43 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52088/tests/kraken/driver.html?testName=imaging-desaturate) 14:39:44 INFO - PID 10895 | RSS: Main: 175673344 14:39:44 INFO - PID 10895 | 14:39:47 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52088/tests/kraken/driver.html?testName=json-parse-financial) 14:39:47 INFO - PID 10895 | RSS: Main: 175927296 14:39:47 INFO - PID 10895 | 14:39:49 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52088/tests/kraken/driver.html?testName=json-stringify-tinderbox) 14:39:50 INFO - PID 10895 | RSS: Main: 176168960 14:39:50 INFO - PID 10895 | 14:39:52 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52088/tests/kraken/driver.html?testName=stanford-crypto-aes) 14:39:52 INFO - PID 10895 | RSS: Main: 176021504 14:39:52 INFO - PID 10895 | 14:39:54 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52088/tests/kraken/driver.html?testName=stanford-crypto-ccm) 14:39:55 INFO - PID 10895 | RSS: Main: 175747072 14:39:55 INFO - PID 10895 | 14:39:58 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52088/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 14:39:59 INFO - PID 10895 | RSS: Main: 176070656 14:39:59 INFO - PID 10895 | 14:40:02 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52088/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 14:40:02 INFO - PID 10895 | RSS: Main: 176271360 14:40:02 INFO - PID 10895 | 14:40:04 INFO - PID 10895 | Cycle 1(1): loaded http://localhost:52088/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52088/tests/kraken/driver.html?testName=ai-astar) 14:40:05 INFO - PID 10895 | RSS: Main: 177774592 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | __start_tp_report 14:40:05 INFO - PID 10895 | _x_x_mozilla_page_load 14:40:05 INFO - PID 10895 | _x_x_mozilla_page_load_details 14:40:05 INFO - PID 10895 | |i|pagename|runs| 14:40:05 INFO - PID 10895 | |0;ai-astar;103;114;112;110;113;112;113;112;112;113 14:40:05 INFO - PID 10895 | |1;audio-beat-detection;149;124;125;171;124;132;128;128;145;123 14:40:05 INFO - PID 10895 | |2;audio-dft;165;163;164;167;166;175;162;163;163;162 14:40:05 INFO - PID 10895 | |3;audio-fft;75;73;73;110;75;75;74;75;90;75 14:40:05 INFO - PID 10895 | |4;audio-oscillator;84;84;118;84;84;83;102;84;83;105 14:40:05 INFO - PID 10895 | |5;imaging-gaussian-blur;113;114;115;114;114;114;117;114;115;115 14:40:05 INFO - PID 10895 | |6;imaging-darkroom;151;151;150;151;151;150;151;151;153;152 14:40:05 INFO - PID 10895 | |7;imaging-desaturate;95;96;98;95;95;94;94;95;94;94 14:40:05 INFO - PID 10895 | |8;json-parse-financial;56;55;53;56;55;58;59;57;56;54 14:40:05 INFO - PID 10895 | |9;json-stringify-tinderbox;56;57;57;57;56;61;57;61;57;57 14:40:05 INFO - PID 10895 | |10;stanford-crypto-aes;87;89;87;86;85;88;90;90;118;88 14:40:05 INFO - PID 10895 | |11;stanford-crypto-ccm;140;137;141;132;137;153;145;146;143;137 14:40:05 INFO - PID 10895 | |12;stanford-crypto-pbkdf2;198;196;201;192;186;194;191;195;195;199 14:40:05 INFO - PID 10895 | |13;stanford-crypto-sha256-iterative;76;78;72;77;76;73;75;75;72;72 14:40:05 INFO - PID 10895 | __end_tp_report 14:40:05 INFO - PID 10895 | __start_cc_report 14:40:05 INFO - PID 10895 | _x_x_mozilla_cycle_collect,901 14:40:05 INFO - PID 10895 | __end_cc_report 14:40:05 INFO - PID 10895 | __startTimestamp1495748405026__endTimestamp 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | ------- Summary: start ------- 14:40:05 INFO - PID 10895 | Number of tests: 14 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#0] ai-astar Cycles:10 Average:111.40 Median:112.50 stddev:3.13 (2.8%) stddev-sans-first:1.12 14:40:05 INFO - PID 10895 | Values: 103.0 114.0 112.0 110.0 113.0 112.0 113.0 112.0 112.0 113.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#1] audio-beat-detection Cycles:10 Average:134.90 Median:130.00 stddev:15.58 (12.0%) stddev-sans-first:15.67 14:40:05 INFO - PID 10895 | Values: 149.0 124.0 125.0 171.0 124.0 132.0 128.0 128.0 145.0 123.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#2] audio-dft Cycles:10 Average:165.00 Median:164.50 stddev:3.89 (2.4%) stddev-sans-first:4.12 14:40:05 INFO - PID 10895 | Values: 165.0 163.0 164.0 167.0 166.0 175.0 162.0 163.0 163.0 162.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#3] audio-fft Cycles:10 Average:79.50 Median:75.00 stddev:11.82 (15.8%) stddev-sans-first:12.42 14:40:05 INFO - PID 10895 | Values: 75.0 73.0 73.0 110.0 75.0 75.0 74.0 75.0 90.0 75.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#4] audio-oscillator Cycles:10 Average:91.10 Median:84.00 stddev:12.56 (14.9%) stddev-sans-first:13.05 14:40:05 INFO - PID 10895 | Values: 84.0 84.0 118.0 84.0 84.0 83.0 102.0 84.0 83.0 105.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#5] imaging-gaussian-blur Cycles:10 Average:114.50 Median:114.50 stddev:1.08 (0.9%) stddev-sans-first:1.00 14:40:05 INFO - PID 10895 | Values: 113.0 114.0 115.0 114.0 114.0 114.0 117.0 114.0 115.0 115.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#6] imaging-darkroom Cycles:10 Average:151.10 Median:151.00 stddev:0.88 (0.6%) stddev-sans-first:0.93 14:40:05 INFO - PID 10895 | Values: 151.0 151.0 150.0 151.0 151.0 150.0 151.0 151.0 153.0 152.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:95.00 stddev:1.25 (1.3%) stddev-sans-first:1.32 14:40:05 INFO - PID 10895 | Values: 95.0 96.0 98.0 95.0 95.0 94.0 94.0 95.0 94.0 94.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#8] json-parse-financial Cycles:10 Average:55.90 Median:56.00 stddev:1.79 (3.2%) stddev-sans-first:1.90 14:40:05 INFO - PID 10895 | Values: 56.0 55.0 53.0 56.0 55.0 58.0 59.0 57.0 56.0 54.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#9] json-stringify-tinderbox Cycles:10 Average:57.60 Median:57.00 stddev:1.84 (3.2%) stddev-sans-first:1.86 14:40:05 INFO - PID 10895 | Values: 56.0 57.0 57.0 57.0 56.0 61.0 57.0 61.0 57.0 57.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#10] stanford-crypto-aes Cycles:10 Average:90.80 Median:88.00 stddev:9.69 (11.0%) stddev-sans-first:10.18 14:40:05 INFO - PID 10895 | Values: 87.0 89.0 87.0 86.0 85.0 88.0 90.0 90.0 118.0 88.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#11] stanford-crypto-ccm Cycles:10 Average:141.10 Median:142.00 stddev:5.95 (4.2%) stddev-sans-first:6.30 14:40:05 INFO - PID 10895 | Values: 140.0 137.0 141.0 132.0 137.0 153.0 145.0 146.0 143.0 137.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:194.70 Median:195.50 stddev:4.32 (2.2%) stddev-sans-first:4.42 14:40:05 INFO - PID 10895 | Values: 198.0 196.0 201.0 192.0 186.0 194.0 191.0 195.0 195.0 199.0 14:40:05 INFO - PID 10895 | 14:40:05 INFO - PID 10895 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:74.60 Median:75.50 stddev:2.22 (2.9%) stddev-sans-first:2.30 14:40:05 INFO - PID 10895 | Values: 76.0 78.0 72.0 77.0 76.0 73.0 75.0 75.0 72.0 72.0 14:40:05 INFO - PID 10895 | -------- Summary: end -------- 14:40:05 INFO - PID 10895 | 14:40:06 INFO - TEST-INFO | 10895: exit 0 14:40:06 INFO - TEST-OK | kraken | took 92506ms 14:40:06 INFO - SUITE-END | took 1239s 14:40:06 INFO - Completed test suite (00:20:39) 14:40:06 INFO - javascript benchmark 14:40:06 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6787.620429174896, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2727.3999720061584, 2736.0, 2755.366265758875, 2758.117402431222, 2766.502029634666, 5118.846434606959, 5260.947390526088, 5271.604629652777, 5297.735113244342, 5315.574754019679, 5115.923261151086, 5130.102232109384, 5223.608229382792, 5343.385510666275, 5374.167004114369, 4665.4168228971375, 4695.3191787190835, 4747.691400059002, 4767.880802979936, 4784.90430191396, 4571.748553829538, 4729.550692684206, 4733.976330118345, 4750.477447480775, 4779.498152693952, 4605.263157894721, 4702.27114797207, 4722.952770472286, 4768.690035147722, 4768.785404656782, 4596.965682721394, 4616.722996620214, 4626.976865115653, 4722.0, 4723.126221648971, 4664.463586687541, 4670.089332580148, 4692.671512994092, 4693.272542755878, 4710.599599034086, 5223.242629818693, 5224.242484839677, 5236.266922630796, 5265.815696450606, 5282.418933917266, 5544.528715059225, 5650.5479561634975, 5679.318481782171, 5771.538276937877, 5789.392113828029, 5739.569532285053, 5740.0, 5744.109663002199, 5754.913676294859, 5801.0, 5277.498637629457, 5319.468053194727, 5320.600954928396, 5327.893442131136, 5329.680219186861, 5720.456556627114, 5793.913091303634, 5819.88360232793, 5876.559258055663, 5931.288245410578, 5530.640508366943, 5552.3892371839065, 5562.749676264578, 5565.582581306418, 5645.80239691617, 5701.486866182064, 5722.971385143131, 5728.169415434739, 5728.77084916607, 5732.111522713986, 5571.888562228733, 5670.659760414306, 5682.0, 5691.03252447085, 5691.857703557362, 5543.36251331094, 5579.995600791815, 5631.831045068655, 5665.150227465913, 5682.062459694187, 4745.0, 4760.45254795696, 4770.189067858403, 4779.996200797871, 4813.3983252093485, 4080.897977550585, 4093.406456063854, 4100.425940368351, 4122.670186385082, 4138.79306034697, 4699.906001879944, 4705.529447055335, 4760.09558183944, 4768.0, 4800.903981920412, 5682.602217844711, 5733.741981610838, 5743.62666426681, 5790.94209057904, 5794.246747922743, 4796.112719146969, 4801.51984801517, 4814.542618451242, 4817.205161148371, 4843.878903027382, 4942.555170034714, 5012.774425150877, 5039.84880453587, 5047.520485553867, 5051.823186188466, 5244.029854476934, 5325.961437519646, 5329.307190065267, 5333.866653333697, 5349.866253343542, 5573.080441727232, 5713.657180569179, 5737.254156959569, 5741.91387129185, 5755.53955683536, 5214.426413094632, 5236.423993360651, 5244.580433565229, 5248.317718696545, 5258.132408152612, 5430.67415955044, 5598.440155984369, 5601.215829783752, 5605.439456054362, 5611.270534830446, 5760.913586296125, 5771.538276937918, 5801.796937107181, 5821.039528477754, 5838.065909454467, 5465.808696695596, 5585.2180694701965, 5589.972050139723, 5596.356419011703, 5602.0, 5491.945080549303, 5504.504594586507, 5534.612577119563, 5580.497755202051, 5581.7209139543675, 5492.752826122914, 5514.36584792754, 5523.1991361253195, 5525.613207075467, 5526.949879522877, 5501.697406642673, 5608.579356548356, 5622.297212848394, 5626.746796394254, 5631.155326701028, 5325.041492531382, 5404.270423492935, 5414.756335964812, 5485.286912701324, 5491.066518691752], "value": 5156.095687514597, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [680.2415306932771, 718.6227230703881, 739.7743688175107, 1039.3711804358368, 1048.5700862646318, 31807.204819879487, 32664.183395415097, 32716.83641581789, 32722.345553088922, 32782.508262376025, 33943.321133577374, 34270.82864585674, 34295.485567716445, 34370.0, 34429.65570344296, 6359.8092057238355, 6415.679216039202, 6826.214985276694, 6952.652367381636, 6955.374016338528, 6573.769918052869, 6744.730210791562, 6744.763933262337, 6746.730130794786, 6762.594244345355, 6719.260881303053, 6806.285340039299, 6809.761658341959, 6810.557313774589, 6824.4199243064395, 6710.0, 6737.292584278629, 6762.695678694446, 6765.05289259504, 6794.0827988221945, 6660.400563949268, 6717.6977036033495, 6720.83197920051, 6731.899021514681, 6733.528652994292, 30700.2324941876, 31044.223894402596, 31085.844570777, 31114.0, 31219.84390078035, 3012.9849350753325, 3050.6186726659166, 3052.526858336961, 3054.541818727209, 3057.0, 23599.0, 23794.76205237943, 23816.28551143451, 23823.761762382328, 23863.52272954531, 3051.5117581186905, 3081.091078131934, 3083.491223948046, 3087.5986121804244, 3130.2800355918266, 145022.0, 145853.0, 148025.0, 151171.9999999989, 152854.0, 38899.0, 38998.80500597479, 39008.804955975036, 39063.609363906566, 39070.41394379087, 40387.19225615471, 40543.39184912229, 40605.0, 40778.79610601987, 40833.387499187535, 11679.299242045505, 11766.705832354088, 11768.764624707457, 11806.40967951599, 11846.585369512199, 9376.812463750686, 9386.577604007836, 9387.483688397204, 9390.67132650354, 9391.812163756687, 12130.211536250115, 12133.635990920286, 12161.817572736416, 12217.694557635952, 12236.143469957196, 5130.461301563357, 5164.380274367025, 5197.1684530475695, 5311.893762124736, 5335.599830012765, 862.3618522293458, 904.6924045824451, 908.5230254116642, 914.0049628778756, 939.084392717109, 20019.499512512302, 20641.0, 20694.379168624964, 20864.791352086588, 21140.47148821292, 988.8615593816871, 992.4640694025146, 992.806402751471, 993.5429702336861, 1012.3824467075078, 10787.244892857425, 10856.34861908288, 11180.91268472843, 11190.38452885083, 11282.0, 175667.0, 176703.0, 177470.11264943593, 177580.0, 177765.0, 39371.40942885859, 39419.80290098531, 39574.406383904265, 39646.801765991564, 39685.60314396819, 1169.3682095695126, 1227.9324637145044, 1231.956881509143, 1234.2594443333749, 1245.8131280308025, 19157.521061973563, 19828.90085549563, 20288.492787680425, 20534.281300154424, 20721.481962951046, 28493.430131397672, 28600.570991434728, 28756.137315880558, 28823.279418014718, 28834.0, 148951.0, 149770.0, 149787.0, 149791.0, 149914.25042874715, 27887.860560697878, 28173.154805355873, 29190.27024324409, 29612.259693507836, 30096.69903300939, 35177.64822351744, 35828.283434330646, 36010.819945900104, 36050.27899441944, 36683.63316366802, 27166.72833271642, 27613.171604851887, 27927.720722793325, 27929.860350698116, 28322.433551328446, 26713.465730685668, 27025.59461608038, 27314.317142071606, 27848.025319113734, 28738.85630571834, 29539.0, 30421.543676844423, 30672.693273066983, 30736.077917662507, 30862.382752345275, 26393.0, 26694.19917402481, 26964.0, 27074.0, 27868.442631147667, 21127.366179014654, 22121.0, 22242.443938901655, 22390.552188955804, 22494.887525562266], "value": 14235.565750223857, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [409.38796499233666, 414.2274657763269, 426.8122026308424, 435.8627032484767, 436.8187202311041, 11908.940455297712, 16502.25739841707, 17218.3112675493, 17240.999999999985, 17943.910280448614, 18395.632087358244, 18512.629747405044, 18516.0741962902, 18641.627167456678, 18661.34685286015, 5237.3715154181555, 5390.730463476821, 5582.302212223472, 5596.3284405871145, 5605.943940560604, 5364.034473794715, 5410.296661434028, 5421.83734487966, 5422.2951016367815, 5457.536109430684, 5327.401779466164, 5396.271503347057, 5399.325084364455, 5399.514043736063, 5401.513863752261, 5426.457354264562, 5478.863028424321, 5483.479069488392, 5503.449655034505, 5516.227728118067, 4896.828610998634, 4941.802327906879, 4956.752162391902, 4981.178105612606, 4992.625553083497, 21166.259180928595, 21656.24203152898, 21893.0, 22059.889700551554, 22077.558448831092, 1639.9262033208533, 1665.3172199398189, 1672.0720000399774, 1678.4461127827788, 1682.2850288627285, 14381.137131772128, 14436.278186090758, 14486.565403037926, 14915.105093694305, 14926.925365373212, 1980.821726044663, 2013.9395818125479, 2045.6829191475197, 2054.260466232155, 2055.969160462594, 86190.56904715499, 88658.0, 92941.0, 94729.52635236848, 97634.0, 10851.67444976652, 11014.118870490342, 11087.889121108685, 11090.722731931766, 11099.77902430732, 15026.398944042334, 15560.922195389177, 15584.688306233811, 15596.688066238612, 15598.220088995506, 7931.682732690743, 7975.162607926084, 8072.798180045545, 8104.311133553596, 8139.226773456512, 7337.0, 7421.962890185622, 7423.665935032936, 7563.600733864143, 7654.349380302625, 6873.312668733087, 6876.965615171892, 6880.621565813928, 7017.824554386079, 7018.75434359795, 1917.9904100479687, 1931.671615825313, 1935.951601209981, 1953.1601411392953, 2070.6893965905233, 842.6966292134827, 883.5449743382163, 892.433304851424, 898.5237823953315, 913.8949020862553, 16686.83313166853, 16876.409325673543, 16883.24025418859, 16927.238274277686, 17627.206775695126, 874.9125087491327, 881.3345923827469, 886.5301390263171, 893.0890491698431, 901.2519608724742, 9072.228860546928, 9183.90816091844, 10701.197410194267, 11802.763944721057, 11862.110341724232, 376412.0, 393854.0, 398617.0, 403490.0, 404160.0, 77893.61053194698, 78123.60938195387, 80720.0, 81786.59106704428, 81849.59075204586, 993.1707024634367, 1026.4457193115634, 1042.926995110335, 1042.968710938673, 1099.8570185875785, 16810.495685129466, 16899.66200676004, 17668.469945901645, 17690.734638980684, 17699.469015929542, 39296.80351598224, 40346.0, 40503.59496405116, 40718.0, 40897.38653920253, 51024.0, 52098.21852672137, 52171.47828521666, 52210.21684674809, 53900.92198155937, 8194.959025204837, 8231.753047408587, 8451.704190353308, 8490.386826502945, 8496.490210587384, 11881.801866654696, 12195.329256890602, 12752.87247127554, 13027.609171724484, 13277.468901243841, 10380.792384152124, 10534.94732526363, 10649.733756655836, 11040.613578524713, 11618.6514404568, 9808.754781130243, 9971.800563988825, 10044.748881278027, 10069.546870390997, 10179.38923664553, 10222.795544088927, 10348.689539313833, 10463.424511651932, 11394.829077563678, 11659.825102623297, 8104.351651867954, 8203.958980205061, 8220.63007164667, 8285.0, 8425.873611895704, 10923.672289831318, 10993.945030274797, 11120.0, 11275.379854108103, 11563.6530904073], "value": 8898.473496852439, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1234.771567260057, 1287.639460950934, 1293.3533233383303, 1294.2881415221625, 1301.2842936384989, 10514.21143414244, 10687.145028397728, 11054.115670746341, 11063.612773552928, 11135.164862635294, 10904.563817447312, 10992.120630349573, 11011.559537618487, 11087.057600104, 11099.112071034318, 2234.8770817604986, 2277.52172043871, 2281.041962375798, 2298.712660917385, 2300.482391461916, 2202.922897698581, 2240.8879556022216, 2242.990654205606, 2243.080337061805, 2246.067881829047, 1998.4404366777326, 2013.7180794688682, 2017.3342796877068, 2028.381343690174, 2031.2890488329115, 2110.746710394747, 2120.109553987329, 2124.957500849982, 2129.7018417421573, 2131.5843410534953, 1895.0619443375617, 1985.4143027806688, 2061.9484512887148, 2123.5115923337717, 2171.392010237136, 10561.471926403648, 10651.25441219115, 10666.0, 10675.41285229312, 10676.252662313642, 5635.154726790973, 5854.47309742121, 5878.0, 5882.6764527950945, 5898.174255604219, 3275.132089996153, 3378.2905589826164, 3459.775114617542, 3486.4247399179103, 3489.668481494254, 1162.4536467860091, 1163.5345861655405, 1166.8424762657019, 1183.0417361936773, 1191.4281145050425, 15723.292451839694, 15872.0, 15894.284757185838, 15904.125273109974, 15930.442434514736, 4730.219513780256, 4801.663883528119, 4955.8017679292425, 4980.850574482772, 5025.346704928336, 11081.27971681838, 11125.499352529156, 11171.106311495061, 11180.832287515694, 11220.887791122148, 5549.500544950974, 5679.545636349165, 5688.573356998241, 5727.8854422912145, 5740.512056475246, 5265.868353291198, 5320.441353657888, 5334.91997620036, 5337.172738225581, 5392.4607539246545, 3831.942520862189, 3902.7658340499092, 3914.8434062637743, 3971.001893570336, 4016.0763024504527, 1118.8209886418133, 1142.9371384573928, 1144.9370284634258, 1162.002034750342, 1172.2556176827604, 669.521292276025, 704.2886684448744, 708.2068083746237, 715.0347031507423, 722.241646271413, 5437.8368648940595, 5575.8884822304135, 5578.442155784389, 5607.719614019283, 5639.097744360883, 537.5350321971466, 554.4510934175138, 565.7708628005664, 566.125336355332, 566.4081035318103, 3639.1448009717697, 3699.7595156314756, 3743.8502459901297, 4022.738521996061, 4274.444322238089, 13556.59330220095, 13823.654408639864, 14117.43530258778, 14123.78814317786, 14164.929175354056, 13778.724425511635, 13809.093134927914, 13830.170189788645, 13903.721925561635, 14134.222617756122, 7790.376769858511, 7974.401919855918, 7991.640376183086, 7992.560409177551, 8005.959970200228, 6087.604305720114, 6240.7503699851495, 6259.061140828912, 6267.2165979252595, 6342.651154186564, 12392.75214495723, 12489.562865299671, 12522.311272880079, 12708.491660333853, 12753.171043882117, 12819.923218427697, 12947.741045179233, 12953.805692914426, 13082.411291492095, 13153.53962611304, 7776.988991431078, 7878.094019187867, 7890.171531989058, 7890.763277101696, 7919.802004949923, 9766.316357854881, 10019.849702254618, 10101.69694909154, 10109.49452527356, 10124.59501619927, 8075.515469071875, 8200.794980125545, 8242.670293188205, 8330.958345208235, 8362.790930226793, 7949.165337639696, 8058.758237252891, 8062.879056814035, 8074.798130046795, 8132.634031468479, 7487.475876688797, 7732.265434783687, 7811.218878112143, 7823.647935842787, 7858.882116768139, 5020.272060551272, 5465.672059676433, 5528.419515950767, 5546.168074788814, 5566.359868615161, 5508.173773933942, 5518.420565840529, 5574.386817449996, 5607.0, 5658.547316214611], "value": 4798.97479365657, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [349.5089399393851, 366.1468777747848, 366.9284489524544, 376.60268416820253, 379.9012256813228, 5307.469253074691, 5524.751386187621, 5532.944670553294, 5534.363548191959, 5552.361478429977, 5292.259083728281, 5366.255966810782, 5370.5435038021715, 5384.1923711443305, 5385.78456861726, 4074.4906886639096, 4084.7344922579937, 4085.83656653735, 4099.528554216274, 4116.444280022203, 3926.528816542019, 4100.261952848486, 4106.1992911382295, 4107.424960505532, 4119.485064366954, 4072.7149099563044, 4072.8778136655947, 4076.082881351702, 4077.8164982575854, 4090.6522945549664, 4039.858604948842, 4055.1889622075555, 4060.127072679388, 4062.1469491406842, 4065.654419374342, 3520.348735483918, 3538.8938331849827, 3547.0954906498937, 3557.288542291552, 3557.8932632021083, 5191.299174611417, 5262.289590905217, 5267.051930652481, 5277.920831187535, 5310.734463276859, 4768.332433459318, 4771.4512831024185, 4781.665283430161, 4784.067106914154, 4799.904001919942, 5573.27547418837, 5700.0, 5715.485606295453, 5719.97040532704, 5741.138829175616, 3928.292907276689, 3960.8019599019935, 3986.960130398717, 3991.9221810111108, 3994.1013272013856, 5839.503642190419, 6033.396660333975, 6048.123022161806, 6076.574639775217, 6087.239095113111, 3979.2837289288204, 3980.9402858957137, 3999.9800000999808, 4003.199360127986, 4010.057636455431, 4046.109855831712, 4046.9275641954905, 4048.8785336439955, 4055.2295063938345, 4058.894945366797, 4663.976680116645, 4666.393368862026, 4683.016566521069, 4714.0, 4721.220998535272, 5744.4829965303325, 5764.241906218644, 5782.508486778671, 5785.768569257267, 5796.362400135981, 1415.476273778688, 1429.9142051476945, 1431.2986636548017, 1434.1395162902174, 1435.2464955898238, 914.5792935249726, 959.6689142245914, 970.6408628807386, 973.9870534643891, 975.5463709375033, 4991.47589503097, 5005.324281221989, 5006.52438018395, 5006.74966251686, 5010.599152067826, 5914.822555323347, 5927.911081333784, 5938.248216776062, 5958.901371286906, 5975.014122669798, 4810.158222311152, 4888.60891128716, 4937.802487900515, 4952.62855285855, 4961.330220420269, 3091.0, 3124.8906638143585, 3134.905952821419, 3136.40408322418, 3149.346593038673, 5442.292501974718, 5455.8363249102595, 5459.580509067671, 5464.398916119224, 5476.397596264408, 5826.41735826414, 6022.126791615279, 6038.245219347582, 6100.633961962208, 6107.8473038173515, 5490.835274941758, 5492.5331346835965, 5497.39528651848, 5500.779968801203, 5523.171524271311, 5755.45319197829, 5894.174815525916, 5913.852153696192, 5925.407459254213, 5968.910466343095, 5829.417058294137, 5832.24180856486, 5834.27071616048, 5835.824925252249, 5848.824535263949, 5295.338082739658, 5458.2904222450825, 5480.6437581557075, 5487.5884308677805, 5505.724713764376, 4039.8990025249605, 4048.9797551012057, 4074.286999774968, 4079.6736261099636, 4101.8974525637095, 5850.765969361178, 5971.984762590457, 5982.102684597346, 5988.101784732325, 5992.543057346467, 5711.343710323959, 5723.399043100415, 5778.537716982547, 5785.27684039495, 5787.334456537384, 5735.627184233012, 5741.712914354349, 5762.394948530344, 5763.884722305615, 5805.242509807807, 5641.971790141023, 5677.233573467529, 5695.835582478631, 5704.458076482728, 5709.771609135588, 5752.884942301047, 5784.884302314014, 5791.739371728198, 5792.7103644818435, 5825.94174058254, 5447.863803404946, 5550.167474878639, 5597.384287728428, 5626.943730562642, 5637.633553818989], "value": 4270.20968278444, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [743.2864450127878, 745.4595418321715, 765.1392183793237, 777.7861088200744, 781.4295564238105, 11811.409429528532, 12464.314462704548, 13122.737545249101, 14073.225972571505, 14169.71660566788, 14225.217613031278, 14835.406583736638, 14840.25798710063, 15167.924160379183, 15175.317110730017, 868.5006121480159, 883.4346018548134, 883.5493898111977, 884.5621417398397, 887.3699673232013, 890.875277461156, 892.5314210039717, 892.8437523433406, 893.1515060692336, 893.7006102955518, 909.7179874238974, 913.8674892140668, 919.0350132361027, 919.7884486568094, 921.2814005076051, 886.9113088691112, 921.3412410126758, 930.7207837648679, 942.9717108486757, 947.8767760191131, 680.7038938061959, 683.3883674111692, 684.4626967830279, 686.0, 688.686647575352, 13604.455821767118, 13656.112352697042, 13738.175709457464, 13752.587422377344, 13809.309534523234, 15163.241837908061, 16233.83766162335, 16524.0, 16594.75107873383, 16766.413175538797, 12581.433835477334, 12630.115891887572, 12838.550650727273, 12896.87103128966, 13017.958563314913, 3061.6938306169427, 3094.675059118805, 3096.349766549027, 3097.334073174256, 3099.550565168038, 84509.57745211296, 85629.57185214035, 86121.0, 86345.0, 87179.56410217908, 12779.936100319439, 12859.357032148355, 12875.163114397534, 13174.670633234246, 13215.66960825987, 23447.296581102593, 23724.881375593355, 23808.761912381, 23993.640095398583, 23999.7600024001, 5988.28140623128, 6044.969775151184, 6058.12157237207, 6062.666553339609, 6096.993995990611, 2752.779777617786, 2821.971780282212, 2823.7599804016477, 2826.4771017361854, 2826.943461130766, 3775.7356985011334, 3834.5206849143856, 3834.8082595870096, 3845.5000849889893, 3887.37801951692, 773.9806504837425, 788.9763307100797, 789.9802504937308, 797.5613412623034, 835.0480452284401, 583.9270091238595, 603.4810063345519, 622.8909940760349, 629.5876201088295, 634.2104080419815, 9758.219342452587, 9977.750556236007, 10589.735256618493, 11075.72310692239, 11077.778444431066, 606.1090197409801, 620.7641096383436, 626.2985456288985, 627.97802076928, 635.6408629124622, 4721.811127554928, 4729.361536192639, 4773.880652983703, 4919.77860996256, 4937.333459982929, 79125.0, 80461.0, 81118.0, 81914.59042704868, 84397.45031871017, 74737.0, 75871.24128758752, 78025.0, 78690.0, 79988.60005699935, 66196.00705989414, 66349.6682516594, 66411.33588664148, 66925.66537167283, 68596.0, 9260.0, 9869.605215791287, 9949.452780097165, 9968.202543796333, 9980.550875210778, 26680.59979100276, 26785.33036674099, 27206.591901121894, 27527.31181720393, 27965.580516291866, 51848.481515184365, 52056.47943520516, 52570.21727610036, 52633.7368313156, 54492.727536362065, 15169.24153792328, 15403.383864645737, 15497.690046199239, 15701.685966280382, 15727.213639318217, 16251.51245462638, 16616.086115263777, 16628.667426651642, 17180.656386871942, 17428.0, 13089.607311780663, 14692.779608306098, 14947.103173809606, 15199.77200342018, 15225.0, 15056.6988660224, 15698.215089245721, 15732.370705172123, 15889.0, 16159.838401616304, 15515.922420387826, 15547.84452155464, 15683.29425175847, 15905.125218113115, 15907.284172212047, 10748.247622666338, 10810.24328297043, 10999.890001099886, 11319.264247823865, 11564.306141631192, 11923.284602923852, 12038.699032524257, 12435.067369947472, 12601.747965040831, 12647.620571382873], "value": 7305.75540292655, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1557.1999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 114.0, 112.0, 110.0, 113.0, 112.0, 113.0, 112.0, 112.0, 113.0], "value": 111.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 124.0, 125.0, 171.0, 124.0, 132.0, 128.0, 128.0, 145.0, 123.0], "value": 134.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 163.0, 164.0, 167.0, 166.0, 175.0, 162.0, 163.0, 163.0, 162.0], "value": 165.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 73.0, 73.0, 110.0, 75.0, 75.0, 74.0, 75.0, 90.0, 75.0], "value": 79.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 118.0, 84.0, 84.0, 83.0, 102.0, 84.0, 83.0, 105.0], "value": 91.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 114.0, 115.0, 114.0, 114.0, 114.0, 117.0, 114.0, 115.0, 115.0], "value": 114.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 151.0, 150.0, 151.0, 151.0, 150.0, 151.0, 151.0, 153.0, 152.0], "value": 151.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 98.0, 95.0, 95.0, 94.0, 94.0, 95.0, 94.0, 94.0], "value": 95.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 55.0, 53.0, 56.0, 55.0, 58.0, 59.0, 57.0, 56.0, 54.0], "value": 55.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 57.0, 57.0, 57.0, 56.0, 61.0, 57.0, 61.0, 57.0, 57.0], "value": 57.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 89.0, 87.0, 86.0, 85.0, 88.0, 90.0, 90.0, 118.0, 88.0], "value": 90.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [140.0, 137.0, 141.0, 132.0, 137.0, 153.0, 145.0, 146.0, 143.0, 137.0], "value": 141.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [198.0, 196.0, 201.0, 192.0, 186.0, 194.0, 191.0, 195.0, 195.0, 199.0], "value": 194.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 78.0, 72.0, 77.0, 76.0, 73.0, 75.0, 75.0, 72.0, 72.0], "value": 74.6, "unit": "score"}]}]} 14:40:06 INFO - Return code: 0 14:40:06 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 14:40:06 INFO - # TBPL SUCCESS # 14:40:06 INFO - Running post-action listener: _resource_record_post_action 14:40:06 INFO - [mozharness: 2017-05-25 21:40:06.310815Z] Finished run-tests step (success) 14:40:06 INFO - Running post-run listener: _resource_record_post_run 14:40:06 INFO - Total resource usage - Wall time: 1256s; CPU: 13.0%; Read bytes: 499712; Write bytes: 421142528; Read time: 252; Write time: 400268 14:40:06 INFO - TinderboxPrint: CPU usage
12.7% 14:40:06 INFO - TinderboxPrint: I/O read bytes / time
499,712 / 252 14:40:06 INFO - TinderboxPrint: I/O write bytes / time
421,142,528 / 400,268 14:40:06 INFO - TinderboxPrint: CPU idle
8,751.7 (87.3%) 14:40:06 INFO - TinderboxPrint: CPU user
1,219.5 (12.2%) 14:40:06 INFO - TinderboxPrint: Swap in / out
0 / 0 14:40:06 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 113303552; Read time: 0; Write time: 167852 14:40:06 INFO - run-tests - Wall time: 1240s; CPU: 13.0%; Read bytes: 499712; Write bytes: 307838976; Read time: 252; Write time: 232416 14:40:06 INFO - Running post-run listener: _upload_blobber_files 14:40:06 INFO - Blob upload gear active. 14:40:06 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 14:40:06 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 14:40:06 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'] 14:40:06 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 14:40:07 INFO - (blobuploader) - INFO - Open directory for files ... 14:40:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 14:40:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:40:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:40:08 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 14:40:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:40:08 INFO - (blobuploader) - INFO - Done attempting. 14:40:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 14:40:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:40:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:40:15 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 14:40:15 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:40:15 INFO - (blobuploader) - INFO - Done attempting. 14:40:15 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 14:40:15 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:40:15 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:40:16 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 14:40:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:40:16 INFO - (blobuploader) - INFO - Done attempting. 14:40:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 14:40:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:40:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:40:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 14:40:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:40:17 INFO - (blobuploader) - INFO - Done attempting. 14:40:17 INFO - (blobuploader) - INFO - Iteration through files over. 14:40:17 INFO - Return code: 0 14:40:17 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 14:40:17 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 14:40:17 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/749bee6e5108a2d6b05e94bfeef5ece9bd27b0e57c98a0ca6d251a75c30e1e36626828731971b0f0a25c476869bc1fbe5ecb125de5915c901354dfeca44b6885", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ed2110aff7a7f58f82dabfe63a759c197be74c6f754ed6dd5c99c25bb036dbdbb6a356bcdd67e3a742e6caf7c2ba6182038c4a81021ccefbd0ca7330c4b39ef0", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/6ef0b9d61f333c2df4ef6300fc55cb67a3db2747822601d04518d9cdf13ad9e7c8d69da9524758c4d26231b68ab3b74c5bc4758db633755271cd6a118386f415", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4a7ac848d9d1710d1aec122e7373128eab103a0328bbc923e44159593dbb90b961de26493446ebe65039510b701932c7a8a52e6d9318aa656cc967bb14b3c790"} 14:40:17 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 14:40:17 INFO - Writing to file /builds/slave/test/properties/blobber_files 14:40:17 INFO - Contents: 14:40:17 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/749bee6e5108a2d6b05e94bfeef5ece9bd27b0e57c98a0ca6d251a75c30e1e36626828731971b0f0a25c476869bc1fbe5ecb125de5915c901354dfeca44b6885", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ed2110aff7a7f58f82dabfe63a759c197be74c6f754ed6dd5c99c25bb036dbdbb6a356bcdd67e3a742e6caf7c2ba6182038c4a81021ccefbd0ca7330c4b39ef0", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/6ef0b9d61f333c2df4ef6300fc55cb67a3db2747822601d04518d9cdf13ad9e7c8d69da9524758c4d26231b68ab3b74c5bc4758db633755271cd6a118386f415", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4a7ac848d9d1710d1aec122e7373128eab103a0328bbc923e44159593dbb90b961de26493446ebe65039510b701932c7a8a52e6d9318aa656cc967bb14b3c790"} 14:40:17 INFO - Running post-run listener: copy_logs_to_upload_dir 14:40:17 INFO - Copying logs to upload dir... 14:40:17 INFO - mkdir: /builds/slave/test/build/upload/logs 14:40:17 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1318.807725 ========= master_lag: 0.06 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 58 secs) (at 2017-05-25 14:40:17.352571) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-25 14:40:17.357394) ========= 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=17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518 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/749bee6e5108a2d6b05e94bfeef5ece9bd27b0e57c98a0ca6d251a75c30e1e36626828731971b0f0a25c476869bc1fbe5ecb125de5915c901354dfeca44b6885", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ed2110aff7a7f58f82dabfe63a759c197be74c6f754ed6dd5c99c25bb036dbdbb6a356bcdd67e3a742e6caf7c2ba6182038c4a81021ccefbd0ca7330c4b39ef0", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/6ef0b9d61f333c2df4ef6300fc55cb67a3db2747822601d04518d9cdf13ad9e7c8d69da9524758c4d26231b68ab3b74c5bc4758db633755271cd6a118386f415", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4a7ac848d9d1710d1aec122e7373128eab103a0328bbc923e44159593dbb90b961de26493446ebe65039510b701932c7a8a52e6d9318aa656cc967bb14b3c790"} build_url:https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011382 build_url: 'https://queue.taskcluster.net/v1/task/Ti71EBITRXS4dxuwSZXJCQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/749bee6e5108a2d6b05e94bfeef5ece9bd27b0e57c98a0ca6d251a75c30e1e36626828731971b0f0a25c476869bc1fbe5ecb125de5915c901354dfeca44b6885", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ed2110aff7a7f58f82dabfe63a759c197be74c6f754ed6dd5c99c25bb036dbdbb6a356bcdd67e3a742e6caf7c2ba6182038c4a81021ccefbd0ca7330c4b39ef0", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/6ef0b9d61f333c2df4ef6300fc55cb67a3db2747822601d04518d9cdf13ad9e7c8d69da9524758c4d26231b68ab3b74c5bc4758db633755271cd6a118386f415", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4a7ac848d9d1710d1aec122e7373128eab103a0328bbc923e44159593dbb90b961de26493446ebe65039510b701932c7a8a52e6d9318aa656cc967bb14b3c790"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-25 14:40:17.388171) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-25 14:40:17.388573) ========= 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=17051fcd5208b27b50bedfeb000001dd-1495747096.145836-1940693518 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004447 ========= master_lag: 0.07 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-25 14:40:17.466865) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-25 14:40:17.467207) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-25 14:40:17.467526) ========= ========= Total master_lag: 0.22 =========