builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-033 starttime: 1458131070.69 results: success (0) buildid: 20160316035746 builduid: e3beea6707f34707a6fd11a3151829c1 revision: db96206f80c80292286d0fae12112ab2b47af364 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.691688) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.692129) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.692412) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] 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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006356 basedir: '/builds/slave/test' ========= master_lag: 0.04 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.736465) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.736758) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.818622) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.818879) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', '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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004568 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.872574) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.872852) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.873174) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:30.873476) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-16 05:24:30-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.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: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 40.7M=0s 2016-03-16 05:24:31 (40.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.166336 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.053329) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.053648) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] 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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020357 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.103475) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.103846) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev db96206f80c80292286d0fae12112ab2b47af364 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev db96206f80c80292286d0fae12112ab2b47af364 --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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-16 05:24:31,144 truncating revision to first 12 chars 2016-03-16 05:24:31,144 Setting DEBUG logging. 2016-03-16 05:24:31,144 attempt 1/10 2016-03-16 05:24:31,144 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/db96206f80c8?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-16 05:24:31,392 unpacking tar archive at: fx-team-db96206f80c8/testing/mozharness/ program finished with exit code 0 elapsedTime=0.534997 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.651276) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.651593) ========= echo db96206f80c80292286d0fae12112ab2b47af364 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'db96206f80c80292286d0fae12112ab2b47af364'] 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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False db96206f80c80292286d0fae12112ab2b47af364 program finished with exit code 0 elapsedTime=0.003815 script_repo_revision: 'db96206f80c80292286d0fae12112ab2b47af364' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.700436) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.700764) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-16 05:24:31.710734) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 46 secs) (at 2016-03-16 05:24:31.711064) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 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', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:24:31 INFO - MultiFileLogger online at 20160316 05:24:31 in /builds/slave/test 05:24:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 05:24:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:24:31 INFO - {'append_to_log': False, 05:24:31 INFO - 'base_work_dir': '/builds/slave/test', 05:24:31 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 05:24:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:24:31 INFO - 'branch': 'Fx-Team-Non-PGO', 05:24:31 INFO - 'buildbot_json_path': 'buildprops.json', 05:24:31 INFO - 'config_files': ('talos/linux_config.py',), 05:24:31 INFO - 'default_actions': ('clobber', 05:24:31 INFO - 'read-buildbot-config', 05:24:31 INFO - 'download-and-extract', 05:24:31 INFO - 'populate-webroot', 05:24:31 INFO - 'create-virtualenv', 05:24:31 INFO - 'install', 05:24:31 INFO - 'run-tests'), 05:24:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:24:31 INFO - 'download_minidump_stackwalk': True, 05:24:31 INFO - 'download_symbols': 'ondemand', 05:24:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:24:31 INFO - 'tooltool.py': '/tools/tooltool.py', 05:24:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:24:31 INFO - '/tools/misc-python/virtualenv.py')}, 05:24:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:24:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:24:31 INFO - 'installer_path': 'installer.exe', 05:24:31 INFO - 'log_level': 'info', 05:24:31 INFO - 'log_name': 'talos', 05:24:31 INFO - 'log_to_console': True, 05:24:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:24:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:24:31 INFO - 'opt_config_files': (), 05:24:31 INFO - 'pip_index': False, 05:24:31 INFO - 'sps_profile': False, 05:24:31 INFO - 'sps_profile_interval': 0, 05:24:31 INFO - 'suite': 'dromaeojs', 05:24:31 INFO - 'system_bits': '32', 05:24:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:24:31 INFO - 'title': 'talos-linux64-ix-033', 05:24:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:24:31 INFO - 'use_talos_json': True, 05:24:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:24:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:24:31 INFO - 'work_dir': 'build'} 05:24:31 INFO - ##### 05:24:31 INFO - ##### Running clobber step. 05:24:31 INFO - ##### 05:24:31 INFO - Running pre-action listener: _resource_record_pre_action 05:24:31 INFO - Running main action method: clobber 05:24:31 INFO - rmtree: /builds/slave/test/build 05:24:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:24:32 INFO - Running post-action listener: _resource_record_post_action 05:24:32 INFO - ##### 05:24:32 INFO - ##### Running read-buildbot-config step. 05:24:32 INFO - ##### 05:24:32 INFO - Running pre-action listener: _resource_record_pre_action 05:24:32 INFO - Running main action method: read_buildbot_config 05:24:32 INFO - Using buildbot properties: 05:24:32 INFO - { 05:24:32 INFO - "project": "", 05:24:32 INFO - "product": "firefox", 05:24:32 INFO - "script_repo_revision": "production", 05:24:32 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 05:24:32 INFO - "repository": "", 05:24:32 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 05:24:32 INFO - "buildid": "20160316035746", 05:24:32 INFO - "pgo_build": "False", 05:24:32 INFO - "basedir": "/builds/slave/test", 05:24:32 INFO - "buildnumber": 2643, 05:24:32 INFO - "slavename": "talos-linux64-ix-033", 05:24:32 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 05:24:32 INFO - "platform": "ubuntu64_hw", 05:24:32 INFO - "scheduler": "tests-fx-team-linux64-talos", 05:24:32 INFO - "branch": "fx-team", 05:24:32 INFO - "repo_path": "integration/fx-team", 05:24:32 INFO - "revision": "db96206f80c80292286d0fae12112ab2b47af364", 05:24:32 INFO - "stage_platform": "linux64", 05:24:32 INFO - "builduid": "e3beea6707f34707a6fd11a3151829c1", 05:24:32 INFO - "slavebuilddir": "test" 05:24:32 INFO - } 05:24:32 INFO - Found installer url https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 05:24:32 INFO - Running post-action listener: _resource_record_post_action 05:24:32 INFO - ##### 05:24:32 INFO - ##### Running download-and-extract step. 05:24:32 INFO - ##### 05:24:32 INFO - Running pre-action listener: _resource_record_pre_action 05:24:32 INFO - Running main action method: download_and_extract 05:24:32 INFO - mkdir: /builds/slave/test/build/tests 05:24:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:32 INFO - https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 05:24:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 05:24:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 05:24:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 05:24:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 05:24:37 INFO - Downloaded 1361 bytes. 05:24:37 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 05:24:37 INFO - Using the following test package requirements: 05:24:37 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 05:24:37 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:37 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:24:37 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:37 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:24:37 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:37 INFO - u'jsshell-linux-x86_64.zip'], 05:24:37 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:37 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:24:37 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 05:24:37 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:37 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:24:37 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:37 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:24:37 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:37 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:24:37 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:24:37 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:24:37 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:24:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:37 INFO - https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:24:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:24:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:24:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:24:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:24:42 INFO - Downloaded 21992845 bytes. 05:24:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:24:42 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 05:24:43 INFO - Return code: 0 05:24:43 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:24:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:43 INFO - https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:24:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:24:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:24:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:24:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:24:46 INFO - Downloaded 21992845 bytes. 05:24:46 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:24:46 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 05:24:47 INFO - Return code: 0 05:24:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:47 INFO - https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:24:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 05:24:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 05:24:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 05:24:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:24:49 INFO - Downloaded 10846462 bytes. 05:24:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:24:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 05:24:49 INFO - Return code: 0 05:24:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:49 INFO - https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:24:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:24:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:24:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:24:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:24:51 INFO - Downloaded 54143978 bytes. 05:24:51 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:24:51 INFO - mkdir: /builds/slave/test/properties 05:24:51 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:24:51 INFO - Writing to file /builds/slave/test/properties/build_url 05:24:51 INFO - Contents: 05:24:51 INFO - build_url:https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:24:52 INFO - Running post-action listener: _resource_record_post_action 05:24:52 INFO - Running post-action listener: set_extra_try_arguments 05:24:52 INFO - ##### 05:24:52 INFO - ##### Running populate-webroot step. 05:24:52 INFO - ##### 05:24:52 INFO - Running pre-action listener: _resource_record_pre_action 05:24:52 INFO - Running main action method: populate_webroot 05:24:52 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:24:52 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:24:52 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:24:52 INFO - '--tppagecycles', 05:24:52 INFO - '7'], 05:24:52 INFO - 'tests': ['tsvgm']}}, 05:24:52 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:24:52 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:24:52 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 05:24:52 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:24:52 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:24:52 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:52 INFO - 'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:24:52 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:52 INFO - 'tests': ['damp', 'tps']}, 05:24:52 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:52 INFO - 'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['damp', 'tps']}, 05:24:52 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:24:52 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:24:52 INFO - 'other': {'tests': ['a11yr', 05:24:52 INFO - 'ts_paint', 05:24:52 INFO - 'tpaint', 05:24:52 INFO - 'sessionrestore', 05:24:52 INFO - 'sessionrestore_no_auto_restore', 05:24:52 INFO - 'tabpaint']}, 05:24:52 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['a11yr', 05:24:52 INFO - 'ts_paint', 05:24:52 INFO - 'tpaint', 05:24:52 INFO - 'sessionrestore', 05:24:52 INFO - 'sessionrestore_no_auto_restore', 05:24:52 INFO - 'tabpaint']}, 05:24:52 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['a11yr', 05:24:52 INFO - 'ts_paint', 05:24:52 INFO - 'tpaint', 05:24:52 INFO - 'sessionrestore', 05:24:52 INFO - 'sessionrestore_no_auto_restore', 05:24:52 INFO - 'tabpaint']}, 05:24:52 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['a11yr', 05:24:52 INFO - 'ts_paint', 05:24:52 INFO - 'tpaint', 05:24:52 INFO - 'sessionrestore', 05:24:52 INFO - 'sessionrestore_no_auto_restore', 05:24:52 INFO - 'tabpaint']}, 05:24:52 INFO - 'other_l64': {'tests': ['a11yr', 05:24:52 INFO - 'ts_paint', 05:24:52 INFO - 'tpaint', 05:24:52 INFO - 'sessionrestore', 05:24:52 INFO - 'sessionrestore_no_auto_restore', 05:24:52 INFO - 'tabpaint']}, 05:24:52 INFO - 'other_nol64': {'tests': ['a11yr', 05:24:52 INFO - 'ts_paint', 05:24:52 INFO - 'tpaint', 05:24:52 INFO - 'sessionrestore', 05:24:52 INFO - 'sessionrestore_no_auto_restore', 05:24:52 INFO - 'tabpaint']}, 05:24:52 INFO - 'svgr': {'tests': ['tsvgx', 05:24:52 INFO - 'tsvgr_opacity', 05:24:52 INFO - 'tart', 05:24:52 INFO - 'tscrollx', 05:24:52 INFO - 'cart']}, 05:24:52 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['tsvgx', 05:24:52 INFO - 'tsvgr_opacity', 05:24:52 INFO - 'tart', 05:24:52 INFO - 'tscrollx', 05:24:52 INFO - 'cart']}, 05:24:52 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:52 INFO - 'tests': ['tp5o']}, 05:24:52 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:52 INFO - 'talos_options': ['--e10s'], 05:24:52 INFO - 'tests': ['tp5o']}, 05:24:52 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:52 INFO - 'talos_options': ['--xperf_path', 05:24:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:24:52 INFO - 'tests': ['tp5n']}, 05:24:52 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:24:52 INFO - 'talos_options': ['--e10s', 05:24:52 INFO - '--xperf_path', 05:24:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:24:52 INFO - 'tests': ['tp5n']}}, 05:24:52 INFO - 'talos.zip': {'path': '', 05:24:52 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:24:52 INFO - Running post-action listener: _resource_record_post_action 05:24:52 INFO - ##### 05:24:52 INFO - ##### Running create-virtualenv step. 05:24:52 INFO - ##### 05:24:52 INFO - Running pre-action listener: _resource_record_pre_action 05:24:52 INFO - Running main action method: create_virtualenv 05:24:52 INFO - Creating virtualenv /builds/slave/test/build/venv 05:24:52 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 05:24:52 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:24:52 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:24:52 INFO - Using real prefix '/usr' 05:24:52 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:24:52 INFO - Installing distribute.............................................................................................................................................................................................done. 05:24:54 INFO - Installing pip.................done. 05:24:54 INFO - Return code: 0 05:24:54 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:24:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:54 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:24:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 05:24:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:24:54 INFO - Using env: {'DISPLAY': ':0', 05:24:54 INFO - 'HOME': '/home/cltbld', 05:24:54 INFO - 'LANG': 'en_US.UTF-8', 05:24:54 INFO - 'LANGUAGE': 'en_US:en', 05:24:54 INFO - 'LOGNAME': 'cltbld', 05:24:54 INFO - 'MAIL': '/var/mail/cltbld', 05:24:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:54 INFO - 'MOZ_NO_REMOTE': '1', 05:24:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:24:54 INFO - 'NO_EM_RESTART': '1', 05:24:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:24:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:54 INFO - 'PWD': '/builds/slave/test', 05:24:54 INFO - 'SHELL': '/bin/bash', 05:24:54 INFO - 'SHLVL': '1', 05:24:54 INFO - 'TERM': 'linux', 05:24:54 INFO - 'TMOUT': '86400', 05:24:54 INFO - 'USER': 'cltbld', 05:24:54 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:24:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:54 INFO - '_': '/tools/buildbot/bin/python'} 05:24:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:54 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 05:24:54 INFO - Cleaning up... 05:24:54 INFO - Return code: 0 05:24:54 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:24:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:54 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:24:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 05:24:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 05:24:54 INFO - Using env: {'DISPLAY': ':0', 05:24:54 INFO - 'HOME': '/home/cltbld', 05:24:54 INFO - 'LANG': 'en_US.UTF-8', 05:24:54 INFO - 'LANGUAGE': 'en_US:en', 05:24:54 INFO - 'LOGNAME': 'cltbld', 05:24:54 INFO - 'MAIL': '/var/mail/cltbld', 05:24:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:54 INFO - 'MOZ_NO_REMOTE': '1', 05:24:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:24:54 INFO - 'NO_EM_RESTART': '1', 05:24:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:24:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:54 INFO - 'PWD': '/builds/slave/test', 05:24:54 INFO - 'SHELL': '/bin/bash', 05:24:54 INFO - 'SHLVL': '1', 05:24:54 INFO - 'TERM': 'linux', 05:24:54 INFO - 'TMOUT': '86400', 05:24:54 INFO - 'USER': 'cltbld', 05:24:54 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:24:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:54 INFO - '_': '/tools/buildbot/bin/python'} 05:24:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:55 INFO - Downloading/unpacking psutil>=0.7.1 05:24: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 05:24: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 05:24:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:24:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:24: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 05:24: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 05:24:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:24:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:24:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:24:57 INFO - Installing collected packages: psutil 05:24:57 INFO - Running setup.py install for psutil 05:24:57 INFO - building 'psutil._psutil_linux' extension 05:24:57 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 05:24:57 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 05:24:57 INFO - building 'psutil._psutil_posix' extension 05:24:57 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 05:24:57 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 05:24:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:24:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:24:57 INFO - Successfully installed psutil 05:24:57 INFO - Cleaning up... 05:24:57 INFO - Return code: 0 05:24:57 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:24:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:57 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:24:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 05:24:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 05:24:57 INFO - Using env: {'DISPLAY': ':0', 05:24:57 INFO - 'HOME': '/home/cltbld', 05:24:57 INFO - 'LANG': 'en_US.UTF-8', 05:24:57 INFO - 'LANGUAGE': 'en_US:en', 05:24:57 INFO - 'LOGNAME': 'cltbld', 05:24:57 INFO - 'MAIL': '/var/mail/cltbld', 05:24:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:57 INFO - 'MOZ_NO_REMOTE': '1', 05:24:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:24:57 INFO - 'NO_EM_RESTART': '1', 05:24:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:24:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:57 INFO - 'PWD': '/builds/slave/test', 05:24:57 INFO - 'SHELL': '/bin/bash', 05:24:57 INFO - 'SHLVL': '1', 05:24:57 INFO - 'TERM': 'linux', 05:24:57 INFO - 'TMOUT': '86400', 05:24:57 INFO - 'USER': 'cltbld', 05:24:57 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:24:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:57 INFO - '_': '/tools/buildbot/bin/python'} 05:24:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:57 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:24: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 05:24: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 05:24:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:24:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:24: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 05:24: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 05:24:59 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:24:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:24:59 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:24:59 INFO - Installing collected packages: mozsystemmonitor 05:24:59 INFO - Running setup.py install for mozsystemmonitor 05:24:59 INFO - Successfully installed mozsystemmonitor 05:24:59 INFO - Cleaning up... 05:24:59 INFO - Return code: 0 05:24:59 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:24:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:59 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:24:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 05:24:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:24:59 INFO - Using env: {'DISPLAY': ':0', 05:24:59 INFO - 'HOME': '/home/cltbld', 05:24:59 INFO - 'LANG': 'en_US.UTF-8', 05:24:59 INFO - 'LANGUAGE': 'en_US:en', 05:24:59 INFO - 'LOGNAME': 'cltbld', 05:24:59 INFO - 'MAIL': '/var/mail/cltbld', 05:24:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:59 INFO - 'MOZ_NO_REMOTE': '1', 05:24:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:24:59 INFO - 'NO_EM_RESTART': '1', 05:24:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:24:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:59 INFO - 'PWD': '/builds/slave/test', 05:24:59 INFO - 'SHELL': '/bin/bash', 05:24:59 INFO - 'SHLVL': '1', 05:24:59 INFO - 'TERM': 'linux', 05:24:59 INFO - 'TMOUT': '86400', 05:24:59 INFO - 'USER': 'cltbld', 05:24:59 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:24:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:59 INFO - '_': '/tools/buildbot/bin/python'} 05:25:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:00 INFO - Downloading/unpacking blobuploader==1.2.4 05:25: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 05:25: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 05:25:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25: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 05:25: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 05:25:01 INFO - Downloading blobuploader-1.2.4.tar.gz 05:25:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:25:02 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:25:02 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 05:25:02 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 05:25:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:02 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 05:25:02 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 05:25:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:25:02 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:25:02 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 05:25:02 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 05:25:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:02 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 05:25:02 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 05:25:02 INFO - Downloading docopt-0.6.1.tar.gz 05:25:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:25:02 INFO - Installing collected packages: blobuploader, requests, docopt 05:25:02 INFO - Running setup.py install for blobuploader 05:25:02 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:25:02 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:25:02 INFO - Running setup.py install for requests 05:25:03 INFO - Running setup.py install for docopt 05:25:03 INFO - Successfully installed blobuploader requests docopt 05:25:03 INFO - Cleaning up... 05:25:03 INFO - Return code: 0 05:25:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:25:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:03 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:25:03 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 05:25:03 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:25:03 INFO - Using env: {'DISPLAY': ':0', 05:25:03 INFO - 'HOME': '/home/cltbld', 05:25:03 INFO - 'LANG': 'en_US.UTF-8', 05:25:03 INFO - 'LANGUAGE': 'en_US:en', 05:25:03 INFO - 'LOGNAME': 'cltbld', 05:25:03 INFO - 'MAIL': '/var/mail/cltbld', 05:25:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:03 INFO - 'MOZ_NO_REMOTE': '1', 05:25:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:03 INFO - 'NO_EM_RESTART': '1', 05:25:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:03 INFO - 'PWD': '/builds/slave/test', 05:25:03 INFO - 'SHELL': '/bin/bash', 05:25:03 INFO - 'SHLVL': '1', 05:25:03 INFO - 'TERM': 'linux', 05:25:03 INFO - 'TMOUT': '86400', 05:25:03 INFO - 'USER': 'cltbld', 05:25:03 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:25:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:03 INFO - '_': '/tools/buildbot/bin/python'} 05:25:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:25:03 INFO - Running setup.py (path:/tmp/pip-VYaslR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:25:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:25:03 INFO - Running setup.py (path:/tmp/pip-H4f3F4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:25:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:25:03 INFO - Running setup.py (path:/tmp/pip-zccsmN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:25:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:25:03 INFO - Running setup.py (path:/tmp/pip-V1YPxg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:25:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:25:03 INFO - Running setup.py (path:/tmp/pip-AOcB2D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:25:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:25:03 INFO - Running setup.py (path:/tmp/pip-3PAjbM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:25:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:25:03 INFO - Running setup.py (path:/tmp/pip-_diTvG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:25:04 INFO - Running setup.py (path:/tmp/pip-fWtvp_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:25:04 INFO - Running setup.py (path:/tmp/pip-qVL0PS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:25:04 INFO - Running setup.py (path:/tmp/pip-t6geW6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:25:04 INFO - Running setup.py (path:/tmp/pip-LwHAbE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:25:04 INFO - Running setup.py (path:/tmp/pip-opUx7m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:25:04 INFO - Running setup.py (path:/tmp/pip-8ZkLc_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:25:04 INFO - Running setup.py (path:/tmp/pip-ZHh_Tr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:25:04 INFO - Running setup.py (path:/tmp/pip-5KkRVJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:25:04 INFO - Running setup.py (path:/tmp/pip-XdKLzQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:25:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:25:04 INFO - Running setup.py (path:/tmp/pip-7giZpe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:25:04 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:25:04 INFO - Running setup.py install for manifestparser 05:25:04 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:25:04 INFO - Running setup.py install for mozcrash 05:25:04 INFO - Running setup.py install for mozdebug 05:25:05 INFO - Running setup.py install for mozdevice 05:25:05 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Running setup.py install for mozfile 05:25:05 INFO - Running setup.py install for mozhttpd 05:25:05 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Running setup.py install for mozinfo 05:25:05 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Running setup.py install for mozInstall 05:25:05 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Running setup.py install for mozleak 05:25:05 INFO - Running setup.py install for mozlog 05:25:05 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Running setup.py install for moznetwork 05:25:05 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:25:05 INFO - Running setup.py install for mozprocess 05:25:06 INFO - Running setup.py install for mozprofile 05:25:06 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Running setup.py install for mozrunner 05:25:06 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Running setup.py install for mozscreenshot 05:25:06 INFO - Running setup.py install for moztest 05:25:06 INFO - Running setup.py install for mozversion 05:25:06 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:25:06 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:25:06 INFO - Cleaning up... 05:25:06 INFO - Return code: 0 05:25:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:25:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:06 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:25:06 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 05:25:06 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:25:06 INFO - Using env: {'DISPLAY': ':0', 05:25:06 INFO - 'HOME': '/home/cltbld', 05:25:06 INFO - 'LANG': 'en_US.UTF-8', 05:25:06 INFO - 'LANGUAGE': 'en_US:en', 05:25:06 INFO - 'LOGNAME': 'cltbld', 05:25:06 INFO - 'MAIL': '/var/mail/cltbld', 05:25:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:06 INFO - 'MOZ_NO_REMOTE': '1', 05:25:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:06 INFO - 'NO_EM_RESTART': '1', 05:25:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:06 INFO - 'PWD': '/builds/slave/test', 05:25:06 INFO - 'SHELL': '/bin/bash', 05:25:06 INFO - 'SHLVL': '1', 05:25:06 INFO - 'TERM': 'linux', 05:25:06 INFO - 'TMOUT': '86400', 05:25:06 INFO - 'USER': 'cltbld', 05:25:06 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:25:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:06 INFO - '_': '/tools/buildbot/bin/python'} 05:25:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:25:06 INFO - Running setup.py (path:/tmp/pip-XNUsHT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:25:06 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)) 05:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:25:06 INFO - Running setup.py (path:/tmp/pip-KQXfX5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:25:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 05:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:25:06 INFO - Running setup.py (path:/tmp/pip-nAOSMH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:25:07 INFO - Running setup.py (path:/tmp/pip-7Bdgue-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:25:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:25:07 INFO - Running setup.py (path:/tmp/pip-8mREnU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:25:07 INFO - Running setup.py (path:/tmp/pip-XmJgSx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:25:07 INFO - Running setup.py (path:/tmp/pip-oMCb5K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:25:07 INFO - Running setup.py (path:/tmp/pip-wNSZW3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:25:07 INFO - Running setup.py (path:/tmp/pip-IzLAjy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:25:07 INFO - Running setup.py (path:/tmp/pip-sjobN8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:25:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:25:07 INFO - Running setup.py (path:/tmp/pip-IIURZR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:25:07 INFO - Running setup.py (path:/tmp/pip-Ep_46n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:25:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:25:07 INFO - Running setup.py (path:/tmp/pip-5RmAUG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:25:07 INFO - Running setup.py (path:/tmp/pip-UCU2bh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:25:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:25:07 INFO - Running setup.py (path:/tmp/pip-2GKAYQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:25:07 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:25:07 INFO - Running setup.py (path:/tmp/pip-G8uws6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:25:07 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 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)) 05:25:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:25:07 INFO - Running setup.py (path:/tmp/pip-JzkJ0M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:25:08 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)) 05:25:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:25:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:25:08 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)) 05:25:08 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:25:08 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:25:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:25:08 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 05:25:08 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 05:25:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:08 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 05:25:08 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 05:25:09 INFO - Downloading blessings-1.6.tar.gz 05:25:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:25:09 INFO - Installing collected packages: blessings 05:25:09 INFO - Running setup.py install for blessings 05:25:10 INFO - Successfully installed blessings 05:25:10 INFO - Cleaning up... 05:25:10 INFO - Return code: 0 05:25:10 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:25:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:25:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:25:10 INFO - Reading from file tmpfile_stdout 05:25:10 INFO - Current package versions: 05:25:10 INFO - argparse == 1.2.1 05:25:10 INFO - blessings == 1.6 05:25:10 INFO - blobuploader == 1.2.4 05:25:10 INFO - docopt == 0.6.1 05:25:10 INFO - manifestparser == 1.1 05:25:10 INFO - mozInstall == 1.12 05:25:10 INFO - mozcrash == 0.17 05:25:10 INFO - mozdebug == 0.1 05:25:10 INFO - mozdevice == 0.48 05:25:10 INFO - mozfile == 1.2 05:25:10 INFO - mozhttpd == 0.7 05:25:10 INFO - mozinfo == 0.9 05:25:10 INFO - mozleak == 0.1 05:25:10 INFO - mozlog == 3.1 05:25:10 INFO - moznetwork == 0.27 05:25:10 INFO - mozprocess == 0.22 05:25:10 INFO - mozprofile == 0.28 05:25:10 INFO - mozrunner == 6.11 05:25:10 INFO - mozscreenshot == 0.1 05:25:10 INFO - mozsystemmonitor == 0.0 05:25:10 INFO - moztest == 0.7 05:25:10 INFO - mozversion == 1.4 05:25:10 INFO - psutil == 3.1.1 05:25:10 INFO - requests == 1.2.3 05:25:10 INFO - wsgiref == 0.1.2 05:25:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:25:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:10 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:25:10 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 05:25:10 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:25:10 INFO - Using env: {'DISPLAY': ':0', 05:25:10 INFO - 'HOME': '/home/cltbld', 05:25:10 INFO - 'LANG': 'en_US.UTF-8', 05:25:10 INFO - 'LANGUAGE': 'en_US:en', 05:25:10 INFO - 'LOGNAME': 'cltbld', 05:25:10 INFO - 'MAIL': '/var/mail/cltbld', 05:25:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:10 INFO - 'MOZ_NO_REMOTE': '1', 05:25:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:10 INFO - 'NO_EM_RESTART': '1', 05:25:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:10 INFO - 'PWD': '/builds/slave/test', 05:25:10 INFO - 'SHELL': '/bin/bash', 05:25:10 INFO - 'SHLVL': '1', 05:25:10 INFO - 'TERM': 'linux', 05:25:10 INFO - 'TMOUT': '86400', 05:25:10 INFO - 'USER': 'cltbld', 05:25:10 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:25:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:10 INFO - '_': '/tools/buildbot/bin/python'} 05:25:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 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)) 05:25:10 INFO - Cleaning up... 05:25:10 INFO - Return code: 0 05:25:10 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:25:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:25:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 05:25:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:25:10 INFO - Using env: {'DISPLAY': ':0', 05:25:10 INFO - 'HOME': '/home/cltbld', 05:25:10 INFO - 'LANG': 'en_US.UTF-8', 05:25:10 INFO - 'LANGUAGE': 'en_US:en', 05:25:10 INFO - 'LOGNAME': 'cltbld', 05:25:10 INFO - 'MAIL': '/var/mail/cltbld', 05:25:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:10 INFO - 'MOZ_NO_REMOTE': '1', 05:25:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:10 INFO - 'NO_EM_RESTART': '1', 05:25:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:10 INFO - 'PWD': '/builds/slave/test', 05:25:10 INFO - 'SHELL': '/bin/bash', 05:25:10 INFO - 'SHLVL': '1', 05:25:10 INFO - 'TERM': 'linux', 05:25:10 INFO - 'TMOUT': '86400', 05:25:10 INFO - 'USER': 'cltbld', 05:25:10 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:25:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:10 INFO - '_': '/tools/buildbot/bin/python'} 05:25:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:10 INFO - Downloading/unpacking jsonschema 05:25:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:25:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:25:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:25:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:25:12 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:25:12 INFO - Downloading/unpacking functools32 (from jsonschema) 05:25:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:25:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:25:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:25:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:25:12 INFO - Downloading functools32-3.2.3-2.tar.gz 05:25:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:25:12 INFO - warning: no files found matching '*.txt' 05:25:12 INFO - no previously-included directories found matching 'build' 05:25:12 INFO - no previously-included directories found matching 'dist' 05:25:12 INFO - no previously-included directories found matching '.git*' 05:25:12 INFO - Installing collected packages: jsonschema, functools32 05:25:12 INFO - Running setup.py install for functools32 05:25:13 INFO - warning: no files found matching '*.txt' 05:25:13 INFO - no previously-included directories found matching 'build' 05:25:13 INFO - no previously-included directories found matching 'dist' 05:25:13 INFO - no previously-included directories found matching '.git*' 05:25:13 INFO - Successfully installed jsonschema functools32 05:25:13 INFO - Cleaning up... 05:25:13 INFO - Return code: 0 05:25:13 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 05:25:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:25:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:25:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:25:13 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f312badcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23cb410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', '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 05:25:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 05:25:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 05:25:13 INFO - Using env: {'DISPLAY': ':0', 05:25:13 INFO - 'HOME': '/home/cltbld', 05:25:13 INFO - 'LANG': 'en_US.UTF-8', 05:25:13 INFO - 'LANGUAGE': 'en_US:en', 05:25:13 INFO - 'LOGNAME': 'cltbld', 05:25:13 INFO - 'MAIL': '/var/mail/cltbld', 05:25:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:13 INFO - 'MOZ_NO_REMOTE': '1', 05:25:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:13 INFO - 'NO_EM_RESTART': '1', 05:25:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:13 INFO - 'PWD': '/builds/slave/test', 05:25:13 INFO - 'SHELL': '/bin/bash', 05:25:13 INFO - 'SHLVL': '1', 05:25:13 INFO - 'TERM': 'linux', 05:25:13 INFO - 'TMOUT': '86400', 05:25:13 INFO - 'USER': 'cltbld', 05:25:13 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:25:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:13 INFO - '_': '/tools/buildbot/bin/python'} 05:25:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:25:13 INFO - Downloading/unpacking flake8 05:25:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:25:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:25:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:25:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:25:15 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:25:15 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:25:15 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 05:25:15 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 05:25:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:15 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 05:25:15 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 05:25:15 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:25:15 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:25:15 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 05:25:15 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 05:25:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:15 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 05:25:15 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 05:25:15 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:25:15 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 05:25:15 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 05:25:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:25:15 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 05:25:15 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 05:25:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 05:25:15 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:25:15 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:25:15 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:25:15 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:25:15 INFO - no previously-included directories found matching 'docs/_build' 05:25:15 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:25:15 INFO - Running setup.py install for pep8 05:25:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:25:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:25:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:25:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:25:16 INFO - no previously-included directories found matching 'docs/_build' 05:25:16 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 05:25:16 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:25:16 INFO - Cleaning up... 05:25:16 INFO - Return code: 0 05:25:16 INFO - Running post-action listener: _resource_record_post_action 05:25:16 INFO - Running post-action listener: _start_resource_monitoring 05:25:16 INFO - Starting resource monitoring. 05:25:16 INFO - ##### 05:25:16 INFO - ##### Running install step. 05:25:16 INFO - ##### 05:25:16 INFO - Running pre-action listener: _resource_record_pre_action 05:25:16 INFO - Running main action method: install 05:25:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:25:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:25:16 INFO - Reading from file tmpfile_stdout 05:25:16 INFO - Detecting whether we're running mozinstall >=1.0... 05:25:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:25:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:25:16 INFO - Reading from file tmpfile_stdout 05:25:16 INFO - Output received: 05:25:16 INFO - Usage: mozinstall [options] installer 05:25:16 INFO - Options: 05:25:16 INFO - -h, --help show this help message and exit 05:25:16 INFO - -d DEST, --destination=DEST 05:25:16 INFO - Directory to install application into. [default: 05:25:16 INFO - "/builds/slave/test"] 05:25:16 INFO - --app=APP Application being installed. [default: firefox] 05:25:16 INFO - mkdir: /builds/slave/test/build/application 05:25:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:25:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 05:25:32 INFO - Reading from file tmpfile_stdout 05:25:32 INFO - Output received: 05:25:32 INFO - /builds/slave/test/build/application/firefox/firefox 05:25:32 INFO - Running post-action listener: _resource_record_post_action 05:25:32 INFO - ##### 05:25:32 INFO - ##### Running run-tests step. 05:25:32 INFO - ##### 05:25:32 INFO - Running pre-action listener: _resource_record_pre_action 05:25:32 INFO - Running main action method: run_tests 05:25:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:25:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:25:32 INFO - Python 2.7.3 05:25:32 INFO - Return code: 0 05:25:32 INFO - grabbing minidump binary from tooltool 05:25:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:25:32 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x245a160>, '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 0x245b060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x245b4f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:25:32 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 05:25:32 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 05:25:32 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:25:32 INFO - Return code: 0 05:25:32 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:25:32 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:25:32 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:25:32 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:25:32 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:25:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 05:25:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 05:25:33 INFO - Return code: 0 05:25:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-033', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 05:25:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-033 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 05:25:33 INFO - Using env: {'DISPLAY': ':0', 05:25:33 INFO - 'HOME': '/home/cltbld', 05:25:33 INFO - 'LANG': 'en_US.UTF-8', 05:25:33 INFO - 'LANGUAGE': 'en_US:en', 05:25:33 INFO - 'LOGNAME': 'cltbld', 05:25:33 INFO - 'MAIL': '/var/mail/cltbld', 05:25:33 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:25:33 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:25:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:33 INFO - 'MOZ_NO_REMOTE': '1', 05:25:33 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:25:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:25:33 INFO - 'NO_EM_RESTART': '1', 05:25:33 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:25:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:33 INFO - 'PWD': '/builds/slave/test', 05:25:33 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:25:33 INFO - 'SHELL': '/bin/bash', 05:25:33 INFO - 'SHLVL': '1', 05:25:33 INFO - 'TERM': 'linux', 05:25:33 INFO - 'TMOUT': '86400', 05:25:33 INFO - 'USER': 'cltbld', 05:25:33 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948', 05:25:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:33 INFO - '_': '/tools/buildbot/bin/python'} 05:25:33 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-033', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 05:25:33 INFO - mozversion application_buildid: 20160316035746 05:25:33 INFO - mozversion application_changeset: db96206f80c80292286d0fae12112ab2b47af364 05:25:33 INFO - mozversion application_display_name: Nightly 05:25:33 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:25:33 INFO - mozversion application_name: Firefox 05:25:33 INFO - mozversion application_remotingname: firefox 05:25:33 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 05:25:33 INFO - mozversion application_vendor: Mozilla 05:25:33 INFO - mozversion application_version: 48.0a1 05:25:33 INFO - mozversion platform_buildid: 20160316035746 05:25:33 INFO - mozversion platform_changeset: db96206f80c80292286d0fae12112ab2b47af364 05:25:33 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 05:25:33 INFO - mozversion platform_version: 48.0a1 05:25:33 INFO - using testdate: 1458131133 05:25:33 INFO - actual date: 1458131133 05:25:33 INFO - starting webserver on 'localhost:46977' 05:25:33 INFO - SUITE-START | Running 2 tests 05:25:33 INFO - TEST-START | dromaeo_css 05:25:33 INFO - operating with platform_type : linux_ 05:25:33 INFO - Initialising browser for dromaeo_css test... 05:25:33 INFO - TEST-INFO | started process 31393 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5PabgS/profile http://localhost:46977/getInfo.html) 05:25:39 INFO - PROCESS | 31393 | __metrics Screen width/height:1600/1200 05:25:39 INFO - PROCESS | 31393 | colorDepth:24 05:25:39 INFO - PROCESS | 31393 | Browser inner width/height: 1024/697 05:25:39 INFO - PROCESS | 31393 | __metrics 05:25:40 ERROR - PROCESS | 31393 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 05:25:41 INFO - TEST-INFO | 31393: exit 0 05:25:41 INFO - Browser initialized. 05:25:41 INFO - Running cycle 1/1 for dromaeo_css test... 05:25:41 INFO - TEST-INFO | started process 31487 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5PabgS/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:25:53 INFO - PROCESS | 31487 | RSS: Main: 154406912 05:25:53 INFO - PROCESS | 31487 | 05:26:44 INFO - PROCESS | 31487 | 1458131204768 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 05:28:56 INFO - PROCESS | 31487 | Cycle 1(1): loaded http://localhost:46977/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46977/tests/dromaeo/cssquery-ext.html) 05:28:57 INFO - PROCESS | 31487 | RSS: Main: 264736768 05:28:57 INFO - PROCESS | 31487 | 05:31:59 INFO - PROCESS | 31487 | Cycle 1(1): loaded http://localhost:46977/tests/dromaeo/cssquery-ext.html (next: http://localhost:46977/tests/dromaeo/cssquery-jquery.html) 05:32:00 INFO - PROCESS | 31487 | RSS: Main: 237703168 05:32:00 INFO - PROCESS | 31487 | 05:35:02 INFO - PROCESS | 31487 | Cycle 1(1): loaded http://localhost:46977/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46977/tests/dromaeo/cssquery-mootools.html) 05:35:02 INFO - PROCESS | 31487 | RSS: Main: 239325184 05:35:02 INFO - PROCESS | 31487 | 05:38:04 INFO - PROCESS | 31487 | Cycle 1(1): loaded http://localhost:46977/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46977/tests/dromaeo/cssquery-prototype.html) 05:38:05 INFO - PROCESS | 31487 | RSS: Main: 222683136 05:38:05 INFO - PROCESS | 31487 | 05:41:08 INFO - PROCESS | 31487 | Cycle 1(1): loaded http://localhost:46977/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46977/tests/dromaeo/cssquery-yui.html) 05:41:08 INFO - PROCESS | 31487 | RSS: Main: 207015936 05:41:08 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | Cycle 1(1): loaded http://localhost:46977/tests/dromaeo/cssquery-yui.html (next: http://localhost:46977/tests/dromaeo/cssquery-dojo.html) 05:44:11 INFO - PROCESS | 31487 | RSS: Main: 273354752 05:44:11 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | __start_tp_report 05:44:11 INFO - PROCESS | 31487 | _x_x_mozilla_page_load 05:44:11 INFO - PROCESS | 31487 | _x_x_mozilla_page_load_details 05:44:11 INFO - PROCESS | 31487 | |i|pagename|runs| 05:44:11 INFO - PROCESS | 31487 | |0;dojo.html;2626.9211923642292;2693.138195777351;2706.688730795959;2720.238333266685;2741.8217815841967;4513.7517436540975;4664.626829853612;4680.976595117024;4687.039156972821;4703.741294228816;4654.3251228571835;4657.254839225725;4667.486576476585;4674.158651442731;4677.883052923678;4263.445752052229;4342.413774140498;4366.323219900904;4401.405810215628;4445.466544014723;4243.363495475673;4322.13557288542;4398.890027749316;4404.29531274996;4411.360352748849;4251.171021650779;4296.484421869396;4317.740935543878;4354.695171338008;4403.6256918162;4271.63691086258;4289.764062976535;4294.763787991659;4332.588404101637;4335.609795118455;4148.02521407469;4274.978625106885;4277.550857160016;4278.229918614648;4331.848385306499;4502.954970450319;4516.006478574708;4533.138703646329;4533.184026875161;4535.614472769818;4999.850004499871;5090.898182036375;5094.261332106824;5099.515546023122;5099.541041306263;5044.167712327461;5046.7476626168545;5049.873753156164;5050.646454748169;5060.696358218519;4699.459562150328;4705.411823522059;4705.952940470552;4709.246520556729;4743;4964.776585053682;5111.565516931102;5213.452587478336;5259.027079990214;5260.684358938476;4951.183054795991;4976.62675299354;4977.303177555145;4983.227599722049;5027.798888044437;4819.783109760069;5063.215201643751;5063.772130254148;5067.113255180328;5067.569256613156;4960.553550180501;4982.451930287665;5011.924821127686;5037.370328708911;5053.570446512014;5003.124453220672;5026.949730502722;5035.194368901031;5037.949620503821;5074.188129899198;3873.3221686205366;3944.6252606002386;3971.7616942982936;3982.303096958021;4026.4966879140106;3502.7898326100517;3557.0395993081725;3582.820858957094;3583.4624806279267;3591.2278860045217;4378.387025816388;4385.605295523418;4401.119776044804;4409.559044095629;4444.400005999213;4924.507549245047;5029.5221953914315;5082.313887625197;5090.898182036339;5144.948550514522;4344.066025804467;4352.260115780262;4379.671524635665;4393.956060439418;4400.427944367212;4497.550244975476;4515.932261016087;4516.029053753458;4519.525449827786;4561.042181141997;4654.022655242437;4770.379850619397;4779.115863565252;4780.211265141213;4857.0528746894015;5013.699178049329;5026.547610714907;5035.118854200427;5035.29505869186;5052.8484145475695;4752.453467851241;4755.548222918817;4765.73788441639;4779.283107533898;4796.640251981045;4803.375561177025;4898.9020219594695;4946.554810067111;4951.207806750903;4984;4983.327250821093;4993.925091123563;4995.050940321327;5003.54968052877;5040.319556859777;4859.732714700725;4860.6111511079735;4864.416270047617;4866.197077482176;4908.7300198488;4758.381410416624;4842.080004799077;4904;4936.407631084293;4939.110960027229;4760.262159365304;4773.09311230865;4776.617870570415;4784.5215478453265;4800.183968725395;4843.176659967743;4883.096627123993;4887.413510378778;4887.682300650446;4920.40955085392;4683.812647494062;4817.590504806991;4866.270059491105;4912.410510738591;4912.778924948315 05:44:11 INFO - PROCESS | 31487 | |1;ext.html;539.9001184780815;540.5027374815172;559.7453158812739;563.2536888622576;574.1015311038225;29849.403011939747;35134.82432587837;35602.2879542409;35675.464868027004;35721;38794.418083728764;39281.803590982076;39325.41011884824;39340.21319573607;39347;7577.090749110114;7859.331956783652;7861.882071768928;7867.409944254176;7874.3700503959835;7718.459707820455;7821.843563128762;7833.216678332178;7845;8054.879176812353;7995.240452157036;8088.676452941904;8089.0293164820305;8091.2717855393;8096.919030809705;7971.202879712011;8065.435419520636;8072.394570407243;8076.8788468173025;8082.636281367352;7874.409419293576;7999.1600881907725;8005.0794158671915;8005.919940800634;8010.479318844315;37940.43089353662;38478.230435391415;38563;38635.420468692995;38640.42039369412;3044.604201453819;3049.786514943955;3189.2983543620367;3258.006308076036;3375.358681850465;28933.71066289331;29376.265593360124;29592.26019349512;29705;30264.54603180932;3490.6858382745677;3567.94648080279;3576.7138628909624;3600.963990360115;3621.5654121505327;253215;253220.99999999817;254096;255495;257203;57989.710051449474;58192;58322.12516812251;58403.123953140734;58447.70776146092;61676.69161654163;61825.690871545354;62250;63491.365086348545;63695.36304636987;14276.500322488662;14390.424383024561;14402.711945761026;14461.13233206011;14476.420943162366;10894.346339219514;10964.068054215322;10970.177236707279;10977.451127443595;10977.890221097847;19222;19370;19493.902530487256;19561.315353962542;19624.41126766199;7556.168821429638;7825;7846.215378462108;7918.366530677532;7955.443118981616;752.7929819299736;821.9095899451056;912.0332447605426;945.4232917920064;986.8667729856521;26514.46971060568;27128.59307110395;27821.860890695418;27863.16410507688;27883.72116278852;913.1735779119907;938.1275413865171;944.9133496478967;1004.4174378860243;1008.294194064158;13639.318034098256;14182.555456788208;14192;14353.6411589709;14427.711445771025;284705;286634;286965;287628;288237;47162.76418617885;48155.5184448158;48330.758346208044;48367;48396.27405588919;1111.555377848867;1161.7386088130272;1225.8957988571071;1228.5085965613825;1253.1040306181123;24059.455160071862;27164.665540304402;27442.17673469799;27643.58534621942;27689.58465622977;37820.24359512849;38226.235475290894;38245.043873902265;38288.23423531458;38331;202958;208741;208953;210329;210892;26801.98985076088;28166.155015349574;31163.84418077895;31206.843965780026;32082.518762219053;35433;35780.64219357877;35967.82016089903;36433.27133457369;36801.81599091987;29293.121206363845;30935.381292374477;31017.534736978512;31458.52812207773;31662.525062123626;32723;33395.33209335751;33473.83263083766;33724.32551349008;33838;33577.49633755447;33755;34254;34260.14349641279;34322.82838585791;29193.7080629191;30009.249768755955;30354.54468182935;30567.694323056483;30817.8459107712;23710.966048354454;23836.52326953486;23876.880615596812;24011.51976960416;24189.75810241875 05:44:11 INFO - PROCESS | 31487 | |2;jquery.html;351.82936275906184;353.80010294183785;360.1248965015013;365.85914422947155;369.6765330335956;15282.465113721022;15362.462313819018;16570;16817.66364672706;16826.915865420688;14920.850791492081;15122.773158402606;15490.148041857694;15526.146061966587;15533.22333883304;4904.877378065559;4953.281774142747;5101.795928162869;5105.795768169269;5133.383993920735;5077.949220507803;5101.20931255656;5119.872003199931;5131.820386286481;5131.948680513203;5010.248462730583;5059.924101138467;5069;5069.290299358093;5074.644774865761;4991.40103187618;5161.122609156452;5175.534201921808;5176.818811341623;5177.456367081478;4983.103041452537;4985.825496107655;4986.07757564848;4997.250412438127;4998.925016124761;14102.506412275623;18556.16497257613;19175.041247937548;19194.520136996547;19196.040197990045;1929.411529483507;1942.300771722179;1961.4213806926991;2058.7220725202205;2365.491419344849;8899.4215376001;9055.637774489012;9058.592363343665;11045.613403530839;13042.934785326108;1646.7859178306862;1794.371969810569;1813.138759089435;1831.4414103698366;1846.1599972012837;50385;55627.44372556263;59360.10959835563;59790.70104649493;61209.69395152996;9856.852147217798;10062.899371006197;10167.593296268215;10292.948535257425;10371.377717336833;11589;12223.205491643015;12667;13143.60569182926;13161.407736651874;6898.206706228748;6922.100126983561;7017.859642807115;7090.92909070913;7102.822429439306;6737.427318677967;6748.662566871735;6807.727690892408;6937.7224911004005;6949.478789090737;4186.706930514834;4334.28484300087;4345.869623911288;4394.648428125743;4417.933730994037;1784.8304411080926;1829.5334689654053;1834.0737927346604;1839.7608310919495;1840.3374785077363;851.3912552524974;864.632531174261;912.7626817027488;950.9049095090436;992.9453880036523;15510.146941918078;15528.14595197275;15566.455174068853;15910.522684319489;16095.436659716854;857.648364170687;888.0852721696663;903.3134817538587;908.5729707037682;956.7655924298591;9126.771830704285;9141.268698504104;9168.587413566405;9259.490728009889;9357.157855792875;431605;442848;447729;449112;449973;65847.34152658412;67378.3262167372;68589.65705171443;68833.65583172052;69071.30928690749;928.8328100941895;933.6872147830417;949.8005418862116;953.7043516509904;955.2739917662487;14101.576952691024;14378.35297411598;14450.494232701805;14464.638384040483;14643.414263429344;25474.363140921625;26726.59910101311;33331.666683333824;33380.49929251015;33649.32701345911;45452.54547454483;46349.304760429295;46367;46678.29982550196;46699.29951050805;7063.505554611128;7101.82245443868;7140.107486564179;7245.239249878898;7280.344768970818;10286.228532859916;11085.22403431752;11414.143939204427;11440.141989351;11509.251898626562;9843.261755368232;9855;10098.444585547571;10202.846957295498;10312.948435257777;9758.902410976083;10089.376346215799;10089.646862360076;10099.899001009895;10178.185745140223;10060.90571078258;10116.544755486168;10171.440570768678;10347.793044139225;10406.115480183966;7241.782746517613;7426.814329641802;7482.850342993219;7519.43604229674;7525.285097915689;9583.281253906125;9945.850812237966;10038.698839034842;10102.242331824995;10441.958737260751 05:44:11 INFO - PROCESS | 31487 | |3;mootools.html;1314.7501974624815;1417.0718179592368;1432.5773896700468;1588;1781.3765182186237;6962.1297337832775;7148.60682662454;7149.535280206783;7153.427725781938;7157;7066.505344625878;7209.387202087829;7240.348368646821;7241.3120753528465;7247.202807691163;1884.2745542965988;1929.6140771845687;2180.0407820558903;2191.3316438486254;2219.178903805594;2229.55408918217;2237.093976939334;2240.8879556022216;2242.4057624729458;2243.8204943604474;2142.700021996922;2170.381441289233;2200.449887528118;2200.9889950550223;2204.492966617679;2191.2878314547834;2214.7010153629294;2222.4443889027825;2225.2100504320897;2237.8545394549465;2178.357384571555;2183.4759657682202;2197.7142971413773;2198.736151661795;2201.328594778592;7373.77878663641;7432.256774322578;7433.739819106359;7446.85106297871;7447.2552744725635;4462.129884672458;4557.794899229542;4582.060677561092;4583.931241031387;4587.931181032287;2975.7470614997533;3010.8946186883572;3052.328487732695;3056.923576910595;3095.814251144916;930.1767935377172;943.528235882059;955.6416343871049;964.8070385922773;969.8351280282369;9936.552855121538;9981.600735970553;9982.25133115012;9990.050945160197;9993.550290236957;4250.128723611652;4339.088791353788;4350.32569951658;4375.431193944767;4398.73607583546;8505.362097842562;8542.231199192103;8549.658013679384;8566.100559441293;8567.957160214159;4441.533638967927;4469.173202957463;4485.59629633328;4488.5511448855505;4489.259272220047;3572.821358932043;3965.206958608232;4052.5947405259826;4106.815193316308;4108.609682080198;3577.2308953575107;3632.019354774196;3636.054625797312;3661.6704496595435;3691.90770230741;1159.7854396936593;1181.3679681370425;1186.2348785033605;1208.9274643521417;1209.0448545649015;1187.0800129899396;1190.7618476304774;1191.5531675621642;1199.3103965220034;1230.3786587773118;6788.253292137861;6883.414909732629;6897.48268879836;6911.516193866481;6921.1002569666625;477.35556998053045;481.4559547711064;484.46950589104875;484.49370407923806;494.61172979211864;5104.336436263262;5107.463716309734;5109.7700603472185;5117.513836185556;5143.97428012865;8111.269985701315;8144.633491492778;8221.424500284922;8614.569271536398;8861.424007439497;8132.390070744717;8169.387295952709;8212.260896519223;8221.424500285042;8224.342052635775;6794.184697836291;6865.828354291183;6893.620850853251;6957.478189135835;6983.441324694012;6819.931800682129;6841.144856892888;6858;6892;6905.965470172617;7933.642986065525;7970.601469926596;8159.306458951056;8261.463004904663;8290.626921788655;8233.670653173805;8369.581520924052;8374.790630234293;8423.07346191906;8538.914610853812;5586.273784408001;6169.383061693795;6309.873802524015;6429;6504.056911747675;6859.348361905611;6861.039454476278;6879.6560171992205;6885.621290828852;6914.412274956685;6130.386961303834;6156.261248650011;6174.475169610633;6181.134641150153;6234.719437625227;6055;6224.533160012927;6276.089966954674;6294.8111556653375;6364.586301890362;6383.0744542042075;6451.419372256331;6515.478761699147;6526.836829079311;6528.771492997722;6064.787732429344;6120.7857724981195;6129.1112788644505;6136.969315153396;6142.723577438936;5813.563982701399;5940.584159108821;5943.3759455258305;5959.612625179349;5976.252968378953 05:44:11 INFO - PROCESS | 31487 | |4;prototype.html;323.94492936200845;324.7726591386029;326.62275072291504;330.4217619166458;335.8236925614052;5455.263539422177;5472.315960504937;5490.835274941754;5491.752871120799;5522.530584900288;5432.538234250083;5438.483344082316;5440.775825439274;5449.455054494549;5450.700211488366;4015.237104950065;4146.067134894654;4246.193223287581;4262.403263543107;4266.57334266574;4266.850660226893;4267.082577245891;4267.210566045276;4271.722338048033;4282.97858510707;4228.06982463859;4231.640310573605;4239.2793225151645;4242.53332133465;4250.61744443;4038.8788336349808;4116.91766164678;4233.724807887477;4240.385144154111;4243.236217480852;3728.272986767581;3735.4957080794015;3736.3087828751495;3737.7196710246567;3740.9438858417147;5239.816606418757;5239.973800131013;5252.973735131338;5255.921161182585;5257.421683614799;4905.656604037718;4906.852794416173;4909.042736666352;4910.1898186799135;4920.138975679241;5741.19623252745;5752.769889204426;5753.597248192628;5759.3376761672525;5763.596548241625;3846.326892793778;4114.321137012389;4115.567865374122;4120.031792528754;4123.0516981094215;5936.5547583931375;6032.366601506823;6058.545609079337;6065.969670151665;6068.6662233577135;4082.632563069338;4085.305498065336;4085.4893138357706;4089.2639324921206;4095.7133000689664;4147.087640719037;4147.108371700099;4147.3778933160265;4148.336266197394;4154.106867023544;4791.760411979387;4793.32893394925;4801.5438533339975;4808.975955120202;4810;5761.279840019997;5773.24947756789;5774.538036957033;5775.393583673737;5776.740046697824;1418.8439271680106;1445.6674964757954;1469.808924839764;1472.801171841809;1477.623206082442;930.5161316115582;948.4356807699407;970.4953424219508;986.4673076538733;991.1624677147798;4906.509349065136;4917.8361520930675;4951.9752401237765;5058.038972595195;5059.86153115546;5941.376155503696;5956.672383018976;6020.578559500793;6021.518278537794;6042.214512113397;5088.211327244283;5092.38891333035;5095.541401273903;5096.592272618256;5102.36220472441;3177.4121787469394;3208.5401142480114;3211.6948889855425;3212.2611799286296;3215.6302025267396;5649.237352957381;5673.978683836866;5680.943190568041;5681.602287839812;5684.062129748628;6012.8797424052145;6209.2548894133;6215.627062376272;6217.347178546278;6223.875522489525;5666.716664166775;5689.715514224272;5702.51528620072;5703.25857638496;5704.429557044263;6015.2781666200335;6017.729202185999;6020.127081573235;6023.216981792339;6024.789132380346;5919.585629005928;5923.614965027432;5932.851678708067;5934.762609495572;5938.524918006463;5464.453554644663;5687.630304030225;5689.31728192603;5692.7722891083895;5693.345265294379;4049.230646177217;4067.471228740363;4084.8366065357054;4088.0801819591543;4095.569965153735;5955.583109182316;5962.970185149046;5976.103584462192;5976.103584462366;5985.880282394415;5723.8855222896145;5727.799527016701;5732;5735.942640573541;5739.053056245672;5770.480656740746;5770.682612456355;5773.336066352424;5778.508826749773;5783.884322313615;5443.129099344086;5625.634333768292;5675.659460432387;5691.032524470933;5697.202391665087;5792.652440853562;5801.36185019639;5805.535557155502;5825.621334613236;5839.8832023358445;5657.2928383952;5664.122061080539;5672.064109422065;5675.517581005495;5677.318721753416 05:44:11 INFO - PROCESS | 31487 | |5;yui.html;648.2447948140417;661.1273119482282;721.8087206890172;722.3679280629449;761.2007392238148;11494.712632184199;11547.307161570301;11552.711182220448;11609.419529023557;11611.47748351323;12454.688632784162;12745.808812867814;12751.553695620654;12771.680707982305;12773.552925647604;648.0279580629057;805.8227190018201;815.3517953227199;818.643889907889;819.045811629451;822.0833770346081;823.6746485138367;827.0199813221321;827.9047909490396;827.9089300176976;853.9743807685779;858.2361698088706;858.2790456016944;858.5321000054985;860.4450129666361;681.7784220128428;686.9072675188886;841.0034109580137;842.0779246724857;842.3177226446567;506.3038322306828;625.6777759453885;626.5081910700079;626.9341719119518;627.5638431290255;11515.251508651994;11519.884801151966;11522;11559.94220028903;11568.53725850965;11464.598739044177;11874.465649045813;12106.39468026604;12190.817137742852;12405.62783116508;9901.207903367713;10077.748056298578;10084.798304033879;10093.192544596488;10177.949110254402;3318.070940136766;3343.5319055332275;3371.2920286739813;3434.1929646533044;3440.9483857742152;43573.564264357585;43835.561644383786;44269;44478;44556.3316550252;9516.23870090405;9606.231501479864;9823.508824558743;9887.703368898945;10328.793424131476;17522.474325770247;17541.912290438468;17665.7350139748;17709.29162833498;17737.822621773874;6607.504437167232;6696.129503164558;6744.5616034957575;6761.830954226184;6915.861682766316;3605.4231322988194;3726.2361215950664;3770.377887648562;3784.129650180474;3888.6694630956686;2812.9859350703114;2861.4563232985665;2863.3271181272385;2871.052552657618;2876.8273903565855;482.9420469543607;483.86209930170435;487.99268010979864;496.5903129917832;499.7376377401893;491.7418355363391;538.8033367820717;542.7259234086761;574.9252597162342;580.2543731305252;7038.2961703829205;7040.401565866856;7102.112235970504;7283.235260297698;7304.561726296439;538.8706710389479;543.1228565866177;544.1728572569672;545.2448359022782;558.5570444917853;3316.651751566099;3352.7150192233444;3390.28803951173;3463.8268086595567;3635.0367152704553;49731.254031189565;50161.498385015686;51515;51829.7408512955;51932;46262;47032.5296747035;47138.52861471342;47887.04225915462;48051.75974120107;41815;42383.7880810594;42793.57206427958;42961;43127.137457250676;6951.756688515878;7037.683304251219;7054;7085.362317391459;7167.641617918979;31387.058388248388;31959.360812784078;32845.67154328426;32965.34069318648;33141.17147071246;38405;41157;41709.79145104255;41790;41893.1621367577;8759.12408759119;8800.603972821367;8803.119688031145;8807.471551706918;8811.427257228259;9556.283278753983;9696.95151524238;9717.514124293899;9722.125008749246;9732.318737688576;8787;9455.858162127712;9530.761730956505;9569.234461243223;9575.425474471554;9164.495952722664;9258.398204116711;9284.489353085375;9302.488363140092;9312.906870931203;8800.47197168172;9272.675456358995;9349.813003740022;9360.485173315534;9401.529923503935;8054.114047454658;8187.4678145920325;8227.465214761021;8273.958630206811;8451.915480845113;8037.799055023671;8198.467099638505;8330.791730206793;8369.455985360932;8373.665053397795 05:44:11 INFO - PROCESS | 31487 | __end_tp_report 05:44:11 INFO - PROCESS | 31487 | __start_cc_report 05:44:11 INFO - PROCESS | 31487 | _x_x_mozilla_cycle_collect,958 05:44:11 INFO - PROCESS | 31487 | __end_cc_report 05:44:11 INFO - PROCESS | 31487 | __startTimestamp1458132251344__endTimestamp 05:44:11 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | ------- Summary: start ------- 05:44:11 INFO - PROCESS | 31487 | Number of tests: 6 05:44:11 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | [#0] dojo.html Cycles:165 Average:4630.72 Median:4770.38 stddev:497.63 (10.4%) stddev-sans-first:473.68 05:44:11 INFO - PROCESS | 31487 | Values: 2626.9 2693.1 2706.7 2720.2 2741.8 4513.8 4664.6 4681.0 4687.0 4703.7 4654.3 4657.3 4667.5 4674.2 4677.9 4263.4 4342.4 4366.3 4401.4 4445.5 4243.4 4322.1 4398.9 4404.3 4411.4 4251.2 4296.5 4317.7 4354.7 4403.6 4271.6 4289.8 4294.8 4332.6 4335.6 4148.0 4275.0 4277.6 4278.2 4331.8 4503.0 4516.0 4533.1 4533.2 4535.6 4999.9 5090.9 5094.3 5099.5 5099.5 5044.2 5046.7 5049.9 5050.6 5060.7 4699.5 4705.4 4706.0 4709.2 4743.0 4964.8 5111.6 5213.5 5259.0 5260.7 4951.2 4976.6 4977.3 4983.2 5027.8 4819.8 5063.2 5063.8 5067.1 5067.6 4960.6 4982.5 5011.9 5037.4 5053.6 5003.1 5026.9 5035.2 5037.9 5074.2 3873.3 3944.6 3971.8 3982.3 4026.5 3502.8 3557.0 3582.8 3583.5 3591.2 4378.4 4385.6 4401.1 4409.6 4444.4 4924.5 5029.5 5082.3 5090.9 5144.9 4344.1 4352.3 4379.7 4394.0 4400.4 4497.6 4515.9 4516.0 4519.5 4561.0 4654.0 4770.4 4779.1 4780.2 4857.1 5013.7 5026.5 5035.1 5035.3 5052.8 4752.5 4755.5 4765.7 4779.3 4796.6 4803.4 4898.9 4946.6 4951.2 4984.0 4983.3 4993.9 4995.1 5003.5 5040.3 4859.7 4860.6 4864.4 4866.2 4908.7 4758.4 4842.1 4904.0 4936.4 4939.1 4760.3 4773.1 4776.6 4784.5 4800.2 4843.2 4883.1 4887.4 4887.7 4920.4 4683.8 4817.6 4866.3 4912.4 4912.8 05:44:11 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | [#1] ext.html Cycles:180 Average:41338.65 Median:34257.07 stddev:65776.63 (192.0%) stddev-sans-first:65889.82 05:44:11 INFO - PROCESS | 31487 | Values: 539.9 540.5 559.7 563.3 574.1 29849.4 35134.8 35602.3 35675.5 35721.0 38794.4 39281.8 39325.4 39340.2 39347.0 7577.1 7859.3 7861.9 7867.4 7874.4 7718.5 7821.8 7833.2 7845.0 8054.9 7995.2 8088.7 8089.0 8091.3 8096.9 7971.2 8065.4 8072.4 8076.9 8082.6 7874.4 7999.2 8005.1 8005.9 8010.5 37940.4 38478.2 38563.0 38635.4 38640.4 3044.6 3049.8 3189.3 3258.0 3375.4 28933.7 29376.3 29592.3 29705.0 30264.5 3490.7 3567.9 3576.7 3601.0 3621.6 253215.0 253221.0 254096.0 255495.0 257203.0 57989.7 58192.0 58322.1 58403.1 58447.7 61676.7 61825.7 62250.0 63491.4 63695.4 14276.5 14390.4 14402.7 14461.1 14476.4 10894.3 10964.1 10970.2 10977.5 10977.9 19222.0 19370.0 19493.9 19561.3 19624.4 7556.2 7825.0 7846.2 7918.4 7955.4 752.8 821.9 912.0 945.4 986.9 26514.5 27128.6 27821.9 27863.2 27883.7 913.2 938.1 944.9 1004.4 1008.3 13639.3 14182.6 14192.0 14353.6 14427.7 284705.0 286634.0 286965.0 287628.0 288237.0 47162.8 48155.5 48330.8 48367.0 48396.3 1111.6 1161.7 1225.9 1228.5 1253.1 24059.5 27164.7 27442.2 27643.6 27689.6 37820.2 38226.2 38245.0 38288.2 38331.0 202958.0 208741.0 208953.0 210329.0 210892.0 26802.0 28166.2 31163.8 31206.8 32082.5 35433.0 35780.6 35967.8 36433.3 36801.8 29293.1 30935.4 31017.5 31458.5 31662.5 32723.0 33395.3 33473.8 33724.3 33838.0 33577.5 33755.0 34254.0 34260.1 34322.8 29193.7 30009.2 30354.5 30567.7 30817.8 23711.0 23836.5 23876.9 24011.5 24189.8 05:44:11 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | [#2] jquery.html Cycles:180 Average:24624.95 Median:247712.77 stddev:72699.08 (29.3%) stddev-sans-first:72880.18 05:44:11 INFO - PROCESS | 31487 | Values: 351.8 353.8 360.1 365.9 369.7 15282.5 15362.5 16570.0 16817.7 16826.9 14920.9 15122.8 15490.1 15526.1 15533.2 4904.9 4953.3 5101.8 5105.8 5133.4 5077.9 5101.2 5119.9 5131.8 5131.9 5010.2 5059.9 5069.0 5069.3 5074.6 4991.4 5161.1 5175.5 5176.8 5177.5 4983.1 4985.8 4986.1 4997.3 4998.9 14102.5 18556.2 19175.0 19194.5 19196.0 1929.4 1942.3 1961.4 2058.7 2365.5 8899.4 9055.6 9058.6 11045.6 13042.9 1646.8 1794.4 1813.1 1831.4 1846.2 50385.0 55627.4 59360.1 59790.7 61209.7 9856.9 10062.9 10167.6 10292.9 10371.4 11589.0 12223.2 12667.0 13143.6 13161.4 6898.2 6922.1 7017.9 7090.9 7102.8 6737.4 6748.7 6807.7 6937.7 6949.5 4186.7 4334.3 4345.9 4394.6 4417.9 1784.8 1829.5 1834.1 1839.8 1840.3 851.4 864.6 912.8 950.9 992.9 15510.1 15528.1 15566.5 15910.5 16095.4 857.6 888.1 903.3 908.6 956.8 9126.8 9141.3 9168.6 9259.5 9357.2 431605.0 442848.0 447729.0 449112.0 449973.0 65847.3 67378.3 68589.7 68833.7 69071.3 928.8 933.7 949.8 953.7 955.3 14101.6 14378.4 14450.5 14464.6 14643.4 25474.4 26726.6 33331.7 33380.5 33649.3 45452.5 46349.3 46367.0 46678.3 46699.3 7063.5 7101.8 7140.1 7245.2 7280.3 10286.2 11085.2 11414.1 11440.1 11509.3 9843.3 9855.0 10098.4 10202.8 10312.9 9758.9 10089.4 10089.6 10099.9 10178.2 10060.9 10116.5 10171.4 10347.8 10406.1 7241.8 7426.8 7482.9 7519.4 7525.3 9583.3 9945.9 10038.7 10102.2 10442.0 05:44:11 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | [#3] mootools.html Cycles:180 Average:5094.47 Median:6133.68 stddev:2608.87 (42.5%) stddev-sans-first:2600.71 05:44:11 INFO - PROCESS | 31487 | Values: 1314.8 1417.1 1432.6 1588.0 1781.4 6962.1 7148.6 7149.5 7153.4 7157.0 7066.5 7209.4 7240.3 7241.3 7247.2 1884.3 1929.6 2180.0 2191.3 2219.2 2229.6 2237.1 2240.9 2242.4 2243.8 2142.7 2170.4 2200.4 2201.0 2204.5 2191.3 2214.7 2222.4 2225.2 2237.9 2178.4 2183.5 2197.7 2198.7 2201.3 7373.8 7432.3 7433.7 7446.9 7447.3 4462.1 4557.8 4582.1 4583.9 4587.9 2975.7 3010.9 3052.3 3056.9 3095.8 930.2 943.5 955.6 964.8 969.8 9936.6 9981.6 9982.3 9990.1 9993.6 4250.1 4339.1 4350.3 4375.4 4398.7 8505.4 8542.2 8549.7 8566.1 8568.0 4441.5 4469.2 4485.6 4488.6 4489.3 3572.8 3965.2 4052.6 4106.8 4108.6 3577.2 3632.0 3636.1 3661.7 3691.9 1159.8 1181.4 1186.2 1208.9 1209.0 1187.1 1190.8 1191.6 1199.3 1230.4 6788.3 6883.4 6897.5 6911.5 6921.1 477.4 481.5 484.5 484.5 494.6 5104.3 5107.5 5109.8 5117.5 5144.0 8111.3 8144.6 8221.4 8614.6 8861.4 8132.4 8169.4 8212.3 8221.4 8224.3 6794.2 6865.8 6893.6 6957.5 6983.4 6819.9 6841.1 6858.0 6892.0 6906.0 7933.6 7970.6 8159.3 8261.5 8290.6 8233.7 8369.6 8374.8 8423.1 8538.9 5586.3 6169.4 6309.9 6429.0 6504.1 6859.3 6861.0 6879.7 6885.6 6914.4 6130.4 6156.3 6174.5 6181.1 6234.7 6055.0 6224.5 6276.1 6294.8 6364.6 6383.1 6451.4 6515.5 6526.8 6528.8 6064.8 6120.8 6129.1 6137.0 6142.7 5813.6 5940.6 5943.4 5959.6 5976.3 05:44:11 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | [#4] prototype.html Cycles:180 Average:4782.92 Median:5452.98 stddev:1413.99 (25.9%) stddev-sans-first:1377.78 05:44:11 INFO - PROCESS | 31487 | Values: 323.9 324.8 326.6 330.4 335.8 5455.3 5472.3 5490.8 5491.8 5522.5 5432.5 5438.5 5440.8 5449.5 5450.7 4015.2 4146.1 4246.2 4262.4 4266.6 4266.9 4267.1 4267.2 4271.7 4283.0 4228.1 4231.6 4239.3 4242.5 4250.6 4038.9 4116.9 4233.7 4240.4 4243.2 3728.3 3735.5 3736.3 3737.7 3740.9 5239.8 5240.0 5253.0 5255.9 5257.4 4905.7 4906.9 4909.0 4910.2 4920.1 5741.2 5752.8 5753.6 5759.3 5763.6 3846.3 4114.3 4115.6 4120.0 4123.1 5936.6 6032.4 6058.5 6066.0 6068.7 4082.6 4085.3 4085.5 4089.3 4095.7 4147.1 4147.1 4147.4 4148.3 4154.1 4791.8 4793.3 4801.5 4809.0 4810.0 5761.3 5773.2 5774.5 5775.4 5776.7 1418.8 1445.7 1469.8 1472.8 1477.6 930.5 948.4 970.5 986.5 991.2 4906.5 4917.8 4952.0 5058.0 5059.9 5941.4 5956.7 6020.6 6021.5 6042.2 5088.2 5092.4 5095.5 5096.6 5102.4 3177.4 3208.5 3211.7 3212.3 3215.6 5649.2 5674.0 5680.9 5681.6 5684.1 6012.9 6209.3 6215.6 6217.3 6223.9 5666.7 5689.7 5702.5 5703.3 5704.4 6015.3 6017.7 6020.1 6023.2 6024.8 5919.6 5923.6 5932.9 5934.8 5938.5 5464.5 5687.6 5689.3 5692.8 5693.3 4049.2 4067.5 4084.8 4088.1 4095.6 5955.6 5963.0 5976.1 5976.1 5985.9 5723.9 5727.8 5732.0 5735.9 5739.1 5770.5 5770.7 5773.3 5778.5 5783.9 5443.1 5625.6 5675.7 5691.0 5697.2 5792.7 5801.4 5805.5 5825.6 5839.9 5657.3 5664.1 5672.1 5675.5 5677.3 05:44:11 INFO - PROCESS | 31487 | 05:44:11 INFO - PROCESS | 31487 | [#5] yui.html Cycles:180 Average:12423.42 Median:543.65 stddev:14598.96 (2685.4%) stddev-sans-first:14613.13 05:44:11 INFO - PROCESS | 31487 | Values: 648.2 661.1 721.8 722.4 761.2 11494.7 11547.3 11552.7 11609.4 11611.5 12454.7 12745.8 12751.6 12771.7 12773.6 648.0 805.8 815.4 818.6 819.0 822.1 823.7 827.0 827.9 827.9 854.0 858.2 858.3 858.5 860.4 681.8 686.9 841.0 842.1 842.3 506.3 625.7 626.5 626.9 627.6 11515.3 11519.9 11522.0 11559.9 11568.5 11464.6 11874.5 12106.4 12190.8 12405.6 9901.2 10077.7 10084.8 10093.2 10177.9 3318.1 3343.5 3371.3 3434.2 3440.9 43573.6 43835.6 44269.0 44478.0 44556.3 9516.2 9606.2 9823.5 9887.7 10328.8 17522.5 17541.9 17665.7 17709.3 17737.8 6607.5 6696.1 6744.6 6761.8 6915.9 3605.4 3726.2 3770.4 3784.1 3888.7 2813.0 2861.5 2863.3 2871.1 2876.8 482.9 483.9 488.0 496.6 499.7 491.7 538.8 542.7 574.9 580.3 7038.3 7040.4 7102.1 7283.2 7304.6 538.9 543.1 544.2 545.2 558.6 3316.7 3352.7 3390.3 3463.8 3635.0 49731.3 50161.5 51515.0 51829.7 51932.0 46262.0 47032.5 47138.5 47887.0 48051.8 41815.0 42383.8 42793.6 42961.0 43127.1 6951.8 7037.7 7054.0 7085.4 7167.6 31387.1 31959.4 32845.7 32965.3 33141.2 38405.0 41157.0 41709.8 41790.0 41893.2 8759.1 8800.6 8803.1 8807.5 8811.4 9556.3 9697.0 9717.5 9722.1 9732.3 8787.0 9455.9 9530.8 9569.2 9575.4 9164.5 9258.4 9284.5 9302.5 9312.9 8800.5 9272.7 9349.8 9360.5 9401.5 8054.1 8187.5 8227.5 8274.0 8451.9 8037.8 8198.5 8330.8 8369.5 8373.7 05:44:11 INFO - PROCESS | 31487 | -------- Summary: end -------- 05:44:11 INFO - PROCESS | 31487 | 05:44:12 INFO - TEST-INFO | 31487: exit 0 05:44:12 INFO - TEST-OK | dromaeo_css | took 1118405ms 05:44:12 INFO - TEST-START | kraken 05:44:12 INFO - operating with platform_type : linux_ 05:44:12 INFO - Initialising browser for kraken test... 05:44:12 INFO - TEST-INFO | started process 31666 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpXpkYCm/profile http://localhost:46977/getInfo.html) 05:44:17 INFO - PROCESS | 31666 | __metrics Screen width/height:1600/1200 05:44:17 INFO - PROCESS | 31666 | colorDepth:24 05:44:17 INFO - PROCESS | 31666 | Browser inner width/height: 1024/697 05:44:17 INFO - PROCESS | 31666 | __metrics 05:44:18 ERROR - PROCESS | 31666 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 05:44:19 INFO - TEST-INFO | 31666: exit 0 05:44:19 INFO - Browser initialized. 05:44:19 INFO - Running cycle 1/1 for kraken test... 05:44:19 INFO - TEST-INFO | started process 31751 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpXpkYCm/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:44:31 INFO - PROCESS | 31751 | RSS: Main: 154513408 05:44:31 INFO - PROCESS | 31751 | 05:44:34 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46977/tests/kraken/driver.html?testName=audio-beat-detection) 05:44:34 INFO - PROCESS | 31751 | RSS: Main: 195510272 05:44:34 INFO - PROCESS | 31751 | 05:44:37 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46977/tests/kraken/driver.html?testName=audio-dft) 05:44:38 INFO - PROCESS | 31751 | RSS: Main: 184254464 05:44:38 INFO - PROCESS | 31751 | 05:44:41 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46977/tests/kraken/driver.html?testName=audio-fft) 05:44:41 INFO - PROCESS | 31751 | RSS: Main: 171991040 05:44:41 INFO - PROCESS | 31751 | 05:44:43 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46977/tests/kraken/driver.html?testName=audio-oscillator) 05:44:44 INFO - PROCESS | 31751 | RSS: Main: 172220416 05:44:44 INFO - PROCESS | 31751 | 05:44:46 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46977/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:44:47 INFO - PROCESS | 31751 | RSS: Main: 173768704 05:44:47 INFO - PROCESS | 31751 | 05:44:50 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46977/tests/kraken/driver.html?testName=imaging-darkroom) 05:44:51 INFO - PROCESS | 31751 | RSS: Main: 175636480 05:44:51 INFO - PROCESS | 31751 | 05:44:54 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46977/tests/kraken/driver.html?testName=imaging-desaturate) 05:44:55 INFO - PROCESS | 31751 | RSS: Main: 176644096 05:44:55 INFO - PROCESS | 31751 | 05:44:57 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46977/tests/kraken/driver.html?testName=json-parse-financial) 05:44:58 INFO - PROCESS | 31751 | RSS: Main: 175394816 05:44:58 INFO - PROCESS | 31751 | 05:45:00 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46977/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:45:00 INFO - PROCESS | 31751 | RSS: Main: 184373248 05:45:00 INFO - PROCESS | 31751 | 05:45:02 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46977/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:45:03 INFO - PROCESS | 31751 | RSS: Main: 181547008 05:45:03 INFO - PROCESS | 31751 | 05:45:05 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46977/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:45:05 INFO - PROCESS | 31751 | RSS: Main: 189878272 05:45:05 INFO - PROCESS | 31751 | 05:45:08 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46977/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:45:08 INFO - PROCESS | 31751 | RSS: Main: 198656000 05:45:08 INFO - PROCESS | 31751 | 05:45:11 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46977/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:45:12 INFO - PROCESS | 31751 | RSS: Main: 197910528 05:45:12 INFO - PROCESS | 31751 | 05:45:13 INFO - PROCESS | 31751 | Cycle 1(1): loaded http://localhost:46977/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46977/tests/kraken/driver.html?testName=ai-astar) 05:45:14 INFO - PROCESS | 31751 | RSS: Main: 258433024 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | __start_tp_report 05:45:14 INFO - PROCESS | 31751 | _x_x_mozilla_page_load 05:45:14 INFO - PROCESS | 31751 | _x_x_mozilla_page_load_details 05:45:14 INFO - PROCESS | 31751 | |i|pagename|runs| 05:45:14 INFO - PROCESS | 31751 | |0;ai-astar;112;113;110;113;113;113;102;113;112;112 05:45:14 INFO - PROCESS | 31751 | |1;audio-beat-detection;151;125;156;176;139;154;154;136;182;136 05:45:14 INFO - PROCESS | 31751 | |2;audio-dft;163;162;161;162;160;160;163;162;163;161 05:45:14 INFO - PROCESS | 31751 | |3;audio-fft;74;85;115;94;72;73;77;112;99;73 05:45:14 INFO - PROCESS | 31751 | |4;audio-oscillator;94;94;144;93;95;95;137;94;94;136 05:45:14 INFO - PROCESS | 31751 | |5;imaging-gaussian-blur;116;116;116;116;117;117;117;117;117;117 05:45:14 INFO - PROCESS | 31751 | |6;imaging-darkroom;146;146;145;146;146;146;145;145;146;145 05:45:14 INFO - PROCESS | 31751 | |7;imaging-desaturate;95;96;96;95;96;95;96;96;95;96 05:45:14 INFO - PROCESS | 31751 | |8;json-parse-financial;66;66;65;66;65;65;75;73;65;65 05:45:14 INFO - PROCESS | 31751 | |9;json-stringify-tinderbox;64;63;65;63;64;65;65;64;65;66 05:45:14 INFO - PROCESS | 31751 | |10;stanford-crypto-aes;80;85;81;80;81;85;81;82;81;80 05:45:14 INFO - PROCESS | 31751 | |11;stanford-crypto-ccm;128;114;121;117;115;123;125;120;122;118 05:45:14 INFO - PROCESS | 31751 | |12;stanford-crypto-pbkdf2;135;143;146;135;142;131;140;142;140;142 05:45:14 INFO - PROCESS | 31751 | |13;stanford-crypto-sha256-iterative;68;68;67;69;67;66;66;68;66;66 05:45:14 INFO - PROCESS | 31751 | __end_tp_report 05:45:14 INFO - PROCESS | 31751 | __start_cc_report 05:45:14 INFO - PROCESS | 31751 | _x_x_mozilla_cycle_collect,1140 05:45:14 INFO - PROCESS | 31751 | __end_cc_report 05:45:14 INFO - PROCESS | 31751 | __startTimestamp1458132314108__endTimestamp 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | ------- Summary: start ------- 05:45:14 INFO - PROCESS | 31751 | Number of tests: 14 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#0] ai-astar Cycles:10 Average:111.30 Median:113.00 stddev:3.40 (3.0%) stddev-sans-first:3.60 05:45:14 INFO - PROCESS | 31751 | Values: 112.0 113.0 110.0 113.0 113.0 113.0 102.0 113.0 112.0 112.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#1] audio-beat-detection Cycles:10 Average:150.90 Median:154.00 stddev:17.95 (11.7%) stddev-sans-first:19.04 05:45:14 INFO - PROCESS | 31751 | Values: 151.0 125.0 156.0 176.0 139.0 154.0 154.0 136.0 182.0 136.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#2] audio-dft Cycles:10 Average:161.70 Median:162.00 stddev:1.16 (0.7%) stddev-sans-first:1.13 05:45:14 INFO - PROCESS | 31751 | Values: 163.0 162.0 161.0 162.0 160.0 160.0 163.0 162.0 163.0 161.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#3] audio-fft Cycles:10 Average:87.40 Median:75.50 stddev:16.63 (22.0%) stddev-sans-first:16.92 05:45:14 INFO - PROCESS | 31751 | Values: 74.0 85.0 115.0 94.0 72.0 73.0 77.0 112.0 99.0 73.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#4] audio-oscillator Cycles:10 Average:107.60 Median:94.00 stddev:21.77 (23.2%) stddev-sans-first:22.53 05:45:14 INFO - PROCESS | 31751 | Values: 94.0 94.0 144.0 93.0 95.0 95.0 137.0 94.0 94.0 136.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#5] imaging-gaussian-blur Cycles:10 Average:116.60 Median:117.00 stddev:0.52 (0.4%) stddev-sans-first:0.50 05:45:14 INFO - PROCESS | 31751 | Values: 116.0 116.0 116.0 116.0 117.0 117.0 117.0 117.0 117.0 117.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#6] imaging-darkroom Cycles:10 Average:145.60 Median:146.00 stddev:0.52 (0.4%) stddev-sans-first:0.53 05:45:14 INFO - PROCESS | 31751 | Values: 146.0 146.0 145.0 146.0 146.0 146.0 145.0 145.0 146.0 145.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 05:45:14 INFO - PROCESS | 31751 | Values: 95.0 96.0 96.0 95.0 96.0 95.0 96.0 96.0 95.0 96.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#8] json-parse-financial Cycles:10 Average:67.10 Median:66.00 stddev:3.70 (5.6%) stddev-sans-first:3.90 05:45:14 INFO - PROCESS | 31751 | Values: 66.0 66.0 65.0 66.0 65.0 65.0 75.0 73.0 65.0 65.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#9] json-stringify-tinderbox Cycles:10 Average:64.40 Median:65.00 stddev:0.97 (1.5%) stddev-sans-first:1.01 05:45:14 INFO - PROCESS | 31751 | Values: 64.0 63.0 65.0 63.0 64.0 65.0 65.0 64.0 65.0 66.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#10] stanford-crypto-aes Cycles:10 Average:81.60 Median:81.00 stddev:1.90 (2.3%) stddev-sans-first:1.92 05:45:14 INFO - PROCESS | 31751 | Values: 80.0 85.0 81.0 80.0 81.0 85.0 81.0 82.0 81.0 80.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#11] stanford-crypto-ccm Cycles:10 Average:120.30 Median:121.50 stddev:4.42 (3.6%) stddev-sans-first:3.71 05:45:14 INFO - PROCESS | 31751 | Values: 128.0 114.0 121.0 117.0 115.0 123.0 125.0 120.0 122.0 118.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:139.60 Median:142.00 stddev:4.55 (3.2%) stddev-sans-first:4.51 05:45:14 INFO - PROCESS | 31751 | Values: 135.0 143.0 146.0 135.0 142.0 131.0 140.0 142.0 140.0 142.0 05:45:14 INFO - PROCESS | 31751 | 05:45:14 INFO - PROCESS | 31751 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.10 Median:67.50 stddev:1.10 (1.6%) stddev-sans-first:1.12 05:45:14 INFO - PROCESS | 31751 | Values: 68.0 68.0 67.0 69.0 67.0 66.0 66.0 68.0 66.0 66.0 05:45:14 INFO - PROCESS | 31751 | -------- Summary: end -------- 05:45:14 INFO - PROCESS | 31751 | 05:45:15 INFO - TEST-INFO | 31751: exit 0 05:45:15 INFO - TEST-OK | kraken | took 62915ms 05:45:15 INFO - SUITE-END | took 1181s 05:45:15 INFO - Completed test suite (00:19:41) 05:45:15 INFO - javascript benchmark 05:45:15 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2626.9211923642292, 2693.138195777351, 2706.688730795959, 2720.238333266685, 2741.8217815841967, 4513.7517436540975, 4664.626829853612, 4680.976595117024, 4687.039156972821, 4703.741294228816, 4654.3251228571835, 4657.254839225725, 4667.486576476585, 4674.158651442731, 4677.883052923678, 4263.445752052229, 4342.413774140498, 4366.323219900904, 4401.405810215628, 4445.466544014723, 4243.363495475673, 4322.13557288542, 4398.890027749316, 4404.29531274996, 4411.360352748849, 4251.171021650779, 4296.484421869396, 4317.740935543878, 4354.695171338008, 4403.6256918162, 4271.63691086258, 4289.764062976535, 4294.763787991659, 4332.588404101637, 4335.609795118455, 4148.02521407469, 4274.978625106885, 4277.550857160016, 4278.229918614648, 4331.848385306499, 4502.954970450319, 4516.006478574708, 4533.138703646329, 4533.184026875161, 4535.614472769818, 4999.850004499871, 5090.898182036375, 5094.261332106824, 5099.515546023122, 5099.541041306263, 5044.167712327461, 5046.7476626168545, 5049.873753156164, 5050.646454748169, 5060.696358218519, 4699.459562150328, 4705.411823522059, 4705.952940470552, 4709.246520556729, 4743.0, 4964.776585053682, 5111.565516931102, 5213.452587478336, 5259.027079990214, 5260.684358938476, 4951.183054795991, 4976.62675299354, 4977.303177555145, 4983.227599722049, 5027.798888044437, 4819.783109760069, 5063.215201643751, 5063.772130254148, 5067.113255180328, 5067.569256613156, 4960.553550180501, 4982.451930287665, 5011.924821127686, 5037.370328708911, 5053.570446512014, 5003.124453220672, 5026.949730502722, 5035.194368901031, 5037.949620503821, 5074.188129899198, 3873.3221686205366, 3944.6252606002386, 3971.7616942982936, 3982.303096958021, 4026.4966879140106, 3502.7898326100517, 3557.0395993081725, 3582.820858957094, 3583.4624806279267, 3591.2278860045217, 4378.387025816388, 4385.605295523418, 4401.119776044804, 4409.559044095629, 4444.400005999213, 4924.507549245047, 5029.5221953914315, 5082.313887625197, 5090.898182036339, 5144.948550514522, 4344.066025804467, 4352.260115780262, 4379.671524635665, 4393.956060439418, 4400.427944367212, 4497.550244975476, 4515.932261016087, 4516.029053753458, 4519.525449827786, 4561.042181141997, 4654.022655242437, 4770.379850619397, 4779.115863565252, 4780.211265141213, 4857.0528746894015, 5013.699178049329, 5026.547610714907, 5035.118854200427, 5035.29505869186, 5052.8484145475695, 4752.453467851241, 4755.548222918817, 4765.73788441639, 4779.283107533898, 4796.640251981045, 4803.375561177025, 4898.9020219594695, 4946.554810067111, 4951.207806750903, 4984.0, 4983.327250821093, 4993.925091123563, 4995.050940321327, 5003.54968052877, 5040.319556859777, 4859.732714700725, 4860.6111511079735, 4864.416270047617, 4866.197077482176, 4908.7300198488, 4758.381410416624, 4842.080004799077, 4904.0, 4936.407631084293, 4939.110960027229, 4760.262159365304, 4773.09311230865, 4776.617870570415, 4784.5215478453265, 4800.183968725395, 4843.176659967743, 4883.096627123993, 4887.413510378778, 4887.682300650446, 4920.40955085392, 4683.812647494062, 4817.590504806991, 4866.270059491105, 4912.410510738591, 4912.778924948315], "unit": "score", "name": "dojo.html", "value": 4598.9249397362255}, {"lowerIsBetter": false, "replicates": [539.9001184780815, 540.5027374815172, 559.7453158812739, 563.2536888622576, 574.1015311038225, 29849.403011939747, 35134.82432587837, 35602.2879542409, 35675.464868027004, 35721.0, 38794.418083728764, 39281.803590982076, 39325.41011884824, 39340.21319573607, 39347.0, 7577.090749110114, 7859.331956783652, 7861.882071768928, 7867.409944254176, 7874.3700503959835, 7718.459707820455, 7821.843563128762, 7833.216678332178, 7845.0, 8054.879176812353, 7995.240452157036, 8088.676452941904, 8089.0293164820305, 8091.2717855393, 8096.919030809705, 7971.202879712011, 8065.435419520636, 8072.394570407243, 8076.8788468173025, 8082.636281367352, 7874.409419293576, 7999.1600881907725, 8005.0794158671915, 8005.919940800634, 8010.479318844315, 37940.43089353662, 38478.230435391415, 38563.0, 38635.420468692995, 38640.42039369412, 3044.604201453819, 3049.786514943955, 3189.2983543620367, 3258.006308076036, 3375.358681850465, 28933.71066289331, 29376.265593360124, 29592.26019349512, 29705.0, 30264.54603180932, 3490.6858382745677, 3567.94648080279, 3576.7138628909624, 3600.963990360115, 3621.5654121505327, 253215.0, 253220.99999999817, 254096.0, 255495.0, 257203.0, 57989.710051449474, 58192.0, 58322.12516812251, 58403.123953140734, 58447.70776146092, 61676.69161654163, 61825.690871545354, 62250.0, 63491.365086348545, 63695.36304636987, 14276.500322488662, 14390.424383024561, 14402.711945761026, 14461.13233206011, 14476.420943162366, 10894.346339219514, 10964.068054215322, 10970.177236707279, 10977.451127443595, 10977.890221097847, 19222.0, 19370.0, 19493.902530487256, 19561.315353962542, 19624.41126766199, 7556.168821429638, 7825.0, 7846.215378462108, 7918.366530677532, 7955.443118981616, 752.7929819299736, 821.9095899451056, 912.0332447605426, 945.4232917920064, 986.8667729856521, 26514.46971060568, 27128.59307110395, 27821.860890695418, 27863.16410507688, 27883.72116278852, 913.1735779119907, 938.1275413865171, 944.9133496478967, 1004.4174378860243, 1008.294194064158, 13639.318034098256, 14182.555456788208, 14192.0, 14353.6411589709, 14427.711445771025, 284705.0, 286634.0, 286965.0, 287628.0, 288237.0, 47162.76418617885, 48155.5184448158, 48330.758346208044, 48367.0, 48396.27405588919, 1111.555377848867, 1161.7386088130272, 1225.8957988571071, 1228.5085965613825, 1253.1040306181123, 24059.455160071862, 27164.665540304402, 27442.17673469799, 27643.58534621942, 27689.58465622977, 37820.24359512849, 38226.235475290894, 38245.043873902265, 38288.23423531458, 38331.0, 202958.0, 208741.0, 208953.0, 210329.0, 210892.0, 26801.98985076088, 28166.155015349574, 31163.84418077895, 31206.843965780026, 32082.518762219053, 35433.0, 35780.64219357877, 35967.82016089903, 36433.27133457369, 36801.81599091987, 29293.121206363845, 30935.381292374477, 31017.534736978512, 31458.52812207773, 31662.525062123626, 32723.0, 33395.33209335751, 33473.83263083766, 33724.32551349008, 33838.0, 33577.49633755447, 33755.0, 34254.0, 34260.14349641279, 34322.82838585791, 29193.7080629191, 30009.249768755955, 30354.54468182935, 30567.694323056483, 30817.8459107712, 23710.966048354454, 23836.52326953486, 23876.880615596812, 24011.51976960416, 24189.75810241875], "unit": "score", "name": "ext.html", "value": 17049.261621730584}, {"lowerIsBetter": false, "replicates": [351.82936275906184, 353.80010294183785, 360.1248965015013, 365.85914422947155, 369.6765330335956, 15282.465113721022, 15362.462313819018, 16570.0, 16817.66364672706, 16826.915865420688, 14920.850791492081, 15122.773158402606, 15490.148041857694, 15526.146061966587, 15533.22333883304, 4904.877378065559, 4953.281774142747, 5101.795928162869, 5105.795768169269, 5133.383993920735, 5077.949220507803, 5101.20931255656, 5119.872003199931, 5131.820386286481, 5131.948680513203, 5010.248462730583, 5059.924101138467, 5069.0, 5069.290299358093, 5074.644774865761, 4991.40103187618, 5161.122609156452, 5175.534201921808, 5176.818811341623, 5177.456367081478, 4983.103041452537, 4985.825496107655, 4986.07757564848, 4997.250412438127, 4998.925016124761, 14102.506412275623, 18556.16497257613, 19175.041247937548, 19194.520136996547, 19196.040197990045, 1929.411529483507, 1942.300771722179, 1961.4213806926991, 2058.7220725202205, 2365.491419344849, 8899.4215376001, 9055.637774489012, 9058.592363343665, 11045.613403530839, 13042.934785326108, 1646.7859178306862, 1794.371969810569, 1813.138759089435, 1831.4414103698366, 1846.1599972012837, 50385.0, 55627.44372556263, 59360.10959835563, 59790.70104649493, 61209.69395152996, 9856.852147217798, 10062.899371006197, 10167.593296268215, 10292.948535257425, 10371.377717336833, 11589.0, 12223.205491643015, 12667.0, 13143.60569182926, 13161.407736651874, 6898.206706228748, 6922.100126983561, 7017.859642807115, 7090.92909070913, 7102.822429439306, 6737.427318677967, 6748.662566871735, 6807.727690892408, 6937.7224911004005, 6949.478789090737, 4186.706930514834, 4334.28484300087, 4345.869623911288, 4394.648428125743, 4417.933730994037, 1784.8304411080926, 1829.5334689654053, 1834.0737927346604, 1839.7608310919495, 1840.3374785077363, 851.3912552524974, 864.632531174261, 912.7626817027488, 950.9049095090436, 992.9453880036523, 15510.146941918078, 15528.14595197275, 15566.455174068853, 15910.522684319489, 16095.436659716854, 857.648364170687, 888.0852721696663, 903.3134817538587, 908.5729707037682, 956.7655924298591, 9126.771830704285, 9141.268698504104, 9168.587413566405, 9259.490728009889, 9357.157855792875, 431605.0, 442848.0, 447729.0, 449112.0, 449973.0, 65847.34152658412, 67378.3262167372, 68589.65705171443, 68833.65583172052, 69071.30928690749, 928.8328100941895, 933.6872147830417, 949.8005418862116, 953.7043516509904, 955.2739917662487, 14101.576952691024, 14378.35297411598, 14450.494232701805, 14464.638384040483, 14643.414263429344, 25474.363140921625, 26726.59910101311, 33331.666683333824, 33380.49929251015, 33649.32701345911, 45452.54547454483, 46349.304760429295, 46367.0, 46678.29982550196, 46699.29951050805, 7063.505554611128, 7101.82245443868, 7140.107486564179, 7245.239249878898, 7280.344768970818, 10286.228532859916, 11085.22403431752, 11414.143939204427, 11440.141989351, 11509.251898626562, 9843.261755368232, 9855.0, 10098.444585547571, 10202.846957295498, 10312.948435257777, 9758.902410976083, 10089.376346215799, 10089.646862360076, 10099.899001009895, 10178.185745140223, 10060.90571078258, 10116.544755486168, 10171.440570768678, 10347.793044139225, 10406.115480183966, 7241.782746517613, 7426.814329641802, 7482.850342993219, 7519.43604229674, 7525.285097915689, 9583.281253906125, 9945.850812237966, 10038.698839034842, 10102.242331824995, 10441.958737260751], "unit": "score", "name": "jquery.html", "value": 7932.725193415139}, {"lowerIsBetter": false, "replicates": [1314.7501974624815, 1417.0718179592368, 1432.5773896700468, 1588.0, 1781.3765182186237, 6962.1297337832775, 7148.60682662454, 7149.535280206783, 7153.427725781938, 7157.0, 7066.505344625878, 7209.387202087829, 7240.348368646821, 7241.3120753528465, 7247.202807691163, 1884.2745542965988, 1929.6140771845687, 2180.0407820558903, 2191.3316438486254, 2219.178903805594, 2229.55408918217, 2237.093976939334, 2240.8879556022216, 2242.4057624729458, 2243.8204943604474, 2142.700021996922, 2170.381441289233, 2200.449887528118, 2200.9889950550223, 2204.492966617679, 2191.2878314547834, 2214.7010153629294, 2222.4443889027825, 2225.2100504320897, 2237.8545394549465, 2178.357384571555, 2183.4759657682202, 2197.7142971413773, 2198.736151661795, 2201.328594778592, 7373.77878663641, 7432.256774322578, 7433.739819106359, 7446.85106297871, 7447.2552744725635, 4462.129884672458, 4557.794899229542, 4582.060677561092, 4583.931241031387, 4587.931181032287, 2975.7470614997533, 3010.8946186883572, 3052.328487732695, 3056.923576910595, 3095.814251144916, 930.1767935377172, 943.528235882059, 955.6416343871049, 964.8070385922773, 969.8351280282369, 9936.552855121538, 9981.600735970553, 9982.25133115012, 9990.050945160197, 9993.550290236957, 4250.128723611652, 4339.088791353788, 4350.32569951658, 4375.431193944767, 4398.73607583546, 8505.362097842562, 8542.231199192103, 8549.658013679384, 8566.100559441293, 8567.957160214159, 4441.533638967927, 4469.173202957463, 4485.59629633328, 4488.5511448855505, 4489.259272220047, 3572.821358932043, 3965.206958608232, 4052.5947405259826, 4106.815193316308, 4108.609682080198, 3577.2308953575107, 3632.019354774196, 3636.054625797312, 3661.6704496595435, 3691.90770230741, 1159.7854396936593, 1181.3679681370425, 1186.2348785033605, 1208.9274643521417, 1209.0448545649015, 1187.0800129899396, 1190.7618476304774, 1191.5531675621642, 1199.3103965220034, 1230.3786587773118, 6788.253292137861, 6883.414909732629, 6897.48268879836, 6911.516193866481, 6921.1002569666625, 477.35556998053045, 481.4559547711064, 484.46950589104875, 484.49370407923806, 494.61172979211864, 5104.336436263262, 5107.463716309734, 5109.7700603472185, 5117.513836185556, 5143.97428012865, 8111.269985701315, 8144.633491492778, 8221.424500284922, 8614.569271536398, 8861.424007439497, 8132.390070744717, 8169.387295952709, 8212.260896519223, 8221.424500285042, 8224.342052635775, 6794.184697836291, 6865.828354291183, 6893.620850853251, 6957.478189135835, 6983.441324694012, 6819.931800682129, 6841.144856892888, 6858.0, 6892.0, 6905.965470172617, 7933.642986065525, 7970.601469926596, 8159.306458951056, 8261.463004904663, 8290.626921788655, 8233.670653173805, 8369.581520924052, 8374.790630234293, 8423.07346191906, 8538.914610853812, 5586.273784408001, 6169.383061693795, 6309.873802524015, 6429.0, 6504.056911747675, 6859.348361905611, 6861.039454476278, 6879.6560171992205, 6885.621290828852, 6914.412274956685, 6130.386961303834, 6156.261248650011, 6174.475169610633, 6181.134641150153, 6234.719437625227, 6055.0, 6224.533160012927, 6276.089966954674, 6294.8111556653375, 6364.586301890362, 6383.0744542042075, 6451.419372256331, 6515.478761699147, 6526.836829079311, 6528.771492997722, 6064.787732429344, 6120.7857724981195, 6129.1112788644505, 6136.969315153396, 6142.723577438936, 5813.563982701399, 5940.584159108821, 5943.3759455258305, 5959.612625179349, 5976.252968378953], "unit": "score", "name": "mootools.html", "value": 4155.840142700239}, {"lowerIsBetter": false, "replicates": [323.94492936200845, 324.7726591386029, 326.62275072291504, 330.4217619166458, 335.8236925614052, 5455.263539422177, 5472.315960504937, 5490.835274941754, 5491.752871120799, 5522.530584900288, 5432.538234250083, 5438.483344082316, 5440.775825439274, 5449.455054494549, 5450.700211488366, 4015.237104950065, 4146.067134894654, 4246.193223287581, 4262.403263543107, 4266.57334266574, 4266.850660226893, 4267.082577245891, 4267.210566045276, 4271.722338048033, 4282.97858510707, 4228.06982463859, 4231.640310573605, 4239.2793225151645, 4242.53332133465, 4250.61744443, 4038.8788336349808, 4116.91766164678, 4233.724807887477, 4240.385144154111, 4243.236217480852, 3728.272986767581, 3735.4957080794015, 3736.3087828751495, 3737.7196710246567, 3740.9438858417147, 5239.816606418757, 5239.973800131013, 5252.973735131338, 5255.921161182585, 5257.421683614799, 4905.656604037718, 4906.852794416173, 4909.042736666352, 4910.1898186799135, 4920.138975679241, 5741.19623252745, 5752.769889204426, 5753.597248192628, 5759.3376761672525, 5763.596548241625, 3846.326892793778, 4114.321137012389, 4115.567865374122, 4120.031792528754, 4123.0516981094215, 5936.5547583931375, 6032.366601506823, 6058.545609079337, 6065.969670151665, 6068.6662233577135, 4082.632563069338, 4085.305498065336, 4085.4893138357706, 4089.2639324921206, 4095.7133000689664, 4147.087640719037, 4147.108371700099, 4147.3778933160265, 4148.336266197394, 4154.106867023544, 4791.760411979387, 4793.32893394925, 4801.5438533339975, 4808.975955120202, 4810.0, 5761.279840019997, 5773.24947756789, 5774.538036957033, 5775.393583673737, 5776.740046697824, 1418.8439271680106, 1445.6674964757954, 1469.808924839764, 1472.801171841809, 1477.623206082442, 930.5161316115582, 948.4356807699407, 970.4953424219508, 986.4673076538733, 991.1624677147798, 4906.509349065136, 4917.8361520930675, 4951.9752401237765, 5058.038972595195, 5059.86153115546, 5941.376155503696, 5956.672383018976, 6020.578559500793, 6021.518278537794, 6042.214512113397, 5088.211327244283, 5092.38891333035, 5095.541401273903, 5096.592272618256, 5102.36220472441, 3177.4121787469394, 3208.5401142480114, 3211.6948889855425, 3212.2611799286296, 3215.6302025267396, 5649.237352957381, 5673.978683836866, 5680.943190568041, 5681.602287839812, 5684.062129748628, 6012.8797424052145, 6209.2548894133, 6215.627062376272, 6217.347178546278, 6223.875522489525, 5666.716664166775, 5689.715514224272, 5702.51528620072, 5703.25857638496, 5704.429557044263, 6015.2781666200335, 6017.729202185999, 6020.127081573235, 6023.216981792339, 6024.789132380346, 5919.585629005928, 5923.614965027432, 5932.851678708067, 5934.762609495572, 5938.524918006463, 5464.453554644663, 5687.630304030225, 5689.31728192603, 5692.7722891083895, 5693.345265294379, 4049.230646177217, 4067.471228740363, 4084.8366065357054, 4088.0801819591543, 4095.569965153735, 5955.583109182316, 5962.970185149046, 5976.103584462192, 5976.103584462366, 5985.880282394415, 5723.8855222896145, 5727.799527016701, 5732.0, 5735.942640573541, 5739.053056245672, 5770.480656740746, 5770.682612456355, 5773.336066352424, 5778.508826749773, 5783.884322313615, 5443.129099344086, 5625.634333768292, 5675.659460432387, 5691.032524470933, 5697.202391665087, 5792.652440853562, 5801.36185019639, 5805.535557155502, 5825.621334613236, 5839.8832023358445, 5657.2928383952, 5664.122061080539, 5672.064109422065, 5675.517581005495, 5677.318721753416], "unit": "score", "name": "prototype.html", "value": 4329.851123202034}, {"lowerIsBetter": false, "replicates": [648.2447948140417, 661.1273119482282, 721.8087206890172, 722.3679280629449, 761.2007392238148, 11494.712632184199, 11547.307161570301, 11552.711182220448, 11609.419529023557, 11611.47748351323, 12454.688632784162, 12745.808812867814, 12751.553695620654, 12771.680707982305, 12773.552925647604, 648.0279580629057, 805.8227190018201, 815.3517953227199, 818.643889907889, 819.045811629451, 822.0833770346081, 823.6746485138367, 827.0199813221321, 827.9047909490396, 827.9089300176976, 853.9743807685779, 858.2361698088706, 858.2790456016944, 858.5321000054985, 860.4450129666361, 681.7784220128428, 686.9072675188886, 841.0034109580137, 842.0779246724857, 842.3177226446567, 506.3038322306828, 625.6777759453885, 626.5081910700079, 626.9341719119518, 627.5638431290255, 11515.251508651994, 11519.884801151966, 11522.0, 11559.94220028903, 11568.53725850965, 11464.598739044177, 11874.465649045813, 12106.39468026604, 12190.817137742852, 12405.62783116508, 9901.207903367713, 10077.748056298578, 10084.798304033879, 10093.192544596488, 10177.949110254402, 3318.070940136766, 3343.5319055332275, 3371.2920286739813, 3434.1929646533044, 3440.9483857742152, 43573.564264357585, 43835.561644383786, 44269.0, 44478.0, 44556.3316550252, 9516.23870090405, 9606.231501479864, 9823.508824558743, 9887.703368898945, 10328.793424131476, 17522.474325770247, 17541.912290438468, 17665.7350139748, 17709.29162833498, 17737.822621773874, 6607.504437167232, 6696.129503164558, 6744.5616034957575, 6761.830954226184, 6915.861682766316, 3605.4231322988194, 3726.2361215950664, 3770.377887648562, 3784.129650180474, 3888.6694630956686, 2812.9859350703114, 2861.4563232985665, 2863.3271181272385, 2871.052552657618, 2876.8273903565855, 482.9420469543607, 483.86209930170435, 487.99268010979864, 496.5903129917832, 499.7376377401893, 491.7418355363391, 538.8033367820717, 542.7259234086761, 574.9252597162342, 580.2543731305252, 7038.2961703829205, 7040.401565866856, 7102.112235970504, 7283.235260297698, 7304.561726296439, 538.8706710389479, 543.1228565866177, 544.1728572569672, 545.2448359022782, 558.5570444917853, 3316.651751566099, 3352.7150192233444, 3390.28803951173, 3463.8268086595567, 3635.0367152704553, 49731.254031189565, 50161.498385015686, 51515.0, 51829.7408512955, 51932.0, 46262.0, 47032.5296747035, 47138.52861471342, 47887.04225915462, 48051.75974120107, 41815.0, 42383.7880810594, 42793.57206427958, 42961.0, 43127.137457250676, 6951.756688515878, 7037.683304251219, 7054.0, 7085.362317391459, 7167.641617918979, 31387.058388248388, 31959.360812784078, 32845.67154328426, 32965.34069318648, 33141.17147071246, 38405.0, 41157.0, 41709.79145104255, 41790.0, 41893.1621367577, 8759.12408759119, 8800.603972821367, 8803.119688031145, 8807.471551706918, 8811.427257228259, 9556.283278753983, 9696.95151524238, 9717.514124293899, 9722.125008749246, 9732.318737688576, 8787.0, 9455.858162127712, 9530.761730956505, 9569.234461243223, 9575.425474471554, 9164.495952722664, 9258.398204116711, 9284.489353085375, 9302.488363140092, 9312.906870931203, 8800.47197168172, 9272.675456358995, 9349.813003740022, 9360.485173315534, 9401.529923503935, 8054.114047454658, 8187.4678145920325, 8227.465214761021, 8273.958630206811, 8451.915480845113, 8037.799055023671, 8198.467099638505, 8330.791730206793, 8369.455985360932, 8373.665053397795], "unit": "score", "name": "yui.html", "value": 5644.12741150511}], "name": "dromaeo_css", "value": 6310.920866011167}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 113.0, 110.0, 113.0, 113.0, 113.0, 102.0, 113.0, 112.0, 112.0], "unit": "score", "name": "ai-astar", "value": 111.3}, {"lowerIsBetter": true, "replicates": [151.0, 125.0, 156.0, 176.0, 139.0, 154.0, 154.0, 136.0, 182.0, 136.0], "unit": "score", "name": "audio-beat-detection", "value": 150.9}, {"lowerIsBetter": true, "replicates": [163.0, 162.0, 161.0, 162.0, 160.0, 160.0, 163.0, 162.0, 163.0, 161.0], "unit": "score", "name": "audio-dft", "value": 161.7}, {"lowerIsBetter": true, "replicates": [74.0, 85.0, 115.0, 94.0, 72.0, 73.0, 77.0, 112.0, 99.0, 73.0], "unit": "score", "name": "audio-fft", "value": 87.4}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 144.0, 93.0, 95.0, 95.0, 137.0, 94.0, 94.0, 136.0], "unit": "score", "name": "audio-oscillator", "value": 107.6}, {"lowerIsBetter": true, "replicates": [116.0, 116.0, 116.0, 116.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.6}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 145.0, 146.0, 146.0, 146.0, 145.0, 145.0, 146.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.6}, {"lowerIsBetter": true, "replicates": [95.0, 96.0, 96.0, 95.0, 96.0, 95.0, 96.0, 96.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.6}, {"lowerIsBetter": true, "replicates": [66.0, 66.0, 65.0, 66.0, 65.0, 65.0, 75.0, 73.0, 65.0, 65.0], "unit": "score", "name": "json-parse-financial", "value": 67.1}, {"lowerIsBetter": true, "replicates": [64.0, 63.0, 65.0, 63.0, 64.0, 65.0, 65.0, 64.0, 65.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.4}, {"lowerIsBetter": true, "replicates": [80.0, 85.0, 81.0, 80.0, 81.0, 85.0, 81.0, 82.0, 81.0, 80.0], "unit": "score", "name": "stanford-crypto-aes", "value": 81.6}, {"lowerIsBetter": true, "replicates": [128.0, 114.0, 121.0, 117.0, 115.0, 123.0, 125.0, 120.0, 122.0, 118.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 120.3}, {"lowerIsBetter": true, "replicates": [135.0, 143.0, 146.0, 135.0, 142.0, 131.0, 140.0, 142.0, 140.0, 142.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 139.6}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 67.0, 69.0, 67.0, 66.0, 66.0, 68.0, 66.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.1}], "name": "kraken", "value": 1516.7999999999997}]} 05:45:15 INFO - Return code: 0 05:45:15 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 05:45:15 ERROR - # TBPL SUCCESS # 05:45:15 INFO - Running post-action listener: _resource_record_post_action 05:45:15 INFO - Running post-run listener: _resource_record_post_run 05:45:16 INFO - Total resource usage - Wall time: 1199s; CPU: 13.0%; Read bytes: 4096; Write bytes: 517963776; Read time: 16; Write time: 1460108 05:45:16 INFO - install - Wall time: 16s; CPU: 17.0%; Read bytes: 0; Write bytes: 232484864; Read time: 0; Write time: 675832 05:45:16 INFO - run-tests - Wall time: 1183s; CPU: 13.0%; Read bytes: 4096; Write bytes: 285478912; Read time: 16; Write time: 784276 05:45:16 INFO - Running post-run listener: _upload_blobber_files 05:45:16 INFO - Blob upload gear active. 05:45:16 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:45:16 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 05:45:16 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', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:45:16 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 Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:45:16 INFO - (blobuploader) - INFO - Open directory for files ... 05:45:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 05:45:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:45:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:45:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:45:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:45:17 INFO - (blobuploader) - INFO - Done attempting. 05:45:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:45:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:45:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:45:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:45:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:45:18 INFO - (blobuploader) - INFO - Done attempting. 05:45:18 INFO - (blobuploader) - INFO - Iteration through files over. 05:45:18 INFO - Return code: 0 05:45:18 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:45:18 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:45:18 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/60de18bc2bfede43651c7f3dcb47b21157fa3755fc456511aeed7e0bc7e81afb029f542a8d04b489006c6d2cee1beacaee088c1ea0a582c56e76be1dde3ae6ef", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5cb4831017c34d3a4a57a6e62c9d5394247e284563d52416fc5746848401c6b47509f03c6f2b3d87df0969b9ecd69dcdd607ca4e2171d0f389d2601e6a34199c"} 05:45:18 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:45:18 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:45:18 INFO - Contents: 05:45:18 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/60de18bc2bfede43651c7f3dcb47b21157fa3755fc456511aeed7e0bc7e81afb029f542a8d04b489006c6d2cee1beacaee088c1ea0a582c56e76be1dde3ae6ef", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5cb4831017c34d3a4a57a6e62c9d5394247e284563d52416fc5746848401c6b47509f03c6f2b3d87df0969b9ecd69dcdd607ca4e2171d0f389d2601e6a34199c"} 05:45:18 INFO - Running post-run listener: copy_logs_to_upload_dir 05:45:18 INFO - Copying logs to upload dir... 05:45:18 INFO - mkdir: /builds/slave/test/build/upload/logs 05:45:18 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1246.739493 ========= master_lag: 0.15 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 46 secs) (at 2016-03-16 05:45:18.604763) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-16 05:45:18.612053) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/60de18bc2bfede43651c7f3dcb47b21157fa3755fc456511aeed7e0bc7e81afb029f542a8d04b489006c6d2cee1beacaee088c1ea0a582c56e76be1dde3ae6ef", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5cb4831017c34d3a4a57a6e62c9d5394247e284563d52416fc5746848401c6b47509f03c6f2b3d87df0969b9ecd69dcdd607ca4e2171d0f389d2601e6a34199c"} build_url:https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011219 build_url: 'https://queue.taskcluster.net/v1/task/U-S4iOHgQsmMimmv_Snygw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/60de18bc2bfede43651c7f3dcb47b21157fa3755fc456511aeed7e0bc7e81afb029f542a8d04b489006c6d2cee1beacaee088c1ea0a582c56e76be1dde3ae6ef", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5cb4831017c34d3a4a57a6e62c9d5394247e284563d52416fc5746848401c6b47509f03c6f2b3d87df0969b9ecd69dcdd607ca4e2171d0f389d2601e6a34199c"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-16 05:45:18.639575) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:45:18.639935) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1458129075.460947-932677948 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004489 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 05:45:18.689720) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-16 05:45:18.690037) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-16 05:45:18.690343) ========= ========= Total master_lag: 0.40 =========